Date: Tue, 31 Aug 2004 14:35:50 -0400 (EDT) From: "David E. Cross" <crossd@cs.rpi.edu> To: freebsd-stable@freebsd.org Subject: READ_DMA interrupt was seen but timeout fired LBA=#### Message-ID: <20040831142831.D22883@monica.cs.rpi.edu>
next in thread | raw e-mail | index | archive | help
I searched the mailing list an didn't see anything listed for August, so I thought I would write. Upon switching to 5.3-BETA2 I see these a LOT on my IBM TP T30. In fact BETA2 panics shortly after boot, and once in DDB I can't actually do anything ('panic' doesn't work, 'call boot(0)' doesn't work, eventually DDB itself just locks). Upgrading to RELENG_5 makes it a bit better, I still see oodles of those messages and WRITE_DMA messages also, but it doesn't panic. Eventually everything will lock behind "ufs" in a wait channel. Booting to single-user seems to make it better (I can run commands, etc and not get stuck in [ufs]). ACPI doesn't seem to make a difference. Also, the GENERIC on the CD loader doesn't seem to exhibit any of these problems. Below is a copy of my DMESG; ideas? Any additional information required? Aug 30 23:13:44 syslogd: kernel boot file is /boot/kernel/kernel Aug 30 23:13:44 kernel: Copyright (c) 1992-2004 The FreeBSD Project. Aug 30 23:13:44 kernel: Copyright (c) 1979, 1980, 1983, 1986, 1988, 1989, 1991, 1992, 1993, 1994 Aug 30 23:13:44 kernel: The Regents of the University of California. All rights reserved. Aug 30 23:13:44 kernel: FreeBSD 5.3-BETA2 #1: Sat Aug 28 21:29:15 UTC 2004 Aug 30 23:13:44 kernel: root@mack.dcsl.buffalo.edu:/usr/obj/usr/src/sys/GENERICAug 30 23:13:44 kernel: WARNING: WITNESS option enabled, expect reduced performance. Aug 30 23:13:44 kernel: Timecounter "i8254" frequency 1193182 Hz quality 0 Aug 30 23:13:44 kernel: CPU: Mobile Intel(R) Pentium(R) 4 - M CPU 2.00GHz (1998.31-MHz 686-class CPU) Aug 30 23:13:44 kernel: Origin = "GenuineIntel" Id = 0xf27 Stepping = 7 Aug 30 23:13:44 kernel: Features=0xbfebf9ff<FPU,VME,DE,PSE,TSC,MSR,PAE,MCE,CX8,SEP,MTRR,PGE,MCA,CMOV,PAT,PSE36,CLFLUSH,DTS,ACPI,MMX,FXSR,SSE,SSE2,SS,HTT,TM,PBE> Aug 30 23:13:44 kernel: real memory = 267780096 (255 MB) Aug 30 23:13:44 kernel: avail memory = 252379136 (240 MB) Aug 30 23:13:44 kernel: npx0: [FAST] Aug 30 23:13:44 kernel: npx0: <math processor> on motherboard Aug 30 23:13:44 kernel: npx0: INT 16 interface Aug 30 23:13:44 kernel: acpi0: <IBM TP-1I> on motherboard Aug 30 23:13:44 kernel: acpi_ec_ecdt_probe: can't get handle Aug 30 23:13:44 kernel: ACPI-0358: *** Error: Region EmbeddedControl(3) has no handler Aug 30 23:13:44 kernel: ACPI-1303: *** Error: Method execution failed [\_SB_.PCI0.LPC_.FDC_._INI] (Node 0xc15e6420), AE_NOT_EXIST Aug 30 23:13:44 kernel: ACPI-0358: *** Error: Region EmbeddedControl(3) has no handler Aug 30 23:13:44 kernel: ACPI-1303: *** Error: Method execution failed [\_SB_.PCI0.LPC_.EC__._INI] (Node 0xc15dab00), AE_NOT_EXIST Aug 30 23:13:44 kernel: ACPI-0358: *** Error: Region EmbeddedControl(3) has no handler Aug 30 23:13:44 kernel: ACPI-1303: *** Error: Method execution failed [\_SB_.PCI0.LPC_.EC__.BAT0._STA] (Node 0xc15dc6a0), AE_NOT_EXIST Aug 30 23:13:44 kernel: ACPI-0239: *** Error: Method execution failed [\_SB_.PCI0.LPC_.EC__.BAT0._STA] (Node 0xc15dc6a0), AE_NOT_EXIST Aug 30 23:13:44 kernel: ACPI-0358: *** Error: Region EmbeddedControl(3) has no handler Aug 30 23:13:44 kernel: ACPI-1303: *** Error: Method execution failed [\_SB_.PCI0.LPC_.EC__.BAT1._STA] (Node 0xc15dc520), AE_NOT_EXIST Aug 30 23:13:44 kernel: ACPI-0239: *** Error: Method execution failed [\_SB_.PCI0.LPC_.EC__.BAT1._STA] (Node 0xc15dc520), AE_NOT_EXIST Aug 30 23:13:44 kernel: ACPI-0358: *** Error: Region EmbeddedControl(3) has no handler Aug 30 23:13:44 kernel: ACPI-1303: *** Error: Method execution failed [\_SB_.PCI0.LPC_.EC__.BGID] (Node 0xc15e6560), AE_NOT_EXIST Aug 30 23:13:44 kernel: ACPI-1303: *** Error: Method execution failed [\_SB_.PCI0.LPC_.EC__.BINI] (Node 0xc15e6580), AE_NOT_EXIST Aug 30 23:13:44 kernel: ACPI-1303: *** Error: Method execution failed [\_SB_.PCI0.LPC_.EC__.BSTA] (Node 0xc15e65c0), AE_NOT_EXIST Aug 30 23:13:44 kernel: ACPI-1303: *** Error: Method execution failed [\_SB_.PCI0.IDE0.SCND.MSTR._STA] (Node 0xc15e6480), AE_NOT_EXIST Aug 30 23:13:44 kernel: ACPI-0239: *** Error: Method execution failed [\_SB_.PCI0.IDE0.SCND.MSTR._STA] (Node 0xc15e6480), AE_NOT_EXIST Aug 30 23:13:44 kernel: ACPI-0358: *** Error: Region EmbeddedControl(3) has no handler Aug 30 23:13:44 kernel: ACPI-1303: *** Error: Method execution failed [\_SB_.PCI0.LPC_.EC__.BGID] (Node 0xc15e6560), AE_NOT_EXIST Aug 30 23:13:44 kernel: ACPI-1303: *** Error: Method execution failed [\_SB_.PCI0.LPC_.EC__.BINI] (Node 0xc15e6580), AE_NOT_EXIST Aug 30 23:13:44 kernel: ACPI-1303: *** Error: Method execution failed [\_SB_.PCI0.LPC_.EC__.BSTA] (Node 0xc15e65c0), AE_NOT_EXIST Aug 30 23:13:44 kernel: ACPI-1303: *** Error: Method execution failed [\_SB_.PCI0.USB0.URTH.UNST._STA] (Node 0xc15e26e0), AE_NOT_EXIST Aug 30 23:13:44 kernel: ACPI-0239: *** Error: Method execution failed [\_SB_.PCI0.USB0.URTH.UNST._STA] (Node 0xc15e26e0), AE_NOT_EXIST Aug 30 23:13:44 kernel: ACPI-0358: *** Error: Region EmbeddedControl(3) has no handler Aug 30 23:13:44 kernel: ACPI-1303: *** Error: Method execution failed [\_SB_.PCI0.LPC_.EC__.BGID] (Node 0xc15e6560), AE_NOT_EXIST Aug 30 23:13:44 kernel: ACPI-1303: *** Error: Method execution failed [\_SB_.PCI0.LPC_.EC__.BINI] (Node 0xc15e6580), AE_NOT_EXIST Aug 30 23:13:44 kernel: ACPI-1303: *** Error: Method execution failed [\_SB_.PCI0.LPC_.EC__.BSTA] (Node 0xc15e65c0), AE_NOT_EXIST Aug 30 23:13:44 kernel: ACPI-1303: *** Error: Method execution failed [\_SB_.NEST._STA] (Node 0xc15e62e0), AE_NOT_EXIST Aug 30 23:13:44 kernel: ACPI-0239: *** Error: Method execution failed [\_SB_.NEST._STA] (Node 0xc15e62e0), AE_NOT_EXIST Aug 30 23:13:44 kernel: acpi0: Power Button (fixed) Aug 30 23:13:44 kernel: acpi_ec0: <Embedded Controller: GPE 0x1c> port 0x66,0x62 on acpi0 Aug 30 23:13:44 kernel: Timecounter "ACPI-fast" frequency 3579545 Hz quality 1000 Aug 30 23:13:44 kernel: acpi_timer0: <24-bit timer at 3.579545MHz> port 0x1008-0x100b on acpi0 Aug 30 23:13:44 kernel: cpu0: <ACPI CPU (3 Cx states)> on acpi0 Aug 30 23:13:44 kernel: acpi_tz0: <Thermal Zone> on acpi0 Aug 30 23:13:44 kernel: acpi_lid0: <Control Method Lid Switch> on acpi0 Aug 30 23:13:44 kernel: acpi_button0: <Sleep Button> on acpi0 Aug 30 23:13:44 kernel: pcib0: <ACPI Host-PCI bridge> port 0xcf8-0xcff on acpi0 Aug 30 23:13:44 kernel: acpi link get: empty IRQ resource Aug 30 23:13:44 kernel: pci0: <ACPI PCI bus> on pcib0 Aug 30 23:13:44 kernel: agp0: <Intel 82845 host to AGP bridge> mem 0xe0000000-0xe3ffffff at device 0.0 on pci0 Aug 30 23:13:44 kernel: pcib1: <ACPI PCI-PCI bridge> at device 1.0 on pci0 Aug 30 23:13:44 kernel: pci1: <ACPI PCI bus> on pcib1 Aug 30 23:13:44 kernel: pci1: <display, VGA> at device 0.0 (no driver attached)Aug 30 23:13:44 kernel: uhci0: <Intel 82801CA/CAM (ICH3) USB controller USB-A> port 0x1800-0x181f irq 11 at device 29.0 on pci0 Aug 30 23:13:44 kernel: uhci0: [GIANT-LOCKED] Aug 30 23:13:44 kernel: usb0: <Intel 82801CA/CAM (ICH3) USB controller USB-A> on uhci0 Aug 30 23:13:44 kernel: usb0: USB revision 1.0 Aug 30 23:13:44 kernel: uhub0: Intel UHCI root hub, class 9/0, rev 1.00/1.00, addr 1 Aug 30 23:13:44 kernel: uhub0: 2 ports with 2 removable, self powered Aug 30 23:13:44 kernel: uhci1: <Intel 82801CA/CAM (ICH3) USB controller USB-B> port 0x1820-0x183f irq 11 at device 29.1 on pci0 Aug 30 23:13:44 kernel: uhci1: [GIANT-LOCKED] Aug 30 23:13:44 kernel: usb1: <Intel 82801CA/CAM (ICH3) USB controller USB-B> on uhci1 Aug 30 23:13:44 kernel: usb1: USB revision 1.0 Aug 30 23:13:44 kernel: uhub1: Intel UHCI root hub, class 9/0, rev 1.00/1.00, addr 1 Aug 30 23:13:44 kernel: uhub1: 2 ports with 2 removable, self powered Aug 30 23:13:44 kernel: uhci2: <Intel 82801CA/CAM (ICH3) USB controller USB-C> port 0x1840-0x185f irq 11 at device 29.2 on pci0 Aug 30 23:13:44 kernel: uhci2: [GIANT-LOCKED] Aug 30 23:13:44 kernel: usb2: <Intel 82801CA/CAM (ICH3) USB controller USB-C> on uhci2 Aug 30 23:13:44 kernel: usb2: USB revision 1.0 Aug 30 23:13:44 kernel: uhub2: Intel UHCI root hub, class 9/0, rev 1.00/1.00, addr 1 Aug 30 23:13:44 kernel: uhub2: 2 ports with 2 removable, self powered Aug 30 23:13:44 kernel: pcib2: <ACPI PCI-PCI bridge> at device 30.0 on pci0 Aug 30 23:13:44 kernel: pci2: <ACPI PCI bus> on pcib2 Aug 30 23:13:44 kernel: cbb0: <TI1520 PCI-CardBus Bridge> mem 0x50000000-0x50000fff irq 11 at device 0.0 on pci2 Aug 30 23:13:44 kernel: cardbus0: <CardBus bus> on cbb0 Aug 30 23:13:44 kernel: pccard0: <16-bit PCCard bus> on cbb0 Aug 30 23:13:44 kernel: cbb1: <TI1520 PCI-CardBus Bridge> mem 0x51000000-0x51000fff irq 5 at device 0.1 on pci2 Aug 30 23:13:44 kernel: cardbus1: <CardBus bus> on cbb1 Aug 30 23:13:44 kernel: pccard1: <16-bit PCCard bus> on cbb1 Aug 30 23:13:44 kernel: wi0: <Intersil Prism2.5> mem 0xf8000000-0xf8000fff irq 11 at device 2.0 on pci2 Aug 30 23:13:44 kernel: wi0: [GIANT-LOCKED] Aug 30 23:13:44 kernel: wi0: using RF:PRISM2.5 MAC:ISL3874A(Mini-PCI) Aug 30 23:13:44 kernel: wi0: Intersil Firmware: Primary (1.1.0), Station (1.4.9) Aug 30 23:13:44 kernel: wi0: Ethernet address: 00:05:3c:04:7a:fc Aug 30 23:13:44 kernel: wi0: 11b rates: 1Mbps 2Mbps 5.5Mbps 11Mbps Aug 30 23:13:44 kernel: fxp0: <Intel 82801CAM (ICH3) Pro/100 VE Ethernet> port 0x8000-0x803f mem 0xd0200000-0xd0200fff irq 10 at device 8.0 on pci2 Aug 30 23:13:44 kernel: miibus0: <MII bus> on fxp0 Aug 30 23:13:44 kernel: inphy0: <i82562ET 10/100 media interface> on miibus0 Aug 30 23:13:44 kernel: inphy0: 10baseT, 10baseT-FDX, 100baseTX, 100baseTX-FDX, auto Aug 30 23:13:44 kernel: fxp0: Ethernet address: 00:09:6b:02:99:7f Aug 30 23:13:44 kernel: fxp0: [GIANT-LOCKED] Aug 30 23:13:44 kernel: isab0: <PCI-ISA bridge> at device 31.0 on pci0 Aug 30 23:13:44 kernel: isa0: <ISA bus> on isab0 Aug 30 23:13:44 kernel: atapci0: <Intel ICH3 UDMA100 controller> port 0x1860-0x186f,0x376,0x170-0x177,0x3f6,0x1f0-0x1f7 at device 31.1 on pci0 Aug 30 23:13:44 kernel: ata0: channel #0 on atapci0 Aug 30 23:13:44 kernel: ata1: channel #1 on atapci0 Aug 30 23:13:44 kernel: pci0: <serial bus, SMBus> at device 31.3 (no driver attached) Aug 30 23:13:44 kernel: pci0: <multimedia, audio> at device 31.5 (no driver attached) Aug 30 23:13:44 kernel: pci0: <simple comms> at device 31.6 (no driver attached) Aug 30 23:13:44 kernel: atkbdc0: <Keyboard controller (i8042)> port 0x64,0x60 irq 1 on acpi0 Aug 30 23:13:44 kernel: atkbd0: <AT Keyboard> irq 1 on atkbdc0 Aug 30 23:13:44 kernel: kbd0 at atkbd0 Aug 30 23:13:44 kernel: atkbd0: [GIANT-LOCKED] Aug 30 23:13:44 kernel: psm0: <PS/2 Mouse> irq 12 on atkbdc0 Aug 30 23:13:44 kernel: psm0: [GIANT-LOCKED] Aug 30 23:13:44 kernel: psm0: model Generic PS/2 mouse, device ID 0 Aug 30 23:13:44 kernel: fdc0: <floppy drive controller (FDE)> port 0x3f7,0x3f0-0x3f5 irq 6 drq 2 on acpi0 Aug 30 23:13:44 kernel: sio0 port 0x3f8-0x3ff irq 4 on acpi0 Aug 30 23:13:44 kernel: sio0: type 16550A Aug 30 23:13:44 kernel: ppc0 port 0x3bc-0x3be irq 7 on acpi0 Aug 30 23:13:44 kernel: ppc0: Generic chipset (NIBBLE-only) in COMPATIBLE mode Aug 30 23:13:44 kernel: ppbus0: <Parallel port bus> on ppc0 Aug 30 23:13:44 kernel: plip0: <PLIP network interface> on ppbus0 Aug 30 23:13:44 kernel: lpt0: <Printer> on ppbus0 Aug 30 23:13:44 kernel: lpt0: Interrupt-driven port Aug 30 23:13:44 kernel: ppi0: <Parallel I/O> on ppbus0 Aug 30 23:13:44 kernel: sio1 port 0x2f8-0x2ff irq 3 drq 3 on acpi0 Aug 30 23:13:44 kernel: sio1: type 16550A Aug 30 23:13:44 kernel: acpi_cmbat0: <Control Method Battery> on acpi0 Aug 30 23:13:44 kernel: acpi_acad0: <AC Adapter> on acpi0 Aug 30 23:13:44 kernel: orm0: <ISA Option ROMs> at iomem 0xdc000-0xdffff,0xd1000-0xd1fff,0xd0000-0xd0fff on isa0 Aug 30 23:13:44 kernel: pmtimer0 on isa0 Aug 30 23:13:44 kernel: sc0: <System console> at flags 0x100 on isa0 Aug 30 23:13:44 kernel: sc0: VGA <16 virtual consoles, flags=0x300> Aug 30 23:13:44 kernel: vga0: <Generic ISA VGA> at port 0x3c0-0x3df iomem 0xa0000-0xbffff on isa0 Aug 30 23:13:44 kernel: Timecounter "TSC" frequency 1998312320 Hz quality 800 Aug 30 23:13:44 kernel: Timecounters tick every 10.000 msec Aug 30 23:13:44 kernel: acpi_cpu: throttling enabled, 8 steps (100% to 12.5%), currently 100.0% Aug 30 23:13:44 kernel: ad0: 38154MB <IC25N040ATCS05-0/CS4OA61A> [77520/16/63] at ata0-master UDMA100 Aug 30 23:13:44 kernel: ATAPI_RESET time = 170us Aug 30 23:13:44 kernel: ata1-slave: FAILURE - ATAPI_IDENTIFY timed out Aug 30 23:13:44 kernel: ATAPI_RESET time = 330us Aug 30 23:13:44 kernel: acd0: CDRW <UJDA730 DVD/CDRW/1.04> at ata1-master UDMA33 Aug 30 23:13:44 kernel: Mounting root from ufs:/dev/ad0s3a Aug 30 23:13:45 kernel: ad0: WARNING - READ_DMA interrupt was seen but timeout -- David E. Cross
Want to link to this message? Use this URL: <https://mail-archive.FreeBSD.org/cgi/mid.cgi?20040831142831.D22883>