← Back to team overview

kernel-packages team mailing list archive

[Bug 1177394] Re: USB sequence errors in snd_usb_usx2y

 

Hello,

Sorry I'm not able to test this more quickly - my free time has all but
dried up these days!

But I've just tried the latest kernel, 4.3 rc4, and saw no change.
Here's the trace from the kernel that shows up in the syslog when I plug
the device in:



Oct  7 15:16:43 scaph kernel: [   93.329270] usb 3-1.2: new full-speed USB device number 9 using ehci-pci
Oct  7 15:16:43 scaph kernel: [   93.422645] usb 3-1.2: New USB device found, idVendor=1604, idProduct=8007
Oct  7 15:16:43 scaph kernel: [   93.422652] usb 3-1.2: New USB device strings: Mfr=0, Product=0, SerialNumber=0
Oct  7 15:16:43 scaph mtp-probe: checking bus 3, device 9: "/sys/devices/pci0000:00/0000:00:1a.0/usb3/3-1/3-1.2"
Oct  7 15:16:43 scaph mtp-probe: bus: 3, device: 9 was not an MTP device
Oct  7 15:16:43 scaph /lib/udev/tascam_fpga: calling /usr/bin/usx2yloader for
Oct  7 15:16:45 scaph /lib/udev/tascam_fpga: leaving
Oct  7 15:16:46 scaph systemd-udevd[2016]: Process '/usr/sbin/alsactl -E HOME=/var/run/alsa restore 1' failed with exit code 99.
Oct  7 15:16:46 scaph kernel: [   96.656497] ------------[ cut here ]------------
Oct  7 15:16:46 scaph kernel: [   96.656507] WARNING: CPU: 0 PID: 0 at include/linux/kref.h:47 usb_get_urb+0x40/0x50 [usbcore]()
Oct  7 15:16:46 scaph kernel: [   96.656508] Modules linked in: snd_seq_midi snd_seq_midi_event snd_usb_usx2y snd_usbmidi_lib snd_rawmidi sha256_generic hmac drbg ansi_cprng ctr ccm binfmt_misc
 snd_hrtimer snd_seq snd_seq_device bnep joydev nfsd auth_rpcgss oid_registry nfs_acl nfs lockd grace fscache sunrpc snd_hda_codec_hdmi iTCO_wdt snd_hda_codec_realtek iTCO_vendor_support snd_hd
a_codec_generic intel_rapl iosf_mbi x86_pkg_temp_thermal intel_powerclamp coretemp kvm arc4 crc32_pclmul aesni_intel aes_i586 xts lrw gf128mul ablk_helper cryptd iwldvm evdev psmouse serio_raw 
mac80211 i2c_i801 uvcvideo videobuf2_vmalloc videobuf2_memops iwlwifi videobuf2_core btusb v4l2_common btrtl btbcm btintel bluetooth videodev snd_hda_intel cfg80211 snd_hda_codec snd_hda_core m
edia snd_hwdep snd_pcm lpc_ich sg mfd_core snd_timer shpchp i915 thinkpad_acpi wmi nvram snd soundcore tpm_tis rfkill battery drm_kms_helper ac tpm drm i2c_algo_bit video button processor loop 
parport_pc ppdev lp parport autofs4 ext4 crc16 mbcache jbd2 sd_mod crc32c_intel ahci libahci libata scsi_mod sdhci_pci sdhci mmc_core ehci_pci ehci_hcd xhci_pci e1000e xhci_hcd ptp pps_core usb
core usb_common thermal
Oct  7 15:16:46 scaph kernel: [   96.656572] CPU: 0 PID: 0 Comm: swapper/0 Not tainted 4.3.0-rc4+ #3
Oct  7 15:16:46 scaph kernel: [   96.656573] Hardware name: LENOVO 23252UF/23252UF, BIOS G2ET85WW (2.05 ) 10/22/2012
Oct  7 15:16:46 scaph kernel: [   96.656575]  f82dbc1a f742fe24 c12949c5 00000000 c106367d c15e79a4 00000000 00000000
Oct  7 15:16:46 scaph kernel: [   96.656578]  f82dbc1a 0000002f f82c7300 00000009 f82c7300 f68b4300 f0de4400 00000020
Oct  7 15:16:46 scaph kernel: [   96.656581]  f742fe34 c1063752 00000009 00000000 f742fe40 f82c7300 f68b4300 f742ff00
Oct  7 15:16:46 scaph kernel: [   96.656584] Call Trace:
Oct  7 15:16:46 scaph kernel: [   96.656590]  [<c12949c5>] ? dump_stack+0x3e/0x59
Oct  7 15:16:46 scaph kernel: [   96.656593]  [<c106367d>] ? warn_slowpath_common+0x8d/0xc0
Oct  7 15:16:46 scaph kernel: [   96.656597]  [<f82c7300>] ? usb_get_urb+0x40/0x50 [usbcore]
Oct  7 15:16:46 scaph kernel: [   96.656599]  [<f82c7300>] ? usb_get_urb+0x40/0x50 [usbcore]
Oct  7 15:16:46 scaph kernel: [   96.656601]  [<c1063752>] ? warn_slowpath_null+0x22/0x30
Oct  7 15:16:46 scaph kernel: [   96.656604]  [<f82c7300>] ? usb_get_urb+0x40/0x50 [usbcore]
Oct  7 15:16:46 scaph kernel: [   96.656608]  [<f82c529a>] ? usb_hcd_submit_urb+0x3a/0x9b0 [usbcore]
Oct  7 15:16:46 scaph kernel: [   96.656612]  [<c12a7fc7>] ? find_next_bit+0x17/0x30
Oct  7 15:16:46 scaph kernel: [   96.656614]  [<c1294818>] ? cpumask_next_and+0x28/0x40
Oct  7 15:16:46 scaph kernel: [   96.656617]  [<c10958ab>] ? load_balance+0xeb/0x860
Oct  7 15:16:46 scaph kernel: [   96.656620]  [<f892ebe8>] ? usX2Y_urb_submit.isra.3+0x38/0x70 [snd_usb_usx2y]
Oct  7 15:16:46 scaph kernel: [   96.656624]  [<c1084288>] ? update_rq_clock.part.77+0x18/0x50
Oct  7 15:16:46 scaph kernel: [   96.656626]  [<f892ede8>] ? i_usX2Y_urb_complete+0x168/0x540 [snd_usb_usx2y]
Oct  7 15:16:46 scaph kernel: [   96.656629]  [<c13f0f9b>] ? led_trigger_blink_setup+0x2b/0xa0
Oct  7 15:16:46 scaph kernel: [   96.656633]  [<f82c3be3>] ? __usb_hcd_giveback_urb+0x73/0x130 [usbcore]
Oct  7 15:16:46 scaph kernel: [   96.656636]  [<f82c449c>] ? usb_giveback_urb_bh+0x7c/0xc0 [usbcore]
Oct  7 15:16:46 scaph kernel: [   96.656639]  [<c1067358>] ? tasklet_hi_action+0xc8/0xe0
Oct  7 15:16:46 scaph kernel: [   96.656641]  [<c1067957>] ? __do_softirq+0xd7/0x230
Oct  7 15:16:46 scaph kernel: [   96.656643]  [<c1067880>] ? cpu_callback+0x190/0x190
Oct  7 15:16:46 scaph kernel: [   96.656647]  [<c1013fa8>] ? do_softirq_own_stack+0x28/0x30
Oct  7 15:16:46 scaph kernel: [   96.656648]  <IRQ>  [<c1067c25>] ? irq_exit+0xa5/0xb0
Oct  7 15:16:46 scaph kernel: [   96.656652]  [<c150beb5>] ? do_IRQ+0x45/0xc0
Oct  7 15:16:46 scaph kernel: [   96.656654]  [<c1096084>] ? pick_next_task_fair+0x64/0x490
Oct  7 15:16:46 scaph kernel: [   96.656657]  [<c10c7b9a>] ? ktime_get+0x4a/0x120
Oct  7 15:16:46 scaph kernel: [   96.656661]  [<c150b333>] ? common_interrupt+0x33/0x38
Oct  7 15:16:46 scaph kernel: [   96.656664]  [<c13edcaf>] ? cpuidle_enter_state+0x13f/0x2e0
Oct  7 15:16:46 scaph kernel: [   96.656667]  [<c109c39a>] ? cpu_startup_entry+0x23a/0x2f0
Oct  7 15:16:46 scaph kernel: [   96.656669]  [<c171db05>] ? start_kernel+0x3b3/0x3ba
Oct  7 15:16:46 scaph kernel: [   96.656670] ---[ end trace 7dbf5e0bc21ce091 ]---
Oct  7 15:16:48 scaph kernel: [   99.124075] should not be here with counts=0
Oct  7 15:16:49 scaph kernel: [   99.278993] usb 3-1.2: USB disconnect, device number 9
Oct  7 15:16:49 scaph pulseaudio[1492]: [alsa-sink-US-X2Y Audio] alsa-util.c: Got POLLNVAL from ALSA
Oct  7 15:16:49 scaph pulseaudio[1492]: [alsa-source-US-X2Y Audio] alsa-util.c: Got POLLNVAL from ALSA
Oct  7 15:16:49 scaph pulseaudio[1492]: [alsa-sink-US-X2Y Audio] alsa-util.c: Could not recover from POLLERR|POLLNVAL|POLLHUP with snd_pcm_prepare(): No such device
Oct  7 15:16:49 scaph pulseaudio[1492]: [alsa-source-US-X2Y Audio] alsa-util.c: Could not recover from POLLERR|POLLNVAL|POLLHUP with snd_pcm_prepare(): No such device

.....

and then a few minutes later, this happened, and my whole system froze
solid, requiring a hard reset:


Oct  7 15:20:01 scaph kernel: [  292.005150] BUG: unable to handle kernel paging request at 000b0000
Oct  7 15:20:01 scaph kernel: [  292.005236] IP: [<c114a6b9>] put_page+0x9/0x40
Oct  7 15:20:01 scaph kernel: [  292.005293] *pdpt = 00000000301e5001 *pde = 0000000000000000 
Oct  7 15:20:01 scaph kernel: [  292.005360] Oops: 0000 [#1] SMP 
Oct  7 15:20:01 scaph kernel: [  292.005402] Modules linked in: snd_seq_midi snd_seq_midi_event snd_usb_usx2y snd_usbmidi_lib snd_rawmidi sha256_generic hmac drbg ansi_cprng ctr ccm binfmt_misc
 snd_hrtimer snd_seq snd_seq_device bnep joydev nfsd auth_rpcgss oid_registry nfs_acl nfs lockd grace fscache sunrpc snd_hda_codec_hdmi iTCO_wdt snd_hda_codec_realtek iTCO_vendor_support snd_hd
a_codec_generic intel_rapl iosf_mbi x86_pkg_temp_thermal intel_powerclamp coretemp kvm arc4 crc32_pclmul aesni_intel aes_i586 xts lrw gf128mul ablk_helper cryptd iwldvm evdev psmouse serio_raw 
mac80211 i2c_i801 uvcvideo videobuf2_vmalloc videobuf2_memops iwlwifi videobuf2_core btusb v4l2_common btrtl btbcm btintel bluetooth videodev snd_hda_intel cfg80211 snd_hda_codec snd_hda_core m
edia snd_hwdep snd_pcm lpc_ich sg mfd_core snd_timer shpchp i915 thinkpad_acpi wmi nvram snd soundcore tpm_tis rfkill battery drm_kms_helper ac tpm drm i2c_algo_bit video button processor loop 
parport_pc ppdev lp parport autofs4 ext4 crc16 mbcache jbd2 sd_mod crc32c_intel ahci libahci libata scsi_mod sdhci_pci sdhci mmc_core ehci_pci ehci_hcd xhci_pci e1000e xhci_hcd ptp pps_core usb
core usb_common thermal
Oct  7 15:20:01 scaph kernel: [  292.006778] CPU: 0 PID: 1196 Comm: Xorg Tainted: G        W       4.3.0-rc4+ #3
Oct  7 15:20:01 scaph kernel: [  292.006853] Hardware name: LENOVO 23252UF/23252UF, BIOS G2ET85WW (2.05 ) 10/22/2012
Oct  7 15:20:01 scaph kernel: [  292.006931] task: eec0f440 ti: f0274000 task.ti: f0274000
Oct  7 15:20:01 scaph kernel: [  292.006988] EIP: 0060:[<c114a6b9>] EFLAGS: 00013202 CPU: 0
Oct  7 15:20:01 scaph kernel: [  292.007045] EIP is at put_page+0x9/0x40
Oct  7 15:20:01 scaph kernel: [  292.007085] EAX: 000b0000 EBX: eefc2080 ECX: 00000000 EDX: 03ac8800
Oct  7 15:20:01 scaph kernel: [  292.007148] ESI: 000b0000 EDI: f8c1b028 EBP: f0275da4 ESP: f0275da0
Oct  7 15:20:01 scaph kernel: [  292.007210]  DS: 007b ES: 007b FS: 00d8 GS: 00e0 SS: 0068
Oct  7 15:20:01 scaph kernel: [  292.007265] CR0: 80050033 CR2: 000b0000 CR3: 30144140 CR4: 001406f0
Oct  7 15:20:01 scaph kernel: [  292.007328] Stack:
Oct  7 15:20:01 scaph kernel: [  292.007351]  eefc2080 f0275dd0 f8b9c690 00000000 c12b0088 e8ca7c40 f68b4300 00000000
Oct  7 15:20:01 scaph kernel: [  292.007453]  00000004 00000001 00000000 eefc2080 f0275de4 f8b9a6ed eefc2080 eefc2084
Oct  7 15:20:01 scaph kernel: [  292.007554]  eefcd240 f0275e10 f8b9d77a f57bc98c 00000002 00000000 f0275e38 f6a80000
Oct  7 15:20:01 scaph kernel: [  292.007654] Call Trace:
Oct  7 15:20:01 scaph kernel: [  292.007704]  [<f8b9c690>] ? i915_gem_object_put_pages_gtt+0x90/0x180 [i915]
Oct  7 15:20:01 scaph kernel: [  292.007776]  [<c12b0088>] ? list_del+0x8/0x20
Oct  7 15:20:01 scaph kernel: [  292.007838]  [<f8b9a6ed>] ? i915_gem_object_put_pages+0x6d/0xd0 [i915]
Oct  7 15:20:01 scaph kernel: [  292.007919]  [<f8b9d77a>] ? i915_gem_free_object+0x12a/0x2e0 [i915]
Oct  7 15:20:01 scaph kernel: [  292.007989]  [<f88d8c95>] ? drm_gem_object_free+0x25/0x50 [drm]
Oct  7 15:20:01 scaph kernel: [  292.008054]  [<f88d91c7>] ? drm_gem_object_handle_unreference_unlocked+0xe7/0x100 [drm]
Oct  7 15:20:01 scaph kernel: [  292.008137]  [<f88d926c>] ? drm_gem_handle_delete+0x8c/0xd0 [drm]
Oct  7 15:20:01 scaph kernel: [  292.008203]  [<f88d97f0>] ? drm_gem_handle_create+0x30/0x30 [drm]
Oct  7 15:20:01 scaph kernel: [  292.011383]  [<f88da0b3>] ? drm_ioctl+0x123/0x4d0 [drm]
Oct  7 15:20:01 scaph kernel: [  292.014574]  [<f88d97f0>] ? drm_gem_handle_create+0x30/0x30 [drm]
Oct  7 15:20:01 scaph kernel: [  292.017689]  [<c11420c5>] ? free_pages_prepare+0x1a5/0x2e0
Oct  7 15:20:01 scaph kernel: [  292.020777]  [<c1164689>] ? tlb_finish_mmu+0x29/0x40
Oct  7 15:20:01 scaph kernel: [  292.023860]  [<c116a727>] ? unmap_region+0x97/0xd0
Oct  7 15:20:01 scaph kernel: [  292.026934]  [<f88d9f90>] ? drm_getmap+0xc0/0xc0 [drm]
Oct  7 15:20:01 scaph kernel: [  292.029991]  [<c11aaa92>] ? do_vfs_ioctl+0x2e2/0x500
Oct  7 15:20:01 scaph kernel: [  292.033027]  [<c116a79e>] ? remove_vma+0x3e/0x50
Oct  7 15:20:01 scaph kernel: [  292.036037]  [<c116cacd>] ? do_munmap+0x23d/0x360
Oct  7 15:20:01 scaph kernel: [  292.039110]  [<c11aad18>] ? SyS_ioctl+0x68/0x80
Oct  7 15:20:01 scaph kernel: [  292.039134]  [<c150ab17>] ? sysenter_do_call+0x12/0x12
Oct  7 15:20:01 scaph kernel: [  292.039173] Code: 09 74 cc eb dd 89 f0 e8 46 f8 ff ff 31 d2 89 f0 e8 3d 86 ff ff eb cb 8d 74 26 00 8d bc 27 00 00 00 00 55 89 e5 53 3e 8d 74 26 00 <f7> 00 00 c0
 00 00 75 27 f0 ff 48 10 74 09 5b 5d c3 8d b6 00 00
Oct  7 15:20:01 scaph kernel: [  292.039178] EIP: [<c114a6b9>] put_page+0x9/0x40 SS:ESP 0068:f0275da0
Oct  7 15:20:01 scaph kernel: [  292.039180] CR2: 00000000000b0000
Oct  7 15:20:01 scaph kernel: [  292.062151] ---[ end trace 7dbf5e0bc21ce092 ]---

-- 
You received this bug notification because you are a member of Kernel
Packages, which is subscribed to linux in Ubuntu.
https://bugs.launchpad.net/bugs/1177394

Title:
  USB  sequence errors in snd_usb_usx2y

Status in linux package in Ubuntu:
  Incomplete

Bug description:
  Using kernel 3.8.0.19.35, when I plug in my Tascam us-122 usb audio
  device, the log fills up with many of the following messages as soon
  as the firmware is loaded:

  May  5 18:40:31 scaph kernel: [64138.774214] Sequence Error!(hcd_frame=391894 ep=10out;wait=391892,frame=391890).
  May  5 18:40:31 scaph kernel: [64138.774214] Most probably some urb of usb-frame 391892 is still missing.
  May  5 18:40:31 scaph kernel: [64138.774214] Cause could be too long delays in usb-hcd interrupt handling.

  The device seems to initialize properly, but any attempt to actually
  use it (starting jackd for example) results in a few more of those
  messages in the log, and the program fails to connect to the device.

  This is very similar to a bug that cropped up several years ago -
  here's a thread I made on the alsa-user list back in 2006 (!) about
  that one: http://www.mail-archive.com/alsa-
  user@xxxxxxxxxxxxxxxxxxxxx/msg18003.html That bug was fixed in  2.6.18
  so I don't know if it might be actually related or not.

  In any case, I've temporarily solved the issue by downgrading to
  quantal's kernel, 3.5.0-28, which doesn't have the bug.

  ProblemType: Bug
  DistroRelease: Ubuntu 13.04
  Package: linux-image-generic 3.8.0.19.35
  ProcVersionSignature: Ubuntu 3.5.0-28.48-generic 3.5.7.9
  Uname: Linux 3.5.0-28-generic i686
  ApportVersion: 2.9.2-0ubuntu8
  Architecture: i386
  AudioDevicesInUse:
   USER        PID ACCESS COMMAND
   /dev/snd/controlC0:  jono       1741 F.... pulseaudio
  Date: Tue May  7 09:31:02 2013
  HibernationDevice: RESUME=UUID=21e8f32e-d542-4900-ac9c-2ade76ed3084
  Lsusb:
   Bus 001 Device 001: ID 1d6b:0002 Linux Foundation 2.0 root hub
   Bus 002 Device 001: ID 1d6b:0001 Linux Foundation 1.1 root hub
   Bus 003 Device 001: ID 1d6b:0001 Linux Foundation 1.1 root hub
   Bus 004 Device 001: ID 1d6b:0001 Linux Foundation 1.1 root hub
   Bus 005 Device 001: ID 1d6b:0001 Linux Foundation 1.1 root hub
  MachineType: LENOVO 170237U
  MarkForUpload: True
  PccardctlIdent:
   Socket 0:
     no product info available
  PccardctlStatus:
   Socket 0:
     no card
  ProcFB: 0 inteldrmfb
  ProcKernelCmdLine: BOOT_IMAGE=/boot/vmlinuz-3.5.0-28-generic root=UUID=860958bf-acf0-48eb-abb6-acd3022e5a9c ro quiet splash
  RelatedPackageVersions:
   linux-restricted-modules-3.5.0-28-generic N/A
   linux-backports-modules-3.5.0-28-generic  N/A
   linux-firmware                            1.106
  RfKill:
   0: phy0: Wireless LAN
   	Soft blocked: no
   	Hard blocked: no
  SourcePackage: linux
  UpgradeStatus: Upgraded to raring on 2013-04-13 (23 days ago)
  WifiSyslog:
   
  WpaSupplicantLog:
   
  dmi.bios.date: 03/31/2011
  dmi.bios.vendor: LENOVO
  dmi.bios.version: 7BETD8WW (2.19 )
  dmi.board.name: 170237U
  dmi.board.vendor: LENOVO
  dmi.board.version: Not Available
  dmi.chassis.asset.tag: No Asset Information
  dmi.chassis.type: 10
  dmi.chassis.vendor: LENOVO
  dmi.chassis.version: Not Available
  dmi.modalias: dmi:bvnLENOVO:bvr7BETD8WW(2.19):bd03/31/2011:svnLENOVO:pn170237U:pvrThinkPadX60s:rvnLENOVO:rn170237U:rvrNotAvailable:cvnLENOVO:ct10:cvrNotAvailable:
  dmi.product.name: 170237U
  dmi.product.version: ThinkPad X60s
  dmi.sys.vendor: LENOVO

To manage notifications about this bug go to:
https://bugs.launchpad.net/ubuntu/+source/linux/+bug/1177394/+subscriptions