Code: Alles auswählen
D [07/Jun/2016:16:28:27 +0200] [Job 13] Loading from cache...
D [07/Jun/2016:16:28:27 +0200] [Job 13] Loading attributes...
D [07/Jun/2016:16:28:27 +0200] cupsdAddSubscription(mask=0, dest=(nil)(), job=(nil)(0), uri="(null)")
D [07/Jun/2016:16:28:27 +0200] cupsdAddSubscription(mask=0, dest=(nil)(), job=(nil)(0), uri="(null)")
D [07/Jun/2016:16:28:27 +0200] cupsdAddSubscription(mask=0, dest=(nil)(), job=(nil)(0), uri="(null)")
I [07/Jun/2016:16:28:27 +0200] Full reload complete.
D [07/Jun/2016:16:28:27 +0200] cupsdCleanFiles(path="/var/spool/cups/tmp", pattern="(null)")
I [07/Jun/2016:16:28:27 +0200] Cleaning out old files in "/var/spool/cups/tmp".
D [07/Jun/2016:16:28:27 +0200] cupsdCleanFiles(path="/var/cache/cups", pattern="*.ipp")
I [07/Jun/2016:16:28:27 +0200] Cleaning out old files in "/var/cache/cups".
D [07/Jun/2016:16:28:27 +0200] service_checkin: pid=3102
D [07/Jun/2016:16:28:27 +0200] service_checkin: 1 listeners.
D [07/Jun/2016:16:28:27 +0200] service_checkin: Listener #1 at fd 3, "/var/run/cups/cups.sock".
D [07/Jun/2016:16:28:27 +0200] service_checkin: Matched existing listener #1 to /var/run/cups/cups.sock.
D [07/Jun/2016:16:28:27 +0200] Creating keep-alive file "/var/cache/cups/org.cups.cupsd".
D [07/Jun/2016:16:28:27 +0200] Calling FindDeviceById(cups-Canon_iP3600_series)
D [07/Jun/2016:16:28:27 +0200] FindDeviceById failed: org.freedesktop.ColorManager.NotFound:device id \'cups-Canon_iP3600_series\' does not exist
D [07/Jun/2016:16:28:27 +0200] Calling FindDeviceById(cups-iP3600-TurboPrint)
D [07/Jun/2016:16:28:27 +0200] FindDeviceById failed: org.freedesktop.ColorManager.NotFound:device id \'cups-iP3600-TurboPrint\' does not exist
D [07/Jun/2016:16:28:27 +0200] Using profile ID "iP3600-TurboPrint-Gray..".
D [07/Jun/2016:16:28:27 +0200] Calling CreateProfile(iP3600-TurboPrint-Gray..,temp)
D [07/Jun/2016:16:28:27 +0200] Created profile "/org/freedesktop/ColorManager/profiles/iP3600_TurboPrint_Gray__".
D [07/Jun/2016:16:28:27 +0200] Using profile ID "iP3600-TurboPrint-RGB..".
D [07/Jun/2016:16:28:27 +0200] Calling CreateProfile(iP3600-TurboPrint-RGB..,temp)
D [07/Jun/2016:16:28:27 +0200] Created profile "/org/freedesktop/ColorManager/profiles/iP3600_TurboPrint_RGB__".
I [07/Jun/2016:16:28:27 +0200] Registering ICC color profiles for "iP3600-TurboPrint".
D [07/Jun/2016:16:28:27 +0200] Calling CreateDevice(cups-iP3600-TurboPrint,temp)
D [07/Jun/2016:16:28:27 +0200] Created device "/org/freedesktop/ColorManager/devices/cups_iP3600_TurboPrint".
D [07/Jun/2016:16:28:27 +0200] Calling /org/freedesktop/ColorManager/devices/cups_iP3600_TurboPrint:AddProfile(/org/freedesktop/ColorManager/profiles/iP3600_TurboPrint_Gray__) [soft]
D [07/Jun/2016:16:28:27 +0200] Calling /org/freedesktop/ColorManager/devices/cups_iP3600_TurboPrint:AddProfile(/org/freedesktop/ColorManager/profiles/iP3600_TurboPrint_RGB__) [soft]
D [07/Jun/2016:16:28:27 +0200] Calling FindDeviceById(cups-MFCL2700DW)
D [07/Jun/2016:16:28:27 +0200] FindDeviceById failed: org.freedesktop.ColorManager.NotFound:device id \'cups-MFCL2700DW\' does not exist
D [07/Jun/2016:16:28:27 +0200] Using profile ID "MFCL2700DW-Gray..".
D [07/Jun/2016:16:28:27 +0200] Calling CreateProfile(MFCL2700DW-Gray..,temp)
D [07/Jun/2016:16:28:27 +0200] Created profile "/org/freedesktop/ColorManager/profiles/MFCL2700DW_Gray__".
I [07/Jun/2016:16:28:27 +0200] Registering ICC color profiles for "MFCL2700DW".
D [07/Jun/2016:16:28:27 +0200] Calling CreateDevice(cups-MFCL2700DW,temp)
D [07/Jun/2016:16:28:27 +0200] Created device "/org/freedesktop/ColorManager/devices/cups_MFCL2700DW".
D [07/Jun/2016:16:28:27 +0200] Calling /org/freedesktop/ColorManager/devices/cups_MFCL2700DW:AddProfile(/org/freedesktop/ColorManager/profiles/MFCL2700DW_Gray__) [soft]
I [07/Jun/2016:16:28:27 +0200] Listening to [v1.::1]:631 on fd 10...
I [07/Jun/2016:16:28:27 +0200] Listening to 127.0.0.1:631 on fd 11...
I [07/Jun/2016:16:28:27 +0200] Listening to /var/run/cups/cups.sock on fd 3...
I [07/Jun/2016:16:28:27 +0200] Resuming new connection processing...
D [07/Jun/2016:16:28:27 +0200] cupsdSetBusyState: newbusy="Dirty files", busy="Dirty files"
D [07/Jun/2016:16:28:27 +0200] cupsdAddCert: Adding certificate for PID 0
D [07/Jun/2016:16:28:27 +0200] Notifier dbus started - PID = 3105
D [07/Jun/2016:16:28:27 +0200] Notifier dbus started - PID = 3106
D [07/Jun/2016:16:28:27 +0200] cupsdMarkDirty(----S)
D [07/Jun/2016:16:28:27 +0200] cupsdSetBusyState: newbusy="Dirty files", busy="Dirty files"
D [07/Jun/2016:16:28:27 +0200] [Job 13] time-at-processing=1465309707
D [07/Jun/2016:16:28:27 +0200] cupsdMarkDirty(---J-)
D [07/Jun/2016:16:28:27 +0200] cupsdSetBusyState: newbusy="Dirty files", busy="Dirty files"
D [07/Jun/2016:16:28:27 +0200] cupsdSetBusyState: newbusy="Dirty files", busy="Dirty files"
D [07/Jun/2016:16:28:27 +0200] cupsdMarkDirty(----S)
D [07/Jun/2016:16:28:27 +0200] cupsdSetBusyState: newbusy="Dirty files", busy="Dirty files"
D [07/Jun/2016:16:28:27 +0200] cupsdMarkDirty(P----)
D [07/Jun/2016:16:28:27 +0200] cupsdSetBusyState: newbusy="Dirty files", busy="Dirty files"
D [07/Jun/2016:16:28:27 +0200] [Job 13] 2 filters for job:
D [07/Jun/2016:16:28:27 +0200] [Job 13] pdftopdf (application/pdf to application/vnd.cups-pdf, cost 66)
D [07/Jun/2016:16:28:27 +0200] [Job 13] pstoturboprint (application/vnd.cups-pdf to printer/iP3600-TurboPrint, cost 10)
D [07/Jun/2016:16:28:27 +0200] [Job 13] job-sheets=none,none
D [07/Jun/2016:16:28:27 +0200] [Job 13] argv[0]="iP3600-TurboPrint"
D [07/Jun/2016:16:28:27 +0200] [Job 13] argv[1]="13"
D [07/Jun/2016:16:28:27 +0200] [Job 13] argv[2]="jt"
D [07/Jun/2016:16:28:27 +0200] [Job 13] argv[3]="Unbenannt1"
D [07/Jun/2016:16:28:27 +0200] [Job 13] argv[4]="1"
D [07/Jun/2016:16:28:27 +0200] [Job 13] argv[5]="InputSlot=AutoSelect PageSize=A4 job-uuid=urn:uuid:5a930778-b7cd-3ba5-7562-ecc066ab7b4c job-originating-host-name=localhost date-time-at-creation= date-time-at-processing= time-at-creation=1465309310 time-at-processing=1465309707 document-name-supplied=gUAUh5"
D [07/Jun/2016:16:28:27 +0200] [Job 13] argv[6]="/var/spool/cups/d00013-001"
D [07/Jun/2016:16:28:27 +0200] [Job 13] envp[0]="CUPS_CACHEDIR=/var/cache/cups"
D [07/Jun/2016:16:28:27 +0200] [Job 13] envp[1]="CUPS_DATADIR=/usr/share/cups"
D [07/Jun/2016:16:28:27 +0200] [Job 13] envp[2]="CUPS_DOCROOT=/usr/share/cups/doc-root"
D [07/Jun/2016:16:28:27 +0200] [Job 13] envp[3]="CUPS_FONTPATH=/usr/share/cups/fonts"
D [07/Jun/2016:16:28:27 +0200] [Job 13] envp[4]="CUPS_REQUESTROOT=/var/spool/cups"
D [07/Jun/2016:16:28:27 +0200] [Job 13] envp[5]="CUPS_SERVERBIN=/usr/lib/cups"
D [07/Jun/2016:16:28:27 +0200] [Job 13] envp[6]="CUPS_SERVERROOT=/etc/cups"
D [07/Jun/2016:16:28:27 +0200] [Job 13] envp[7]="CUPS_STATEDIR=/var/run/cups"
D [07/Jun/2016:16:28:27 +0200] [Job 13] envp[8]="HOME=/var/spool/cups/tmp"
D [07/Jun/2016:16:28:27 +0200] [Job 13] envp[9]="PATH=/usr/lib/cups/filter:/usr/bin:/usr/sbin:/bin:/usr/bin"
D [07/Jun/2016:16:28:27 +0200] [Job 13] envp[10]="SERVER_ADMIN=root@jt-MS-7392-ssd-ubu16"
D [07/Jun/2016:16:28:27 +0200] [Job 13] envp[11]="SOFTWARE=CUPS/2.1.3"
D [07/Jun/2016:16:28:27 +0200] [Job 13] envp[12]="TMPDIR=/var/spool/cups/tmp"
D [07/Jun/2016:16:28:27 +0200] [Job 13] envp[13]="USER=root"
D [07/Jun/2016:16:28:27 +0200] [Job 13] envp[14]="CUPS_MAX_MESSAGE=2047"
D [07/Jun/2016:16:28:27 +0200] [Job 13] envp[15]="CUPS_SERVER=/var/run/cups/cups.sock"
D [07/Jun/2016:16:28:27 +0200] [Job 13] envp[16]="CUPS_ENCRYPTION=IfRequested"
D [07/Jun/2016:16:28:27 +0200] [Job 13] envp[17]="IPP_PORT=631"
D [07/Jun/2016:16:28:27 +0200] [Job 13] envp[18]="CHARSET=utf-8"
D [07/Jun/2016:16:28:27 +0200] [Job 13] envp[19]="LANG=de_DE.UTF-8"
D [07/Jun/2016:16:28:27 +0200] [Job 13] envp[20]="PPD=/etc/cups/ppd/iP3600-TurboPrint.ppd"
D [07/Jun/2016:16:28:27 +0200] [Job 13] envp[21]="RIP_MAX_CACHE=128m"
D [07/Jun/2016:16:28:27 +0200] [Job 13] envp[22]="CONTENT_TYPE=application/pdf"
D [07/Jun/2016:16:28:27 +0200] [Job 13] envp[23]="DEVICE_URI=dnssd://Canon%20iP3600%20series%20(%C3%BCber%20raspberry)%20%40%20raspberrypi._ipp._tcp.local/cups?uuid=7b72b129-2f44-3300-72b9-d68740aa0f20"
D [07/Jun/2016:16:28:27 +0200] [Job 13] envp[24]="PRINTER_INFO=Canon_PIXMA_iP3600_(TurboPrint)"
D [07/Jun/2016:16:28:27 +0200] [Job 13] envp[25]="PRINTER_LOCATION="
D [07/Jun/2016:16:28:27 +0200] [Job 13] envp[26]="PRINTER=iP3600-TurboPrint"
D [07/Jun/2016:16:28:27 +0200] [Job 13] envp[27]="PRINTER_STATE_REASONS=cups-waiting-for-job-completed"
D [07/Jun/2016:16:28:27 +0200] [Job 13] envp[28]="CUPS_FILETYPE=document"
D [07/Jun/2016:16:28:27 +0200] [Job 13] envp[29]="FINAL_CONTENT_TYPE=application/vnd.cups-pdf"
D [07/Jun/2016:16:28:27 +0200] [Job 13] envp[30]="AUTH_I****"
I [07/Jun/2016:16:28:27 +0200] [Job 13] Started filter /usr/lib/cups/filter/pdftopdf (PID 3107)
I [07/Jun/2016:16:28:27 +0200] [Job 13] Started filter /usr/lib/cups/filter/pstoturboprint (PID 3108)
I [07/Jun/2016:16:28:27 +0200] [Job 13] Started backend /usr/lib/cups/backend/dnssd (PID 3109)
D [07/Jun/2016:16:28:27 +0200] cupsdMarkDirty(----S)
D [07/Jun/2016:16:28:27 +0200] cupsdSetBusyState: newbusy="Printing jobs and dirty files", busy="Dirty files"
D [07/Jun/2016:16:28:27 +0200] [Notifier] state=3
D [07/Jun/2016:16:28:27 +0200] Report: clients=0
D [07/Jun/2016:16:28:27 +0200] Report: jobs=10
D [07/Jun/2016:16:28:27 +0200] Report: jobs-active=1
D [07/Jun/2016:16:28:27 +0200] Report: printers=3
D [07/Jun/2016:16:28:27 +0200] Report: stringpool-string-count=8551
D [07/Jun/2016:16:28:27 +0200] Report: stringpool-alloc-bytes=12792
D [07/Jun/2016:16:28:27 +0200] Report: stringpool-total-bytes=167520
D [07/Jun/2016:16:28:27 +0200] [Notifier] Connected to D-BUS
D [07/Jun/2016:16:28:27 +0200] [Notifier] ServerStarted
D [07/Jun/2016:16:28:27 +0200] [Notifier] state=3
D [07/Jun/2016:16:28:27 +0200] [Notifier] PrinterStateChanged
D [07/Jun/2016:16:28:27 +0200] [Client 1] Accepted from localhost (Domain)
D [07/Jun/2016:16:28:27 +0200] [Client 1] Waiting for request.
D [07/Jun/2016:16:28:27 +0200] [Client 1] POST / HTTP/1.1
D [07/Jun/2016:16:28:27 +0200] cupsdSetBusyState: newbusy="Active clients, printing jobs, and dirty files", busy="Printing jobs and dirty files"
D [07/Jun/2016:16:28:27 +0200] [Client 1] Read: status=200
D [07/Jun/2016:16:28:27 +0200] [Client 1] No authentication data provided.
D [07/Jun/2016:16:28:27 +0200] [Client 1] 2.0 Get-Jobs 147
D [07/Jun/2016:16:28:27 +0200] Get-Jobs ipp://localhost/printers/iP3600-TurboPrint
D [07/Jun/2016:16:28:27 +0200] [Client 1] Returning IPP successful-ok for Get-Jobs (ipp://localhost/printers/iP3600-TurboPrint) from localhost
D [07/Jun/2016:16:28:27 +0200] [Client 1] Content-Length: 377
D [07/Jun/2016:16:28:27 +0200] [Client 1] cupsdSendHeader: code=200, type="application/ipp", auth_type=0
D [07/Jun/2016:16:28:27 +0200] [Client 1] con->http=0x55c1672cefd0
D [07/Jun/2016:16:28:27 +0200] [Client 1] cupsdWriteClient error=0, used=0, state=HTTP_STATE_POST_SEND, data_encoding=HTTP_ENCODING_LENGTH, data_remaining=377, response=0x55c1672d8980(IPP_STATE_DATA), pipe_pid=0, file=-1
D [07/Jun/2016:16:28:27 +0200] [Client 1] Writing IPP response, ipp_state=IPP_STATE_DATA, old wused=0, new wused=0
D [07/Jun/2016:16:28:27 +0200] [Client 1] bytes=0, http_state=0, data_remaining=377
D [07/Jun/2016:16:28:27 +0200] [Client 1] Flushing write buffer.
D [07/Jun/2016:16:28:27 +0200] [Client 1] New state is HTTP_STATE_WAITING
D [07/Jun/2016:16:28:27 +0200] [Client 1] Waiting for request.
D [07/Jun/2016:16:28:27 +0200] cupsdSetBusyState: newbusy="Printing jobs and dirty files", busy="Active clients, printing jobs, and dirty files"
D [07/Jun/2016:16:28:27 +0200] [Client 1] HTTP_STATE_WAITING Closing for error 32 (Broken pipe)
D [07/Jun/2016:16:28:27 +0200] [Client 1] Closing connection.
D [07/Jun/2016:16:28:27 +0200] cupsdSetBusyState: newbusy="Printing jobs and dirty files", busy="Printing jobs and dirty files"
D [07/Jun/2016:16:28:27 +0200] [Client 2] Accepted from localhost (Domain)
D [07/Jun/2016:16:28:27 +0200] [Client 2] Waiting for request.
D [07/Jun/2016:16:28:27 +0200] [Client 2] POST / HTTP/1.1
D [07/Jun/2016:16:28:27 +0200] cupsdSetBusyState: newbusy="Active clients, printing jobs, and dirty files", busy="Printing jobs and dirty files"
D [07/Jun/2016:16:28:27 +0200] [Client 2] Read: status=200
D [07/Jun/2016:16:28:27 +0200] [Client 2] No authentication data provided.
D [07/Jun/2016:16:28:27 +0200] [Client 2] 2.0 Get-Jobs 148
D [07/Jun/2016:16:28:27 +0200] Get-Jobs ipp://localhost/printers/iP3600-TurboPrint
D [07/Jun/2016:16:28:27 +0200] [Client 2] Returning IPP successful-ok for Get-Jobs (ipp://localhost/printers/iP3600-TurboPrint) from localhost
D [07/Jun/2016:16:28:27 +0200] [Client 2] Content-Length: 377
D [07/Jun/2016:16:28:27 +0200] [Client 2] cupsdSendHeader: code=200, type="application/ipp", auth_type=0
D [07/Jun/2016:16:28:27 +0200] [Client 2] con->http=0x55c1672cefd0
D [07/Jun/2016:16:28:27 +0200] [Client 2] cupsdWriteClient error=0, used=0, state=HTTP_STATE_POST_SEND, data_encoding=HTTP_ENCODING_LENGTH, data_remaining=377, response=0x55c1672d8980(IPP_STATE_DATA), pipe_pid=0, file=-1
D [07/Jun/2016:16:28:27 +0200] [Client 2] Writing IPP response, ipp_state=IPP_STATE_DATA, old wused=0, new wused=0
D [07/Jun/2016:16:28:27 +0200] [Client 2] bytes=0, http_state=0, data_remaining=377
D [07/Jun/2016:16:28:27 +0200] [Client 2] Flushing write buffer.
D [07/Jun/2016:16:28:27 +0200] [Client 2] New state is HTTP_STATE_WAITING
D [07/Jun/2016:16:28:27 +0200] [Client 2] Waiting for request.
D [07/Jun/2016:16:28:27 +0200] cupsdSetBusyState: newbusy="Printing jobs and dirty files", busy="Active clients, printing jobs, and dirty files"
D [07/Jun/2016:16:28:27 +0200] [Notifier] state=3
D [07/Jun/2016:16:28:27 +0200] [Notifier] JobState
D [07/Jun/2016:16:28:27 +0200] [Client 2] HTTP_STATE_WAITING Closing for error 32 (Broken pipe)
D [07/Jun/2016:16:28:27 +0200] [Client 2] Closing connection.
D [07/Jun/2016:16:28:27 +0200] cupsdSetBusyState: newbusy="Printing jobs and dirty files", busy="Printing jobs and dirty files"
D [07/Jun/2016:16:28:27 +0200] [Client 3] Accepted from localhost (Domain)
D [07/Jun/2016:16:28:27 +0200] [Client 3] Waiting for request.
D [07/Jun/2016:16:28:27 +0200] [Client 3] POST / HTTP/1.1
D [07/Jun/2016:16:28:27 +0200] cupsdSetBusyState: newbusy="Active clients, printing jobs, and dirty files", busy="Printing jobs and dirty files"
D [07/Jun/2016:16:28:27 +0200] [Client 3] Read: status=200
D [07/Jun/2016:16:28:27 +0200] [Client 3] No authentication data provided.
D [07/Jun/2016:16:28:27 +0200] [Client 3] 2.0 Get-Jobs 149
D [07/Jun/2016:16:28:27 +0200] Get-Jobs ipp://localhost/printers/iP3600-TurboPrint
D [07/Jun/2016:16:28:27 +0200] [Client 3] Returning IPP successful-ok for Get-Jobs (ipp://localhost/printers/iP3600-TurboPrint) from localhost
D [07/Jun/2016:16:28:27 +0200] [Client 3] Content-Length: 377
D [07/Jun/2016:16:28:27 +0200] [Client 3] cupsdSendHeader: code=200, type="application/ipp", auth_type=0
D [07/Jun/2016:16:28:27 +0200] [Client 3] con->http=0x55c1672cefd0
D [07/Jun/2016:16:28:27 +0200] [Client 3] cupsdWriteClient error=0, used=0, state=HTTP_STATE_POST_SEND, data_encoding=HTTP_ENCODING_LENGTH, data_remaining=377, response=0x55c1672d8980(IPP_STATE_DATA), pipe_pid=0, file=-1
D [07/Jun/2016:16:28:27 +0200] [Client 3] Writing IPP response, ipp_state=IPP_STATE_DATA, old wused=0, new wused=0
D [07/Jun/2016:16:28:27 +0200] [Client 3] bytes=0, http_state=0, data_remaining=377
D [07/Jun/2016:16:28:27 +0200] [Client 3] Flushing write buffer.
D [07/Jun/2016:16:28:27 +0200] [Client 3] New state is HTTP_STATE_WAITING
D [07/Jun/2016:16:28:27 +0200] [Client 3] Waiting for request.
D [07/Jun/2016:16:28:27 +0200] cupsdSetBusyState: newbusy="Printing jobs and dirty files", busy="Active clients, printing jobs, and dirty files"
D [07/Jun/2016:16:28:27 +0200] [Notifier] state=3
D [07/Jun/2016:16:28:27 +0200] [Job 13] Resolving \"Canon iP3600 series (über raspberry) @ raspberrypi._ipp._tcp.local\"...
D [07/Jun/2016:16:28:27 +0200] [Job 13] STATE: +connecting-to-device
D [07/Jun/2016:16:28:27 +0200] cupsdMarkDirty(---J-)
D [07/Jun/2016:16:28:27 +0200] cupsdSetBusyState: newbusy="Dirty files", busy="Printing jobs and dirty files"
D [07/Jun/2016:16:28:27 +0200] [Job 13] Resolving \"Canon iP3600 series (über raspberry) @ raspberrypi\", regtype=\"_ipp._tcp\", domain=\"local.\"...
D [07/Jun/2016:16:28:27 +0200] cupsdMarkDirty(----S)
D [07/Jun/2016:16:28:27 +0200] cupsdSetBusyState: newbusy="Dirty files", busy="Dirty files"
D [07/Jun/2016:16:28:27 +0200] [Notifier] state=3
D [07/Jun/2016:16:28:27 +0200] [Notifier] PrinterStateChanged
D [07/Jun/2016:16:28:27 +0200] [Client 3] HTTP_STATE_WAITING Closing for error 32 (Broken pipe)
D [07/Jun/2016:16:28:27 +0200] [Client 3] Closing connection.
D [07/Jun/2016:16:28:27 +0200] cupsdSetBusyState: newbusy="Dirty files", busy="Dirty files"
D [07/Jun/2016:16:28:27 +0200] [Client 4] Accepted from localhost (Domain)
D [07/Jun/2016:16:28:27 +0200] [Client 4] Waiting for request.
D [07/Jun/2016:16:28:27 +0200] [Client 4] POST / HTTP/1.1
D [07/Jun/2016:16:28:27 +0200] cupsdSetBusyState: newbusy="Active clients and dirty files", busy="Dirty files"
D [07/Jun/2016:16:28:27 +0200] [Client 4] Read: status=200
D [07/Jun/2016:16:28:27 +0200] [Client 4] No authentication data provided.
D [07/Jun/2016:16:28:27 +0200] [Client 4] 2.0 Get-Jobs 150
D [07/Jun/2016:16:28:27 +0200] Get-Jobs ipp://localhost/printers/iP3600-TurboPrint
D [07/Jun/2016:16:28:27 +0200] [Client 4] Returning IPP successful-ok for Get-Jobs (ipp://localhost/printers/iP3600-TurboPrint) from localhost
D [07/Jun/2016:16:28:27 +0200] [Client 4] Content-Length: 377
D [07/Jun/2016:16:28:27 +0200] [Client 4] cupsdSendHeader: code=200, type="application/ipp", auth_type=0
D [07/Jun/2016:16:28:27 +0200] [Client 4] con->http=0x55c1672cefd0
D [07/Jun/2016:16:28:27 +0200] [Client 4] cupsdWriteClient error=0, used=0, state=HTTP_STATE_POST_SEND, data_encoding=HTTP_ENCODING_LENGTH, data_remaining=377, response=0x55c1672db790(IPP_STATE_DATA), pipe_pid=0, file=-1
D [07/Jun/2016:16:28:27 +0200] [Client 4] Writing IPP response, ipp_state=IPP_STATE_DATA, old wused=0, new wused=0
D [07/Jun/2016:16:28:27 +0200] [Client 4] bytes=0, http_state=0, data_remaining=377
D [07/Jun/2016:16:28:27 +0200] [Client 4] Flushing write buffer.
D [07/Jun/2016:16:28:27 +0200] [Client 4] New state is HTTP_STATE_WAITING
D [07/Jun/2016:16:28:27 +0200] [Client 4] Waiting for request.
D [07/Jun/2016:16:28:27 +0200] cupsdSetBusyState: newbusy="Dirty files", busy="Active clients and dirty files"
D [07/Jun/2016:16:28:27 +0200] [Client 4] HTTP_STATE_WAITING Closing for error 32 (Broken pipe)
D [07/Jun/2016:16:28:27 +0200] [Client 4] Closing connection.
D [07/Jun/2016:16:28:27 +0200] cupsdSetBusyState: newbusy="Dirty files", busy="Dirty files"
D [07/Jun/2016:16:28:27 +0200] [Client 5] Accepted from localhost (Domain)
D [07/Jun/2016:16:28:27 +0200] [Client 5] Waiting for request.
D [07/Jun/2016:16:28:27 +0200] [Client 5] POST / HTTP/1.1
D [07/Jun/2016:16:28:27 +0200] cupsdSetBusyState: newbusy="Active clients and dirty files", busy="Dirty files"
D [07/Jun/2016:16:28:27 +0200] [Client 5] Read: status=200
D [07/Jun/2016:16:28:27 +0200] [Client 5] No authentication data provided.
D [07/Jun/2016:16:28:27 +0200] [Client 5] 2.0 Get-Jobs 151
D [07/Jun/2016:16:28:27 +0200] Get-Jobs ipp://localhost/printers/iP3600-TurboPrint
D [07/Jun/2016:16:28:27 +0200] [Client 5] Returning IPP successful-ok for Get-Jobs (ipp://localhost/printers/iP3600-TurboPrint) from localhost
D [07/Jun/2016:16:28:27 +0200] [Client 5] Content-Length: 377
D [07/Jun/2016:16:28:27 +0200] [Client 5] cupsdSendHeader: code=200, type="application/ipp", auth_type=0
D [07/Jun/2016:16:28:27 +0200] [Client 5] con->http=0x55c1672cefd0
D [07/Jun/2016:16:28:27 +0200] [Client 5] cupsdWriteClient error=0, used=0, state=HTTP_STATE_POST_SEND, data_encoding=HTTP_ENCODING_LENGTH, data_remaining=377, response=0x55c1672db790(IPP_STATE_DATA), pipe_pid=0, file=-1
D [07/Jun/2016:16:28:27 +0200] [Client 5] Writing IPP response, ipp_state=IPP_STATE_DATA, old wused=0, new wused=0
D [07/Jun/2016:16:28:27 +0200] [Client 5] bytes=0, http_state=0, data_remaining=377
D [07/Jun/2016:16:28:27 +0200] [Client 5] Flushing write buffer.
D [07/Jun/2016:16:28:27 +0200] [Client 5] New state is HTTP_STATE_WAITING
D [07/Jun/2016:16:28:27 +0200] [Client 5] Waiting for request.
D [07/Jun/2016:16:28:27 +0200] cupsdSetBusyState: newbusy="Dirty files", busy="Active clients and dirty files"
D [07/Jun/2016:16:28:27 +0200] [Notifier] Connected to D-BUS
D [07/Jun/2016:16:28:27 +0200] [Notifier] state=3
D [07/Jun/2016:16:28:27 +0200] [Notifier] state=3
D [07/Jun/2016:16:28:27 +0200] [Notifier] state=3
D [07/Jun/2016:16:28:27 +0200] [Job 13] PID 3107 (/usr/lib/cups/filter/pdftopdf) exited with no errors.
D [07/Jun/2016:16:28:27 +0200] [Client 6] Accepted from localhost (Domain)
D [07/Jun/2016:16:28:27 +0200] [Client 6] Waiting for request.
D [07/Jun/2016:16:28:27 +0200] [Client 6] POST / HTTP/1.1
D [07/Jun/2016:16:28:27 +0200] cupsdSetBusyState: newbusy="Active clients and dirty files", busy="Dirty files"
D [07/Jun/2016:16:28:27 +0200] [Client 6] Read: status=200
D [07/Jun/2016:16:28:27 +0200] [Client 6] No authentication data provided.
D [07/Jun/2016:16:28:27 +0200] [Client 6] 2.0 Get-Printer-Attributes 1
D [07/Jun/2016:16:28:27 +0200] Get-Printer-Attributes ipp://localhost:631/printers/iP3600-TurboPrint
D [07/Jun/2016:16:28:27 +0200] [Client 6] Returning IPP successful-ok for Get-Printer-Attributes (ipp://localhost:631/printers/iP3600-TurboPrint) from localhost
D [07/Jun/2016:16:28:27 +0200] [Client 6] Content-Length: 1341
D [07/Jun/2016:16:28:27 +0200] [Client 6] cupsdSendHeader: code=200, type="application/ipp", auth_type=0
D [07/Jun/2016:16:28:27 +0200] [Client 6] con->http=0x55c1672d21e0
D [07/Jun/2016:16:28:27 +0200] [Client 6] cupsdWriteClient error=0, used=0, state=HTTP_STATE_POST_SEND, data_encoding=HTTP_ENCODING_LENGTH, data_remaining=1341, response=0x55c1672dc9d0(IPP_STATE_DATA), pipe_pid=0, file=-1
D [07/Jun/2016:16:28:27 +0200] [Client 6] Writing IPP response, ipp_state=IPP_STATE_DATA, old wused=0, new wused=0
D [07/Jun/2016:16:28:27 +0200] [Client 6] bytes=0, http_state=0, data_remaining=1341
D [07/Jun/2016:16:28:27 +0200] [Client 6] Flushing write buffer.
D [07/Jun/2016:16:28:27 +0200] [Client 6] New state is HTTP_STATE_WAITING
D [07/Jun/2016:16:28:27 +0200] [Client 6] Waiting for request.
D [07/Jun/2016:16:28:27 +0200] cupsdSetBusyState: newbusy="Dirty files", busy="Active clients and dirty files"
D [07/Jun/2016:16:28:27 +0200] [Client 6] HTTP_STATE_WAITING Closing for error 32 (Broken pipe)
D [07/Jun/2016:16:28:27 +0200] [Client 6] Closing connection.
D [07/Jun/2016:16:28:27 +0200] cupsdSetBusyState: newbusy="Dirty files", busy="Dirty files"
D [07/Jun/2016:16:28:27 +0200] [Client 7] Accepted from localhost (Domain)
D [07/Jun/2016:16:28:27 +0200] [Client 7] Waiting for request.
D [07/Jun/2016:16:28:27 +0200] [Client 7] POST / HTTP/1.1
D [07/Jun/2016:16:28:27 +0200] cupsdSetBusyState: newbusy="Active clients and dirty files", busy="Dirty files"
D [07/Jun/2016:16:28:27 +0200] [Client 7] Read: status=200
D [07/Jun/2016:16:28:27 +0200] [Client 7] No authentication data provided.
D [07/Jun/2016:16:28:27 +0200] [Client 7] 2.0 CUPS-Get-Printers 2
D [07/Jun/2016:16:28:27 +0200] CUPS-Get-Printers
D [07/Jun/2016:16:28:27 +0200] [Client 7] Returning IPP successful-ok for CUPS-Get-Printers (no URI) from localhost
D [07/Jun/2016:16:28:27 +0200] [Client 7] Content-Length: 689
D [07/Jun/2016:16:28:27 +0200] [Client 7] cupsdSendHeader: code=200, type="application/ipp", auth_type=0
D [07/Jun/2016:16:28:27 +0200] [Client 7] con->http=0x55c1672d21e0
D [07/Jun/2016:16:28:27 +0200] [Client 7] cupsdWriteClient error=0, used=0, state=HTTP_STATE_POST_SEND, data_encoding=HTTP_ENCODING_LENGTH, data_remaining=689, response=0x55c1672dc910(IPP_STATE_DATA), pipe_pid=0, file=-1
D [07/Jun/2016:16:28:27 +0200] [Client 7] Writing IPP response, ipp_state=IPP_STATE_DATA, old wused=0, new wused=0
D [07/Jun/2016:16:28:27 +0200] [Client 7] bytes=0, http_state=0, data_remaining=689
D [07/Jun/2016:16:28:27 +0200] [Client 7] Flushing write buffer.
D [07/Jun/2016:16:28:27 +0200] [Client 7] New state is HTTP_STATE_WAITING
D [07/Jun/2016:16:28:27 +0200] [Client 7] Waiting for request.
D [07/Jun/2016:16:28:27 +0200] cupsdSetBusyState: newbusy="Dirty files", busy="Active clients and dirty files"
D [07/Jun/2016:16:28:27 +0200] [Client 7] HTTP_STATE_WAITING Closing for error 32 (Broken pipe)
D [07/Jun/2016:16:28:27 +0200] [Client 7] Closing connection.
D [07/Jun/2016:16:28:27 +0200] cupsdSetBusyState: newbusy="Dirty files", busy="Dirty files"
D [07/Jun/2016:16:28:27 +0200] [Client 8] Accepted from localhost (Domain)
D [07/Jun/2016:16:28:27 +0200] [Client 8] Waiting for request.
D [07/Jun/2016:16:28:27 +0200] [Client 8] POST /printers/ HTTP/1.1
D [07/Jun/2016:16:28:27 +0200] cupsdSetBusyState: newbusy="Active clients and dirty files", busy="Dirty files"
D [07/Jun/2016:16:28:27 +0200] [Client 8] Read: status=200
D [07/Jun/2016:16:28:27 +0200] [Client 8] No authentication data provided.
D [07/Jun/2016:16:28:27 +0200] [Client 8] 2.0 CUPS-Get-Printers 1
D [07/Jun/2016:16:28:27 +0200] CUPS-Get-Printers
D [07/Jun/2016:16:28:27 +0200] [Client 8] Returning IPP successful-ok for CUPS-Get-Printers () from localhost
D [07/Jun/2016:16:28:27 +0200] [Client 8] Content-Length: 1543
D [07/Jun/2016:16:28:27 +0200] [Client 8] cupsdSendHeader: code=200, type="application/ipp", auth_type=0
D [07/Jun/2016:16:28:27 +0200] [Client 8] con->http=0x55c1672d21e0
D [07/Jun/2016:16:28:27 +0200] [Client 8] cupsdWriteClient error=0, used=0, state=HTTP_STATE_POST_SEND, data_encoding=HTTP_ENCODING_LENGTH, data_remaining=1543, response=0x55c1672dc8a0(IPP_STATE_DATA), pipe_pid=0, file=-1
D [07/Jun/2016:16:28:27 +0200] [Client 8] Writing IPP response, ipp_state=IPP_STATE_DATA, old wused=0, new wused=0
D [07/Jun/2016:16:28:27 +0200] [Client 8] bytes=0, http_state=0, data_remaining=1543
D [07/Jun/2016:16:28:27 +0200] [Client 8] Flushing write buffer.
D [07/Jun/2016:16:28:27 +0200] [Client 8] New state is HTTP_STATE_WAITING
D [07/Jun/2016:16:28:27 +0200] [Client 8] Waiting for request.
D [07/Jun/2016:16:28:27 +0200] cupsdSetBusyState: newbusy="Dirty files", busy="Active clients and dirty files"
D [07/Jun/2016:16:28:27 +0200] [Client 8] HTTP_STATE_WAITING Closing for error 32 (Broken pipe)
D [07/Jun/2016:16:28:27 +0200] [Client 8] Closing connection.
D [07/Jun/2016:16:28:27 +0200] cupsdSetBusyState: newbusy="Dirty files", busy="Dirty files"
D [07/Jun/2016:16:28:27 +0200] [Job 13] document didn\'t set mediasize yet
D [07/Jun/2016:16:28:27 +0200] [Job 13] .MediaSize = 595.200012 x 841.799988
D [07/Jun/2016:16:28:27 +0200] [Job 13] page size in pixels forced to width=4960 height=7015
D [07/Jun/2016:16:28:27 +0200] [Job 13] Margins set to [ L B R T ] = [ 0.000000 0.000000 0.000000 0.000000 ]
D [07/Jun/2016:16:28:27 +0200] [Job 13] HWMargins in points [ L B R T ] = [ 0.000000 0.000000 0.000000 0.000000 ]
D [07/Jun/2016:16:28:27 +0200] [Job 13] ImagingBBox in points [ L B R T ] = [ 0.000000 0.000000 0.000000 0.000000 ]
D [07/Jun/2016:16:28:27 +0200] [Job 13] MediaSize in points [ W H ] = [ 595.200012 841.799988 ]
D [07/Jun/2016:16:28:27 +0200] [Job 13] MediaSize in pixels [ W H ] = [ 4960 7015 ]
D [07/Jun/2016:16:28:27 +0200] [Job 13] .MediaSize = 595.200012 x 841.799988
D [07/Jun/2016:16:28:27 +0200] [Job 13] portrait_diff 0.000000 landscape_diff 0.707258
D [07/Jun/2016:16:28:27 +0200] [Job 13] .MediaSize = 595.200012 x 841.799988
D [07/Jun/2016:16:28:27 +0200] [Job 13] page size in pixels forced to width=4960 height=7015
D [07/Jun/2016:16:28:27 +0200] [Job 13] .MediaSize = 595.000000 x 842.000000
D [07/Jun/2016:16:28:27 +0200] [Job 13] portrait_diff 0.000405 landscape_diff 0.708070
D [07/Jun/2016:16:28:27 +0200] [Job 13] .MediaSize = 595.200012 x 841.799988
D [07/Jun/2016:16:28:27 +0200] [Job 13] page size in pixels forced to width=4960 height=7015
D [07/Jun/2016:16:28:27 +0200] [Job 13] zedo_print_page_copies: colors rgb 8 cmyk 0 gray 1
D [07/Jun/2016:16:28:27 +0200] [Job 13] HWMargins in points [ L B R T ] = [ 0.000000 0.000000 0.000000 0.000000 ]
D [07/Jun/2016:16:28:27 +0200] [Job 13] ImagingBBox in points [ L B R T ] = [ 0.000000 0.000000 0.000000 0.000000 ]
D [07/Jun/2016:16:28:27 +0200] [Job 13] MediaSize in points [ W H ] = [ 595.200012 841.799988 ]
D [07/Jun/2016:16:28:27 +0200] [Job 13] Margins in points [ W H ] = [ 0.000000 0.000000 ]
D [07/Jun/2016:16:28:27 +0200] [Job 13] MarginsHWResolution [ W H ] = [ 72.000000 72.000000 ]
D [07/Jun/2016:16:28:27 +0200] [Job 13] MediaSize in pixels [ W H ] = [ 4960 7015 ]
D [07/Jun/2016:16:28:27 +0200] [Job 13] zedo_write_page: zbitsperpixel 24 width 4960 height 7015 depth 24