Bug 2055871

Summary: Errors when starting an hp printer connected by USB like io/hpmud/musb.c 153: unable get_string_descriptor -4: Resource temporarily unavailable
Product: [Fedora] Fedora Reporter: Matt Fagnani <matt.fagnani>
Component: hplipAssignee: Zdenek Dohnal <zdohnal>
Status: CLOSED DUPLICATE QA Contact: Fedora Extras Quality Assurance <extras-qa>
Severity: unspecified Docs Contact:
Priority: unspecified    
Version: 35CC: jridky, sait.a.umar, tkorbar, twaugh, zdohnal
Target Milestone: ---   
Target Release: ---   
Hardware: Unspecified   
OS: Unspecified   
Whiteboard:
Fixed In Version: Doc Type: If docs needed, set a value
Doc Text:
Story Points: ---
Clone Of: Environment:
Last Closed: 2022-02-21 05:48:27 UTC Type: Bug
Regression: --- Mount Type: ---
Documentation: --- CRM:
Verified Versions: Category: ---
oVirt Team: --- RHEL 7.3 requirements from Atomic Host:
Cloudforms Team: --- Target Upstream Version:
Embargoed:
Attachments:
Description Flags
the journal with cups debug logging enabled when starting the printer
none
/etc/cups/ppd/psc-1200-series.ppd as listed https://docs.fedoraproject.org/en-US/quick-docs/how-to-debug-printing-problems/#_i_have_hp_printer_installed_it_with_hplip_and_have_a_problem_with_it
none
the journal with cups debug logging enabled and trying to a PDF from okular that didn't print none

Description Matt Fagnani 2022-02-17 20:25:38 UTC 
Created attachment 1861768 [details]
the journal with cups debug logging enabled when starting the printer

Description of problem:

I was using Plasma 5.23.5 on Wayland in a Fedora 35 KDE Plasma installation. I attached an hp psc 1200 printer by USB to an hp laptop. Errors like "python3[8397]: io/hpmud/musb.c 153: unable get_string_descriptor -4: Resource temporarily unavailable" occurred in the journal. 

Feb 17 14:56:16 localhost.localdomain kernel: usb 2-4: new full-speed USB device number 4 using xhci_hcd
Feb 17 14:56:16 localhost.localdomain kernel: usb 2-4: New USB device found, idVendor=03f0, idProduct=2f11, bcdDevice= 1.00
Feb 17 14:56:16 localhost.localdomain kernel: usb 2-4: New USB device strings: Mfr=1, Product=2, SerialNumber=3
Feb 17 14:56:16 localhost.localdomain kernel: usb 2-4: Product: psc 1200 series
Feb 17 14:56:16 localhost.localdomain kernel: usb 2-4: Manufacturer: Hewlett-Packard
Feb 17 14:56:16 localhost.localdomain kernel: usb 2-4: SerialNumber: MY3CHG83TW5H
Feb 17 14:56:16 localhost.localdomain root[5228]: loading HP Device 002 004
Feb 17 14:56:17 localhost.localdomain python3[5229]: io/hpmud/musb.c 2185: [5229] hpmud_make_usb_uri() bus=002 dev=004
Feb 17 14:56:17 localhost.localdomain python3[5229]: io/hpmud/musb.c 153: unable get_string_descriptor -4: Resource temporarily unavailable
Feb 17 14:56:17 localhost.localdomain python3[5229]: io/hpmud/musb.c 2232: invalid product id string ret=-4
Feb 17 14:56:17 localhost.localdomain python3[5229]: io/hpmud/musb.c 153: unable get_string_descriptor -4: Resource temporarily unavailable
Feb 17 14:56:17 localhost.localdomain python3[5229]: io/hpmud/musb.c 2237: invalid serial id string ret=-4
Feb 17 14:56:17 localhost.localdomain python3[5229]: io/hpmud/musb.c 153: unable get_string_descriptor -4: Resource temporarily unavailable
Feb 17 14:56:17 localhost.localdomain python3[5229]: io/hpmud/musb.c 2104: invalid product id string ret=-4
Feb 17 14:56:17 localhost.localdomain python3[5229]: io/hpmud/musb.c 153: unable get_string_descriptor -4: Resource temporarily unavailable
Feb 17 14:56:17 localhost.localdomain python3[5229]: io/hpmud/musb.c 2109: invalid serial id string ret=-4
Feb 17 14:56:17 localhost.localdomain python3[5229]: io/hpmud/musb.c 153: unable get_string_descriptor -4: Resource temporarily unavailable
Feb 17 14:56:17 localhost.localdomain python3[5229]: io/hpmud/musb.c 2114: invalid manufacturer string ret=-4
Feb 17 14:56:17 localhost.localdomain hp-config_usb_printer[5229]: hp-config_usb_printer[5229]: error: This is not a valid device

/usr/lib/cups/backend/gutenprint53+usb segmentation faulted in ___pthread_mutex_lock at pthread_mutex_lock.c:76 in glibc-2.34-25.fc35 as I reported at https://bugzilla.redhat.com/show_bug.cgi?id=2055504
mutex=0x28 looked like an invalid pointer in the trace. PDF files didn't print out from Thunderbird and okular. The PDF print jobs were paused in the Plasma print queue. I also saw these crashes using the Fedora 36 image Fedora-KDE-Live-x86_64-36-20220215.n.0.iso, but the PDFs did print from okular in F36. I'm reporting this problem and attaching the journal with cups debug logging enabled as suggested by Zdenek Dohnal at https://bugzilla.redhat.com/show_bug.cgi?id=2055504#c1

Version-Release number of selected component (if applicable):
gutenprint-5.3.4-6.fc35
libusb1-1.0.25-3.fc35
glibc-2.34-25.fc35
hplip-3.21.12-1.fc35.x86_64
cups-2.3.3op2-13.fc35.x86_64
plasma-desktop-5.23.5-1.fc35.x86_64
kf5-plasma-5.90.0-1.fc35.x86_64
qt5-qtbase-5.15.2-30.fc35.x86_64
thunderbird-91.6.0-1.fc35.x86_64
okular-21.12.2-1.fc35.x86_64

How reproducible:
The errors and gutenprint53+usb crashes happened each of several times I started the hp printer.

Steps to Reproduce:
1. Boot a Fedora 35 KDE Plasma installation updated to 2022-2-16 with updates-testing enabled.
2. Log in to Plasma 5.23.5 on Wayland
3. attach an hp psc 1200 printer by USB
4. Start the printer
5. start okular
6. Open and print PDF files from okular

Actual results:
Errors when starting an hp printer connected by USB like io/hpmud/musb.c 153: unable get_string_descriptor -4: Resource temporarily unavailable. PDF files didn't print from Thunderbird and okular.

Expected results:
No errors or crashes would happen. PDF files would print out normally.

Additional info:
Comment 1 Matt Fagnani 2022-02-17 20:38:02 UTC 
Created attachment 1861769 [details]
/etc/cups/ppd/psc-1200-series.ppd as listed https://docs.fedoraproject.org/en-US/quick-docs/how-to-debug-printing-problems/#_i_have_hp_printer_installed_it_with_hplip_and_have_a_problem_with_it
Comment 2 Matt Fagnani 2022-02-17 21:14:47 UTC 
Created attachment 1861778 [details]
the journal with cups debug logging enabled and trying to a PDF from okular that didn't print

the journal with cups debug logging enabled. I tried to print a PDF file from okular which I didn't do in the journal I first attached. The print job was paused at first in the Plasma print queue. I unpaused the print job, and the PDF didn't print. I paused the print job after about a minute.
Comment 3 Sammy 2022-02-20 15:42:25 UTC 
See bug#2055504. It is libusb1 problem. Downgrading to version 1.0.24 solved the problem.
Comment 4 Zdenek Dohnal 2022-02-21 05:48:27 UTC 
Hi Matt,

I'm closing the issue based on your response in https://bugzilla.redhat.com/show_bug.cgi?id=2055504#c4 - it seems libusb issue affects hplip as well.

Thank you for the data and I'm sorry for inconvenience,

Zdenek
Comment 5 Zdenek Dohnal 2022-02-21 05:49:04 UTC 
Of course I meant duplicate...

*** This bug has been marked as a duplicate of bug 2055504 ***