Bug 5942

Summary: serial driver gives up and we get IRQ3 nobody cared
Product: Drivers Reporter: Stuart Rowan (kernel-bugs)
Component: SerialAssignee: Russell King (rmk)
Status: REJECTED INSUFFICIENT_DATA    
Severity: normal CC: bunk
Priority: P2    
Hardware: i386   
OS: Linux   
Kernel Version: 2.6.14.5 Subsystem:
Regression: --- Bisected commit-id:
Attachments: lspci -vv without wrapping

Description Stuart Rowan 2006-01-23 04:24:39 UTC
Hey,

So this is the dmesg output below, it persistently does this after a few days
uptime.

[17179569.184000] Linux version 2.6.14.5 (stuart@strr) (gcc version 4.0.3
20051201 (prerelease) (Debian 4.0.2-5)) #1 SMP PREEMPT Mon Jan 2 14:22:00 GMT 2006
[17179569.184000] BIOS-provided physical RAM map:
[17179569.184000]  BIOS-e820: 0000000000000000 - 000000000009e800 (usable)
[17179569.184000]  BIOS-e820: 000000000009e800 - 00000000000a0000 (reserved)
[17179569.184000]  BIOS-e820: 00000000000d2000 - 0000000000100000 (reserved)
[17179569.184000]  BIOS-e820: 0000000000100000 - 000000001fef0000 (usable)
[17179569.184000]  BIOS-e820: 000000001fef0000 - 000000001feff000 (ACPI data)
[17179569.184000]  BIOS-e820: 000000001feff000 - 000000001ff00000 (ACPI NVS)
[17179569.184000]  BIOS-e820: 000000001ff00000 - 000000001ff80000 (usable)
[17179569.184000]  BIOS-e820: 000000001ff80000 - 0000000020000000 (reserved)
........
[17610000.352000] irq 3: nobody cared (try booting with the "irqpoll" option)
[17610000.352000]  [<c0146bfa>] __report_bad_irq+0x2a/0x90
[17610000.352000]  [<c014644d>] handle_IRQ_event+0x3d/0x70
[17610000.352000]  [<c0146d07>] note_interrupt+0x87/0xe0
[17610000.352000]  [<c0146578>] __do_IRQ+0xf8/0x110
[17610000.352000]  [<c0105903>] do_IRQ+0x23/0x40
[17610000.352000]  [<c0103f96>] common_interrupt+0x1a/0x20
[17610000.352000]  [<c0302470>] _spin_lock_irqsave+0x0/0x90
[17610000.352000]  [<c01468fe>] free_irq+0x4e/0x110
[17610000.352000]  [<e08f8a8c>] serial_unlink_irq_chain+0x5c/0x80 [8250]
[17610000.352000]  [<e08de2f3>] uart_shutdown+0x63/0xf0 [serial_core]
[17610000.352000]  [<e08df9a9>] uart_close+0xc9/0x200 [serial_core]
[17610000.352000]  [<c0225ef3>] release_dev+0x163/0x770
[17610000.352000]  [<c030286f>] _spin_unlock_irqrestore+0xf/0x30
[17610000.352000]  [<c02242bc>] tty_ldisc_deref+0x4c/0x80
[17610000.352000]  [<c030286f>] _spin_unlock_irqrestore+0xf/0x30
[17610000.352000]  [<c022757b>] tty_ioctl+0x1fb/0x5b0
[17610000.352000]  [<c03023f6>] _spin_lock+0x16/0x90
[17610000.352000]  [<c0194d62>] inotify_dentry_parent_queue_event+0x52/0xe0
[17610000.352000]  [<c02269f4>] tty_release+0x14/0x20
[17610000.352000]  [<c016a55d>] __fput+0xad/0x1d0
[17610000.352000]  [<c01688f2>] filp_close+0x52/0x90
[17610000.352000]  [<c01689a2>] sys_close+0x72/0xb0
[17610000.352000]  [<c01034f7>] sysenter_past_esp+0x54/0x75
[17610000.352000] handlers:
[17610000.352000] [<e08f87b0>] (serial8250_interrupt+0x0/0x110 [8250])
[17610000.352000] Disabling IRQ #3

cat /proc/interrupts:
           CPU0       CPU1
  0:   55790093   56559985    IO-APIC-edge  timer
  1:     156588     157696    IO-APIC-edge  i8042
  3:      65572      68882    IO-APIC-edge  serial
  7:          0          0    IO-APIC-edge  parport0
  8:          1          3    IO-APIC-edge  rtc
  9:          0          1   IO-APIC-level  acpi
 12:    2545298    2561937    IO-APIC-edge  i8042
 14:    2226493    2234597    IO-APIC-edge  ide0
 15:    3936966    3981457    IO-APIC-edge  ide1
169:    2060456    2073215   IO-APIC-level  ide2
177:   10596131   10540917   IO-APIC-level  ohci_hcd:usb1, eth0
185:     460768     470055   IO-APIC-level  ohci1394, nvidia
193:     431581     420648   IO-APIC-level  EMU10K1
NMI:          0          0
LOC:  112454863  112459349
ERR:         18
MIS:          0

lspci:
0000:00:00.0 Host bridge: Advanced Micro Devices [AMD] AMD-760 MP [IGD4-2P]
System Controller (rev 11)
0000:00:01.0 PCI bridge: Advanced Micro Devices [AMD] AMD-760 MP [IGD4-2P] AGP
Bridge
0000:00:07.0 ISA bridge: Advanced Micro Devices [AMD] AMD-768 [Opus] ISA (rev 05)
0000:00:07.1 IDE interface: Advanced Micro Devices [AMD] AMD-768 [Opus] IDE (rev 04)
0000:00:07.3 Bridge: Advanced Micro Devices [AMD] AMD-768 [Opus] ACPI (rev 03)
0000:00:09.0 Mass storage controller: Promise Technology, Inc. 20269 (rev 02)
0000:00:10.0 PCI bridge: Advanced Micro Devices [AMD] AMD-768 [Opus] PCI (rev 05)
0000:01:05.0 VGA compatible controller: nVidia Corporation NV43 [GeForce
6600/GeForce 6600 GT] (rev a2)
0000:02:00.0 USB Controller: Advanced Micro Devices [AMD] AMD-768 [Opus] USB
(rev 07)
0000:02:05.0 Multimedia audio controller: Creative Labs SB Audigy (rev 03)
0000:02:05.1 Input device controller: Creative Labs SB Audigy MIDI/Game port
(rev 03)
0000:02:05.2 FireWire (IEEE 1394): Creative Labs SB Audigy FireWire Port
0000:02:08.0 Ethernet controller: 3Com Corporation 3c905C-TX/TX-M [Tornado] (rev 78)
Comment 1 Russell King 2006-01-23 15:00:41 UTC
Please provide the full output of lspci -vv
Comment 2 Stuart Rowan 2006-01-23 23:25:37 UTC
0000:00:00.0 Host bridge: Advanced Micro Devices [AMD] AMD-760 MP [IGD4-2P]
System Controller (rev 11)
        Control: I/O- Mem+ BusMaster+ SpecCycle- MemWINV- VGASnoop- ParErr-
Stepping- SERR- FastB2B-
        Status: Cap+ 66MHz+ UDF- FastB2B- ParErr- DEVSEL=medium >TAbort-
<TAbort- <MAbort+ >SERR- <PERR-
        Latency: 32
        Region 0: Memory at d0000000 (32-bit, prefetchable) [size=256M]
        Region 1: Memory at c3100000 (32-bit, prefetchable) [size=4K]
        Region 2: I/O ports at 1020 [disabled] [size=4]
        Capabilities: [a0] AGP version 2.0
                Status: RQ=16 Iso- ArqSz=0 Cal=0 SBA+ ITACoh- GART64- HTrans-
64bit- FW+ AGP3- Rate=x1,x2,x4
                Command: RQ=1 ArqSz=0 Cal=0 SBA+ AGP+ GART64- 64bit- FW+ Rate=x4

0000:00:01.0 PCI bridge: Advanced Micro Devices [AMD] AMD-760 MP [IGD4-2P] AGP
Bridge (prog-if 00 [Normal decode])
        Control: I/O+ Mem+ BusMaster+ SpecCycle- MemWINV- VGASnoop- ParErr-
Stepping- SERR- FastB2B-
        Status: Cap- 66MHz+ UDF- FastB2B- ParErr- DEVSEL=medium >TAbort-
<TAbort- <MAbort- >SERR- <PERR-
        Latency: 99
        Bus: primary=00, secondary=01, subordinate=01, sec-latency=64
        Memory behind bridge: c1000000-c2ffffff
        Prefetchable memory behind bridge: e0000000-efffffff
        BridgeCtl: Parity- SERR- NoISA+ VGA+ MAbort- >Reset- FastB2B-

0000:00:07.0 ISA bridge: Advanced Micro Devices [AMD] AMD-768 [Opus] ISA (rev 05)
        Control: I/O+ Mem+ BusMaster+ SpecCycle+ MemWINV- VGASnoop- ParErr-
Stepping- SERR- FastB2B-
        Status: Cap- 66MHz+ UDF- FastB2B- ParErr- DEVSEL=medium >TAbort-
<TAbort- <MAbort- >SERR- <PERR-
        Latency: 0

0000:00:07.1 IDE interface: Advanced Micro Devices [AMD] AMD-768 [Opus] IDE (rev
04) (prog-if 8a [Master SecP PriP])
        Subsystem: Advanced Micro Devices [AMD] AMD-768 [Opus] IDE
        Control: I/O+ Mem- BusMaster+ SpecCycle- MemWINV- VGASnoop- ParErr-
Stepping- SERR- FastB2B-
        Status: Cap- 66MHz- UDF- FastB2B- ParErr- DEVSEL=medium >TAbort-
<TAbort- <MAbort- >SERR- <PERR-
        Latency: 0
        Region 4: I/O ports at f000 [size=16]

0000:00:07.3 Bridge: Advanced Micro Devices [AMD] AMD-768 [Opus] ACPI (rev 03)
        Subsystem: Advanced Micro Devices [AMD] AMD-768 [Opus] ACPI
        Control: I/O- Mem- BusMaster- SpecCycle- MemWINV- VGASnoop- ParErr-
Stepping- SERR- FastB2B-
        Status: Cap- 66MHz- UDF- FastB2B+ ParErr- DEVSEL=medium >TAbort-
<TAbort- <MAbort- >SERR- <PERR-

0000:00:09.0 Mass storage controller: Promise Technology, Inc. 20269 (rev 02)
(prog-if 85)
        Subsystem: Promise Technology, Inc. Ultra133TX2
        Control: I/O+ Mem+ BusMaster+ SpecCycle- MemWINV- VGASnoop- ParErr-
Stepping- SERR- FastB2B-
        Status: Cap+ 66MHz+ UDF- FastB2B- ParErr- DEVSEL=slow >TAbort- <TAbort-
<MAbort- >SERR- <PERR-
        Latency: 64 (1000ns min, 4500ns max), Cache Line Size: 0x10 (64 bytes)
        Interrupt: pin A routed to IRQ 169
        Region 0: I/O ports at 1038 [size=8]
        Region 1: I/O ports at 1030 [size=4]
        Region 2: I/O ports at 1028 [size=8]
        Region 3: I/O ports at 1024 [size=4]
        Region 4: I/O ports at 1010 [size=16]
        Region 5: Memory at c0000000 (32-bit, non-prefetchable) [size=16K]
        Expansion ROM at 30100000 [disabled] [size=16K]
        Capabilities: [60] Power Management version 1
                Flags: PMEClk- DSI+ D1+ D2- AuxCurrent=0mA
PME(D0-,D1-,D2-,D3hot-,D3cold-)
                Status: D0 PME-Enable- DSel=0 DScale=0 PME-

0000:00:10.0 PCI bridge: Advanced Micro Devices [AMD] AMD-768 [Opus] PCI (rev
05) (prog-if 00 [Normal decode])
        Control: I/O+ Mem+ BusMaster+ SpecCycle- MemWINV+ VGASnoop- ParErr-
Stepping- SERR- FastB2B-
        Status: Cap- 66MHz+ UDF- FastB2B- ParErr- DEVSEL=medium >TAbort-
<TAbort- <MAbort+ >SERR- <PERR-
        Latency: 64
        Bus: primary=00, secondary=02, subordinate=02, sec-latency=168
        I/O behind bridge: 00002000-00002fff
        Memory behind bridge: c3000000-c30fffff
        Prefetchable memory behind bridge: 30000000-300fffff
        BridgeCtl: Parity- SERR- NoISA+ VGA- MAbort- >Reset- FastB2B-

0000:01:05.0 VGA compatible controller: nVidia Corporation NV43 [GeForce
6600/GeForce 6600 GT] (rev a2) (prog-if 00 [VGA])
        Subsystem: XFX Pine Group Inc. GeForce 6600 256MB DDR DUAL DVI TV
        Control: I/O+ Mem+ BusMaster+ SpecCycle- MemWINV- VGASnoop- ParErr-
Stepping- SERR- FastB2B-
        Status: Cap+ 66MHz+ UDF- FastB2B+ ParErr- DEVSEL=medium >TAbort-
<TAbort- <MAbort- >SERR- <PERR-
        Latency: 248 (1250ns min, 250ns max)
        Interrupt: pin A routed to IRQ 185
        Region 0: Memory at c2000000 (32-bit, non-prefetchable) [size=16M]
        Region 1: Memory at e0000000 (32-bit, prefetchable) [size=256M]
        Region 2: Memory at c1000000 (32-bit, non-prefetchable) [size=16M]
        Capabilities: [60] Power Management version 2
                Flags: PMEClk- DSI- D1- D2- AuxCurrent=0mA
PME(D0-,D1-,D2-,D3hot-,D3cold-)
                Status: D0 PME-Enable- DSel=0 DScale=0 PME-
        Capabilities: [44] AGP version 3.0
                Status: RQ=32 Iso- ArqSz=0 Cal=0 SBA+ ITACoh- GART64- HTrans-
64bit- FW+ AGP3- Rate=x1,x2,x4
                Command: RQ=16 ArqSz=0 Cal=0 SBA+ AGP+ GART64- 64bit- FW+ Rate=x4

0000:02:00.0 USB Controller: Advanced Micro Devices [AMD] AMD-768 [Opus] USB
(rev 07) (prog-if 10 [OHCI])
        Subsystem: Advanced Micro Devices [AMD] AMD-768 [Opus] USB
        Control: I/O+ Mem+ BusMaster+ SpecCycle- MemWINV+ VGASnoop- ParErr-
Stepping- SERR- FastB2B-
        Status: Cap- 66MHz- UDF- FastB2B+ ParErr- DEVSEL=medium >TAbort-
<TAbort- <MAbort- >SERR- <PERR+
        Latency: 64 (20000ns max)
        Interrupt: pin D routed to IRQ 177
        Region 0: Memory at c3004000 (32-bit, non-prefetchable) [size=4K]

0000:02:05.0 Multimedia audio controller: Creative Labs SB Audigy (rev 03)
        Subsystem: Creative Labs SB0090 Audigy Player/OEM
        Control: I/O+ Mem- BusMaster+ SpecCycle- MemWINV- VGASnoop- ParErr-
Stepping- SERR- FastB2B-
        Status: Cap+ 66MHz- UDF- FastB2B+ ParErr- DEVSEL=medium >TAbort-
<TAbort- <MAbort- >SERR- <PERR-
        Latency: 64 (500ns min, 5000ns max)
        Interrupt: pin A routed to IRQ 193
        Region 0: I/O ports at 2080 [size=32]
        Capabilities: [dc] Power Management version 2
                Flags: PMEClk- DSI+ D1+ D2+ AuxCurrent=0mA
PME(D0-,D1-,D2-,D3hot-,D3cold-)
                Status: D0 PME-Enable- DSel=0 DScale=0 PME-

0000:02:05.1 Input device controller: Creative Labs SB Audigy MIDI/Game port
(rev 03)
        Subsystem: Creative Labs SB Audigy MIDI/Game Port
        Control: I/O+ Mem- BusMaster+ SpecCycle- MemWINV- VGASnoop- ParErr-
Stepping- SERR- FastB2B-
        Status: Cap+ 66MHz- UDF- FastB2B+ ParErr- DEVSEL=medium >TAbort-
<TAbort- <MAbort- >SERR- <PERR-
        Latency: 64
        Region 0: I/O ports at 20a0 [size=8]
        Capabilities: [dc] Power Management version 2
                Flags: PMEClk- DSI+ D1+ D2+ AuxCurrent=0mA
PME(D0-,D1-,D2-,D3hot-,D3cold-)
                Status: D0 PME-Enable- DSel=0 DScale=0 PME-

0000:02:05.2 FireWire (IEEE 1394): Creative Labs SB Audigy FireWire Port
(prog-if 10 [OHCI])
        Subsystem: Creative Labs SB Audigy FireWire Port
        Control: I/O- Mem+ BusMaster+ SpecCycle- MemWINV+ VGASnoop- ParErr-
Stepping- SERR- FastB2B-
        Status: Cap+ 66MHz- UDF- FastB2B- ParErr- DEVSEL=medium >TAbort-
<TAbort- <MAbort- >SERR- <PERR-
        Latency: 64 (500ns min, 1000ns max), Cache Line Size: 0x10 (64 bytes)
        Interrupt: pin B routed to IRQ 185
        Region 0: Memory at c3005000 (32-bit, non-prefetchable) [size=2K]
        Region 1: Memory at c3000000 (32-bit, non-prefetchable) [size=16K]
        Capabilities: [44] Power Management version 2
                Flags: PMEClk- DSI- D1+ D2+ AuxCurrent=0mA
PME(D0+,D1+,D2+,D3hot+,D3cold-)
                Status: D0 PME-Enable- DSel=0 DScale=0 PME+

0000:02:08.0 Ethernet controller: 3Com Corporation 3c905C-TX/TX-M [Tornado] (rev 78)
        Subsystem: Tyan Computer Tiger MPX S2466 (3C920 Integrated Fast Ethernet
Controller)
        Control: I/O+ Mem+ BusMaster+ SpecCycle- MemWINV+ VGASnoop- ParErr-
Stepping- SERR- FastB2B-
        Status: Cap+ 66MHz- UDF- FastB2B- ParErr- DEVSEL=medium >TAbort-
<TAbort- <MAbort- >SERR- <PERR-
        Latency: 80 (2500ns min, 2500ns max), Cache Line Size: 0x10 (64 bytes)
        Interrupt: pin A routed to IRQ 177
        Region 0: I/O ports at 2000 [size=128]
        Region 1: Memory at c3005800 (32-bit, non-prefetchable) [size=128]
        Expansion ROM at 30000000 [disabled] [size=128K]
        Capabilities: [dc] Power Management version 2
                Flags: PMEClk- DSI- D1+ D2+ AuxCurrent=0mA
PME(D0+,D1+,D2+,D3hot+,D3cold+)
                Status: D0 PME-Enable- DSel=0 DScale=2 PME-

Comment 3 Stuart Rowan 2006-01-23 23:27:40 UTC
Created attachment 7112 [details]
lspci -vv without wrapping

lspci -vv with no wrapping in case that's easier to read
Comment 4 Russell King 2006-04-22 12:53:25 UTC
Are you using serial console?  Would that be on the same port that is being
closed in this instance?
Comment 5 Adrian Bunk 2006-07-10 13:24:02 UTC
Please reopen this bug if:
- it is still present in kerne 2.6.17 and
- you can provide the requested information.
Comment 6 Stuart Rowan 2006-07-11 01:26:53 UTC
I'm not using serial console, I haven't seen the bug with recent kernels so mebe
as Adrian indicates the bug just got magically fixed.