E [24/Sep/2014:15:33:55 -0400] Returning IPP client-error-not-possible for Cancel-Job (ipp://localhost/jobs/86) from localhost
E [24/Sep/2014:15:33:57 -0400] Returning IPP client-error-not-possible for Cancel-Job (ipp://localhost/jobs/86) from localhost
E [24/Sep/2014:15:34:00 -0400] Returning IPP client-error-not-possible for Cancel-Job (ipp://localhost/jobs/86) from localhost
E [24/Sep/2014:15:45:32 -0400] [Job 161] No %%Pages: comment in header!
E [24/Sep/2014:15:45:33 -0400] [Job 161] Job stopped due to filter errors; please consult the error_log file for details.
D [24/Sep/2014:15:45:33 -0400] [Job 161] The following messages were recorded from 03:45:32 PM to 03:45:33 PM
D [24/Sep/2014:15:45:33 -0400] [Job 161] findname: 6 = (IPAGothic)
D [24/Sep/2014:15:45:33 -0400] [Job 161] FFTM 162176 28
D [24/Sep/2014:15:45:33 -0400] [Job 161] GDEF 158020 32
D [24/Sep/2014:15:45:33 -0400] [Job 161] GPOS 158132 4044
D [24/Sep/2014:15:45:33 -0400] [Job 161] GSUB 158052 80
D [24/Sep/2014:15:45:33 -0400] [Job 161] OS/2 440 96
D [24/Sep/2014:15:45:33 -0400] [Job 161] cmap 3220 2998
D [24/Sep/2014:15:45:33 -0400] [Job 161] cvt  9076 554
D [24/Sep/2014:15:45:33 -0400] [Job 161] fpgm 6220 1797
D [24/Sep/2014:15:45:33 -0400] [Job 161] gasp 158004 16
D [24/Sep/2014:15:45:33 -0400] [Job 161] glyf 12320 133272
D [24/Sep/2014:15:45:33 -0400] [Job 161] head 316 54
D [24/Sep/2014:15:45:33 -0400] [Job 161] hhea 372 36
D [24/Sep/2014:15:45:33 -0400] [Job 161] hmtx 536 2684
D [24/Sep/2014:15:45:33 -0400] [Job 161] kern 145592 5160
D [24/Sep/2014:15:45:33 -0400] [Job 161] loca 9632 2688
D [24/Sep/2014:15:45:33 -0400] [Job 161] maxp 408 32
D [24/Sep/2014:15:45:33 -0400] [Job 161] name 150752 2103
D [24/Sep/2014:15:45:33 -0400] [Job 161] post 152856 5145
D [24/Sep/2014:15:45:33 -0400] [Job 161] prep 8020 1056
D [24/Sep/2014:15:45:33 -0400] [Job 161] findname: 6 = (LiberationSans-Italic)
D [24/Sep/2014:15:45:33 -0400] [Job 161] FFTM 268 28
D [24/Sep/2014:15:45:33 -0400] [Job 161] GDEF 296 30
D [24/Sep/2014:15:45:33 -0400] [Job 161] OS/2 328 86
D [24/Sep/2014:15:45:33 -0400] [Job 161] cmap 416 75660
D [24/Sep/2014:15:45:33 -0400] [Job 161] cvt  76076 56
D [24/Sep/2014:15:45:33 -0400] [Job 161] fpgm 76132 199
D [24/Sep/2014:15:45:33 -0400] [Job 161] gasp 76332 16
D [24/Sep/2014:15:45:33 -0400] [Job 161] glyf 76348 3700580
D [24/Sep/2014:15:45:33 -0400] [Job 161] head 3776928 54
D [24/Sep/2014:15:45:33 -0400] [Job 161] hhea 3776984 36
D [24/Sep/2014:15:45:33 -0400] [Job 161] hmtx 3777020 40868
D [24/Sep/2014:15:45:33 -0400] [Job 161] loca 3817888 77164
D [24/Sep/2014:15:45:33 -0400] [Job 161] maxp 3895052 32
D [24/Sep/2014:15:45:33 -0400] [Job 161] name 3895084 3894
D [24/Sep/2014:15:45:33 -0400] [Job 161] post 3898980 194718
D [24/Sep/2014:15:45:33 -0400] [Job 161] prep 4093700 40
D [24/Sep/2014:15:45:33 -0400] [Job 161] findname: 6 = (UnDotum-Bold)
D [24/Sep/2014:15:45:33 -0400] [Job 161] BDF  1420 6204
D [24/Sep/2014:15:45:33 -0400] [Job 161] EBDT 98362 2552155
D [24/Sep/2014:15:45:33 -0400] [Job 161] EBLC 2650517 405360
D [24/Sep/2014:15:45:33 -0400] [Job 161] FFTM 3055877 28
D [24/Sep/2014:15:45:33 -0400] [Job 161] GDEF 3055913 102
D [24/Sep/2014:15:45:33 -0400] [Job 161] GPOS 20042063 2370
D [24/Sep/2014:15:45:33 -0400] [Job 161] GSUB 20044433 994
D [24/Sep/2014:15:45:33 -0400] [Job 161] OS/2 20285009 86
D [24/Sep/2014:15:45:33 -0400] [Job 161] VORG 20666009 8
D [24/Sep/2014:15:45:33 -0400] [Job 161] cmap 7624 90738
D [24/Sep/2014:15:45:33 -0400] [Job 161] gasp 3055905 8
D [24/Sep/2014:15:45:33 -0400] [Job 161] glyf 3056015 16986048
D [24/Sep/2014:15:45:33 -0400] [Job 161] head 20045427 54
D [24/Sep/2014:15:45:33 -0400] [Job 161] hhea 20045481 36
D [24/Sep/2014:15:45:33 -0400] [Job 161] hmtx 20045517 108230
D [24/Sep/2014:15:45:33 -0400] [Job 161] loca 20153747 108496
D [24/Sep/2014:15:45:33 -0400] [Job 161] maxp 20262243 32
D [24/Sep/2014:15:45:33 -0400] [Job 161] name 20262275 22734
D [24/Sep/2014:15:45:33 -0400] [Job 161] post 20285095 272454
D [24/Sep/2014:15:45:33 -0400] [Job 161] vhea 20557549 36
D [24/Sep/2014:15:45:33 -0400] [Job 161] vmtx 20557585 108424
D [24/Sep/2014:15:45:33 -0400] [Job 161] findname: 6 = (UMingCN)
D [24/Sep/2014:15:45:33 -0400] [Job 161] FFTM 141388 28
D [24/Sep/2014:15:45:33 -0400] [Job 161] GDEF 129960 110
D [24/Sep/2014:15:45:33 -0400] [Job 161] GPOS 134420 6968
D [24/Sep/2014:15:45:33 -0400] [Job 161] GSUB 130072 4346
D [24/Sep/2014:15:45:33 -0400] [Job 161] OS/2 408 86
D [24/Sep/2014:15:45:33 -0400] [Job 161] cmap 2448 554
D [24/Sep/2014:15:45:33 -0400] [Job 161] cvt  3116 298
D [24/Sep/2014:15:45:33 -0400] [Job 161] fpgm 3004 100
D [24/Sep/2014:15:45:33 -0400] [Job 161] glyf 4396 111132
D [24/Sep/2014:15:45:33 -0400] [Job 161] head 284 54
D [24/Sep/2014:15:45:33 -0400] [Job 161] hhea 340 36
D [24/Sep/2014:15:45:33 -0400] [Job 161] hmtx 496 1952
D [24/Sep/2014:15:45:33 -0400] [Job 161] loca 3416 978
D [24/Sep/2014:15:45:33 -0400] [Job 161] maxp 376 32
D [24/Sep/2014:15:45:33 -0400] [Job 161] name 115528 3012
D [24/Sep/2014:15:45:33 -0400] [Job 161] post 118540 11420
D [24/Sep/2014:15:45:33 -0400] [Job 161] prep 3104 11
D [24/Sep/2014:15:45:33 -0400] [Job 161] findname: 6 = (Lohit-Assamese)
D [24/Sep/2014:15:45:33 -0400] [Job 161] FFTM 268 28
D [24/Sep/2014:15:45:33 -0400] [Job 161] GDEF 296 30
D [24/Sep/2014:15:45:33 -0400] [Job 161] OS/2 328 86
D [24/Sep/2014:15:45:33 -0400] [Job 161] cmap 416 16572
D [24/Sep/2014:15:45:33 -0400] [Job 161] cvt  16988 12
D [24/Sep/2014:15:45:33 -0400] [Job 161] fpgm 17000 199
D [24/Sep/2014:15:45:33 -0400] [Job 161] gasp 17200 16
D [24/Sep/2014:15:45:33 -0400] [Job 161] glyf 17216 763864
D [24/Sep/2014:15:45:33 -0400] [Job 161] head 781080 54
D [24/Sep/2014:15:45:33 -0400] [Job 161] hhea 781136 36
D [24/Sep/2014:15:45:33 -0400] [Job 161] hmtx 781172 52476
D [24/Sep/2014:15:45:33 -0400] [Job 161] loca 833648 52480
D [24/Sep/2014:15:45:33 -0400] [Job 161] maxp 886128 32
D [24/Sep/2014:15:45:33 -0400] [Job 161] name 886160 3956
D [24/Sep/2014:15:45:33 -0400] [Job 161] post 890116 131596
D [24/Sep/2014:15:45:33 -0400] [Job 161] prep 1021712 40
D [24/Sep/2014:15:45:33 -0400] [Job 161] findname: 6 = (UnDinaru-Bold)
D [24/Sep/2014:15:45:33 -0400] [Job 161] GDEF 300 30
D [24/Sep/2014:15:45:33 -0400] [Job 161] GSUB 332 3546
D [24/Sep/2014:15:45:33 -0400] [Job 161] OS/2 3880 96
D [24/Sep/2014:15:45:33 -0400] [Job 161] cmap 3976 235446
D [24/Sep/2014:15:45:33 -0400] [Job 161] cvt  239424 204
D [24/Sep/2014:15:45:33 -0400] [Job 161] fpgm 239628 113
D [24/Sep/2014:15:45:33 -0400] [Job 161] gasp 239744 16
D [24/Sep/2014:15:45:33 -0400] [Job 161] glyf 239760 7546606
D [24/Sep/2014:15:45:33 -0400] [Job 161] head 7786368 54
D [24/Sep/2014:15:45:33 -0400] [Job 161] hhea 7786424 36
D [24/Sep/2014:15:45:33 -0400] [Job 161] hmtx 7786460 50600
D [24/Sep/2014:15:45:33 -0400] [Job 161] loca 7837060 50916
D [24/Sep/2014:15:45:33 -0400] [Job 161] maxp 7887976 32
D [24/Sep/2014:15:45:33 -0400] [Job 161] name 7888008 1190
D [24/Sep/2014:15:45:33 -0400] [Job 161] post 7889200 120451
D [24/Sep/2014:15:45:33 -0400] [Job 161] prep 8009652 10
D [24/Sep/2014:15:45:33 -0400] [Job 161] vhea 8009664 36
D [24/Sep/2014:15:45:33 -0400] [Job 161] vmtx 8009700 50910
D [24/Sep/2014:15:45:33 -0400] [Job 161] findname: 6 = (IPAPMincho)
D [24/Sep/2014:15:45:33 -0400] [Job 161] FFTM 316 28
D [24/Sep/2014:15:45:33 -0400] [Job 161] GDEF 344 152
D [24/Sep/2014:15:45:33 -0400] [Job 161] GPOS 496 12016
D [24/Sep/2014:15:45:33 -0400] [Job 161] GSUB 12512 1392
D [24/Sep/2014:15:45:33 -0400] [Job 161] OS/2 13904 86
D [24/Sep/2014:15:45:33 -0400] [Job 161] cmap 13992 4242
D [24/Sep/2014:15:45:33 -0400] [Job 161] cvt  18236 420
D [24/Sep/2014:15:45:33 -0400] [Job 161] fpgm 18656 139
D [24/Sep/2014:15:45:33 -0400] [Job 161] gasp 18796 12
D [24/Sep/2014:15:45:33 -0400] [Job 161] glyf 18808 192908
D [24/Sep/2014:15:45:33 -0400] [Job 161] head 211716 54
D [24/Sep/2014:15:45:33 -0400] [Job 161] hhea 211772 36
D [24/Sep/2014:15:45:33 -0400] [Job 161] hmtx 211808 11944
D [24/Sep/2014:15:45:33 -0400] [Job 161] kern 223752 8160
D [24/Sep/2014:15:45:33 -0400] [Job 161] loca 231912 11948
D [24/Sep/2014:15:45:33 -0400] [Job 161] maxp 243860 32
D [24/Sep/2014:15:45:33 -0400] [Job 161] name 243892 8718
D [24/Sep/2014:15:45:33 -0400] [Job 161] post 252612 28071
D [24/Sep/2014:15:45:33 -0400] [Job 161] prep 280684 1407
D [24/Sep/2014:15:45:33 -0400] [Job 161] findname: 6 = (DejaVuSerifCondensed-Bold)
D [24/Sep/2014:15:45:33 -0400] [Job 161] FFTM 304888 28
D [24/Sep/2014:15:45:33 -0400] [Job 161] GDEF 299512 104
D [24/Sep/2014:15:45:33 -0400] [Job 161] GPOS 304856 32
D [24/Sep/2014:15:45:33 -0400] [Job 161] GSUB 299616 5240
D [24/Sep/2014:15:45:33 -0400] [Job 161] OS/2 376 86
D [24/Sep/2014:15:45:33 -0400] [Job 161] cmap 2524 426
D [24/Sep/2014:15:45:33 -0400] [Job 161] gasp 299504 8
D [24/Sep/2014:15:45:33 -0400] [Job 161] glyf 5016 284464
D [24/Sep/2014:15:45:33 -0400] [Job 161] head 252 54
D [24/Sep/2014:15:45:33 -0400] [Job 161] hhea 308 36
D [24/Sep/2014:15:45:33 -0400] [Job 161] hmtx 464 2060
D [24/Sep/2014:15:45:33 -0400] [Job 161] loca 2952 2064
D [24/Sep/2014:15:45:33 -0400] [Job 161] maxp 344 32
D [24/Sep/2014:15:45:33 -0400] [Job 161] name 289480 1980
D [24/Sep/2014:15:45:33 -0400] [Job 161] post 291460 8044
D [24/Sep/2014:15:45:33 -0400] [Job 161] findname: 6 = (LKLUG)
D [24/Sep/2014:15:45:33 -0400] [Job 161] FFTM 268 28
D [24/Sep/2014:15:45:33 -0400] [Job 161] GDEF 296 30
D [24/Sep/2014:15:45:33 -0400] [Job 161] OS/2 328 86
D [24/Sep/2014:15:45:33 -0400] [Job 161] cmap 416 75660
D [24/Sep/2014:15:45:33 -0400] [Job 161] cvt  76076 12
D [24/Sep/2014:15:45:33 -0400] [Job 161] fpgm 76088 199
D [24/Sep/2014:15:45:33 -0400] [Job 161] gasp 76288 16
D [24/Sep/2014:15:45:33 -0400] [Job 161] glyf 76304 5886348
D [24/Sep/2014:15:45:33 -0400] [Job 161] head 5962652 54
D [24/Sep/2014:15:45:33 -0400] [Job 161] hhea 5962708 36
D [24/Sep/2014:15:45:33 -0400] [Job 161] hmtx 5962744 40356
D [24/Sep/2014:15:45:33 -0400] [Job 161] loca 6003100 76140
D [24/Sep/2014:15:45:33 -0400] [Job 161] maxp 6079240 32
D [24/Sep/2014:15:45:33 -0400] [Job 161] name 6079272 3868
D [24/Sep/2014:15:45:33 -0400] [Job 161] post 6083140 191902
D [24/Sep/2014:15:45:33 -0400] [Job 161] prep 6275044 40
D [24/Sep/2014:15:45:33 -0400] [Job 161] findname: 6 = (UnGungseo)
D [24/Sep/2014:15:45:33 -0400] [Job 161] FFTM 78432 28
D [24/Sep/2014:15:45:33 -0400] [Job 161] GDEF 78468 234
D [24/Sep/2014:15:45:33 -0400] [Job 161] GPOS 16213430 2488
D [24/Sep/2014:15:45:33 -0400] [Job 161] GSUB 16215918 832
D [24/Sep/2014:15:45:33 -0400] [Job 161] OS/2 16448531 86
D [24/Sep/2014:15:45:33 -0400] [Job 161] VORG 16824791 8
D [24/Sep/2014:15:45:33 -0400] [Job 161] cmap 1228 77204
D [24/Sep/2014:15:45:33 -0400] [Job 161] gasp 78460 8
D [24/Sep/2014:15:45:33 -0400] [Job 161] glyf 78702 16134728
D [24/Sep/2014:15:45:33 -0400] [Job 161] head 16216750 54
D [24/Sep/2014:15:45:33 -0400] [Job 161] hhea 16216804 36
D [24/Sep/2014:15:45:33 -0400] [Job 161] hmtx 16216840 102274
D [24/Sep/2014:15:45:33 -0400] [Job 161] loca 16319114 107092
D [24/Sep/2014:15:45:33 -0400] [Job 161] maDEBUG: Before page loop - DEBUG: Wrote 0 pages...
D [24/Sep/2014:15:45:33 -0400] [Job 161] cups_get_matrix(0x1ca77e8, 0x7fffc26bf2e0)
D [24/Sep/2014:15:45:33 -0400] [Job 161] Portrait matrix: XX=+1 XY=0 YX=0 YY=-1
D [24/Sep/2014:15:45:33 -0400] [Job 161] width = 800, height = 1061
D [24/Sep/2014:15:45:33 -0400] [Job 161] PageSize = [ 612 792 ], HWResolution = [ 100 100 ]
D [24/Sep/2014:15:45:33 -0400] [Job 161] HWMargins = [ 18.000 14.000 18.000 14.000 ]
D [24/Sep/2014:15:45:33 -0400] [Job 161] matrix = [ 1.389 0.000 0.000 -1.389 -25.000 1080.556 ]
D [24/Sep/2014:15:45:33 -0400] [Job 161] cups_get_params(0x1ca77e8, 0x7fffc26bfa90)
D [24/Sep/2014:15:45:33 -0400] [Job 161] before gdev_prn_get_params()
D [24/Sep/2014:15:45:33 -0400] [Job 161] after gdev_prn_get_params()
D [24/Sep/2014:15:45:33 -0400] [Job 161] Leaving cups_get_params()
D [24/Sep/2014:15:45:33 -0400] [Job 161] cups_print_pages(0x1ca77e8, 0x3cacf8c780, 1)
D [24/Sep/2014:15:45:33 -0400] [Job 161] cupsBitsPerPixel = 1, cupsWidth = 800, cupsBytesPerLine = 100, srcbytes = 100
D [24/Sep/2014:15:45:33 -0400] [Job 161] cupsWidth = 800, cupsHeight = 1061, cupsBytesPerLine = 100
D [24/Sep/2014:15:45:33 -0400] [Job 161] cups->header.Duplex = 0
D [24/Sep/2014:15:45:33 -0400] [Job 161] cups->header.Tumble = 0
D [24/Sep/2014:15:45:33 -0400] [Job 161] cups->page = 1
D [24/Sep/2014:15:45:33 -0400] [Job 161] cupsPPD = 0x1e78850
D [24/Sep/2014:15:45:33 -0400] [Job 161] cups_print_chunked: xflip = 0, yflip = 0, height = 1061
D [24/Sep/2014:15:45:33 -0400] [Job 161] prnt/hpcups/HPCupsFilter.cpp 251: ERROR: Unsupported resolution
D [24/Sep/2014:15:45:33 -0400] [Job 161] End of messages
D [24/Sep/2014:15:45:33 -0400] [Job 161] printer-state=3(idle)
D [24/Sep/2014:15:45:33 -0400] [Job 161] printer-state-message="Processing page 1..."
D [24/Sep/2014:15:45:33 -0400] [Job 161] printer-state-reasons=none
I [24/Sep/2014:15:46:37 -0400] Listening to 0.0.0.0:631 (IPv4)
I [24/Sep/2014:15:46:37 -0400] Listening to :::631 (IPv6)
I [24/Sep/2014:15:46:37 -0400] Listening to /var/run/cups/cups.sock (Domain)
I [24/Sep/2014:15:46:37 -0400] Remote access is enabled.
D [24/Sep/2014:15:46:37 -0400] Added auto ServerAlias Juanita
D [24/Sep/2014:15:46:37 -0400] Added auto ServerAlias localhost
D [24/Sep/2014:15:46:37 -0400] Added auto ServerAlias localhost.localdomain
D [24/Sep/2014:15:46:37 -0400] Added auto ServerAlias localhost4
D [24/Sep/2014:15:46:37 -0400] Added auto ServerAlias localhost4.localdomain4
I [24/Sep/2014:15:46:37 -0400] Loaded configuration file "/etc/cups/cupsd.conf"
I [24/Sep/2014:15:46:37 -0400] Using default TempDir of /var/spool/cups/tmp...
I [24/Sep/2014:15:46:37 -0400] Configured for up to 100 clients.
I [24/Sep/2014:15:46:37 -0400] Allowing up to 100 client connections per host.
I [24/Sep/2014:15:46:37 -0400] Using policy "default" as the default!
D [24/Sep/2014:15:46:37 -0400] load_ppd: Loading /var/cache/cups/Hewlett-Packard-HP-LaserJet-400-M401dn.ipp...
D [24/Sep/2014:15:46:37 -0400] cupsdRegisterPrinter(p=0x7fc0478162b0(Hewlett-Packard-HP-LaserJet-400-M401dn))
D [24/Sep/2014:15:46:37 -0400] cupsdMarkDirty(---p--)
D [24/Sep/2014:15:46:37 -0400] cupsdSetBusyState: Dirty files
I [24/Sep/2014:15:46:37 -0400] Partial reload complete.
I [24/Sep/2014:15:46:37 -0400] Listening to 0.0.0.0:631 on fd 4...
I [24/Sep/2014:15:46:37 -0400] Listening to :::631 on fd 7...
I [24/Sep/2014:15:46:37 -0400] Listening to /var/run/cups/cups.sock on fd 8...
I [24/Sep/2014:15:46:37 -0400] Resuming new connection processing...
D [24/Sep/2014:15:46:37 -0400] cupsdRegisterPrinter(p=0x7fc0478162b0(Hewlett-Packard-HP-LaserJet-400-M401dn))
D [24/Sep/2014:15:46:37 -0400] Discarding unused server-restarted event...
D [24/Sep/2014:15:46:38 -0400] cupsdAcceptClient: skipping getpeercon()
D [24/Sep/2014:15:46:38 -0400] cupsdAcceptClient: 12 from localhost (Domain)
D [24/Sep/2014:15:46:38 -0400] Report: clients=1
D [24/Sep/2014:15:46:38 -0400] Report: jobs=126
D [24/Sep/2014:15:46:38 -0400] Report: jobs-active=1
D [24/Sep/2014:15:46:38 -0400] Report: printers=1
D [24/Sep/2014:15:46:38 -0400] Report: printers-implicit=0
D [24/Sep/2014:15:46:38 -0400] Report: stringpool-string-count=6479
D [24/Sep/2014:15:46:38 -0400] Report: stringpool-alloc-bytes=8216
D [24/Sep/2014:15:46:38 -0400] Report: stringpool-total-bytes=112680
D [24/Sep/2014:15:46:40 -0400] cupsdAcceptClient: skipping getpeercon()
D [24/Sep/2014:15:46:40 -0400] cupsdAcceptClient: 13 from localhost (Domain)
D [24/Sep/2014:15:46:40 -0400] cupsdReadClient: 13 GET /admin/log/error_log HTTP/1.1
D [24/Sep/2014:15:46:40 -0400] cupsdSetBusyState: Active clients and dirty files
D [24/Sep/2014:15:46:40 -0400] cupsdAuthorize: Authorized as root using PeerCred
D [24/Sep/2014:15:46:40 -0400] cupsdSetBusyState: Dirty files
D [24/Sep/2014:15:46:40 -0400] cupsdReadClient: 12 POST / HTTP/1.1
D [24/Sep/2014:15:46:40 -0400] cupsdSetBusyState: Active clients and dirty files
D [24/Sep/2014:15:46:40 -0400] cupsdAuthorize: No authentication data provided.
D [24/Sep/2014:15:46:40 -0400] cupsdReadClient: 12 1.1 Get-Jobs 1
D [24/Sep/2014:15:46:40 -0400] Get-Jobs ipp://localhost/printers/
D [24/Sep/2014:15:46:40 -0400] [Job 161] Loading attributes...
D [24/Sep/2014:15:46:40 -0400] Returning IPP successful-ok for Get-Jobs (ipp://localhost/printers/) from localhost
D [24/Sep/2014:15:46:40 -0400] cupsdSetBusyState: Dirty files
D [24/Sep/2014:15:46:40 -0400] cupsdReadClient: 12 POST / HTTP/1.1
D [24/Sep/2014:15:46:40 -0400] cupsdSetBusyState: Active clients and dirty files
D [24/Sep/2014:15:46:40 -0400] cupsdAuthorize: No authentication data provided.
D [24/Sep/2014:15:46:40 -0400] cupsdReadClient: 12 1.1 Get-Jobs 1
D [24/Sep/2014:15:46:40 -0400] Returning IPP successful-ok for Get-Jobs (ipp://localhost/printers/) from localhost
D [24/Sep/2014:15:46:41 -0400] cupsdSetBusyState: Dirty files
D [24/Sep/2014:15:46:41 -0400] cupsdReadClient: 12 POST / HTTP/1.1
D [24/Sep/2014:15:46:41 -0400] cupsdSetBusyState: Active clients and dirty files
D [24/Sep/2014:15:46:41 -0400] cupsdAuthorize: No authentication data provided.
D [24/Sep/2014:15:46:41 -0400] cupsdReadClient: 12 1.1 Create-Printer-Subscription 1
D [24/Sep/2014:15:46:41 -0400] Create-Printer-Subscription /
D [24/Sep/2014:15:46:41 -0400] cupsdCreateSubscription(con=0x7fc04786b800(12), uri="/")
D [24/Sep/2014:15:46:41 -0400] pullmethod="ippget"
D [24/Sep/2014:15:46:41 -0400] notify-lease-duration=86400
D [24/Sep/2014:15:46:41 -0400] notify-time-interval=0
D [24/Sep/2014:15:46:41 -0400] cupsdAddSubscription(mask=17800, dest=(nil)(), job=(nil)(0), uri="(null)")
D [24/Sep/2014:15:46:41 -0400] Added subscription 62 for server
D [24/Sep/2014:15:46:41 -0400] cupsdMarkDirty(-----S)
D [24/Sep/2014:15:46:41 -0400] Returning IPP successful-ok for Create-Printer-Subscription (/) from localhost
D [24/Sep/2014:15:46:41 -0400] cupsdSetBusyState: Dirty files
D [24/Sep/2014:15:46:42 -0400] cupsdReadClient: 12 POST / HTTP/1.1
D [24/Sep/2014:15:46:42 -0400] cupsdSetBusyState: Active clients and dirty files
D [24/Sep/2014:15:46:42 -0400] cupsdAuthorize: No authentication data provided.
D [24/Sep/2014:15:46:42 -0400] cupsdReadClient: 12 1.1 Get-Notifications 1
D [24/Sep/2014:15:46:42 -0400] Get-Notifications /
D [24/Sep/2014:15:46:42 -0400] cupsdIsAuthorized: requesting-user-name="vnmr1"
D [24/Sep/2014:15:46:42 -0400] Returning IPP successful-ok for Get-Notifications (/) from localhost
D [24/Sep/2014:15:46:42 -0400] cupsdSetBusyState: Dirty files
D [24/Sep/2014:15:46:48 -0400] cupsdReadClient: 13 POST / HTTP/1.1
D [24/Sep/2014:15:46:48 -0400] cupsdSetBusyState: Active clients and dirty files
D [24/Sep/2014:15:46:48 -0400] cupsdAuthorize: Authorized as root using PeerCred
D [24/Sep/2014:15:46:48 -0400] cupsdReadClient: 13 1.1 Get-Job-Attributes 1
D [24/Sep/2014:15:46:48 -0400] Get-Job-Attributes ipp://localhost/jobs/161
D [24/Sep/2014:15:46:48 -0400] Returning IPP successful-ok for Get-Job-Attributes (ipp://localhost/jobs/161) from localhost
D [24/Sep/2014:15:46:48 -0400] cupsdSetBusyState: Dirty files
D [24/Sep/2014:15:46:48 -0400] cupsdReadClient: 13 POST /jobs/ HTTP/1.1
D [24/Sep/2014:15:46:48 -0400] cupsdSetBusyState: Active clients and dirty files
D [24/Sep/2014:15:46:48 -0400] cupsdAuthorize: Authorized as root using PeerCred
D [24/Sep/2014:15:46:48 -0400] cupsdReadClient: 13 1.1 Cancel-Job 1
D [24/Sep/2014:15:46:48 -0400] Cancel-Job ipp://localhost/jobs/161
D [24/Sep/2014:15:46:48 -0400] cupsdIsAuthorized: username="root"
D [24/Sep/2014:15:46:48 -0400] cupsdMarkDirty(-----S)
I [24/Sep/2014:15:46:48 -0400] [Job 161] Job canceled by "root"
D [24/Sep/2014:15:46:48 -0400] cupsdMarkDirty(----J-)
I [24/Sep/2014:15:46:48 -0400] [Job 161] Canceled by "root".
D [24/Sep/2014:15:46:48 -0400] Returning IPP successful-ok for Cancel-Job (ipp://localhost/jobs/161) from localhost
D [24/Sep/2014:15:46:48 -0400] cupsdSetBusyState: Dirty files
D [24/Sep/2014:15:46:49 -0400] cupsdAcceptClient: skipping getpeercon()
D [24/Sep/2014:15:46:49 -0400] cupsdAcceptClient: 16 from localhost (Domain)
D [24/Sep/2014:15:46:49 -0400] cupsdReadClient: 16 POST / HTTP/1.1
D [24/Sep/2014:15:46:49 -0400] cupsdSetBusyState: Active clients and dirty files
D [24/Sep/2014:15:46:49 -0400] cupsdAuthorize: No authentication data provided.
D [24/Sep/2014:15:46:49 -0400] cupsdReadClient: 16 1.1 Get-Notifications 1
D [24/Sep/2014:15:46:49 -0400] Get-Notifications /
D [24/Sep/2014:15:46:49 -0400] cupsdIsAuthorized: requesting-user-name="vnmr1"
D [24/Sep/2014:15:46:49 -0400] Returning IPP successful-ok for Get-Notifications (/) from localhost
D [24/Sep/2014:15:46:49 -0400] cupsdSetBusyState: Dirty files
D [24/Sep/2014:15:46:49 -0400] cupsdReadClient: 12 POST / HTTP/1.1
D [24/Sep/2014:15:46:49 -0400] cupsdSetBusyState: Active clients and dirty files
D [24/Sep/2014:15:46:49 -0400] cupsdAuthorize: No authentication data provided.
D [24/Sep/2014:15:46:49 -0400] cupsdReadClient: 12 1.1 Get-Notifications 1
D [24/Sep/2014:15:46:49 -0400] Get-Notifications /
D [24/Sep/2014:15:46:49 -0400] cupsdIsAuthorized: requesting-user-name="vnmr1"
D [24/Sep/2014:15:46:49 -0400] Returning IPP successful-ok for Get-Notifications (/) from localhost
D [24/Sep/2014:15:46:49 -0400] cupsdSetBusyState: Dirty files
D [24/Sep/2014:15:46:49 -0400] cupsdReadClient: 16 WAITING Closing on EOF
D [24/Sep/2014:15:46:49 -0400] cupsdCloseClient: 16
D [24/Sep/2014:15:46:54 -0400] cupsdReadClient: 12 POST / HTTP/1.1
D [24/Sep/2014:15:46:54 -0400] cupsdSetBusyState: Active clients and dirty files
D [24/Sep/2014:15:46:54 -0400] cupsdAuthorize: No authentication data provided.
D [24/Sep/2014:15:46:54 -0400] cupsdReadClient: 12 1.1 Get-Job-Attributes 1
D [24/Sep/2014:15:46:54 -0400] Get-Job-Attributes ipp://localhost/jobs/161
D [24/Sep/2014:15:46:54 -0400] Returning IPP successful-ok for Get-Job-Attributes (ipp://localhost/jobs/161) from localhost
D [24/Sep/2014:15:46:54 -0400] cupsdSetBusyState: Dirty files
D [24/Sep/2014:15:46:54 -0400] cupsdReadClient: 12 POST / HTTP/1.1
D [24/Sep/2014:15:46:54 -0400] cupsdSetBusyState: Active clients and dirty files
D [24/Sep/2014:15:46:54 -0400] cupsdAuthorize: No authentication data provided.
D [24/Sep/2014:15:46:54 -0400] cupsdReadClient: 12 1.1 Cancel-Subscription 1
D [24/Sep/2014:15:46:54 -0400] Cancel-Subscription /
D [24/Sep/2014:15:46:54 -0400] cupsdIsAuthorized: requesting-user-name="vnmr1"
D [24/Sep/2014:15:46:54 -0400] cupsdMarkDirty(-----S)
D [24/Sep/2014:15:46:54 -0400] Returning IPP successful-ok for Cancel-Subscription (/) from localhost
D [24/Sep/2014:15:46:54 -0400] cupsdSetBusyState: Dirty files
D [24/Sep/2014:15:46:54 -0400] cupsdAcceptClient: skipping getpeercon()
D [24/Sep/2014:15:46:54 -0400] cupsdAcceptClient: 16 from localhost (Domain)
D [24/Sep/2014:15:46:54 -0400] cupsdReadClient: 13 GET /admin/log/error_log HTTP/1.1
D [24/Sep/2014:15:46:54 -0400] cupsdSetBusyState: Active clients and dirty files
D [24/Sep/2014:15:46:54 -0400] cupsdAuthorize: Authorized as root using PeerCred
D [24/Sep/2014:15:46:54 -0400] cupsdSetBusyState: Dirty files
D [24/Sep/2014:15:46:54 -0400] cupsdReadClient: 13 PUT /admin/conf/cupsd.conf HTTP/1.1
D [24/Sep/2014:15:46:54 -0400] cupsdSetBusyState: Active clients and dirty files
D [24/Sep/2014:15:46:54 -0400] cupsdAuthorize: Authorized as root using PeerCred
D [24/Sep/2014:15:46:54 -0400] cupsdIsAuthorized: username="root"
I [24/Sep/2014:15:46:54 -0400] Installing config file "/etc/cups/cupsd.conf"...
D [24/Sep/2014:15:46:54 -0400] cupsdSetBusyState: Dirty files
D [24/Sep/2014:15:46:54 -0400] cupsdCloseClient: 12
D [24/Sep/2014:15:46:54 -0400] cupsdCloseClient: 13
D [24/Sep/2014:15:46:54 -0400] cupsdCloseClient: 16
D [24/Sep/2014:15:46:54 -0400] cupsdDeregisterPrinter(p=0x7fc0478162b0(Hewlett-Packard-HP-LaserJet-400-M401dn), removeit=1)
I [24/Sep/2014:15:46:54 -0400] Generating printcap /etc/printcap...
I [24/Sep/2014:15:46:54 -0400] Saving job cache file "/var/cache/cups/job.cache"...
I [24/Sep/2014:15:46:54 -0400] Saving subscriptions.conf...
D [24/Sep/2014:15:46:54 -0400] cupsdSetBusyState: Not busy
E [24/Sep/2014:15:49:44 -0400] Need to set BrowseLDAPDN to use LDAP browsing!
E [24/Sep/2014:15:50:24 -0400] Authorized using Basic, expected Negotiate!
E [24/Sep/2014:15:50:24 -0400] Authorized using Basic, expected Negotiate!
E [24/Sep/2014:15:50:24 -0400] Authorized using Basic, expected Negotiate!
E [24/Sep/2014:15:50:34 -0400] Authorized using Basic, expected Negotiate!
E [24/Sep/2014:15:50:34 -0400] Authorized using Basic, expected Negotiate!
E [24/Sep/2014:15:50:34 -0400] Authorized using Basic, expected Negotiate!
E [24/Sep/2014:15:50:43 -0400] Authorized using Basic, expected Negotiate!
E [24/Sep/2014:15:50:43 -0400] Authorized using Basic, expected Negotiate!
E [24/Sep/2014:15:50:43 -0400] Authorized using Basic, expected Negotiate!
E [24/Sep/2014:15:50:57 -0400] Authorized using Basic, expected Negotiate!
E [24/Sep/2014:15:50:57 -0400] Authorized using Basic, expected Negotiate!
E [24/Sep/2014:15:50:57 -0400] Authorized using Basic, expected Negotiate!
E [24/Sep/2014:15:52:16 -0400] Authorized using Basic, expected Negotiate!
E [24/Sep/2014:15:52:16 -0400] Authorized using Basic, expected Negotiate!
E [24/Sep/2014:15:52:16 -0400] Authorized using Basic, expected Negotiate!
E [24/Sep/2014:15:52:16 -0400] [CGI] CUPS-Get-Devices request failed with status 403: Unauthorized
E [24/Sep/2014:15:52:40 -0400] Authorized using Basic, expected Negotiate!
E [24/Sep/2014:15:52:40 -0400] Authorized using Basic, expected Negotiate!
E [24/Sep/2014:15:52:40 -0400] Authorized using Basic, expected Negotiate!
E [24/Sep/2014:15:52:40 -0400] [CGI] CUPS-Get-Devices request failed with status 403: Unauthorized
E [24/Sep/2014:16:24:25 -0400] Authorized using Basic, expected Negotiate!
E [24/Sep/2014:16:24:25 -0400] Authorized using Basic, expected Negotiate!
E [24/Sep/2014:16:24:25 -0400] Authorized using Basic, expected Negotiate!
E [24/Sep/2014:17:36:50 -0400] [CGI] CUPS-Get-Devices request failed with status 403: Unauthorized
E [24/Sep/2014:17:40:00 -0400] [CGI] CUPS-Get-Devices request failed with status 403: Unauthorized
E [24/Sep/2014:17:40:06 -0400] [CGI] CUPS-Get-Devices request failed with status 403: Unauthorized
E [25/Sep/2014:07:42:52 -0400] [CGI] CUPS-Get-Devices request failed with status 403: Unauthorized
E [25/Sep/2014:07:43:12 -0400] [CGI] CUPS-Get-Devices request failed with status 403: Unauthorized
E [25/Sep/2014:08:26:37 -0400] Need to set BrowseLDAPDN to use LDAP browsing!
E [25/Sep/2014:08:26:39 -0400] Need to set BrowseLDAPDN to use LDAP browsing!
E [25/Sep/2014:08:30:05 -0400] [CGI] CUPS-Get-Devices request failed with status 403: Unauthorized
E [25/Sep/2014:08:42:56 -0400] [CGI] CUPS-Get-Devices request failed with status 403: Unauthorized