==> access_log <==
localhost - - [12/Feb/2009:13:59:54 +0200] "POST / HTTP/1.1" 200 418 CUPS-Get-Printers successful-ok
localhost - - [12/Feb/2009:13:59:54 +0200] "POST / HTTP/1.1" 200 418 CUPS-Get-Classes successful-ok
localhost - - [12/Feb/2009:13:59:54 +0200] "POST / HTTP/1.1" 200 75 CUPS-Get-Default successful-ok
localhost - - [12/Feb/2009:13:59:54 +0200] "POST /printers/xerox3117 HTTP/1.1" 200 1426 Print-Job successful-ok
==> error_log <==
D [12/Feb/2009:13:59:54 +0200] cupsdAcceptClient: skipping getpeercon()
D [12/Feb/2009:13:59:54 +0200] cupsdAcceptClient: 11 from localhost (Domain)
D [12/Feb/2009:13:59:54 +0200] Report: clients=1
D [12/Feb/2009:13:59:54 +0200] Report: jobs=86
D [12/Feb/2009:13:59:54 +0200] Report: jobs-active=0
D [12/Feb/2009:13:59:54 +0200] Report: printers=1
D [12/Feb/2009:13:59:54 +0200] Report: printers-implicit=0
D [12/Feb/2009:13:59:54 +0200] Report: stringpool-string-count=4799
D [12/Feb/2009:13:59:54 +0200] Report: stringpool-alloc-bytes=9016
D [12/Feb/2009:13:59:54 +0200] Report: stringpool-total-bytes=78088
D [12/Feb/2009:13:59:54 +0200] cupsdReadClient: 11 POST / HTTP/1.1
D [12/Feb/2009:13:59:54 +0200] cupsdAuthorize: No authentication data provided.
D [12/Feb/2009:13:59:54 +0200] CUPS-Get-Printers
D [12/Feb/2009:13:59:54 +0200] cupsdProcessIPPRequest: 11 status_code=0 (successful-ok)
D [12/Feb/2009:13:59:54 +0200] cupsdReadClient: 11 POST / HTTP/1.1
D [12/Feb/2009:13:59:54 +0200] cupsdAuthorize: No authentication data provided.
D [12/Feb/2009:13:59:54 +0200] CUPS-Get-Classes
D [12/Feb/2009:13:59:54 +0200] cupsdProcessIPPRequest: 11 status_code=0 (successful-ok)
D [12/Feb/2009:13:59:54 +0200] cupsdReadClient: 11 POST / HTTP/1.1
D [12/Feb/2009:13:59:54 +0200] cupsdAuthorize: No authentication data provided.
D [12/Feb/2009:13:59:54 +0200] CUPS-Get-Default
D [12/Feb/2009:13:59:54 +0200] cupsdProcessIPPRequest: 11 status_code=0 (successful-ok)
D [12/Feb/2009:13:59:54 +0200] cupsdAcceptClient: skipping getpeercon()
D [12/Feb/2009:13:59:54 +0200] cupsdAcceptClient: 12 from localhost (Domain)
D [12/Feb/2009:13:59:54 +0200] cupsdCloseClient: 11
D [12/Feb/2009:13:59:54 +0200] cupsdReadClient: 12 POST /printers/xerox3117 HTTP/1.1
D [12/Feb/2009:13:59:54 +0200] cupsdAuthorize: No authentication data provided.
D [12/Feb/2009:13:59:54 +0200] Print-Job ipp://localhost/printers/xerox3117
D [12/Feb/2009:13:59:54 +0200] print_job: auto-typing file...
D [12/Feb/2009:13:59:54 +0200] add_job: setting context of job to UNKNOWN SL
D [12/Feb/2009:13:59:54 +0200] add_job: requesting-user-name="iskren"
I [12/Feb/2009:13:59:54 +0200] [Job 99] Adding start banner page "none".
D [12/Feb/2009:13:59:54 +0200] Discarding unused job-created event...
I [12/Feb/2009:13:59:54 +0200] [Job 99] Adding job file of type text/plain.
I [12/Feb/2009:13:59:54 +0200] [Job 99] Adding end banner page "none".
I [12/Feb/2009:13:59:54 +0200] [Job 99] Queued on "xerox3117" by "iskren".
D [12/Feb/2009:13:59:54 +0200] [Job 99] hold_until = 0
D [12/Feb/2009:13:59:54 +0200] Discarding unused printer-state-changed event...
D [12/Feb/2009:13:59:54 +0200] [Job 99] job-sheets=none,none
D [12/Feb/2009:13:59:54 +0200] [Job 99] banner_page = 0
D [12/Feb/2009:13:59:54 +0200] [Job 99] argv[0]="xerox3117"
D [12/Feb/2009:13:59:54 +0200] [Job 99] argv[1]="99"
D [12/Feb/2009:13:59:54 +0200] [Job 99] argv[2]="iskren"
D [12/Feb/2009:13:59:54 +0200] [Job 99] argv[3]="contestapplet.conf"
D [12/Feb/2009:13:59:54 +0200] [Job 99] argv[4]="1"
D [12/Feb/2009:13:59:54 +0200] [Job 99] argv[5]="media=Letter finishings=3 number-up=1 PageSize=A4 job-uuid=urn:uuid:73ba713d-a03a-39f3-5116-329f42104996"
D [12/Feb/2009:13:59:54 +0200] [Job 99] argv[6]="/var/spool/cups/d00099-001"
D [12/Feb/2009:13:59:54 +0200] [Job 99] envp[0]="CUPS_CACHEDIR=/var/cache/cups"
D [12/Feb/2009:13:59:54 +0200] [Job 99] envp[1]="CUPS_DATADIR=/usr/share/cups"
D [12/Feb/2009:13:59:54 +0200] [Job 99] envp[2]="CUPS_DOCROOT=/usr/share/doc/cups-1.3.7"
D [12/Feb/2009:13:59:54 +0200] [Job 99] envp[3]="CUPS_FONTPATH=/usr/share/cups/fonts"
D [12/Feb/2009:13:59:54 +0200] [Job 99] envp[4]="CUPS_REQUESTROOT=/var/spool/cups"
D [12/Feb/2009:13:59:54 +0200] [Job 99] envp[5]="CUPS_SERVERBIN=/usr/lib/cups"
D [12/Feb/2009:13:59:54 +0200] [Job 99] envp[6]="CUPS_SERVERROOT=/etc/cups"
D [12/Feb/2009:13:59:54 +0200] [Job 99] envp[7]="CUPS_STATEDIR=/var/run/cups"
D [12/Feb/2009:13:59:54 +0200] [Job 99] envp[8]="PATH=/usr/lib/cups/filter:/usr/lib64/cups/filter:/usr/bin:/usr/sbin:/bin:/usr/bin"
D [12/Feb/2009:13:59:54 +0200] [Job 99] envp[9]="SERVER_ADMIN=root@iskren.info"
D [12/Feb/2009:13:59:54 +0200] [Job 99] envp[10]="SOFTWARE=CUPS/1.3.7"
D [12/Feb/2009:13:59:54 +0200] [Job 99] envp[11]="TMPDIR=/var/spool/cups/tmp"
D [12/Feb/2009:13:59:54 +0200] [Job 99] envp[12]="USER=root"
D [12/Feb/2009:13:59:54 +0200] [Job 99] envp[13]="CUPS_SERVER=/var/run/cups/cups.sock"
D [12/Feb/2009:13:59:54 +0200] [Job 99] envp[14]="CUPS_ENCRYPTION=IfRequested"
D [12/Feb/2009:13:59:54 +0200] [Job 99] envp[15]="IPP_PORT=631"
D [12/Feb/2009:13:59:54 +0200] [Job 99] envp[16]="CHARSET=utf-8"
D [12/Feb/2009:13:59:54 +0200] [Job 99] envp[17]="LANG=en_US.UTF8"
D [12/Feb/2009:13:59:54 +0200] [Job 99] envp[18]="PPD=/etc/cups/ppd/xerox3117.ppd"
D [12/Feb/2009:13:59:54 +0200] [Job 99] envp[19]="RIP_MAX_CACHE=8m"
D [12/Feb/2009:13:59:54 +0200] [Job 99] envp[20]="CONTENT_TYPE=text/plain"
D [12/Feb/2009:13:59:54 +0200] [Job 99] envp[21]="DEVICE_URI=usb://Xerox/Phaser%203117"
D [12/Feb/2009:13:59:54 +0200] [Job 99] envp[22]="PRINTER=xerox3117"
D [12/Feb/2009:13:59:54 +0200] [Job 99] envp[23]="FINAL_CONTENT_TYPE=printer/xerox3117"
I [12/Feb/2009:13:59:54 +0200] [Job 99] Started filter /usr/lib/cups/filter/texttopaps (PID 16411)
I [12/Feb/2009:13:59:54 +0200] [Job 99] Started filter /usr/lib/cups/filter/pstops (PID 16412)
I [12/Feb/2009:13:59:54 +0200] [Job 99] Started filter /usr/lib/cups/filter/foomatic-rip (PID 16413)
I [12/Feb/2009:13:59:54 +0200] [Job 99] Started backend /usr/lib/cups/backend/usb (PID 16414)
D [12/Feb/2009:13:59:54 +0200] Discarding unused job-state-changed event...
D [12/Feb/2009:13:59:54 +0200] cupsdProcessIPPRequest: 12 status_code=0 (successful-ok)
D [12/Feb/2009:13:59:54 +0200] cupsdCloseClient: 12
D [12/Feb/2009:13:59:54 +0200] Discarding unused printer-state-changed event...
D [12/Feb/2009:13:59:54 +0200] [Job 99] Printer using device file "/dev/usblp0"...
D [12/Feb/2009:13:59:54 +0200] [Job 99] backendRunLoop(print_fd=0, device_fd=5, use_bc=1, side_cb=0x7f39a2241060)
D [12/Feb/2009:13:59:54 +0200] Discarding unused printer-state-changed event...
D [12/Feb/2009:13:59:54 +0200] [Job 99] Page = 595x842; 18,36 to 577,806
D [12/Feb/2009:13:59:54 +0200] [Job 99] slow_collate=0, slow_duplex=0, slow_order=0
D [12/Feb/2009:13:59:54 +0200] [Job 99] Before copy_comments - %!PS-Adobe-3.0
D [12/Feb/2009:13:59:54 +0200] [Job 99] %!PS-Adobe-3.0
D [12/Feb/2009:13:59:54 +0200] [Job 99] %cupsRotation: 0
D [12/Feb/2009:13:59:54 +0200] [Job 99] %%Title: contestapplet.conf
D [12/Feb/2009:13:59:54 +0200] [Job 99] %%Creator: paps version 0.6.7 by Dov Grobgeld
D [12/Feb/2009:13:59:54 +0200] [Job 99] %%Pages: (atend)
D [12/Feb/2009:13:59:54 +0200] [Job 99] %%BoundingBox: 0 0 595 842
D [12/Feb/2009:13:59:54 +0200] [Job 99] %%For: iskren
D [12/Feb/2009:13:59:54 +0200] [Job 99] %%Orientation: Portrait
D [12/Feb/2009:13:59:54 +0200] [Job 99] %%EndComments
D [12/Feb/2009:13:59:54 +0200] [Job 99] Before copy_prolog - %%BeginProlog
D [12/Feb/2009:13:59:54 +0200] [Job 99] Before copy_setup - %%BeginSetup
D [12/Feb/2009:13:59:54 +0200] [Job 99] Before page loop - %%Page: 1 1
D [12/Feb/2009:13:59:54 +0200] [Job 99] Copying page 1...
D [12/Feb/2009:13:59:54 +0200] [Job 99] pagew = 559.0, pagel = 770.0
D [12/Feb/2009:13:59:54 +0200] [Job 99] bboxx = 0, bboxy = 0, bboxw = 595, bboxl = 842
D [12/Feb/2009:13:59:54 +0200] [Job 99] PageLeft = 18.0, PageRight = 577.0
D [12/Feb/2009:13:59:54 +0200] [Job 99] PageTop = 806.0, PageBottom = 36.0
D [12/Feb/2009:13:59:54 +0200] [Job 99] PageWidth = 595.0, PageLength = 842.0
D [12/Feb/2009:13:59:54 +0200] [Job 99] Wrote 1 pages...
D [12/Feb/2009:13:59:54 +0200] PID 16412 (/usr/lib/cups/filter/pstops) exited with no errors.
D [12/Feb/2009:13:59:54 +0200] PID 16411 (/usr/lib/cups/filter/texttopaps) exited with no errors.
D [12/Feb/2009:13:59:54 +0200] [Job 99] foomatic-rip version $Revision$ running...
D [12/Feb/2009:13:59:54 +0200] [Job 99] Parsing PPD file ...
D [12/Feb/2009:13:59:54 +0200] [Job 99] *cupsFilter: "application/vnd.cups-postscript 0 foomatic-rip"
D [12/Feb/2009:13:59:54 +0200] [Job 99] Added option ColorSpace
D [12/Feb/2009:13:59:54 +0200] [Job 99] Added option Manualfeed
D [12/Feb/2009:13:59:54 +0200] [Job 99] Added option Resolution
D [12/Feb/2009:13:59:54 +0200] [Job 99] Added option Economode
D [12/Feb/2009:13:59:54 +0200] [Job 99] Added option MediaType
D [12/Feb/2009:13:59:54 +0200] [Job 99] Added option RET
D [12/Feb/2009:13:59:54 +0200] [Job 99] Added option Copies
D [12/Feb/2009:13:59:54 +0200] [Job 99] Added option PageSize
D [12/Feb/2009:13:59:54 +0200] [Job 99] Added option PageRegion
D [12/Feb/2009:13:59:54 +0200] [Job 99] Added option ImageableArea
D [12/Feb/2009:13:59:54 +0200] [Job 99] Added option PaperDimension
D [12/Feb/2009:13:59:54 +0200] [Job 99] Added option HalftoningAlgorithm
D [12/Feb/2009:13:59:54 +0200] [Job 99] Added option Density
D [12/Feb/2009:13:59:54 +0200] [Job 99] Added option JamRecovery
D [12/Feb/2009:13:59:54 +0200] [Job 99] Added option AllowReprint
D [12/Feb/2009:13:59:54 +0200] [Job 99] Added option Altitude
D [12/Feb/2009:13:59:54 +0200] [Job 99] Added option PageTimeout
D [12/Feb/2009:13:59:54 +0200] [Job 99] Added option PowerSaving
D [12/Feb/2009:13:59:54 +0200] [Job 99] Added option PowerSaveTime
D [12/Feb/2009:13:59:54 +0200] [Job 99] Added option PageSizeJCL
D [12/Feb/2009:13:59:54 +0200] [Job 99] Added option PageSizePS
D [12/Feb/2009:13:59:54 +0200] [Job 99] Added option Font
D [12/Feb/2009:13:59:54 +0200] [Job 99]
D [12/Feb/2009:13:59:54 +0200] [Job 99] Parameter Summary
D [12/Feb/2009:13:59:54 +0200] [Job 99] -----------------
D [12/Feb/2009:13:59:54 +0200] [Job 99]
D [12/Feb/2009:13:59:54 +0200] [Job 99] Spooler: cups
D [12/Feb/2009:13:59:54 +0200] [Job 99] Printer: xerox3117
D [12/Feb/2009:13:59:54 +0200] [Job 99] Shell: /bin/sh
D [12/Feb/2009:13:59:54 +0200] [Job 99] PPD file: /etc/cups/ppd/xerox3117.ppd
D [12/Feb/2009:13:59:54 +0200] [Job 99] ATTR file:
D [12/Feb/2009:13:59:54 +0200] [Job 99] Printer model: Samsung ML-1710 Foomatic/gdi
D [12/Feb/2009:13:59:54 +0200] [Job 99] Job title: contestapplet.conf
D [12/Feb/2009:13:59:54 +0200] [Job 99] File(s) to be printed:
D [12/Feb/2009:13:59:54 +0200] [Job 99] <STDIN>
D [12/Feb/2009:13:59:54 +0200] [Job 99]
D [12/Feb/2009:13:59:54 +0200] [Job 99] GhostScript extra search path ('GS_LIB'): /usr/share/cups/fonts
D [12/Feb/2009:13:59:54 +0200] [Job 99] Pondering option 'media=Letter'
D [12/Feb/2009:13:59:54 +0200] [Job 99] Pondering option 'finishings=3'
D [12/Feb/2009:13:59:54 +0200] [Job 99] Unknown option finishings=3.
D [12/Feb/2009:13:59:54 +0200] [Job 99] Pondering option 'number-up=1'
D [12/Feb/2009:13:59:54 +0200] [Job 99] Unknown option number-up=1.
D [12/Feb/2009:13:59:54 +0200] [Job 99] Pondering option 'PageSize=A4'
D [12/Feb/2009:13:59:54 +0200] [Job 99] Pondering option 'job-uuid=urn:uuid:73ba713d-a03a-39f3-5116-329f42104996'
D [12/Feb/2009:13:59:54 +0200] [Job 99] Unknown option job-uuid=urn:uuid:73ba713d-a03a-39f3-5116-329f42104996.
D [12/Feb/2009:13:59:54 +0200] [Job 99]
D [12/Feb/2009:13:59:54 +0200] [Job 99] ================================================
D [12/Feb/2009:13:59:54 +0200] [Job 99]
D [12/Feb/2009:13:59:54 +0200] [Job 99] File: <STDIN>
D [12/Feb/2009:13:59:54 +0200] [Job 99]
D [12/Feb/2009:13:59:54 +0200] [Job 99] ================================================
D [12/Feb/2009:13:59:54 +0200] [Job 99]
D [12/Feb/2009:13:59:54 +0200] [Job 99] Reading PostScript input ...
D [12/Feb/2009:13:59:54 +0200] [Job 99] --> This document is DSC-conforming!
D [12/Feb/2009:13:59:54 +0200] [Job 99]
D [12/Feb/2009:13:59:54 +0200] [Job 99] -----------
D [12/Feb/2009:13:59:54 +0200] [Job 99] Found: %%BeginProlog
D [12/Feb/2009:13:59:54 +0200] [Job 99] Found: %%EndProlog
D [12/Feb/2009:13:59:54 +0200] [Job 99]
D [12/Feb/2009:13:59:54 +0200] [Job 99] -----------
D [12/Feb/2009:13:59:54 +0200] [Job 99] Found: %%BeginSetup
D [12/Feb/2009:13:59:54 +0200] [Job 99] Found: %%BeginFeature: *PageSize A4
D [12/Feb/2009:13:59:54 +0200] [Job 99] Option: PageSize=A4 --> Setting option
D [12/Feb/2009:13:59:54 +0200] [Job 99] Found: %% FoomaticRIPOptionSetting: PageSize=A4
D [12/Feb/2009:13:59:54 +0200] [Job 99] Option: PageSize=A4 --> Setting option
D [12/Feb/2009:13:59:54 +0200] [Job 99] Found: %%BeginFeature: *Manualfeed Off
D [12/Feb/2009:13:59:54 +0200] [Job 99] Option: Manualfeed=Off --> Setting option
D [12/Feb/2009:13:59:54 +0200] [Job 99] Found: %% FoomaticRIPOptionSetting: Manualfeed=Off
D [12/Feb/2009:13:59:54 +0200] [Job 99] Option: Manualfeed=Off --> Setting option
D [12/Feb/2009:13:59:54 +0200] [Job 99] Found: %%BeginFeature: *Resolution 600x600dpi
D [12/Feb/2009:13:59:54 +0200] [Job 99] Option: Resolution=600x600dpi --> Option will be set by PostScript interpreter
D [12/Feb/2009:13:59:54 +0200] [Job 99] Found: %%BeginFeature: *Economode Off
D [12/Feb/2009:13:59:54 +0200] [Job 99] Option: Economode=Off --> Setting option
D [12/Feb/2009:13:59:54 +0200] [Job 99] Found: %% FoomaticRIPOptionSetting: Economode=Off
D [12/Feb/2009:13:59:54 +0200] [Job 99] Option: Economode=Off --> Setting option
D [12/Feb/2009:13:59:54 +0200] [Job 99] Found: %%BeginFeature: *MediaType Normal
D [12/Feb/2009:13:59:54 +0200] [Job 99] Option: MediaType=Normal --> Setting option
D [12/Feb/2009:13:59:54 +0200] [Job 99] Found: %% FoomaticRIPOptionSetting: MediaType=Normal
D [12/Feb/2009:13:59:54 +0200] [Job 99] Option: MediaType=Normal --> Setting option
D [12/Feb/2009:13:59:54 +0200] [Job 99] Found: %%BeginFeature: *Density 3
D [12/Feb/2009:13:59:54 +0200] [Job 99] Option: Density=3 --> Setting option
D [12/Feb/2009:13:59:54 +0200] [Job 99] Found: %% FoomaticRIPOptionSetting: Density=3
D [12/Feb/2009:13:59:54 +0200] [Job 99] Option: Density=3 --> Setting option
D [12/Feb/2009:13:59:54 +0200] [Job 99] Found: %%BeginFeature: *JamRecovery Yes
D [12/Feb/2009:13:59:54 +0200] [Job 99] Option: JamRecovery=Yes --> Setting option
D [12/Feb/2009:13:59:54 +0200] [Job 99] Found: %% FoomaticRIPOptionSetting: JamRecovery=Yes
D [12/Feb/2009:13:59:54 +0200] [Job 99] Option: JamRecovery=Yes --> Setting option
D [12/Feb/2009:13:59:54 +0200] [Job 99] Found: %%BeginFeature: *AllowReprint Yes
D [12/Feb/2009:13:59:54 +0200] [Job 99] Option: AllowReprint=Yes --> Setting option
D [12/Feb/2009:13:59:54 +0200] [Job 99] Found: %% FoomaticRIPOptionSetting: AllowReprint=Yes
D [12/Feb/2009:13:59:54 +0200] [Job 99] Option: AllowReprint=Yes --> Setting option
D [12/Feb/2009:13:59:54 +0200] [Job 99] Found: %%BeginFeature: *Altitude Low
D [12/Feb/2009:13:59:54 +0200] [Job 99] Option: Altitude=Low --> Setting option
D [12/Feb/2009:13:59:54 +0200] [Job 99] Found: %% FoomaticRIPOptionSetting: Altitude=Low
D [12/Feb/2009:13:59:54 +0200] [Job 99] Option: Altitude=Low --> Setting option
D [12/Feb/2009:13:59:54 +0200] [Job 99] Found: %%BeginFeature: *Copies 1
D [12/Feb/2009:13:59:54 +0200] [Job 99] Option: Copies=1 --> Setting option
D [12/Feb/2009:13:59:54 +0200] [Job 99] Found: %% FoomaticRIPOptionSetting: Copies=1
D [12/Feb/2009:13:59:54 +0200] [Job 99] Option: Copies=1 --> Setting option
D [12/Feb/2009:13:59:54 +0200] [Job 99] Found: %%BeginFeature: *PageTimeout 15
D [12/Feb/2009:13:59:54 +0200] [Job 99] Option: PageTimeout=15 --> Setting option
D [12/Feb/2009:13:59:54 +0200] [Job 99] Found: %% FoomaticRIPOptionSetting: PageTimeout=15
D [12/Feb/2009:13:59:54 +0200] [Job 99] Option: PageTimeout=15 --> Setting option
D [12/Feb/2009:13:59:54 +0200] [Job 99] Found: %%BeginFeature: *PowerSaving On
D [12/Feb/2009:13:59:54 +0200] [Job 99] Option: PowerSaving=On --> Setting option
D [12/Feb/2009:13:59:54 +0200] [Job 99] Found: %% FoomaticRIPOptionSetting: PowerSaving=On
D [12/Feb/2009:13:59:54 +0200] [Job 99] Option: PowerSaving=On --> Setting option
D [12/Feb/2009:13:59:54 +0200] [Job 99] Found: %%BeginFeature: *PowerSaveTime 5
D [12/Feb/2009:13:59:54 +0200] [Job 99] Option: PowerSaveTime=5 --> Setting option
D [12/Feb/2009:13:59:54 +0200] [Job 99] Found: %% FoomaticRIPOptionSetting: PowerSaveTime=5
D [12/Feb/2009:13:59:54 +0200] [Job 99] Option: PowerSaveTime=5 --> Setting option
D [12/Feb/2009:13:59:54 +0200] [Job 99] Found: %%EndSetup
D [12/Feb/2009:13:59:54 +0200] [Job 99] Inserting PostScript code for CUPS' page accounting
D [12/Feb/2009:13:59:54 +0200] [Job 99]
D [12/Feb/2009:13:59:54 +0200] [Job 99] -----------
D [12/Feb/2009:13:59:54 +0200] [Job 99] New page: 1 1
D [12/Feb/2009:13:59:54 +0200] [Job 99] Inserting option code into "PageSetup" section.
D [12/Feb/2009:13:59:54 +0200] [Job 99]
D [12/Feb/2009:13:59:54 +0200] [Job 99] Found: %%BeginPageSetup
D [12/Feb/2009:13:59:54 +0200] [Job 99] Found: %%BeginFeature: *HalftoningAlgorithm Standard
D [12/Feb/2009:13:59:54 +0200] [Job 99] Option: HalftoningAlgorithm=Standard --> Option will be set by PostScript interpreter
D [12/Feb/2009:13:59:54 +0200] [Job 99] Found: %%EndPageSetup
D [12/Feb/2009:13:59:54 +0200] [Job 99] End of page header
D [12/Feb/2009:13:59:54 +0200] [Job 99] Flushing FIFO.
D [12/Feb/2009:13:59:54 +0200] [Job 99]
D [12/Feb/2009:13:59:54 +0200] [Job 99] Starting renderer
D [12/Feb/2009:13:59:54 +0200] [Job 99] JCL: <job data>
D [12/Feb/2009:13:59:54 +0200] [Job 99]
D [12/Feb/2009:13:59:54 +0200] [Job 99]
D [12/Feb/2009:13:59:54 +0200] [Job 99] Closing renderer
D [12/Feb/2009:13:59:54 +0200] [Job 99] renderer PID kid4=16419
D [12/Feb/2009:13:59:54 +0200] [Job 99] renderer command: gs -q -dBATCH -dPARANOIDSAFER -dQUIET -dNOPAUSE -sDEVICE=gdi -sOutputFile=- - | perl -p -e 's/PJL PAGE LETTER/PJL PAGE A4/; s/PJL PAGE (\S*) AUTO/PJL PAGE $1 AUTO/; s/PJL SET TONERSAVE = OFF/PJL SET TONERSAVE = OFF\r\n\@PJL SET ECONOMODE = OFF/; s/PJL SET PAPERTYPE = NORMAL/PJL SET PAPERTYPE = NORMAL/; s/PJL SET DENSITY = 1/PJL SET DENSITY = 3/; s/(\@PJL ENTER LANGUAGE)/\@PJL SET RET = OFF\r\n$1/; s/(\@PJL ENTER LANGUAGE)/\@PJL SET JAMRECOVERY = ON\r\n$1/; s/(\@PJL ENTER LANGUAGE)/\@PJL SET REPRINT = ON\r\n$1/; s/(\@PJL ENTER LANGUAGE)/\@PJL SET ALTITUDE = OFF\r\n$1/; s/PJL COPIES = 1/PJL COPIES = 1/; s/(\@PJL ENTER LANGUAGE)/\@PJL DEFAULT TIMEOUT = 15\r\n$1/; s/(\@PJL ENTER LANGUAGE)/\@PJL DEFAULT POWERSAVE = ON\r\n$1/; s/(\@PJL ENTER LANGUAGE)/\@PJL DEFAULT POWERSAVETIME = 5\r\n$1/; '
D [12/Feb/2009:13:59:54 +0200] [Job 99] Starting process 16420: "foomatic-gswrapper -q -dBATCH -dPARANOIDSAFER -dQUIET -dNOPAUSE -sDEVICE=gdi -sOutputFile=- - | perl..."
D [12/Feb/2009:13:59:55 +0200] [Job 99] foomatic-gswrapper: gs '-sstdout=%stderr' '-dBATCH' '-dPARANOIDSAFER' '-dQUIET' '-dNOPAUSE' '-sDEVICE=gdi' '-sOutputFile=%stdout' '-_'
D [12/Feb/2009:13:59:55 +0200] Discarding unused job-progress event...
D [12/Feb/2009:13:59:55 +0200] [Job 99] Read 4096 bytes of print data...
D [12/Feb/2009:13:59:55 +0200] [Job 99] Wrote 4096 bytes of print data...
D [12/Feb/2009:13:59:55 +0200] [Job 99] Read 8192 bytes of print data...
D [12/Feb/2009:13:59:55 +0200] Discarding unused printer-state-changed event...
D [12/Feb/2009:13:59:55 +0200] [Job 99] Wrote 8192 bytes of print data...
D [12/Feb/2009:13:59:55 +0200] [Job 99] Read 8192 bytes of print data...
...
D [12/Feb/2009:13:59:56 +0200] [Job 99] Process 16420 ending: "foomatic-gswrapper -q -dBATCH -dPARANOIDSAFER -dQUIET -dNOPAUSE -sDEVICE=gdi -sOutputFile=- - | perl..."
D [12/Feb/2009:13:59:56 +0200] [Job 99] KID3 exited with status 0
D [12/Feb/2009:13:59:56 +0200] [Job 99] Read 8192 bytes of print data...
D [12/Feb/2009:13:59:56 +0200] [Job 99] Wrote 8192 bytes of print data...
...
D [12/Feb/2009:13:59:56 +0200] [Job 99] tail process done writing data to STDOUT
D [12/Feb/2009:13:59:56 +0200] [Job 99] KID4 finished
D [12/Feb/2009:13:59:56 +0200] [Job 99] KID4 exited with status 0
D [12/Feb/2009:13:59:56 +0200] [Job 99] Renderer exit stat: 0
D [12/Feb/2009:13:59:56 +0200] [Job 99] KID3 finished
D [12/Feb/2009:13:59:56 +0200] [Job 99] Renderer process finished
D [12/Feb/2009:13:59:56 +0200] [Job 99]
D [12/Feb/2009:13:59:56 +0200] [Job 99] Closing foomatic-rip.
D [12/Feb/2009:13:59:56 +0200] [Job 99] Read 8192 bytes of print data...
D [12/Feb/2009:13:59:56 +0200] PID 16413 (/usr/lib/cups/filter/foomatic-rip) exited with no errors.
D [12/Feb/2009:13:59:56 +0200] [Job 99] Wrote 8192 bytes of print data...
D [12/Feb/2009:13:59:56 +0200] [Job 99] Read 8192 bytes of print data...
...
==> page_log <==
xerox3117 iskren 99 [12/Feb/2009:13:59:55 +0200] 1 1 - localhost
==> error_log <==
D [12/Feb/2009:13:59:56 +0200] [Job 99] Wrote 8192 bytes of print data...
D [12/Feb/2009:13:59:56 +0200] [Job 99] Read 8192 bytes of print data...
...
D [12/Feb/2009:13:59:56 +0200] PID 16414 (/usr/lib/cups/backend/usb) exited with no errors.
D [12/Feb/2009:13:59:56 +0200] [Job 99] File 0 is complete.
I [12/Feb/2009:13:59:56 +0200] [Job 99] Completed successfully.
D [12/Feb/2009:13:59:56 +0200] Discarding unused printer-state-changed event...
D [12/Feb/2009:13:59:56 +0200] Discarding unused job-completed event...
D [12/Feb/2009:13:59:57 +0200] [Job 99] Unloading...