Michael Bevilacqua on Mon, 13 Jan 2003 08:34:05 -0500


[Date Prev] [Date Next] [Thread Prev] [Thread Next] [Date Index] [Thread Index]

[PLUG] CUPS on Debian w/ HP DeskJet 712C


Hi everyone. This past weekend I made an attempt to install cups as a
dedicated print server on my lan using Debian and a custom 2.4.18
kernel. The WebUI, the packages/filters & the device detection all seem
flawless only when attempting to print a test page from the WebUI or
sending input directly using lpr or cat /dev/lp0 there is no response
from the printer at all (response being output via paper or blinking
lights)

I have a PPD file that was included in the Debian CUPS package which was
read and installed into CUPS via the WebUI. This file now resides in
/etc/cups/ppd/  as  dj712c.ppd. When running strings(1) on ppds.dat I
see that dj712c.ppd is included in the database:

clockbot:/etc/cups# strings ppds.dat | grep 712 
HP DeskJet 712C, Foomatic + pnm2ppa
:HP/DeskJet_712C-pnm2ppa.ppd

Below are the steps I've taken. In the debug output below there are
only two errors; one from Perl about not having the correct locale and
one SendError() 'n' code=304 which I haven't yet found in the
documentation. My guess is neither of those should matter considering
I cannot make the printer work when doing a:

echo 'Hello World" >> test.txt
cat test.txt > /dev/lp0

In my 2.4.18 kernel I have the following compiled in staticly:

- Parallel port support
- PC-style hardware
- IEEE 1284 transfer modes


I have read the following HowTo's and FAQ's in their entirety:

http://mumford1.dyndns.org/~bs7452/linuxhelp/cups.html
http://www.gentoo.org/doc/en/printing-howto.xml
http://www.cups.org/cups-help.html


Any help would be greatly appreciated.

-- 
Regards,

Michael Bevilacqua

   ~
  . .
  /V\   Michael@Bevilacqua.us
 // \\
/(   )\
 ^`~'^



Here is what I have done in chronological order:

clockbot:~# cat /proc/sys/dev/parport/parport0/autoprobe
CLASS:PRINTER;
MODEL:DESKJET 710C;
MANUFACTURER:HEWLETT-PACKARD;
DESCRIPTION:Hewlett-Packard DeskJet 710 Series;
COMMAND SET:SCP,VLINK;

apt-get install:

cupsys
cupsys-client
cupsys-bsd (BSD LPD compatibility server [No])
cupsomatic-ppd (Foomatic Printfilter Configuration manual change
preservation [Yes]) (Enable DeBug to /tmp/{cups}omatic.log [Yes])
(text2ps conversion [Automagic]) (Accounting [No])
a2ps (Default Papersize [letter])
mpage
enscript
cupsys-driver-gimpprint

clockbot:~# lpinfo -v
network socket
network http
network ipp
network lpd
direct parallel:/dev/lp0
serial serial:/dev/ttyS0?baud=115200
serial serial:/dev/ttyS1?baud=115200
serial serial:/dev/ttyS2?baud=115200
serial serial:/dev/ttyS3?baud=115200
direct usb:/dev/usb/lp0
direct usb:/dev/usb/lp1
direct usb:/dev/usb/lp2
direct usb:/dev/usb/lp3
direct usb:/dev/usb/lp4
direct usb:/dev/usb/lp5
direct usb:/dev/usb/lp6
direct usb:/dev/usb/lp7
direct usb:/dev/usb/lp8
direct usb:/dev/usb/lp9
direct usb:/dev/usb/lp10
direct usb:/dev/usb/lp11
direct usb:/dev/usb/lp12
direct usb:/dev/usb/lp13
direct usb:/dev/usb/lp14
direct usb:/dev/usb/lp15

apt-get install:
pnm2ppa
foomatic-db
gsfonts-other
hpijs


vim /etc/cups/cupsd.conf
change 'LogLevel debug2'

D [12/Jan/2003:21:24:30 -0500] 0 %%BeginResource procset testprint 1.1 0
d [12/Jan/2003:21:24:29 -0500] FindBest: uri = "/images/add-printer.gif"...
d [12/Jan/2003:21:24:29 -0500] FindBest: Location / Limit 7f
d [12/Jan/2003:21:24:29 -0500] FindBest: Location /admin Limit 7f
d [12/Jan/2003:21:24:29 -0500] FindBest: best = "/"
d [12/Jan/2003:21:24:29 -0500] IsAuthorized: auth = 0, satisfy=0...
d [12/Jan/2003:21:24:29 -0500] get_file() 5 filename=/usr/share/cups/doc-root/images/add-printer.gif size=252
d [12/Jan/2003:21:24:29 -0500] check_if_modified() 5 If-Modified-Since="Sun, 10 Mar 2002 04:55:49 GMT"
d [12/Jan/2003:21:24:29 -0500] check_if_modified() 5 sizes=0,252 dates=1015754149,1015736149
D [12/Jan/2003:21:24:29 -0500] SendError() 5 code=304
D [12/Jan/2003:21:24:29 -0500] CloseClient() 3
d [12/Jan/2003:21:24:29 -0500] CloseClient: Removing fd 3 from InputSet and OutputSet...
D [12/Jan/2003:21:24:29 -0500] CloseClient() 5
d [12/Jan/2003:21:24:29 -0500] CloseClient: Removing fd 5 from InputSet and OutputSet...
d [12/Jan/2003:21:24:30 -0500] AcceptClient(08080e40) 0 NumClients = 0
D [12/Jan/2003:21:24:30 -0500] AcceptClient() 3 from 192.168.1.3:80.
d [12/Jan/2003:21:24:30 -0500] AcceptClient: Adding fd 3 to InputSet...
D [12/Jan/2003:21:24:30 -0500] ReadClient() 3 GET /printers/dj712c?op=print-test-page HTTP/1.1
d [12/Jan/2003:21:24:30 -0500] decode_auth(401f9008): Authorization string = "Basic cm9vdDpreCNwamE4"
d [12/Jan/2003:21:24:30 -0500] decode_auth() 3 username="root"
d [12/Jan/2003:21:24:30 -0500] IsAuthorized: con->uri = "/printers/dj712c?op=print-test-page"
d [12/Jan/2003:21:24:30 -0500] FindBest: uri = "/printers/dj712c?op=print-test-page"...
d [12/Jan/2003:21:24:30 -0500] FindBest: Location / Limit 7f
d [12/Jan/2003:21:24:30 -0500] FindBest: Location /admin Limit 7f
d [12/Jan/2003:21:24:30 -0500] FindBest: best = "/"
d [12/Jan/2003:21:24:30 -0500] IsAuthorized: auth = 0, satisfy=0...
D [12/Jan/2003:21:24:30 -0500] CGI /usr/lib/cups/cgi-bin/printers.cgi started - PID = 673
I [12/Jan/2003:21:24:30 -0500] Started "/usr/lib/cups/cgi-bin/printers.cgi" (pid=673)
D [12/Jan/2003:21:24:30 -0500] SendCommand() 3 file=6
d [12/Jan/2003:21:24:30 -0500] SendCommand: Adding fd 6 to InputSet...
d [12/Jan/2003:21:24:30 -0500] SendCommand: Adding fd 3 to OutputSet...
d [12/Jan/2003:21:24:30 -0500] AcceptClient(08080e40) 0 NumClients = 1
D [12/Jan/2003:21:24:30 -0500] AcceptClient() 5 from 127.0.0.1:80.
d [12/Jan/2003:21:24:30 -0500] AcceptClient: Adding fd 5 to InputSet...
d [12/Jan/2003:21:24:30 -0500] WriteClient() 3 Content-Type: text/html;charset=iso-8859-1
d [12/Jan/2003:21:24:30 -0500] WriteClient() 3
d [12/Jan/2003:21:24:30 -0500] WriteClient() 3 1168 bytes
D [12/Jan/2003:21:24:30 -0500] ReadClient() 5 POST /printers/dj712c HTTP/1.1
d [12/Jan/2003:21:24:30 -0500] decode_auth(401fc220): Authorization string = ""
d [12/Jan/2003:21:24:30 -0500] decode_auth() 5 username=""
d [12/Jan/2003:21:24:30 -0500] IsAuthorized: con->uri = "/printers/dj712c"
d [12/Jan/2003:21:24:30 -0500] FindBest: uri = "/printers/dj712c"...
d [12/Jan/2003:21:24:30 -0500] FindBest: Location / Limit 7f
d [12/Jan/2003:21:24:30 -0500] FindBest: Location /admin Limit 7f
d [12/Jan/2003:21:24:30 -0500] FindBest: best = "/"
d [12/Jan/2003:21:24:30 -0500] IsAuthorized: auth = 0, satisfy=0...
d [12/Jan/2003:21:24:30 -0500] POST /printers/dj712c
d [12/Jan/2003:21:24:30 -0500] CONTENT_TYPE = application/ipp
d [12/Jan/2003:21:24:30 -0500] ReadClient() 5 con->data_encoding = length, con->data_remaining = 14742, con->file = 0
d [12/Jan/2003:21:24:30 -0500] ReadClient() 5 REQUEST /var/spool/cups/0000000f=7
d [12/Jan/2003:21:24:30 -0500] ReadClient() 5 writing 1726 bytes to 7
d [12/Jan/2003:21:24:30 -0500] ReadClient() 5 con->data_encoding = length, con->data_remaining = 12799, con->file = 7
d [12/Jan/2003:21:24:30 -0500] ReadClient() 5 writing 12799 bytes to 7
d [12/Jan/2003:21:24:30 -0500] ReadClient() 5 Closing data file 7, size = 14525.
d [12/Jan/2003:21:24:30 -0500] ProcessIPPRequest(0x401fc220[5]): operation_id = 0002
d [12/Jan/2003:21:24:30 -0500] print_job(0x401fc220[5], ipp://localhost/printers/dj712c)
D [12/Jan/2003:21:24:30 -0500] print_job: request file type is application/postscript.
d [12/Jan/2003:21:24:30 -0500] check_quotas(0x401fc220[5], 0x808b5f0[dj712c])
D [12/Jan/2003:21:24:30 -0500] check_quotas: requesting-user-name = 'root'
D [12/Jan/2003:21:24:30 -0500] print_job: requesting-user-name = 'root'
D [12/Jan/2003:21:24:30 -0500] Adding default job-sheets values "none,none"...
d [12/Jan/2003:21:24:30 -0500] copy_banner(0x401fc220[5], 0x811d490[27], none)
d [12/Jan/2003:21:24:30 -0500] add_file(0x401fc220[5], 27, application/postscript)
d [12/Jan/2003:21:24:30 -0500] copy_banner(0x401fc220[5], 0x811d490[27], none)
I [12/Jan/2003:21:24:30 -0500] Job 27 queued on 'dj712c' by 'root'.
D [12/Jan/2003:21:24:30 -0500] Job 27 hold_until = 0
D [12/Jan/2003:21:24:30 -0500] StartJob(27, 0808b5f0)
D [12/Jan/2003:21:24:30 -0500] StartJob() id = 27, file = 0/1
D [12/Jan/2003:21:24:30 -0500] job-sheets=none,none
D [12/Jan/2003:21:24:30 -0500] banner_page = 0
D [12/Jan/2003:21:24:30 -0500] StartJob: argv = "dj712c","27","root","Test Page","1","","/var/spool/cups/d00027-001"
D [12/Jan/2003:21:24:30 -0500] StartJob: envp = "PATH=/usr/lib/cups/filter:/bin:/usr/bin","SOFTWARE=CUPS/1.1","USER=root","CHARSET=iso-8859-1","LANG=c","TZ=US/Eastern","PPD=/etc/cups/ppd/dj712c.ppd"
,"CUPS_SERVERROOT=/etc/cups","RIP_MAX_CACHE=8m","TMPDIR=/var/spool/cups/tmp","CONTENT_TYPE=application/postscript","DEVICE_URI=parallel:/dev/lp0","PRINTER=dj712c","CUPS_DATADIR=/usr/share/cups","CUP
S_FONTPATH=/usr/share/cups/fonts","",""
d [12/Jan/2003:21:24:30 -0500] StartJob: Allocating status buffer...
D [12/Jan/2003:21:24:30 -0500] StartJob: statusfds = 7, 8
D [12/Jan/2003:21:24:30 -0500] StartJob: filterfds[1] = 9, -1
D [12/Jan/2003:21:24:30 -0500] StartJob: filter = "/usr/lib/cups/filter/pstops"
D [12/Jan/2003:21:24:30 -0500] StartJob: filterfds[0] = 10, 11
D [12/Jan/2003:21:24:30 -0500] start_process("/usr/lib/cups/filter/pstops", bfff1b3c, bffecfec, 9, 11, 8)
I [12/Jan/2003:21:24:30 -0500] Started filter /usr/lib/cups/filter/pstops (PID 674) for job 27.
D [12/Jan/2003:21:24:30 -0500] StartJob: filter = "/usr/lib/cups/filter/cupsomatic"
D [12/Jan/2003:21:24:30 -0500] StartJob: filterfds[1] = 9, 12
D [12/Jan/2003:21:24:30 -0500] start_process("/usr/lib/cups/filter/cupsomatic", bfff1b3c, bffecfec, 10, 12, 8)
I [12/Jan/2003:21:24:30 -0500] Started filter /usr/lib/cups/filter/cupsomatic (PID 675) for job 27.
D [12/Jan/2003:21:24:30 -0500] StartJob: backend = "/usr/lib/cups/backend/parallel"
D [12/Jan/2003:21:24:30 -0500] StartJob: filterfds[0] = -1, 10
D [12/Jan/2003:21:24:30 -0500] start_process("/usr/lib/cups/backend/parallel", bfff1b3c, bffecfec, 9, 10, 8)
I [12/Jan/2003:21:24:30 -0500] Started backend /usr/lib/cups/backend/parallel (PID 676) for job 27.
d [12/Jan/2003:21:24:30 -0500] StartJob: Adding fd 7 to InputSet...
d [12/Jan/2003:21:24:30 -0500] add_job_state_reasons(0x401fc220[5], 27)
d [12/Jan/2003:21:24:30 -0500] AcceptClient(08080e40) 0 NumClients = 2
D [12/Jan/2003:21:24:30 -0500] AcceptClient() 8 from 192.168.1.3:80.
d [12/Jan/2003:21:24:30 -0500] AcceptClient: Adding fd 8 to InputSet...
D [12/Jan/2003:21:24:30 -0500] Page = 612x792; 9,40 to 603,766
D [12/Jan/2003:21:24:30 -0500] 0 %%BoundingBox: 0 0 612 792
D [12/Jan/2003:21:24:30 -0500] 0 %%Pages: 1
D [12/Jan/2003:21:24:30 -0500] 0 %%LanguageLevel: 1
D [12/Jan/2003:21:24:30 -0500] 0 %%DocumentData: Clean7Bit
D [12/Jan/2003:21:24:30 -0500] 0 %%DocumentSuppliedResources: procset testprint/1.0
D [12/Jan/2003:21:24:30 -0500] 0 %%DocumentNeededResources: font Helvetica Helvetica-Bold Times-Roman
D [12/Jan/2003:21:24:30 -0500] 0 %%Creator: Michael Sweet, Easy Software Products
D [12/Jan/2003:21:24:30 -0500] 0 %%CreationDate: May 11, 1999
D [12/Jan/2003:21:24:30 -0500] 0 %%Title: Test Page
D [12/Jan/2003:21:24:30 -0500] 0 %%EndComments
D [12/Jan/2003:21:24:30 -0500] 0 %%BeginProlog
D [12/Jan/2003:21:24:30 -0500] 0 %%BeginResource procset testprint 1.1 0
D [12/Jan/2003:21:24:30 -0500] perl: warning: Setting locale failed.
D [12/Jan/2003:21:24:30 -0500] perl: warning: Please check that your locale settings:
D [12/Jan/2003:21:24:30 -0500] LANGUAGE = (unset),
D [12/Jan/2003:21:24:30 -0500] LC_ALL = (unset),
D [12/Jan/2003:21:24:30 -0500] LANG = "c"
D [12/Jan/2003:21:24:30 -0500] are supported and installed on your system.
D [12/Jan/2003:21:24:30 -0500] perl: warning: Falling back to the standard locale ("C").
D [12/Jan/2003:21:24:30 -0500] 0 %%EndResource
D [12/Jan/2003:21:24:30 -0500] 0 %%EndProlog
D [12/Jan/2003:21:24:30 -0500] 0 %%Page: 1 1
D [12/Jan/2003:21:24:30 -0500] 0 %%Page: 1 1
D [12/Jan/2003:21:24:30 -0500] pw = 594.8, pl = 726.9
D [12/Jan/2003:21:24:30 -0500] PageLeft = 8.6, PageRight = 603.4
D [12/Jan/2003:21:24:30 -0500] PageTop = 766.5, PageBottom = 39.6
D [12/Jan/2003:21:24:30 -0500] PageWidth = 612.0, PageLength = 792.0
d [12/Jan/2003:21:24:30 -0500] AcceptClient(08080e40) 0 NumClients = 3
D [12/Jan/2003:21:24:30 -0500] AcceptClient() 9 from 192.168.1.3:80.
d [12/Jan/2003:21:24:30 -0500] AcceptClient: Adding fd 9 to InputSet...
D [12/Jan/2003:21:24:30 -0500] ReadClient() 8 GET /cups.css HTTP/1.1
d [12/Jan/2003:21:24:30 -0500] decode_auth(401ff438): Authorization string = "Basic cm9vdDpreCNwamE4"
d [12/Jan/2003:21:24:30 -0500] decode_auth() 8 username="root"
d [12/Jan/2003:21:24:30 -0500] IsAuthorized: con->uri = "/cups.css"
d [12/Jan/2003:21:24:30 -0500] FindBest: uri = "/cups.css"...
d [12/Jan/2003:21:24:30 -0500] FindBest: Location / Limit 7f
d [12/Jan/2003:21:24:30 -0500] FindBest: Location /admin Limit 7f
d [12/Jan/2003:21:24:30 -0500] FindBest: best = "/"
d [12/Jan/2003:21:24:30 -0500] IsAuthorized: auth = 0, satisfy=0...
d [12/Jan/2003:21:24:30 -0500] get_file() 8 filename=/usr/share/cups/doc-root/cups.css size=87
d [12/Jan/2003:21:24:30 -0500] check_if_modified() 8 If-Modified-Since="Sun, 10 Mar 2002 04:55:48 GMT"
d [12/Jan/2003:21:24:30 -0500] check_if_modified() 8 sizes=0,87 dates=1015754148,1015736148
D [12/Jan/2003:21:24:30 -0500] SendError() 8 code=304
D [12/Jan/2003:21:24:30 -0500] ReadClient() 9 GET /images/navbar.gif HTTP/1.1
d [12/Jan/2003:21:24:30 -0500] decode_auth(40202650): Authorization string = "Basic cm9vdDpreCNwamE4"
d [12/Jan/2003:21:24:30 -0500] decode_auth() 9 username="root"
d [12/Jan/2003:21:24:30 -0500] IsAuthorized: con->uri = "/images/navbar.gif"
d [12/Jan/2003:21:24:30 -0500] FindBest: uri = "/images/navbar.gif"...
d [12/Jan/2003:21:24:30 -0500] FindBest: Location / Limit 7f
d [12/Jan/2003:21:24:30 -0500] FindBest: Location /admin Limit 7f
d [12/Jan/2003:21:24:30 -0500] FindBest: best = "/"
d [12/Jan/2003:21:24:30 -0500] IsAuthorized: auth = 0, satisfy=0...

_________________________________________________________________________
Philadelphia Linux Users Group        --       http://www.phillylinux.org
Announcements - http://lists.netisland.net/mailman/listinfo/plug-announce
General Discussion  --   http://lists.netisland.net/mailman/listinfo/plug