Dear List,
I'm trying to connect a new laptop into an otherwise entirely Fedora LAN. The new machine can see all the (shared, CUPS) printers, but won't actually print anything. 'lpr' appears to complete normally, teh job says 'completed rending' but the printer status is shown as paused. The debugging output is below. Can anyone suggest how to move forward?
Jonathan +++
D [06/Mar/2016:12:03:16 +0000] [Client 12] Sending file. D [06/Mar/2016:12:03:16 +0000] cupsd is not idle any more, canceling shutdown. D [06/Mar/2016:12:03:16 +0000] [Client 12] cupsdWriteClient error=0, used=0, state=HTTP_STATE_GET_SEND, data_encoding=HTTP_ENCODING_LENGTH, data_remaining=6879, response=(nil)(), pipe_pid=0, file=14 D [06/Mar/2016:12:03:16 +0000] cupsd is not idle any more, canceling shutdown. D [06/Mar/2016:12:03:16 +0000] [Client 12] cupsdWriteClient error=0, used=0, state=HTTP_STATE_GET_SEND, data_encoding=HTTP_ENCODING_LENGTH, data_remaining=4831, response=(nil)(), pipe_pid=0, file=14 D [06/Mar/2016:12:03:16 +0000] cupsd is not idle any more, canceling shutdown. D [06/Mar/2016:12:03:16 +0000] [Client 12] cupsdWriteClient error=0, used=0, state=HTTP_STATE_GET_SEND, data_encoding=HTTP_ENCODING_LENGTH, data_remaining=2783, response=(nil)(), pipe_pid=0, file=14 D [06/Mar/2016:12:03:16 +0000] cupsd is not idle any more, canceling shutdown. D [06/Mar/2016:12:03:16 +0000] [Client 12] cupsdWriteClient error=0, used=0, state=HTTP_STATE_GET_SEND, data_encoding=HTTP_ENCODING_LENGTH, data_remaining=735, response=(nil)(), pipe_pid=0, file=14 D [06/Mar/2016:12:03:16 +0000] [Client 12] Waiting for request. D [06/Mar/2016:12:03:16 +0000] cupsdSetBusyState: newbusy="Dirty files", busy="Active clients and dirty files" D [06/Mar/2016:12:03:16 +0000] cupsd is not idle any more, canceling shutdown. D [06/Mar/2016:12:03:16 +0000] [Client 13] POST / HTTP/1.1 D [06/Mar/2016:12:03:16 +0000] cupsdSetBusyState: newbusy="Active clients and dirty files", busy="Dirty files" D [06/Mar/2016:12:03:16 +0000] [Client 13] No authentication data provided. D [06/Mar/2016:12:03:16 +0000] [Client 13] 2.0 Get-Jobs 44 D [06/Mar/2016:12:03:16 +0000] Get-Jobs ipp://localhost/printers/ D [06/Mar/2016:12:03:16 +0000] [Client 13] Returning IPP successful-ok for Get-Jobs (ipp://localhost/printers/) from localhost D [06/Mar/2016:12:03:16 +0000] [Client 13] Content-Length: 163 D [06/Mar/2016:12:03:16 +0000] cupsd is not idle any more, canceling shutdown. D [06/Mar/2016:12:03:16 +0000] [Client 13] cupsdWriteClient error=0, used=0, state=HTTP_STATE_POST_SEND, data_encoding=HTTP_ENCODING_LENGTH, data_remaining=163, response=0x7f0662f5e7a0(IPP_IDLE), pipe_pid=0, file=-1 D [06/Mar/2016:12:03:16 +0000] [Client 13] Writing IPP response, ipp_state=DATA, old wused=0, new wused=0 D [06/Mar/2016:12:03:16 +0000] [Client 13] bytes=0, http_state=0, data_remaining=0 D [06/Mar/2016:12:03:16 +0000] [Client 13] Waiting for request. D [06/Mar/2016:12:03:16 +0000] cupsdSetBusyState: newbusy="Dirty files", busy="Active clients and dirty files" D [06/Mar/2016:12:03:16 +0000] cupsd is not idle any more, canceling shutdown. D [06/Mar/2016:12:03:16 +0000] [Client 13] POST / HTTP/1.1 D [06/Mar/2016:12:03:16 +0000] cupsdSetBusyState: newbusy="Active clients and dirty files", busy="Dirty files" D [06/Mar/2016:12:03:16 +0000] [Client 13] No authentication data provided. D [06/Mar/2016:12:03:16 +0000] [Client 13] 2.0 Get-Jobs 45 D [06/Mar/2016:12:03:16 +0000] Get-Jobs ipp://localhost/printers/ D [06/Mar/2016:12:03:16 +0000] [Job 2] Loading attributes... D [06/Mar/2016:12:03:16 +0000] [Job 3] Loading attributes... D [06/Mar/2016:12:03:16 +0000] [Job 4] Loading attributes... D [06/Mar/2016:12:03:16 +0000] [Job 5] Loading attributes... D [06/Mar/2016:12:03:16 +0000] [Job 6] Loading attributes... D [06/Mar/2016:12:03:16 +0000] [Job 7] Loading attributes... D [06/Mar/2016:12:03:16 +0000] [Job 8] Loading attributes... D [06/Mar/2016:12:03:16 +0000] [Client 13] Returning IPP successful-ok for Get-Jobs (ipp://localhost/printers/) from localhost D [06/Mar/2016:12:03:16 +0000] [Client 13] Content-Length: 691 D [06/Mar/2016:12:03:16 +0000] [Job 2] Removing document files. D [06/Mar/2016:12:03:16 +0000] [Job 3] Removing document files. D [06/Mar/2016:12:03:16 +0000] [Job 4] Removing document files. D [06/Mar/2016:12:03:16 +0000] [Job 5] Removing document files. D [06/Mar/2016:12:03:16 +0000] [Job 6] Removing document files. D [06/Mar/2016:12:03:16 +0000] [Job 7] Removing document files. D [06/Mar/2016:12:03:16 +0000] [Job 8] Removing document files. D [06/Mar/2016:12:03:16 +0000] cupsd is not idle any more, canceling shutdown. D [06/Mar/2016:12:03:16 +0000] [Client 13] cupsdWriteClient error=0, used=0, state=HTTP_STATE_POST_SEND, data_encoding=HTTP_ENCODING_LENGTH, data_remaining=691, response=0x7f0662f72c70(IPP_IDLE), pipe_pid=0, file=-1 D [06/Mar/2016:12:03:16 +0000] [Client 13] Writing IPP response, ipp_state=DATA, old wused=0, new wused=0 D [06/Mar/2016:12:03:16 +0000] [Client 13] bytes=0, http_state=0, data_remaining=0 D [06/Mar/2016:12:03:16 +0000] [Client 13] Waiting for request. D [06/Mar/2016:12:03:16 +0000] cupsdSetBusyState: newbusy="Dirty files", busy="Active clients and dirty files" D [06/Mar/2016:12:03:16 +0000] cupsd is not idle any more, canceling shutdown. D [06/Mar/2016:12:03:16 +0000] [Client 12] PUT /admin/conf/cupsd.conf HTTP/1.1 D [06/Mar/2016:12:03:16 +0000] cupsdSetBusyState: newbusy="Active clients and dirty files", busy="Dirty files" D [06/Mar/2016:12:03:16 +0000] [Client 12] Authorized as root using PeerCred D [06/Mar/2016:12:03:16 +0000] cupsdIsAuthorized: username="root" D [06/Mar/2016:12:03:16 +0000] cupsd is not idle any more, canceling shutdown. I [06/Mar/2016:12:03:16 +0000] Installing config file "/etc/cups/cupsd.conf"... D [06/Mar/2016:12:03:16 +0000] cupsdSetBusyState: newbusy="Dirty files", busy="Active clients and dirty files" D [06/Mar/2016:12:03:16 +0000] [Client 13] Closing connection. D [06/Mar/2016:12:03:16 +0000] cupsdSetBusyState: newbusy="Dirty files", busy="Dirty files" D [06/Mar/2016:12:03:16 +0000] [Client 12] Closing connection. D [06/Mar/2016:12:03:16 +0000] cupsdSetBusyState: newbusy="Dirty files", busy="Dirty files" I [06/Mar/2016:12:03:16 +0000] Saving printers.conf... I [06/Mar/2016:12:03:16 +0000] Generating printcap /var/run/cups/printcap... D [06/Mar/2016:12:03:16 +0000] cupsdSetBusyState: newbusy="Not busy", busy="Dirty files" W [06/Mar/2016:12:03:16 +0000] Duplicate listen address "/var/run/cups/cups.sock" ignored. E [06/Mar/2016:12:03:16 +0000] Unknown directive JobPrivateAccess on line 84 of /etc/cups/cupsd.conf. E [06/Mar/2016:12:03:16 +0000] Unknown directive JobPrivateValues on line 85 of /etc/cups/cupsd.conf. E [06/Mar/2016:12:03:16 +0000] Unknown directive SubscriptionPrivateAccess on line 86 of /etc/cups/cupsd.conf. E [06/Mar/2016:12:03:16 +0000] Unknown directive SubscriptionPrivateValues on line 87 of /etc/cups/cupsd.conf. W [06/Mar/2016:12:03:16 +0000] CreateProfile failed: org.freedesktop.ColorManager.AlreadyExists:profile id 'laser-Gray..' already exists W [06/Mar/2016:12:03:16 +0000] CreateProfile failed: org.freedesktop.ColorManager.AlreadyExists:profile id 'laser-RGB..' already exists W [06/Mar/2016:12:03:16 +0000] CreateProfile failed: org.freedesktop.ColorManager.AlreadyExists:profile id 'P2015-Gray..' already exists W [06/Mar/2016:12:03:16 +0000] CreateProfile failed: org.freedesktop.ColorManager.AlreadyExists:profile id 'P2015-RGB..' already exists