Welcome to MacForumz.com!
FAQFAQ      ProfileProfile    Private MessagesPrivate Messages   Log inLog in

Problems printing to CUPS server from OS X Panther

 
   Macintosh computer (Home) -> Printing RSS
Next:  Toner,printers,Copiers , Forums  
Author Message
Stephen Cornell

External


Since: Jan 04, 2004
Posts: 3



(Msg. 1) Posted: Sun Jan 04, 2004 9:43 pm
Post subject: Problems printing to CUPS server from OS X Panther
Archived from groups: comp>sys>mac>printing (more info?)

Problem: jobs can be printed from the command line, but no output
appears when attempting to print directly from applications such as
Preview or Microsoft Office. The problem is not the same as the `Word
doesn't print' from which many people seem to suffer - Office is
perfectly aware of the printer.

Server: HP Deskjet attached to a Debian Woody machine (`vihta')
running CUPS 1.1.14. Local printing works perfectly. Cups is set up to be
browsable from the LAN, with `Allow From [LAN IP range]' in the
<Location /printers> directive in cupsd.conf.

Client: Mac OS X 10.3.2 (`omena') attached to the LAN. The remote
printer appears in the Printer Setup Utility as `Deskjet default
queue' under `Shared Printers', and `Show info' reveals that it is
`locally attached' and is referred to as `lp@vihta'.

In Safari, http://localhost:631 gives all the usual info on the queue,
and I can print a test page. I can print PS and PDF files from the
command line using `lpr foo.ps' or `lpr foo.pdf'. I can also print
from unixy programs such as Lyx and gv, which probably use lpr anyway.

However, I haven't had any success printing from `native' OS X
programs such as Office or Preview. I get a brief progress bar
claiming that the job is `processing', but no job appears in the print
queue window. I can successfully print to a PDF file which I can then
print from the command line.

All jobs, whether they produce printed output or not, leave the following message in /var/log/cups/error_log:

I [04/Jan/2004:18:03:47 +0000] Job 23 queued on 'lp@vihta' by 'stephen'.
I [04/Jan/2004:18:03:47 +0000] Started backend /usr/libexec/cups/backend/ipp
(PID 2242) for job 23.

though the following message *sometimes* but not always appears for
unsuccessful jobs:

E [04/Jan/2004:18:03:53 +0000] get_job_attrs: job #23 doesn't exist!

On the server, all jobs - successful or unsuccessful - leave a trace
in /var/log/cups/error_log of the form

I [04/Jan/2004:18:14:19 +0000] Job 44 queued on 'lp' by 'stephen'.
I [04/Jan/2004:18:14:19 +0000] Started filter /usr/lib/cups/filter/pdftops (PID 3393) for job 44.
I [04/Jan/2004:18:14:19 +0000] Started filter /usr/lib/cups/filter/pstops (PID 3394) for job 44.
I [04/Jan/2004:18:14:19 +0000] Started filter /usr/lib/cups/filter/cupsomatic (PID 3395) for job 44.
I [04/Jan/2004:18:14:19 +0000] Started backend /usr/lib/cups/backend/parallel (PID 3396) for job 44.

So, something recognizable is reaching the print server, but this
`something' produces no output when it originates directly from
Preview or Office.

Any ideas what's going on?
--
Stephen Cornell cornell.RemoveThis@zoo.cam.ac.uk Tel/fax +44-1223-336644
University of Cambridge, Zoology Department, Downing Street, CAMBRIDGE CB2 3EJ

 >> Stay informed about: Problems printing to CUPS server from OS X Panther 
Back to top
Login to vote
Thomas Kaiser

External


Since: May 09, 2004
Posts: 38



(Msg. 2) Posted: Mon Jan 05, 2004 1:22 am
Post subject: Re: Problems printing to CUPS server from OS X Panther [Login to view extended thread Info.]
Archived from groups: per prev. post (more info?)

Stephen Cornell wrote in <news:wnr7yfo8pg.fsf@zoo.cam.ac.uk>:

 > Any ideas what's going on?

Set the 'LogLevel' in cupsd.conf to debug on both machines and restart the
CUPS scheduler. Search the PPD on the Mac (in /etc/cups/ppd/) and post all
lines starting with *Cups.

Regards,

Thomas<!-- ~MESSAGE_AFTER~ -->

 >> Stay informed about: Problems printing to CUPS server from OS X Panther 
Back to top
Login to vote
Stephen Cornell

External


Since: Jan 04, 2004
Posts: 3



(Msg. 3) Posted: Tue Jan 06, 2004 3:32 pm
Post subject: Re: Problems printing to CUPS server from OS X Panther [Login to view extended thread Info.]
Archived from groups: per prev. post (more info?)

Thomas Kaiser <Thomas.Kaiser.RemoveThis@phg-online.de> writes:

 > Set the 'LogLevel' in cupsd.conf to debug on both machines and restart the
 > CUPS scheduler. Search the PPD on the Mac (in /etc/cups/ppd/) and post all
 > lines starting with *Cups.

Thanks for your reply. On the client, /etc/cups/ppd is empty, though
there is a binary file /etc/cups/ppds.dat. I tried copying the lp.ppd
file from the server to the client (as lp.RemoveThis@vihta.ppd) but with no
difference in the result.

I set LogLevel to `debug' as you suggested, and here are the lines
from /var/log/cups/error_log when I submit an unsuccessful job (note
the clocks on the two machines appear to be about 30 secs out of
sync). Sorry for including so much material - I'm not sure how much
might be relevant, as there's nothing in here that looks suspicious to
me (the only error is a Locale problem, which appears to be benign).
I've wrapped some of the longer lines of output.

################ On the client:##############################################

I [05/Jan/2004:21:59:00 +0000] Listening to 7f000001:631
D [05/Jan/2004:21:59:00 +0000] AddLocation: added location 'CUPS_INTERNAL_BROWSE_ACL'
D [05/Jan/2004:21:59:00 +0000] AllowIP: CUPS_INTERNAL_BROWSE_ACL allow 7f000001/ffffffff
D [05/Jan/2004:21:59:00 +0000] AllowHost: CUPS_INTERNAL_BROWSE_ACL allow @LOCAL
D [05/Jan/2004:21:59:00 +0000] DenyIP: CUPS_INTERNAL_BROWSE_ACL deny 00000000/00000000
D [05/Jan/2004:21:59:00 +0000] AddLocation: added location '/'
D [05/Jan/2004:21:59:00 +0000] DenyIP: / deny 00000000/00000000
D [05/Jan/2004:21:59:00 +0000] AllowIP: / allow 7f000001/ffffffff
D [05/Jan/2004:21:59:00 +0000] AddLocation: added location '/admin'
D [05/Jan/2004:21:59:00 +0000] DenyIP: /admin deny 00000000/00000000
D [05/Jan/2004:21:59:00 +0000] AllowIP: /admin allow 7f000001/ffffffff
I [05/Jan/2004:21:59:00 +0000] Loaded configuration file "/private/etc/cups/cupsd.conf"
I [05/Jan/2004:21:59:00 +0000] Configured for up to 100 clients.
I [05/Jan/2004:21:59:00 +0000] Allowing up to 100 client connections per host.
I [05/Jan/2004:21:59:00 +0000] Full reload is required.
D [05/Jan/2004:21:59:00 +0000] LoadDevices: Added device "fax"...
D [05/Jan/2004:21:59:00 +0000] LoadDevices: Added device "fax://dev/cu.modem"...
D [05/Jan/2004:21:59:00 +0000] LoadDevices: Added device "fax://dev/cu.Bluetooth-Modem"...
D [05/Jan/2004:21:59:00 +0000] LoadDevices: Added device "http"...
D [05/Jan/2004:21:59:00 +0000] LoadDevices: Added device "ipp"...
D [05/Jan/2004:21:59:00 +0000] LoadDevices: Added device "lpd"...
D [05/Jan/2004:21:59:00 +0000] LoadDevices: Added device "mdns"...
D [05/Jan/2004:21:59:00 +0000] LoadDevices: Added device "pap"...
D [05/Jan/2004:21:59:00 +0000] LoadDevices: Added device "smb"...
D [05/Jan/2004:21:59:00 +0000] LoadDevices: Added device "socket"...
D [05/Jan/2004:21:59:00 +0000] LoadDevices: Added device "usb"...
I [05/Jan/2004:21:59:00 +0000] LoadPPDs: Read "/private/etc/cups/ppds.dat", 209 PPDs...
I [05/Jan/2004:21:59:00 +0000] LoadPPDs: No new or changed PPDs...
D [05/Jan/2004:21:59:00 +0000] LoadAllJobs: Scanning /private/var/spool/cups...
I [05/Jan/2004:21:59:00 +0000] Full reload complete.
D [05/Jan/2004:21:59:00 +0000] StartListening: NumListeners=1
D [05/Jan/2004:21:59:00 +0000] StartListening: address=7f000001 port=631
D [05/Jan/2004:21:59:00 +0000] ResumeListening: setting input bits...
I [05/Jan/2004:22:07:03 +0000] Added remote printer "lp@vihta"...
D [05/Jan/2004:22:08:29 +0000] AcceptClient() 5 from localhost:631.
D [05/Jan/2004:22:08:29 +0000] ReadClient() 5 POST / HTTP/1.1
D [05/Jan/2004:22:08:29 +0000] ProcessIPPRequest: 5 status_code=1
D [05/Jan/2004:22:08:29 +0000] AcceptClient() 7 from localhost:631.
D [05/Jan/2004:22:08:29 +0000] CloseClient() 5
D [05/Jan/2004:22:08:29 +0000] ReadClient() 7 POST / HTTP/1.1
D [05/Jan/2004:22:08:29 +0000] ProcessIPPRequest: 7 status_code=1
D [05/Jan/2004:22:08:29 +0000] AcceptClient() 5 from localhost:631.
D [05/Jan/2004:22:08:29 +0000] CloseClient() 7
D [05/Jan/2004:22:08:29 +0000] ReadClient() 5 POST / HTTP/1.1
D [05/Jan/2004:22:08:29 +0000] ProcessIPPRequest: 5 status_code=0
D [05/Jan/2004:22:08:29 +0000] AcceptClient() 7 from localhost:631.
D [05/Jan/2004:22:08:29 +0000] ReadClient() 7 POST / HTTP/1.1
D [05/Jan/2004:22:08:29 +0000] ProcessIPPRequest: 7 status_code=1
D [05/Jan/2004:22:08:29 +0000] ReadClient() 7 POST / HTTP/1.1
D [05/Jan/2004:22:08:29 +0000] ProcessIPPRequest: 7 status_code=1
D [05/Jan/2004:22:08:29 +0000] ReadClient() 7 POST / HTTP/1.1
D [05/Jan/2004:22:08:29 +0000] ProcessIPPRequest: 7 status_code=1
D [05/Jan/2004:22:08:29 +0000] ReadClient() 7 POST / HTTP/1.1
D [05/Jan/2004:22:08:29 +0000] ProcessIPPRequest: 7 status_code=1
D [05/Jan/2004:22:08:34 +0000] AcceptClient() 8 from localhost:631.
D [05/Jan/2004:22:08:34 +0000] ReadClient() 8 POST / HTTP/1.1
D [05/Jan/2004:22:08:34 +0000] ProcessIPPRequest: 8 status_code=1
D [05/Jan/2004:22:08:34 +0000] AcceptClient() 9 from localhost:631.
D [05/Jan/2004:22:08:34 +0000] CloseClient() 8
D [05/Jan/2004:22:08:34 +0000] ReadClient() 9 POST / HTTP/1.1
D [05/Jan/2004:22:08:34 +0000] ProcessIPPRequest: 9 status_code=1
D [05/Jan/2004:22:08:34 +0000] AcceptClient() 8 from localhost:631.
D [05/Jan/2004:22:08:34 +0000] CloseClient() 9
D [05/Jan/2004:22:08:34 +0000] ReadClient() 8 POST / HTTP/1.1
D [05/Jan/2004:22:08:34 +0000] ProcessIPPRequest: 8 status_code=0
D [05/Jan/2004:22:08:34 +0000] AcceptClient() 9 from localhost:631.
D [05/Jan/2004:22:08:34 +0000] ReadClient() 9 POST /jobs/ HTTP/1.1
D [05/Jan/2004:22:08:34 +0000] ProcessIPPRequest: 9 status_code=1
D [05/Jan/2004:22:08:34 +0000] ReadClient() 9 POST / HTTP/1.1
D [05/Jan/2004:22:08:34 +0000] ProcessIPPRequest: 9 status_code=1
D [05/Jan/2004:22:08:34 +0000] ReadClient() 9 POST / HTTP/1.1
D [05/Jan/2004:22:08:34 +0000] ProcessIPPRequest: 9 status_code=1
D [05/Jan/2004:22:08:34 +0000] ReadClient() 9 POST / HTTP/1.1
D [05/Jan/2004:22:08:34 +0000] ProcessIPPRequest: 9 status_code=1
D [05/Jan/2004:22:08:34 +0000] ReadClient() 9 POST / HTTP/1.1
D [05/Jan/2004:22:08:34 +0000] ProcessIPPRequest: 9 status_code=1
D [05/Jan/2004:22:08:34 +0000] ReadClient() 9 POST / HTTP/1.1
D [05/Jan/2004:22:08:34 +0000] ProcessIPPRequest: 9 status_code=1
D [05/Jan/2004:22:08:37 +0000] ReadClient() 9 POST / HTTP/1.1
D [05/Jan/2004:22:08:37 +0000] ProcessIPPRequest: 9 status_code=1
D [05/Jan/2004:22:08:44 +0000] ReadClient() 9 POST / HTTP/1.1

<Stuff deleted>

D [05/Jan/2004:22:08:44 +0000] ProcessIPPRequest: 9 status_code=1
D [05/Jan/2004:22:08:58 +0000] ProcessIPPRequest: 9 status_code=1
D [05/Jan/2004:22:08:58 +0000] ReadClient() 9 POST / HTTP/1.1
D [05/Jan/2004:22:08:58 +0000] ProcessIPPRequest: 9 status_code=1
D [05/Jan/2004:22:08:59 +0000] ReadClient() 10 POST /printers/lp@vihta HTTP/1.1
D [05/Jan/2004:22:08:59 +0000] print_job: auto-typing file...
D [05/Jan/2004:22:08:59 +0000] print_job: request file type is application/pdf.
D [05/Jan/2004:22:08:59 +0000] check_quotas: requesting-user-name = 'stephen'
D [05/Jan/2004:22:08:59 +0000] print_job: requesting-user-name = 'stephen'
I [05/Jan/2004:22:08:59 +0000] Job 1 queued on 'lp@vihta' by 'stephen'.
D [05/Jan/2004:22:08:59 +0000] Job 1 hold_until = 0
D [05/Jan/2004:22:08:59 +0000] StartJob(1, 0x180cc00)
D [05/Jan/2004:22:08:59 +0000] StartJob() id = 1, file = 0/1
D [05/Jan/2004:22:08:59 +0000] StartJob: Sending job to queue tagged as raw...
D [05/Jan/2004:22:08:59 +0000] No job-sheets attribute.
D [05/Jan/2004:22:08:59 +0000] banner_page = 0
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "Quality=normal"
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "RET=off"
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "MediaType=plain"
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "AP_D_InputSlot="
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "nocollate"
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "media=A4"
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "com.apple.print.PrinterInfo.PMColorDeviceID..n.=1521266240"
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "OutputOrder=Normal"
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "com.apple.print.PrintSettings.PMLastPage..n.=2147483647"
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "com.apple.print.JobInfo.PMApplicationName=Preview"
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "com.apple.print.DocumentTicket.PMSpoolFormat=application/pdf"
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "com.apple.print.PrintSettings.PMCopies..n.=1"
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "com.apple.print.PrintSettings.PMCopyCollate..b."
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "job-hold-until=no-hold"
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "com.apple.print.PrintSettings.PMLayoutTileOrientation..n.=1"
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "DestinationPrinterID=lp@vihta"
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "com.apple.print.PrintSettings.PMLayoutDirection..n.=1"
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "com.apple.print.PrintSettings.PMFirstPage..n.=1"
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "com.apple.print.PrintSettings.PMPageRange..a.0..n.=1"
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "com.apple.print.PrintSettings.PMPageRange..a.1..n.=2147483647"
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "com.apple.print.PrintSettings.PMColorMatchingMode..n.=0"
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "com.apple.print.PrintSettings.PMColorSyncProfileID..n.=1261768892"
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "com.apple.print.JobInfo.PMOutputType=application/postscript"
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "com.apple.print.PrintSettings.PMTotalBeginPages..n.=1"
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "com.apple.print.PrintSettings.PMOrientation..n.=1"
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "com.apple.print.JobInfo.PMJobName=invoice.pdf"
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "com.apple.print.PrintSettings.PMLayoutColumns..n.=1"
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "com.apple.print.PrintSettings.PMTotalSidesImaged..n.=1"
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "nocom.apple.print.PrintSettings.PMBorder..b."
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "com.apple.print.PrintSettings.PMDestinationType..n.=1"
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "nocom.apple.print.PrintSettings.PMLayoutNUp..b."
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "com.apple.print.PrintSettings.PMColorSpaceModel..n.=2"
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "com.apple.print.JobInfo.PMJobOwner='Stephen Cornell'"
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "com.apple.print.PrintSettings.PMLayoutRows..n.=1"
D [05/Jan/2004:22:08:59 +0000] StartJob: option = "job-priority=50"

D [05/Jan/2004:22:08:59 +0000] StartJob: argv =
"lp@vihta","1","stephen","invoice.pdf","1","Quality=normal RET=off
MediaType=plain AP_D_InputSlot= nocollate media=A4
com.apple.print.PrinterInfo.PMColorDeviceID..n.=1521266240
OutputOrder=Normal
com.apple.print.PrintSettings.PMLastPage..n.=2147483647
com.apple.print.JobInfo.PMApplicationName=Preview
com.apple.print.DocumentTicket.PMSpoolFormat=application/pdf
com.apple.print.PrintSettings.PMCopies..n.=1
com.apple.print.PrintSettings.PMCopyCollate..b. job-hold-until=no-hold
com.apple.print.PrintSettings.PMLayoutTileOrientation..n.=1
DestinationPrinterID=lp@vihta
com.apple.print.PrintSettings.PMLayoutDirection..n.=1
com.apple.print.PrintSettings.PMFirstPage..n.=1
com.apple.print.PrintSettings.PMPageRange..a.0..n.=1
com.apple.print.PrintSettings.PMPageRange..a.1..n.=2147483647
com.apple.print.PrintSettings.PMColorMatchingMode..n.=0
com.apple.print.PrintSettings.PMColorSyncProfileID..n.=1261768892
com.apple.print.JobInfo.PMOutputType=application/postscript
com.apple.print.PrintSettings.PMTotalBeginPages..n.=1
com.apple.print.PrintSettings.PMOrientation..n.=1
com.apple.print.JobInfo.PMJobName=invoice.pdf
com.apple.print.PrintSettings.PMLayoutColumns..n.=1
com.apple.print.PrintSettings.PMTotalSidesImaged..n.=1
nocom.apple.print.PrintSettings.PMBorder..b. com.apple.print.PrintSettings.PMDestinationType..n.=1
nocom.apple.print.PrintSettings.PMLayoutNUp..b. com.apple.print.PrintSettings.PMColorSpaceModel..n.=2
com.apple.print.JobInfo.PMJobOwner='Stephen Cornell'
com.apple.print.PrintSettings.PMLayoutRows..n.=1
job-priority=50","/private/var/spool/cups/d00001-001"

D [05/Jan/2004:22:08:59 +0000] StartJob: envp[0]="PATH=/usr/libexec/cups/filter:/bin:/usr/bin"
D [05/Jan/2004:22:08:59 +0000] StartJob: envp[1]="SOFTWARE=CUPS/1.1"
D [05/Jan/2004:22:08:59 +0000] StartJob: envp[2]="USER=root"
D [05/Jan/2004:22:08:59 +0000] StartJob: envp[3]="CHARSET=utf-8"
D [05/Jan/2004:22:08:59 +0000] StartJob: envp[4]="LANG=en_US"
D [05/Jan/2004:22:08:59 +0000] StartJob: envp[5]="PPD=/private/etc/cups/ppd/lp@vihta.ppd"
D [05/Jan/2004:22:08:59 +0000] StartJob: envp[6]="CUPS_SERVERROOT=/private/etc/cups"
D [05/Jan/2004:22:08:59 +0000] StartJob: envp[7]="RIP_MAX_CACHE=8m"
D [05/Jan/2004:22:08:59 +0000] StartJob: envp[8]="TMPDIR=/private/var/spool/cups/tmp"
D [05/Jan/2004:22:08:59 +0000] StartJob: envp[9]="CONTENT_TYPE=application/pdf"
D [05/Jan/2004:22:08:59 +0000] StartJob: envp[10]="DEVICE_URI=ipp://vihta:631/printers/lp"
D [05/Jan/2004:22:08:59 +0000] StartJob: envp[11]="PRINTER=lp@vihta"
D [05/Jan/2004:22:08:59 +0000] StartJob: envp[12]="CUPS_DATADIR=/usr/share/cups"
D [05/Jan/2004:22:08:59 +0000] StartJob: envp[13]="CUPS_FONTPATH=/usr/share/cups/fonts"
D [05/Jan/2004:22:08:59 +0000] StartJob: envp[14]="CUPS_SERVER=localhost"
D [05/Jan/2004:22:08:59 +0000] StartJob: envp[15]="IPP_PORT=631"
D [05/Jan/2004:22:08:59 +0000] StartJob: envp[16]="<CFProcessPath>"
D [05/Jan/2004:22:08:59 +0000] StartJob: statusfds = [ 12 13 ]
D [05/Jan/2004:22:08:59 +0000] StartJob: filterfds[1] = [ 14 -1 ]
D [05/Jan/2004:22:08:59 +0000] StartJob: CFProcessPath=/usr/libexec/cups/backend/ipp
D [05/Jan/2004:22:08:59 +0000] StartJob: backend = "/usr/libexec/cups/backend/ipp"
D [05/Jan/2004:22:08:59 +0000] StartJob: filterfds[0] = [ -1 15 ]
D [05/Jan/2004:22:08:59 +0000] start_process("/usr/libexec/cups/backend/ipp", 0xbffeaa30, 0xbffeb550, 14, 15, 13)
I [05/Jan/2004:22:08:59 +0000] Started backend /usr/libexec/cups/backend/ipp (PID 793) for job 1.
D [05/Jan/2004:22:08:59 +0000] ProcessIPPRequest: 10 status_code=0
D [05/Jan/2004:22:08:59 +0000] ReadClient() 9 POST / HTTP/1.1
D [05/Jan/2004:22:08:59 +0000] ProcessIPPRequest: 9 status_code=1
D [05/Jan/2004:22:08:59 +0000] ReadClient() 9 POST / HTTP/1.1
D [05/Jan/2004:22:08:59 +0000] ProcessIPPRequest: 9 status_code=1
D [05/Jan/2004:22:08:59 +0000] [Job 1] Getting supported attributes...
D [05/Jan/2004:22:08:59 +0000] [Job 1] document-format-supported (30 values)
D [05/Jan/2004:22:08:59 +0000] [Job 1] [0] = "application/msword"
D [05/Jan/2004:22:08:59 +0000] [Job 1] [1] = "application/pdf"
D [05/Jan/2004:22:08:59 +0000] [Job 1] [2] = "application/postscript"
D [05/Jan/2004:22:08:59 +0000] [Job 1] [3] = "application/vnd.cups-form"
D [05/Jan/2004:22:08:59 +0000] [Job 1] [4] = "application/vnd.cups-postscript"
D [05/Jan/2004:22:08:59 +0000] [Job 1] [5] = "application/vnd.cups-raster"
D [05/Jan/2004:22:08:59 +0000] [Job 1] [6] = "application/vnd.cups-raw"
D [05/Jan/2004:22:08:59 +0000] [Job 1] [7] = "application/vnd.hp-hpgl"
D [05/Jan/2004:22:08:59 +0000] [Job 1] [8] = "application/x-cshell"
D [05/Jan/2004:22:08:59 +0000] [Job 1] [9] = "application/x-perl"
D [05/Jan/2004:22:08:59 +0000] [Job 1] [10] = "application/x-shell"
D [05/Jan/2004:22:08:59 +0000] [Job 1] [11] = "image/gif"
D [05/Jan/2004:22:08:59 +0000] [Job 1] [12] = "image/jpeg"
D [05/Jan/2004:22:08:59 +0000] [Job 1] [13] = "image/png"
D [05/Jan/2004:22:08:59 +0000] [Job 1] [14] = "image/tiff"
D [05/Jan/2004:22:08:59 +0000] [Job 1] [15] = "image/x-alias"
D [05/Jan/2004:22:08:59 +0000] [Job 1] [16] = "image/x-bitmap"
D [05/Jan/2004:22:08:59 +0000] [Job 1] [17] = "image/x-photocd"
D [05/Jan/2004:22:08:59 +0000] [Job 1] [18] = "image/x-portable-anymap"
D [05/Jan/2004:22:08:59 +0000] [Job 1] [19] = "image/x-portable-bitmap"
D [05/Jan/2004:22:08:59 +0000] [Job 1] [20] = "image/x-portable-graymap"
D [05/Jan/2004:22:08:59 +0000] [Job 1] [21] = "image/x-portable-pixmap"
D [05/Jan/2004:22:08:59 +0000] [Job 1] [22] = "image/x-sgi-rgb"
D [05/Jan/2004:22:08:59 +0000] [Job 1] [23] = "image/x-sun-raster"
D [05/Jan/2004:22:08:59 +0000] [Job 1] [24] = "image/x-xbitmap"
D [05/Jan/2004:22:08:59 +0000] [Job 1] [25] = "image/x-xpixmap"
D [05/Jan/2004:22:08:59 +0000] [Job 1] [26] = "image/x-xwindowdump"
D [05/Jan/2004:22:08:59 +0000] [Job 1] [27] = "text/html"
D [05/Jan/2004:22:08:59 +0000] [Job 1] [28] = "text/plain"
D [05/Jan/2004:22:08:59 +0000] [Job 1] [29] = "application/octet-stream"
D [05/Jan/2004:22:08:59 +0000] [Job 1] printer-uri = "ipp://vihta:631/printers/lp"
D [05/Jan/2004:22:08:59 +0000] [Job 1] requesting-user-name = "stephen"
D [05/Jan/2004:22:08:59 +0000] [Job 1] job-name = "invoice.pdf"
D [05/Jan/2004:22:08:59 +0000] AcceptClient() 13 from localhost:631.
D [05/Jan/2004:22:08:59 +0000] ReadClient() 13 POST / HTTP/1.1
D [05/Jan/2004:22:08:59 +0000] ProcessIPPRequest: 13 status_code=1
D [05/Jan/2004:22:08:59 +0000] AcceptClient() 14 from localhost:631.
D [05/Jan/2004:22:08:59 +0000] CloseClient() 13

<deleted>

D [05/Jan/2004:22:09:10 +0000] ReadClient() 15 POST / HTTP/1.1
D [05/Jan/2004:22:09:10 +0000] ProcessIPPRequest: 15 status_code=1
D [05/Jan/2004:22:09:10 +0000] ReadClient() 9 POST / HTTP/1.1
D [05/Jan/2004:22:09:10 +0000] ProcessIPPRequest: 9 status_code=1
D [05/Jan/2004:22:09:10 +0000] UpdateJob: job 1, file 0 is complete.
D [05/Jan/2004:22:09:10 +0000] CancelJob: id = 1
D [05/Jan/2004:22:09:10 +0000] StopJob: id = 1, force = 0
D [05/Jan/2004:22:09:10 +0000] StopJob: printer state is 3
D [05/Jan/2004:22:09:15 +0000] ReadClient() 15 POST / HTTP/1.1
D [05/Jan/2004:22:09:15 +0000] ProcessIPPRequest: 15 status_code=1
D [05/Jan/2004:22:09:15 +0000] ReadClient() 15 POST / HTTP/1.1


####################### On the server ###################################

I [05/Jan/2004:22:06:33 +0000] Listening to 0:631
I [05/Jan/2004:22:06:33 +0000] Sending browsing info to c0a801ff:631
D [05/Jan/2004:22:06:33 +0000] AddLocation: added location 'CUPS_INTERNAL_BROWSE_ACL'
D [05/Jan/2004:22:06:33 +0000] AllowIP: CUPS_INTERNAL_BROWSE_ACL allow c0a80100/ffffff00
D [05/Jan/2004:22:06:33 +0000] AddLocation: added location '/'
D [05/Jan/2004:22:06:33 +0000] DenyIP: / deny 00000000/00000000
D [05/Jan/2004:22:06:33 +0000] AllowIP: / allow 7f000001/ffffffff
D [05/Jan/2004:22:06:33 +0000] AddLocation: added location '/printers'
D [05/Jan/2004:22:06:33 +0000] DenyIP: /printers deny 00000000/00000000
D [05/Jan/2004:22:06:33 +0000] AllowIP: /printers allow 7f000001/ffffffff
D [05/Jan/2004:22:06:33 +0000] AllowIP: /printers allow c0a80100/ffffff00
D [05/Jan/2004:22:06:33 +0000] AddLocation: added location '/admin'
D [05/Jan/2004:22:06:33 +0000] DenyIP: /admin deny 00000000/00000000
D [05/Jan/2004:22:06:33 +0000] AllowIP: /admin allow 7f000001/ffffffff
D [05/Jan/2004:22:06:33 +0000] ReadConfiguration() ConfigurationFile="/etc/cups/cupsd.conf"
I [05/Jan/2004:22:06:33 +0000] Configured for up to 100 clients.
I [05/Jan/2004:22:06:33 +0000] LoadPPDs: Read "/etc/cups/ppds.dat", 925 PPDs...
I [05/Jan/2004:22:06:33 +0000] LoadPPDs: No new or changed PPDs...
D [05/Jan/2004:22:06:33 +0000] LoadDevices: Added device "parallel:/dev/lp0"...
D [05/Jan/2004:22:06:33 +0000] LoadDevices: Added device "ipp"...
D [05/Jan/2004:22:06:33 +0000] LoadDevices: Added device "lpd"...
D [05/Jan/2004:22:06:33 +0000] LoadDevices: Added device "serial:/dev/ttyS0?baud=115200"...
D [05/Jan/2004:22:06:33 +0000] LoadDevices: Added device "serial:/dev/ttyS1?baud=115200"...
D [05/Jan/2004:22:06:33 +0000] LoadDevices: Added device "serial:/dev/ttyS2?baud=115200"...
D [05/Jan/2004:22:06:33 +0000] LoadDevices: Added device "serial:/dev/ttyS3?baud=115200"...
D [05/Jan/2004:22:06:33 +0000] LoadDevices: Added device "socket"...
D [05/Jan/2004:22:06:33 +0000] LoadDevices: Added device "usb:/dev/usb/lp0"...
D [05/Jan/2004:22:06:33 +0000] LoadDevices: Added device "usb:/dev/usb/lp1"...
D [05/Jan/2004:22:06:33 +0000] LoadDevices: Added device "usb:/dev/usb/lp2"...
D [05/Jan/2004:22:06:33 +0000] LoadDevices: Added device "usb:/dev/usb/lp3"...
D [05/Jan/2004:22:06:33 +0000] LoadDevices: Added device "usb:/dev/usb/lp4"...
D [05/Jan/2004:22:06:33 +0000] LoadDevices: Added device "usb:/dev/usb/lp5"...
D [05/Jan/2004:22:06:33 +0000] LoadDevices: Added device "usb:/dev/usb/lp6"...
D [05/Jan/2004:22:06:33 +0000] LoadDevices: Added device "usb:/dev/usb/lp7"...
D [05/Jan/2004:22:06:33 +0000] LoadDevices: Added device "usb:/dev/usb/lp8"...
D [05/Jan/2004:22:06:33 +0000] LoadDevices: Added device "usb:/dev/usb/lp9"...
D [05/Jan/2004:22:06:33 +0000] LoadDevices: Added device "usb:/dev/usb/lp10"...
D [05/Jan/2004:22:06:33 +0000] LoadDevices: Added device "usb:/dev/usb/lp11"...
D [05/Jan/2004:22:06:33 +0000] LoadDevices: Added device "usb:/dev/usb/lp12"...
D [05/Jan/2004:22:06:33 +0000] LoadDevices: Added device "usb:/dev/usb/lp13"...
D [05/Jan/2004:22:06:33 +0000] LoadDevices: Added device "usb:/dev/usb/lp14"...
D [05/Jan/2004:22:06:33 +0000] LoadDevices: Added device "usb:/dev/usb/lp15"...
D [05/Jan/2004:22:06:33 +0000] LoadDevices: Added device "http"...
D [05/Jan/2004:22:06:33 +0000] StartListening: NumListeners=1
D [05/Jan/2004:22:06:33 +0000] StartListening: address=00000000 port=631
D [05/Jan/2004:22:06:33 +0000] ResumeListening: setting input bits...
D [05/Jan/2004:22:06:34 +0000] mallinfo: arena = 771616, used = 764536, free = 7080
D [05/Jan/2004:22:07:34 +0000] mallinfo: arena = 771616, used = 764536, free = 7080
D [05/Jan/2004:22:08:25 +0000] AcceptClient() 3 from 192.168.1.100:631.
D [05/Jan/2004:22:08:25 +0000] ReadClient() 3 GET /printers/lp.ppd HTTP/1.1
D [05/Jan/2004:22:08:25 +0000] SendFile() 3 file=4
D [05/Jan/2004:22:08:29 +0000] CloseClient() 3
D [05/Jan/2004:22:08:31 +0000] AcceptClient() 3 from 192.168.1.100:631.
D [05/Jan/2004:22:08:31 +0000] ReadClient() 3 POST /printers/lp HTTP/1.1
D [05/Jan/2004:22:08:31 +0000] ReadClient() 3 POST /printers/lp HTTP/1.1
D [05/Jan/2004:22:08:31 +0000] print_job: request file type is application/pdf.
D [05/Jan/2004:22:08:31 +0000] check_quotas: requesting-user-name = 'stephen'
D [05/Jan/2004:22:08:31 +0000] print_job: requesting-user-name = 'stephen'
D [05/Jan/2004:22:08:31 +0000] Adding default job-sheets values "none,none"...
I [05/Jan/2004:22:08:31 +0000] Job 46 queued on 'lp' by 'stephen'.
D [05/Jan/2004:22:08:31 +0000] Job 46 hold_until = 0
D [05/Jan/2004:22:08:31 +0000] StartJob(46, 0808bd08)
D [05/Jan/2004:22:08:31 +0000] StartJob() id = 46, file = 0/1
D [05/Jan/2004:22:08:31 +0000] job-sheets=none,none
D [05/Jan/2004:22:08:31 +0000] banner_page = 0
D [05/Jan/2004:22:08:31 +0000] StartJob: argv =
"lp","46","stephen","invoice.pdf","1","Quality=normal RET=off
MediaType=plain AP_D_InputSlot= nocollate media=A4
com.apple.print.PrinterInfo.PMColorDeviceID..n.=1521266240
OutputOrder=Normal
com.apple.print.PrintSettings.PMLastPage..n.=2147483647
com.apple.print.JobInfo.PMApplicationName=Preview
com.apple.print.DocumentTicket.PMSpoolFormat=application/pdf
com.apple.print.PrintSettings.PMCopies..n.=1
com.apple.print.PrintSettings.PMCopyCollate..b. com.apple.print.PrintSettings.PMLayoutTileOrientation..n.=1
DestinationPrinterID=lp@vihta
com.apple.print.PrintSettings.PMLayoutDirection..n.=1
com.apple.print.PrintSettings.PMFirstPage..n.=1
com.apple.print.PrintSettings.PMPageRange..a.0..n.=1
com.apple.print.PrintSettings.PMPageRange..a.1..n.=2147483647
com.apple.print.PrintSettings.PMColorMatchingMode..n.=0
com.apple.print.PrintSettings.PMColorSyncProfileID..n.=1261768892
com.apple.print.JobInfo.PMOutputType=application/postscript
com.apple.print.PrintSettings.PMTotalBeginPages..n.=1 com.apple.pr
D [05/Jan/2004:22:08:31 +0000] StartJob: envp =
"PATH=/usr/lib/cups/filter:/bin:/usr/bin","SOFTWARE=CUPS/1.1","USER=root","CHARSET=utf-8","LANG=en-us","TZ=Europe/London","PPD=/etc/cups/ppd/lp.ppd","CUPS_SERVERROOT=/etc/cups","RIP_MAX_CACHE=8m","TMPDIR=/var/spool/cups/tmp","CONTENT_TYPE=application/pdf","DEVICE_URI=parallel:/dev/lp0","PRINTER=lp","CUPS_DATADIR=/usr/share/cups","CUPS_FONTPATH=/usr/share/cups/fonts","",""
D [05/Jan/2004:22:08:31 +0000] StartJob: statusfds = 4, 6 D
[05/Jan/2004:22:08:31 +0000] StartJob: filterfds[1] = 7, -1 D
[05/Jan/2004:22:08:31 +0000] StartJob: filter =
"/usr/lib/cups/filter/pdftops" D [05/Jan/2004:22:08:31 +0000]
StartJob: filterfds[0] = 8, 9 D [05/Jan/2004:22:08:31 +0000]
start_process("/usr/lib/cups/filter/pdftops", bfff1b7c, bffed02c, 7,
9, 6) I [05/Jan/2004:22:08:31 +0000] Started filter
/usr/lib/cups/filter/pdftops (PID 28311) for job 46. D
[05/Jan/2004:22:08:31 +0000] StartJob: filter =
"/usr/lib/cups/filter/pstops" D [05/Jan/2004:22:08:31 +0000] StartJob:
filterfds[1] = 7, 10 D [05/Jan/2004:22:08:31 +0000]
start_process("/usr/lib/cups/filter/pstops", bfff1b7c, bffed02c, 8,
10, 6) I [05/Jan/2004:22:08:31 +0000] Started filter
/usr/lib/cups/filter/pstops (PID 28312) for job 46. D
[05/Jan/2004:22:08:31 +0000] StartJob: filter =
"/usr/lib/cups/filter/cupsomatic" D [05/Jan/2004:22:08:31 +0000]
StartJob: filterfds[0] = 8, 9 D [05/Jan/2004:22:08:31 +0000]
start_process("/usr/lib/cups/filter/cupsomatic", bfff1b7c, bffed02c,
7, 9, 6) I [05/Jan/2004:22:08:31 +0000] Started filter
/usr/lib/cups/filter/cupsomatic (PID 28313) for job 46. D
[05/Jan/2004:22:08:31 +0000] StartJob: backend =
"/usr/lib/cups/backend/parallel" D [05/Jan/2004:22:08:31 +0000]
StartJob: filterfds[1] = -1, 7 D [05/Jan/2004:22:08:31 +0000]
start_process("/usr/lib/cups/backend/parallel", bfff1b7c, bffed02c, 8,
7, 6) I [05/Jan/2004:22:08:31 +0000] Started backend
/usr/lib/cups/backend/parallel (PID 28314) for job 46. D
[05/Jan/2004:22:08:31 +0000] Page = 595x842; 9,40 to 586,816 D
[05/Jan/2004:22:08:31 +0000] perl: warning: Setting locale failed. D
[05/Jan/2004:22:08:31 +0000] perl: warning: Please check that your
locale settings: D [05/Jan/2004:22:08:31 +0000] LANGUAGE = (unset), D
[05/Jan/2004:22:08:31 +0000] LC_ALL = (unset), D [05/Jan/2004:22:08:31
+0000] LANG = "en-us" D [05/Jan/2004:22:08:31 +0000] are supported and
installed on your system. D [05/Jan/2004:22:08:31 +0000] perl:
warning: Falling back to the standard locale ("C"). D
[05/Jan/2004:22:08:31 +0000] ReadClient() 3 POST /printers/lp HTTP/1.1
D [05/Jan/2004:22:08:31 +0000] pdftops - opened PPD file
"/etc/cups/ppd/lp.ppd"... D [05/Jan/2004:22:08:31 +0000] pdftops -
level = 2, width = 595, length = 842 D [05/Jan/2004:22:08:31 +0000]
ReadClient() 3 POST /printers/lp HTTP/1.1 D [05/Jan/2004:22:08:31
+0000] 0 %%Creator: xpdf/pdftops 0.93a D [05/Jan/2004:22:08:31 +0000]
0 %%LanguageLevel: 2 D [05/Jan/2004:22:08:31 +0000] 0 %%DocumentMedia:
plain 595 842 0 () () D [05/Jan/2004:22:08:31 +0000] 0 %%Pages: 1 D
[05/Jan/2004:22:08:31 +0000] 0 %%EndComments D [05/Jan/2004:22:08:31
+0000] 0 %%BeginDefaults D [05/Jan/2004:22:08:31 +0000] 0 %%PageMedia:
plain D [05/Jan/2004:22:08:31 +0000] 0 %%EndDefaults D
[05/Jan/2004:22:08:31 +0000] 0 %%BeginProlog D [05/Jan/2004:22:08:31
+0000] 0 %%BeginResource: procset xpdf 0.93a 0 D [05/Jan/2004:22:08:31
+0000] 0 %%EndResource D [05/Jan/2004:22:08:31 +0000] 0 %%EndProlog D
[05/Jan/2004:22:08:31 +0000] 0 %%BeginSetup D [05/Jan/2004:22:08:31
+0000] 0 %%BeginResource: font RBXJZZ+Helvetica D
[05/Jan/2004:22:08:31 +0000] Cupsomatic backend version $Revision: 2.5
$ running... D [05/Jan/2004:22:08:31 +0000] called with arguments:
'46','stephen','invoice.pdf','1','Quality=normal RET=off
MediaType=plain AP_D_InputSlot= nocollate media=A4
com.apple.print.PrinterInfo.PMColorDeviceID..n.=1521266240
OutputOrder=Normal
com.apple.print.PrintSettings.PMLastPage..n.=2147483647
com.apple.print.JobInfo.PMApplicationName=Preview
com.apple.print.DocumentTicket.PMSpoolFormat=application/pdf
com.apple.print.PrintSettings.PMCopies..n.=1
com.apple.print.PrintSettings.PMCopyCollate..b. com.apple.print.PrintSettings.PMLayoutTileOrientation..n.=1
DestinationPrinterID=lp@vihta
com.apple.print.PrintSettings.PMLayoutDirection..n.=1
com.apple.print.PrintSettings.PMFirstPage..n.=1
com.apple.print.PrintSettings.PMPageRange..a.0..n.=1
com.apple.print.PrintSettings.PMPageRange..a.1..n.=2147483647
com.apple.print.PrintSettings.PMColorMatchingMode..n.=0
com.apple.print.PrintSettings.PMColorSyncProfileID..n.=1261768892
com.apple.print.JobInfo.PMOutputType=application/postscript
com.apple.print.PrintSettings.PMTotalBeginPages..n.=1 com.apple.p D
[05/Jan/2004:22:08:31 +0000] UpdateJob: job 46, file 0 is complete. D
[05/Jan/2004:22:08:31 +0000] CancelJob: id = 46 D
[05/Jan/2004:22:08:31 +0000] StopJob: id = 46, force = 0 D
[05/Jan/2004:22:08:31 +0000] StopJob: printer state is 3 D
[05/Jan/2004:22:08:34 +0000] mallinfo: arena = 779808, used = 774888,
free = 4920 D [05/Jan/2004:22:08:42 +0000] ReadClient() 3 POST
/printers/lp HTTP/1.1 D [05/Jan/2004:22:08:42 +0000] CloseClient() 3 D
[05/Jan/2004:22:09:34 +0000] mallinfo: arena = 779808, used = 774888,
free = 4920 D [05/Jan/2004:22:10:34 +0000] mallinfo: arena = 779808,
used = 774888, free = 4920

etc.

--
Stephen Cornell cornell.RemoveThis@zoo.cam.ac.uk Tel/fax +44-1223-336644
University of Cambridge, Zoology Department, Downing Street, CAMBRIDGE CB2 3EJ<!-- ~MESSAGE_AFTER~ -->
 >> Stay informed about: Problems printing to CUPS server from OS X Panther 
Back to top
Login to vote
Thomas Kaiser

External


Since: May 09, 2004
Posts: 38



(Msg. 4) Posted: Tue Jan 06, 2004 7:16 pm
Post subject: Re: Problems printing to CUPS server from OS X Panther [Login to view extended thread Info.]
Archived from groups: per prev. post (more info?)

Stephen Cornell wrote in <news:wn7k05p89n.fsf@zoo.cam.ac.uk>:

 > On the client, /etc/cups/ppd is empty

Ah -- okay. I forgot that the PPD will be fetched dynamically from the
server when using browsing. Can you post the relevant lines starting with
*cups from there?

 > here are the lines from /var/log/cups/error_log when I submit an
 > unsuccessful job

Have you compared argv and envp (eg. by grepping for "StartJob: argv" in
error_log) when printing a PDF from the command line on the server (or more
general from a job that doesn't fail)?

 > (the only error is a Locale problem, which appears to be benign).

Does this also occur, when printing directly on the server?

 > I've wrapped some of the longer lines of output.

Unfortunately you wrapped the whole stuff at the end, which made it really
hard to read the log ;-(

Unfortunately I couldn't see any special in the output. Do you get different
results with working printjobs regarding the cupsomatic output?

BTW: Debian Woody uses CUPS 1.1.14. I would suggest installing 1.1.20 from

<http://www.backports.org/>

Adding

deb <a style='text-decoration: underline;' href="http://www.backports.org/debian" target="_blank">http://www.backports.org/debian</a> woody cupsys

to your /etc/apt/sources.list and "apt-get update/upgrade" might be
enough...

Regards,

Thomas<!-- ~MESSAGE_AFTER~ -->
 >> Stay informed about: Problems printing to CUPS server from OS X Panther 
Back to top
Login to vote
Peter KERR

External


Since: Jun 30, 2003
Posts: 151



(Msg. 5) Posted: Wed Jan 07, 2004 12:33 pm
Post subject: Re: Problems printing to CUPS server from OS X Panther [Login to view extended thread Info.]
Archived from groups: per prev. post (more info?)

In article <wn7k05p89n.fsf DeleteThis @zoo.cam.ac.uk>,
Stephen Cornell <cornell DeleteThis @zoo.cam.ac.uk> wrote:

 > "PATH=/usr/lib/cups/filter:/bin:/usr/bin","SOFTWARE=CUPS/1.1","USER=root","CHA
 > RSET=utf-8","LANG=en-us","TZ=Europe/London","PPD=/etc/cups/ppd/lp.ppd","CUPS_S
 > ERVERROOT=/etc/cups","RIP_MAX_CACHE=8m","TMPDIR=/var/spool/cups/tmp","CONTENT_
^^^^^^^^^^^^^^^^^^^^^^^^^^
 > TYPE=application/pdf","DEVICE_URI=parallel:/dev/lp0","PRINTER=lp","CUPS_DATADI
 > R=/usr/share/cups","CUPS_FONTPATH=/usr/share/cups/fonts","",""

Assuming this is the log from the non-printing client,
verify that this directory exists

Don't know if it's fixed in Panther, I had a similar problem in 10.2

[localhost:~]p% ls -la /var/spool | grep cups
drwx------ 32 daemon admin 1088 Dec 16 11:43 cups

so you will need to sudo or su to dig deeper

In my case, for whatever reason, /var/spool/cups/tmp did not exist
so the spool jobs were being dumped at /var/spool/cups
where they couldn't be found.

If the dir doesn't exist you can just create it there, chown & chmod

[localhost:/var/spool]p% sudo ls -la cups
drwx------ 32 daemon admin 1088 Dec 16 11:43 .
drwxr-xr-x 12 root wheel 408 Oct 14 12:58 ..
drwx-----T 3 daemon admin 102 Dec 16 11:43 tmp

I didn't set the T flag, daemon must have done it later...<!-- ~MESSAGE_AFTER~ -->
 >> Stay informed about: Problems printing to CUPS server from OS X Panther 
Back to top
Login to vote
Stephen Cornell

External


Since: Jan 04, 2004
Posts: 3



(Msg. 6) Posted: Sat Jan 17, 2004 8:22 pm
Post subject: Re: Problems printing to CUPS server from OS X Panther [Login to view extended thread Info.]
Archived from groups: per prev. post (more info?)

Apologies for the late followups - I've had a rather busy week...

Reminder: printing from an OS X client to a Debian server (running
CUPS) works from the command line (or similar tools which use lpr,
e.g. gv) but not from Preview.app

Thomas Kaiser <Thomas.Kaiser.RemoveThis@phg-online.de> writes:

 > Stephen Cornell wrote in <news:wn7k05p89n.fsf@zoo.cam.ac.uk>:
 >
  > > On the client, /etc/cups/ppd is empty
 >
 > Ah -- okay. I forgot that the PPD will be fetched dynamically from the
 > server when using browsing. Can you post the relevant lines starting with
 > *cups from there?

From /etc/cups/ppd/lp.ppd, on the server:

*cupsVersion: 1.0
*cupsManualCopies: True
*cupsModelNumber: 2
*cupsFilter: "application/vnd.cups-postscript 0 cupsomatic"

  > > here are the lines from /var/log/cups/error_log when I submit an
  > > unsuccessful job
 >
 > Have you compared argv and envp (eg. by grepping for "StartJob: argv" in
 > error_log) when printing a PDF from the command line on the server (or more
 > general from a job that doesn't fail)?

I've appended such lines to the end of this message, for a job sent
from gv on the one hand (uses ghostscript and lpr) and directly from
Preview.app on the other. Output is similar to the lpr case if I
print from the command line on the server, or lpr foo.pdf from the client
file as the argument to lpr from the client.

The list of arguments is much longer when printing from Preview.app,
so much so that the output in error_log is clearly truncated.
Successful jobs seem to have few enough arguments that there is no
truncation. I don't know whether this could cause the error I see.

The biggests difference in error_log between successful and
unsuccessful jobs is that I see lines of postscript for the former.
When printing a PDF file, either via Preview or via lpr, the processes
pdftops, pstops, and then cupsomatic run, but only for the command
line jobs do I get a message `pdftops - opend PPD file
/etc/cups/ppd/lp.ppd', followed by some postscript lines, then some
PJL lines, then the converted file, then EOF etc.

  > > (the only error is a Locale problem, which appears to be benign).
 >
 > Does this also occur, when printing directly on the server?


Yes.




Lines from error_log:

Successful job, printed via gv (i.e.via lpr)

Client:
D [17/Jan/2004:16:17:41 +0000] StartJob: argv = "lp@vihta","9","stephen","gv_40096025_1_EM9048.ps.tmp","1","job-priority=50 job-hold-until=no-hold","/private/var/spool/cups/d00009-001"
D [17/Jan/2004:16:17:41 +0000] StartJob: envp[0]="PATH=/usr/libexec/cups/filter:/bin:/usr/bin"
D [17/Jan/2004:16:17:41 +0000] StartJob: envp[1]="SOFTWARE=CUPS/1.1"
D [17/Jan/2004:16:17:41 +0000] StartJob: envp[2]="USER=root"
D [17/Jan/2004:16:17:41 +0000] StartJob: envp[3]="CHARSET=utf-8"
D [17/Jan/2004:16:17:41 +0000] StartJob: envp[4]="LANG=en_US"
D [17/Jan/2004:16:17:41 +0000] StartJob: envp[5]="PPD=/private/etc/cups/ppd/lp@vihta.ppd"
D [17/Jan/2004:16:17:41 +0000] StartJob: envp[6]="CUPS_SERVERROOT=/private/etc/cups"
D [17/Jan/2004:16:17:41 +0000] StartJob: envp[7]="RIP_MAX_CACHE=8m"
D [17/Jan/2004:16:17:41 +0000] StartJob: envp[8]="TMPDIR=/private/var/spool/cups/tmp"
D [17/Jan/2004:16:17:41 +0000] StartJob: envp[9]="CONTENT_TYPE=application/postscript"
D [17/Jan/2004:16:17:41 +0000] StartJob: envp[10]="DEVICE_URI=ipp://vihta:631/printers/lp"
D [17/Jan/2004:16:17:41 +0000] StartJob: envp[11]="PRINTER=lp@vihta"
D [17/Jan/2004:16:17:41 +0000] StartJob: envp[12]="CUPS_DATADIR=/usr/share/cups"
D [17/Jan/2004:16:17:41 +0000] StartJob: envp[13]="CUPS_FONTPATH=/usr/share/cups/fonts"
D [17/Jan/2004:16:17:41 +0000] StartJob: envp[14]="CUPS_SERVER=localhost"
D [17/Jan/2004:16:17:41 +0000] StartJob: envp[15]="IPP_PORT=631"
D [17/Jan/2004:16:17:41 +0000] StartJob: envp[16]="<CFProcessPath>"

Server:

D [17/Jan/2004:16:17:06 +0000] StartJob: argv = "lp","61","stephen","gv_40096025_1_EM9048.ps.tmp","1","","/var/spool/cups/d00061-001"
D [17/Jan/2004:16:17:06 +0000] StartJob: envp="PATH=/usr/lib/cups/filter:/bin:/usr/bin",
"SOFTWARE=CUPS/1.1","USER=root","CHARSET=utf-8","LANG=en-us","TZ=Europe/London",
"PPD=/etc/cups/ppd/lp.ppd","CUPS_SERVERROOT=/etc/cups","RIP_MAX_CACHE=8m",
"TMPDIR=/var/spool/cups/tmp","CONTENT_TYPE=application/postscript",
"DEVICE_URI=parallel:/dev/lp0","PRINTER=lp","CUPS_DATADIR=/usr/share/cups",
"CUPS_FONTPATH=/usr/share/cups/fonts","",""


Unsuccessful job, from Preview.app:

Client:

D [17/Jan/2004:16:18:53 +0000] StartJob: argv =
"lp@vihta","10","stephen","EM9048","1","Quality=normal RET=off
MediaType=plain AP_D_InputSlot= nocollate media=A4
com.apple.print.PrinterInfo.PMColorDeviceID..n.=1521266240
OutputOrder=Normal com.apple.print.PrintSettings.PMLastPage..n.=1
com.apple.print.JobInfo.PMApplicationName=Preview
com.apple.print.DocumentTicket.PMSpoolFormat=application/pdf
com.apple.print.PrintSettings.PMCopies..n.=1
com.apple.print.PrintSettings.PMCopyCollate..b. job-hold-until=no-hold
com.apple.print.PrintSettings.PMLayoutTileOrientation..n.=1
DestinationPrinterID=lp@vihta
com.apple.print.PrintSettings.PMLayoutDirection..n.=1
com.apple.print.PrintSettings.PMFirstPage..n.=1
com.apple.print.PrintSettings.PMPageRange..a.0..n.=1
com.apple.print.PrintSettings.PMPageRange..a.1..n.=2147483647
com.apple.print.PrintSettings.PMColorMatchingMode..n.=0
com.apple.print.PrintSettings.PMColorSyncProfileID..n.=1261768892
com.apple.print.PrintSettings.PMLayoutColumns..n.=1
com.apple.print.PrintSettings.PMTotalBeginPages..n.=1
com.apple.print.PrintSettings.PMOrientation..n.=1
com.apple.print.JobInfo.PMJobName=EM9048
com.apple.print.PrintSettings.PMTotalSidesImaged..n.=1
nocom.apple.print.PrintSettings.PMBorder..b. com.apple.print.PrintSettings.PMDestinationType..n.=1
nocom.apple.print.PrintSettings.PMLayoutNUp..b. com.apple.print.PrintSettings.PMColorSpaceModel..n.=2
com.apple.print.JobInfo.PMJobOwner='Stephen Cornell'
com.apple.print.PrintSettings.PMLayoutRows..n.=1
job-priority=50","/private/var/spool/cups/d00010-001"
D [17/Jan/2004:16:18:53 +0000] StartJob: envp[0]="PATH=/usr/libexec/cups/filter:/bin:/usr/bin"
D [17/Jan/2004:16:18:53 +0000] StartJob: envp[1]="SOFTWARE=CUPS/1.1"
D [17/Jan/2004:16:18:53 +0000] StartJob: envp[2]="USER=root"
D [17/Jan/2004:16:18:53 +0000] StartJob: envp[3]="CHARSET=utf-8"
D [17/Jan/2004:16:18:53 +0000] StartJob: envp[4]="LANG=en_US"
D [17/Jan/2004:16:18:53 +0000] StartJob: envp[5]="PPD=/private/etc/cups/ppd/lp@vihta.ppd"
D [17/Jan/2004:16:18:53 +0000] StartJob: envp[6]="CUPS_SERVERROOT=/private/etc/cups"
D [17/Jan/2004:16:18:53 +0000] StartJob: envp[7]="RIP_MAX_CACHE=8m"
D [17/Jan/2004:16:18:53 +0000] StartJob: envp[8]="TMPDIR=/private/var/spool/cups/tmp"
D [17/Jan/2004:16:18:53 +0000] StartJob: envp[9]="CONTENT_TYPE=application/pdf"
D [17/Jan/2004:16:18:53 +0000] StartJob: envp[10]="DEVICE_URI=ipp://vihta:631/printers/lp"
D [17/Jan/2004:16:18:53 +0000] StartJob: envp[11]="PRINTER=lp@vihta"
D [17/Jan/2004:16:18:53 +0000] StartJob: envp[12]="CUPS_DATADIR=/usr/share/cups"
D [17/Jan/2004:16:18:53 +0000] StartJob: envp[13]="CUPS_FONTPATH=/usr/share/cups/fonts"
D [17/Jan/2004:16:18:53 +0000] StartJob: envp[14]="CUPS_SERVER=localhost"
D [17/Jan/2004:16:18:53 +0000] StartJob: envp[15]="IPP_PORT=631"
D [17/Jan/2004:16:18:53 +0000] StartJob: envp[16]="<CFProcessPath>"

Server:

D [17/Jan/2004:16:18:18 +0000] StartJob: argv =
"lp","62","stephen","EM9048","1", "Quality=normal RET=off
MediaType=plain AP_D_InputSlot= nocollate media=A4
com.apple.print.PrinterInfo.PMColorDeviceID..n.=1521266240
OutputOrder=Normal com.apple.print.PrintSettings.PMLastPage..n.=1
com.apple.print.JobInfo.PMApplicationName=Preview
com.apple.print.DocumentTicket.PMSpoolFormat=application/pdf
com.apple.print.PrintSettings.PMCopies..n.=1
com.apple.print.PrintSettings.PMCopyCollate..b. com.apple.print.PrintSettings.PMLayoutTileOrientation..n.=1
DestinationPrinterID=lp@vihta
com.apple.print.PrintSettings.PMLayoutDirection..n.=1
com.apple.print.PrintSettings.PMFirstPage..n.=1
com.apple.print.PrintSettings.PMPageRange..a.0..n.=1
com.apple.print.PrintSettings.PMPageRange..a.1..n.=2147483647
com.apple.print.PrintSettings.PMColorMatchingMode..n.=0
com.apple.print.PrintSettings.PMColorSyncProfileID..n.=1261768892
com.apple.print.PrintSettings.PMLayoutColumns..n.=1
com.apple.print.PrintSettings.PMTotalBeginPages..n.=1
com.apple.print.PrintSettings.PMOr
D [17/Jan/2004:16:18:18 +0000] StartJob: envp =
"PATH=/usr/lib/cups/filter:/bin:/usr/bin","SOFTWARE=CUPS/1.1","USER=root","CHARSET=utf-8","LANG=en-us","TZ=Europe/London","PPD=/etc/cups/ppd/lp.ppd","CUPS_SERVERROOT=/etc/cups","RIP_MAX_CACHE=8m","TMPDIR=/var/spool/cups/tmp","CONTENT_TYPE=application/pdf","DEVICE_URI=parallel:/dev/lp0","PRINTER=lp","CUPS_DATADIR=/usr/share/cups","CUPS_FONTPATH=/usr/share/cups/fonts","",""





--
Stephen Cornell cornell.RemoveThis@zoo.cam.ac.uk Tel/fax +44-1223-336644
University of Cambridge, Zoology Department, Downing Street, CAMBRIDGE CB2 3EJ<!-- ~MESSAGE_AFTER~ -->
 >> Stay informed about: Problems printing to CUPS server from OS X Panther 
Back to top
Login to vote
Display posts from previous:   
   Macintosh computer (Home) -> Printing All times are: Pacific Time (US & Canada) (change)
Page 1 of 1

 
You can post new topics in this forum
You can reply to topics in this forum
You can edit your posts in this forum
You can delete your posts in this forum
You can vote in polls in this forum



[ Contact us | Terms of Service/Privacy Policy ]