Skip site navigation (1)Skip section navigation (2)
Date:      Thu, 21 Apr 2016 20:39:29 +0000
From:      bugzilla-noreply@freebsd.org
To:        freebsd-amd64@FreeBSD.org
Subject:   [Bug 208959] UHCI interrupt storm with "uhci_interrupt: uhci_interrupt: host controller halted"
Message-ID:  <bug-208959-6-pfohDMk9Qg@https.bugs.freebsd.org/bugzilla/>
In-Reply-To: <bug-208959-6@https.bugs.freebsd.org/bugzilla/>
References:  <bug-208959-6@https.bugs.freebsd.org/bugzilla/>

next in thread | previous in thread | raw e-mail | index | archive | help
https://bugs.freebsd.org/bugzilla/show_bug.cgi?id=3D208959

--- Comment #2 from Jamie Ivanov <jamie.ivanov@gmail.com> ---
I didn't let this run very long but this is what I kicked-up:

$ sudo sysctl hw.usb.uhci.debug=3D16; tail -f /var/log/messages
hw.usb.uhci.debug: 0 -> 16
Apr 21 20:28:12 irony kernel: uhci_interrupt: real interrupt
Apr 21 20:28:12 irony kernel: uhci_dumpregs: usbus2 regs: cmd=3D0080, sts=
=3D0020,
intr=3D000f, frnum=3D01b6, flbase=3D07a4e6d8, sof=3D0040, portsc1=3D0080, p=
ortsc2=3D0080
Apr 21 20:28:12 irony kernel: uhci_interrupt: uhci_interrupt: host controll=
er
halted
Apr 21 20:28:12 irony kernel: uhci_dumpregs: usbus2 regs: cmd=3D0080, sts=
=3D0020,
intr=3D000f, frnum=3D01b6, flbase=3D07a4e6d8, sof=3D0040, portsc1=3D0080, p=
ortsc2=3D0080
Apr 21 20:28:12 irony kernel: uhci_dump_qh: QH(0xfffffe046844f000) at
0x07a4f002: h_next=3D0x07a50002 e_next=3D0x00000001
Apr 21 20:28:12 irony kernel: uhci_dump_qh: QH(0xfffffe0468450000) at
0x07a50002: h_next=3D0x07a51002 e_next=3D0x00000001
Apr 21 20:28:12 irony kernel: uhci_dump_qh: QH(0xfffffe0468451000) at
0x07a51002: h_next=3D0x07a52002 e_next=3D0x00000001
Apr 21 20:28:12 irony kernel: uhci_dump_qh: QH(0xfffffe0468452000) at
0x07a52002: h_next=3D0x00000001 e_next=3D0x07a53000
# ^^^ spamming
...
Apr 21 20:28:12 irony kernel: uhci_interrupt: real interrupt
Apr 21 20:28:12 irony kernel: uhci_dumpregs: usbus2 regs: cmd=3D0080, sts=
=3D0020,
intr=3D000f, frnum=3D01b6, flbase=3D07a4e6d8, sof=3D0040, portsc1=3D0080, p=
ortsc2=3D0080
Apr 21 20:28:12 irony kernel: uhci_interrupt: uhci_interrupt: host controll=
er
halted
Apr 21 20:28:12 irony kernel: uhci_dumpregs: usbus2 regs: cmd=3D0080, sts=
=3D0020,
intr=3D000f, frnum=3D01b6, flbase=3D07a4e6d8, sof=3D0040, portsc1=3D0080, p=
ortsc2=3D0080
Apr 21 20:28:12 irony kernel: uhci_dump_qh: QH(0xfffffe046844f000) at
0x07a4f002: h_next=3D0x07a50002 e_next=3D0x00000001
Apr 21 20:28:12 irony kernel: uhci_dump_qh: QH(0xfffffe0468450000) at
0x07a50002: h_next=3D0x07a51002 e_next=3D0x00000001
Apr 21 20:28:12 irony kernel: uhci_dump_qh: QH(0xfffffe0468451000) at
0x07a51002: h_next=3D0x07a52002 e_next=3D0x00000001
Apr 21 20:28:12 irony kernel: uhci_dump_qh: QH(0xfffffe0468452000) at
0x07a52002: h_next=3D0x00000001 e_next=3D0x07a53000
Apr 21 20:28:12 irony kernel: uhci_interrupt: real interrupt
Apr 21 20:28:12 irony kernel: uhci_set_hw_power:=20
Apr 21 20:28:12 irony kernel: uhci_set_hw_power:=20
Apr 21 20:28:12 irony kernel: uhci_dumpregs: usbus2 regs: cmd=3D0080, sts=
=3D0020,
intr=3D000f, frnum=3D01b6, flbase=3D07a4e6d8, sof=3D0040, portsc1=3D0080, p=
ortsc2=3D0080
Apr 21 20:28:12 irony kernel: uhci_set_hw_power: Some USB transfer is activ=
e on
unit 0.
Apr 21 20:28:12 irony kernel: uhci_interrupt: uhci_interrupt: host controll=
er
halted
Apr 21 20:28:12 irony kernel: uhci_restart: Already started
Apr 21 20:28:12 irony kernel: uhci_dumpregs: usbus2 regs: cmd=3D0080, sts=
=3D0020,
intr=3D000f, frnum=3D01b6, flbase=3D07a4e6d8, sof=3D0040, portsc1=3D0080, p=
ortsc2=3D0080
Apr 21 20:28:12 irony kernel: uhci_roothub_exec: type=3D0xa3 request=3D0x00
wLen=3D0x0004 wValue=3D0x0000 wIndex=3D0x0001
Apr 21 20:28:12 irony kernel: uhci_dump_qh: QH(0xfffffe046844f000) at
0x07a4f002: h_next=3D0x07a50002 e_next=3D0x00000001
Apr 21 20:28:12 irony kernel: uhci_roothub_exec: type=3D0xa3 request=3D0x00
wLen=3D0x0004 wValue=3D0x0000 wIndex=3D0x0002
Apr 21 20:28:12 irony kernel: uhci_dump_qh: QH(0xfffffe0468450000) at
0x07a50002: h_next=3D0x07a51002 e_next=3D0x00000001
Apr 21 20:28:12 irony kernel: uhci_dump_qh: QH(0xfffffe0468451000) at
0x07a51002: h_next=3D0x07a52002 e_next=3D0x00000001
Apr 21 20:28:12 irony kernel: uhci_set_hw_power: Power save on unit 1.
Apr 21 20:28:12 irony kernel: uhci_dump_qh: QH(0xfffffe0468452000) at
0x07a52002: h_next=3D0x00000001 e_next=3D0x07a53000
Apr 21 20:28:12 irony kernel: uhci_roothub_exec: type=3D0xa3 request=3D0x00
wLen=3D0x0004 wValue=3D0x0000 wIndex=3D0x0001
Apr 21 20:28:12 irony kernel: uhci_interrupt: real interrupt
Apr 21 20:28:12 irony kernel: uhci_set_hw_power:=20
Apr 21 20:28:12 irony kernel: uhci_roothub_exec: type=3D0xa3 request=3D0x00
wLen=3D0x0004 wValue=3D0x0000 wIndex=3D0x0002
Apr 21 20:28:12 irony kernel: uhci_dumpregs: usbus2 regs: cmd=3D0080, sts=
=3D0020,
intr=3D000f, frnum=3D01b6, flbase=3D07a4e6d8, sof=3D0040, portsc1=3D0080, p=
ortsc2=3D0080
Apr 21 20:28:12 irony kernel: uhci_interrupt: uhci_interrupt: host controll=
er
halted
Apr 21 20:28:12 irony kernel: uhci_dumpregs: usbus2 regs: cmd=3D0080, sts=
=3D0020,
intr=3D000f, frnum=3D01b6, flbase=3D07a4e6d8, sof=3D0040, portsc1=3D0080, p=
ortsc2=3D0080
Apr 21 20:28:12 irony kernel: uhci_dump_qh: QH(0xfffffe046844f000) at
0x07a4f002: h_next=3D0x07a50002 e_next=3D0x00000001
Apr 21 20:28:12 irony kernel: uhci_dump_qh: QH(0xfffffe0468450000) at
0x07a50002: h_next=3D0x07a51002 e_next=3D0x00000001
Apr 21 20:28:12 irony kernel: uhci_dump_qh: QH(0xfffffe0468451000) at
0x07a51002: h_next=3D0x07a52002 e_next=3D0x00000001
Apr 21 20:28:12 irony kernel: uhci_dump_qh: QH(0xfffffe0468452000) at
0x07a52002: h_next=3D0x00000001 e_next=3D0x07a53000
Apr 21 20:28:12 irony kernel: uhci_set_hw_power: Power save on unit 2.
Apr 21 20:28:12 irony kernel: uhci_interrupt: real interrupt
Apr 21 20:28:12 irony kernel: uhci_dumpregs: usbus2 regs: cmd=3D0080, sts=
=3D0020,
intr=3D000f, frnum=3D01b6, flbase=3D07a4e6d8, sof=3D0040, portsc1=3D0080, p=
ortsc2=3D0080
Apr 21 20:28:12 irony kernel: uhci_interrupt: uhci_interrupt: host controll=
er
halted
Apr 21 20:28:12 irony kernel: uhci_dumpregs: usbus2 regs: cmd=3D0080, sts=
=3D0020,
intr=3D000f, frnum=3D01b6, flbase=3D07a4e6d8, sof=3D0040, portsc1=3D0080, p=
ortsc2=3D0080
Apr 21 20:28:12 irony kernel: uhci_dump_qh: QH(0xfffffe046844f000) at
0x07a4f002: h_next=3D0x07a50002 e_next=3D0x00000001
Apr 21 20:28:12 irony kernel: uhci_dump_qh: QH(0xfffffe0468450000) at
0x07a50002: h_next=3D0x07a51002 e_next=3D0x00000001
Apr 21 20:28:12 irony kernel: uhci_dump_qh: QH(0xfffffe0468451000) at
0x07a51002: h_next=3D0x07a52002 e_next=3D0x00000001
Apr 21 20:28:12 irony kernel: uhci_dump_qh: QH(0xfffffe0468452000) at
0x07a52002: h_next=3D0x00000001 e_next=3D0x07a53000
Apr 21 20:28:12 irony kernel: uhci_roothub_exec: type=3D0xa3 request=3D0x00
wLen=3D0x0004 wValue=3D0x0000 wIndex=3D0x0001
# ^^^ spamming again
$ sudo sysctl hw.usb.uhci.debug=3D0
hw.usb.uhci.debug: 16 -> 0

I plan on letting this run longer and parsing unique messages out of it to =
see
if there is anything that's more than meets the eye.

-JI

--=20
You are receiving this mail because:
You are on the CC list for the bug.=



Want to link to this message? Use this URL: <https://mail-archive.FreeBSD.org/cgi/mid.cgi?bug-208959-6-pfohDMk9Qg>