ata request_sense illegal request
Kevin Oberman
oberman at es.net
Mon Mar 1 10:18:28 PST 2004
> From: "Mike Schreckengost" <mrpolitics at hotmail.com>
> Date: Sun, 29 Feb 2004 18:29:44 -0500
> Sender: owner-freebsd-current at freebsd.org
>
> I am having *exactly* the same problem on my system. Without CDs in the
> drive, the system just hangs. With CDs in the drive, it boots (with errors,
> as shown below) but for some reason it suddenly locked up hard when starting
> KDE ... don't know if this is a related problem or not.
>
> 'boot -v' provides an endless string of:
> (probe0:ata1:0:0:0): Retrying Command
>
> ... messages (without CDs in the drive). I hope this helps, if anyone needs
> more information don't hesitate to ask. :-)
>
> Thanks,
> Mike
>
> Feb 29 18:16:00 ulb kernel: Copyright (c) 1992-2004 The FreeBSD Project.
> Feb 29 18:16:00 ulb kernel: Copyright (c) 1979, 1980, 1983, 1986, 1988,
> 1989, 19
> 91, 1992, 1993, 1994
> Feb 29 18:16:00 ulb kernel: The Regents of the University of California. All
> rig
> hts reserved.
> Feb 29 18:16:00 ulb kernel: FreeBSD 5.2-CURRENT #20: Sun Feb 29 17:31:10 EST
> 200
> 4
> Feb 29 18:16:00 ulb kernel: root at ulb.home.net:/usr/obj/usr/src/sys/ULB
> Feb 29 18:16:00 ulb kernel: WARNING: WITNESS option enabled, expect reduced
> perf
> ormance.
> Feb 29 18:16:00 ulb kernel: Preloaded elf kernel "/boot/kernel/kernel" at
> 0xc09f
> b000.
> Feb 29 18:16:00 ulb kernel: Preloaded elf module
> "/boot/kernel/snd_emu10k1.ko" a
> t 0xc09fb294.
> Feb 29 18:16:00 ulb kernel: Preloaded elf module "/boot/kernel/snd_pcm.ko"
> at 0x
> c09fb344.
> Feb 29 18:16:00 ulb kernel: Preloaded elf module "/boot/modules/nvidia.ko"
> at 0x
> c09fb3f0.
> Feb 29 18:16:00 ulb kernel: Preloaded elf module "/boot/kernel/linprocfs.ko"
> at
> 0xc09fb49c.
> Feb 29 18:16:00 ulb kernel: Preloaded elf module "/boot/kernel/acpi.ko" at
> 0xc09
> fb54c.
> Feb 29 18:16:00 ulb kernel: ACPI APIC Table: <PTLTD APIC >
> Feb 29 18:16:00 ulb kernel: Timecounter "i8254" frequency 1193182 Hz quality
> 0
> Feb 29 18:16:00 ulb kernel: CPU: AMD Athlon(tm) MP 2100+ (1733.41-MHz
> 686-class
> CPU)
> Feb 29 18:16:00 ulb kernel: Origin = "AuthenticAMD" Id = 0x662 Stepping =
> 2
> Feb 29 18:16:00 ulb kernel:
> Features=0x383fbff<FPU,VME,DE,PSE,TSC,MSR,PAE,MCE,CX
> 8,APIC,SEP,MTRR,PGE,MCA,CMOV,PAT,PSE36,MMX,FXSR,SSE>
> Feb 29 18:16:00 ulb kernel: AMD Features=0xc0480000<MP,AMIE,DSP,3DNow!>
> Feb 29 18:16:00 ulb kernel: real memory = 1073217536 (1023 MB)
> Feb 29 18:16:00 ulb kernel: avail memory = 1040629760 (992 MB)
> Feb 29 18:16:00 ulb kernel: FreeBSD/SMP: Multiprocessor System Detected: 2
> CPUs
> Feb 29 18:16:00 ulb kernel: cpu0 (BSP): APIC ID: 1
> Feb 29 18:16:00 ulb kernel: cpu1 (AP): APIC ID: 0
> Feb 29 18:16:00 ulb kernel: ioapic0 <Version 1.1> irqs 0-23 on motherboard
> Feb 29 18:16:00 ulb kernel: Pentium Pro MTRR support enabled
> Feb 29 18:16:00 ulb kernel: npx0: [FAST]
> Feb 29 18:16:00 ulb kernel: npx0: <math processor> on motherboard
> Feb 29 18:16:00 ulb kernel: npx0: INT 16 interface
> Feb 29 18:16:00 ulb kernel: acpi0: <PTLTD RSDT> on motherboard
> Feb 29 18:16:00 ulb kernel: pcibios: BIOS version 2.10
> Feb 29 18:16:00 ulb kernel: Found $PIR table, 14 entries at 0xc00fdee0
> Feb 29 18:16:00 ulb kernel: acpi0: Power Button (fixed)
> Feb 29 18:16:00 ulb kernel: acpi0: Sleep Button (fixed)
> Feb 29 18:16:00 ulb kernel: Timecounter "ACPI-fast" frequency 3579545 Hz
> quality
> 1000
> Feb 29 18:16:00 ulb kernel: acpi_timer0: <24-bit timer at 3.579545MHz> port
> 0x80
> 08-0x800b on acpi0
> Feb 29 18:16:00 ulb kernel: acpi_cpu0: <CPU> on acpi0
> Feb 29 18:16:00 ulb kernel: acpi_cpu1: <CPU> on acpi0
> Feb 29 18:16:00 ulb kernel: acpi_button0: <Power Button> on acpi0
> Feb 29 18:16:00 ulb kernel: pcib0: <ACPI Host-PCI bridge> port
> 0x8080-0x80ff,0x8
> 000-0x807f,0xcf8-0xcff iomem 0xd8000-0xdbfff on acpi0
> Feb 29 18:16:00 ulb kernel: pci0: <ACPI PCI bus> on pcib0
> Feb 29 18:16:00 ulb kernel: agp0: <AMD 762 host to AGP bridge> port
> 0x1010-0x101
> 3 mem 0xeb200000-0xeb200fff,0xec000000-0xefffffff at device 0.0 on pci0
> Feb 29 18:16:00 ulb kernel: pcib1: <ACPI PCI-PCI bridge> at device 1.0 on
> pci0
> Feb 29 18:16:00 ulb kernel: pci1: <ACPI PCI bus> on pcib1
> Feb 29 18:16:00 ulb kernel: nvidia0: <GeForce4 Ti 4600> mem
> 0xf8000000-0xf807fff
> f,0xf0000000-0xf7ffffff,0xe8000000-0xe8ffffff irq 17 at device 5.0 on pci1
> Feb 29 18:16:00 ulb kernel: isab0: <PCI-ISA bridge> at device 7.0 on pci0
> Feb 29 18:16:00 ulb kernel: isa0: <ISA bus> on isab0
> Feb 29 18:16:00 ulb kernel: atapci0: <AMD 768 UDMA100 controller> port
> 0xf000-0x
> f00f at device 7.1 on pci0
> Feb 29 18:16:00 ulb kernel: ata0: at 0x1f0 irq 14 on atapci0
> Feb 29 18:16:00 ulb kernel: ata0: [MPSAFE]
> Feb 29 18:16:00 ulb kernel: ata1: at 0x170 irq 15 on atapci0
> Feb 29 18:16:00 ulb kernel: ata1: [MPSAFE]
> Feb 29 18:16:00 ulb kernel: pci0: <bridge, PCI-unknown> at device 7.3 (no
> driver
> attached)
> Feb 29 18:16:00 ulb kernel: pcib2: <ACPI PCI-PCI bridge> at device 16.0 on
> pci0
> Feb 29 18:16:00 ulb kernel: pci2: <ACPI PCI bus> on pcib2
> Feb 29 18:16:00 ulb kernel: pcm0: <Creative EMU10K1> port 0x2800-0x281f irq
> 16 a
> t device 4.0 on pci2
> Feb 29 18:16:00 ulb kernel: pcm0: <SigmaTel STAC9708/11 AC97 Codec>
> Feb 29 18:16:00 ulb kernel: ohci0: <NEC uPD 9210 USB controller> mem
> 0xe9001000-
> 0xe9001fff irq 17 at device 5.0 on pci2
> Feb 29 18:16:00 ulb kernel: usb0: OHCI version 1.0
> Feb 29 18:16:00 ulb kernel: usb0: <NEC uPD 9210 USB controller> on ohci0
> Feb 29 18:16:00 ulb kernel: usb0: USB revision 1.0
> Feb 29 18:16:00 ulb kernel: uhub0: NEC OHCI root hub, class 9/0, rev
> 1.00/1.00,
> addr 1
> Feb 29 18:16:00 ulb kernel: uhub0: 3 ports with 3 removable, self powered
> Feb 29 18:16:00 ulb kernel: ums0: Logitech USB Mouse, rev 1.10/6.10, addr 2,
> icl
> ass 3/1
> Feb 29 18:16:00 ulb kernel: ums0: 3 buttons and Z dir.
> Feb 29 18:16:00 ulb kernel: umass0: Behavior Tech. Computer USB 2.0 Storage
> Devi
> ce, rev 2.00/1.03, addr 3
> Feb 29 18:16:00 ulb kernel: ohci1: <NEC uPD 9210 USB controller> mem
> 0xe9002000-
> 0xe9002fff irq 18 at device 5.1 on pci2
> Feb 29 18:16:00 ulb kernel: usb1: OHCI version 1.0
> Feb 29 18:16:00 ulb kernel: usb1: <NEC uPD 9210 USB controller> on ohci1
> Feb 29 18:16:00 ulb kernel: usb1: USB revision 1.0
> Feb 29 18:16:00 ulb kernel: uhub1: NEC OHCI root hub, class 9/0, rev
> 1.00/1.00,
> addr 1
> Feb 29 18:16:00 ulb kernel: uhub1: 2 ports with 2 removable, self powered
> Feb 29 18:16:00 ulb kernel: uscanner0: Canon CanoScan, rev 1.00/1.00, addr 2
> Feb 29 18:16:00 ulb kernel: pci2: <serial bus, USB> at device 5.2 (no driver
> att
> ached)
> Feb 29 18:16:00 ulb kernel: atapci1: <HighPoint HPT370 UDMA100 controller>
> port
> 0x2000-0x20ff,0x2828-0x282b,0x2830-0x2837,0x282c-0x282f,0x2838-0x283f irq 18
> at
> device 6.0 on pci2
> Feb 29 18:16:00 ulb kernel: atapci1: [MPSAFE]
> Feb 29 18:16:00 ulb kernel: ata2: at 0x2838 on atapci1
> Feb 29 18:16:00 ulb kernel: ata2: [MPSAFE]
> Feb 29 18:16:00 ulb kernel: ata3: at 0x2830 on atapci1
> Feb 29 18:16:00 ulb kernel: ata3: [MPSAFE]
> Feb 29 18:16:00 ulb kernel: pci2: <display, VGA> at device 7.0 (no driver
> attach
> ed)
> Feb 29 18:16:00 ulb kernel: xl0: <3Com 3c980C Fast Etherlink XL> port
> 0x2400-0x2
> 47f mem 0xe9003400-0xe900347f irq 18 at device 8.0 on pci2
> Feb 29 18:16:00 ulb kernel: xl0: Ethernet address: 00:e0:81:22:5b:f4
> Feb 29 18:16:00 ulb kernel: miibus0: <MII bus> on xl0
> Feb 29 18:16:00 ulb kernel: ukphy0: <Generic IEEE 802.3u media interface> on
> mii
> bus0
> Feb 29 18:16:00 ulb kernel: ukphy0: 10baseT, 10baseT-FDX, 100baseTX,
> 100baseTX-
> FDX, auto
> Feb 29 18:16:00 ulb kernel: xl1: <3Com 3c980C Fast Etherlink XL> port
> 0x2480-0x2
> 4ff mem 0xe9003800-0xe900387f irq 19 at device 9.0 on pci2
> Feb 29 18:16:00 ulb kernel: xl1: Ethernet address: 00:e0:81:22:5b:f5
> Feb 29 18:16:00 ulb kernel: miibus1: <MII bus> on xl1
> Feb 29 18:16:00 ulb kernel: ukphy1: <Generic IEEE 802.3u media interface> on
> mii
> bus1
> Feb 29 18:16:00 ulb kernel: ukphy1: 10baseT, 10baseT-FDX, 100baseTX,
> 100baseTX-
> FDX, auto
> Feb 29 18:16:00 ulb kernel: atkbdc0: <Keyboard controller (i8042)> port
> 0x64,0x6
> 0 irq 1 on acpi0
> Feb 29 18:16:00 ulb kernel: atkbd0: <AT Keyboard> flags 0x1 irq 1 on atkbdc0
> Feb 29 18:16:00 ulb kernel: kbd0 at atkbd0
> Feb 29 18:16:00 ulb kernel: sio0 port 0x3f8-0x3ff irq 4 on acpi0
> Feb 29 18:16:00 ulb kernel: sio0: type 16550A
> Feb 29 18:16:00 ulb kernel: sio1 port 0x2f8-0x2ff irq 3 on acpi0
> Feb 29 18:16:00 ulb kernel: sio1: type 16550A
> Feb 29 18:16:00 ulb kernel: ppc0 port 0x778-0x77f,0x378-0x37f irq 7 drq 3 on
> acp
> i0
> Feb 29 18:16:00 ulb kernel: ppc0: SMC-like chipset (ECP/EPP/PS2/NIBBLE) in
> COMPA
> TIBLE mode
> Feb 29 18:16:00 ulb kernel: ppc0: FIFO with 16/16/9 bytes threshold
> Feb 29 18:16:00 ulb kernel: ppbus0: <Parallel port bus> on ppc0
> Feb 29 18:16:00 ulb kernel: lpt0: <Printer> on ppbus0
> Feb 29 18:16:00 ulb kernel: lpt0: Interrupt-driven port
> Feb 29 18:16:00 ulb kernel: fdc0: <Enhanced floppy controller (i82077,
> NE72065 o
> r clone)> port 0x3f7,0x3f0-0x3f5 irq 6 drq 2 on acpi0
> Feb 29 18:16:00 ulb kernel: fdc0: FIFO enabled, 8 bytes threshold
> Feb 29 18:16:00 ulb kernel: fd0: <1440-KB 3.5" drive> on fdc0 drive 0
> Feb 29 18:16:00 ulb kernel: orm0: <Option ROMs> at iomem
> 0xe0000-0xe3fff,0xcf800
> -0xcffff,0xcf000-0xcf7ff on isa0
> Feb 29 18:16:00 ulb kernel: pmtimer0 on isa0
> Feb 29 18:16:00 ulb kernel: sc0: <System console> at flags 0x100 on isa0
> Feb 29 18:16:00 ulb kernel: sc0: VGA <16 virtual consoles, flags=0x300>
> Feb 29 18:16:00 ulb kernel: vga0: <Generic ISA VGA> at port 0x3c0-0x3df
> iomem 0x
> a0000-0xbffff on isa0
> Feb 29 18:16:00 ulb kernel: Timecounters tick every 10.000 msec
> Feb 29 18:16:00 ulb kernel: afd0: REMOVABLE <IOMEGA ZIP 250 ATAPI> at
> ata0-maste
> r PIO3
> Feb 29 18:16:00 ulb kernel: acd0: CDRW <CD-RW IDE5232> at ata0-slave PIO4
> Feb 29 18:16:00 ulb kernel: acd1: CDRW <Memorex DVD+R/RW 2.4x8AA> at
> ata1-master
> PIO4
> Feb 29 18:16:00 ulb kernel: ad3: 114473MB <WDC WD1200BB-00CAA1>
> [232581/16/63] a
> t ata1-slave UDMA100
> Feb 29 18:16:00 ulb kernel: ad4: 114473MB <WDC WD1200JB-00CRA1>
> [232581/16/63] a
> t ata2-master UDMA100
> Feb 29 18:16:00 ulb kernel: ad6: 76319MB <WDC WD800BB-00CAA0> [155061/16/63]
> at
> ata3-master UDMA100
> Feb 29 18:16:00 ulb kernel: acd1: FAILURE - REQUEST_SENSE ILLEGAL REQUEST
> asc=0x
> 24 ascq=0x00 status=50<READY,DSC> error=0
> Feb 29 18:16:00 ulb kernel: acd0: FAILURE - REQUEST_SENSE ILLEGAL REQUEST
> asc=0x
> 24 ascq=0x00 status=50<READY,DSC> error=0
> Feb 29 18:16:00 ulb kernel: afd0: FAILURE - REQUEST_SENSE ILLEGAL REQUEST
> asc=0x
> 24 ascq=0x00 status=50<READY,DSC> error=0
> Feb 29 18:16:00 ulb kernel: acd0: FAILURE - REQUEST_SENSE ILLEGAL REQUEST
> asc=0x
> 24 ascq=0x00 status=50<READY,DSC> error=0
> Feb 29 18:16:00 ulb kernel: afd0: FAILURE - REQUEST_SENSE ILLEGAL REQUEST
> asc=0x
> 24 ascq=0x00 status=50<READY,DSC> error=0
> Feb 29 18:16:00 ulb kernel: SMP: AP CPU #1 Launched!
> Feb 29 18:16:00 ulb kernel: da0 at ata0 bus 0 target 0 lun 0
> Feb 29 18:16:00 ulb kernel: da0: <IOMEGA ZIP 250 42.S> Removable Direct
> Access S
> CSI-0 device
> Feb 29 18:16:00 ulb kernel: da0: 11.000MB/s transfers
> Feb 29 18:16:00 ulb kernel: da0: 239MB (489532 512 byte sectors: 64H 32S/T
> 239C)
> Feb 29 18:16:00 ulb kernel: cd2 at ata1 bus 0 target 0 lun 0
> Feb 29 18:16:00 ulb kernel: cd2: <Memorex DVD+R/RW 2.4x8AA 1.51> Removable
> CD-RO
> M SCSI-0 device
> Feb 29 18:16:00 ulb kernel: cd2: 16.000MB/s transfers
> Feb 29 18:16:00 ulb kernel: cd2: cd present [1 x 2048 byte records]
> Feb 29 18:16:00 ulb kernel: cd1 at ata0 bus 0 target 1 lun 0
> Feb 29 18:16:00 ulb kernel: cd1: <CDWRITER IDE5232 000F> Removable CD-ROM
> SCSI-0
> device
> Feb 29 18:16:00 ulb kernel: cd1: 16.000MB/s transfers
> Feb 29 18:16:00 ulb kernel: cd1: cd present [104672 x 2048 byte records]
> Feb 29 18:16:00 ulb kernel: cd0 at umass-sim0 bus 0 target 0 lun 0
> Feb 29 18:16:00 ulb kernel: cd0: <CDWRITER IDE5232 0009> Removable CD-ROM
> SCSI-0
> device
> Feb 29 18:16:00 ulb kernel: cd0: 1.000MB/s transfers
> Feb 29 18:16:00 ulb kernel: cd0: Attempt to query device size failed: NOT
> READY,
> Medium not present - tray closed
> Feb 29 18:16:00 ulb kernel: acd1: FAILURE - REQUEST_SENSE ILLEGAL REQUEST
> asc=0x
> 24 ascq=0x00 status=50<READY,DSC> error=0
> Feb 29 18:16:00 ulb last message repeated 2 times
> Feb 29 18:16:00 ulb kernel: acd1: FAILURE - REQUEST_SENSE ILLEGAL REQUEST
> asc=0x
> 64 ascq=0x01 status=50<READY,DSC> error=0
> Feb 29 18:16:00 ulb kernel: acd1: FAILURE - REQUEST_SENSE ILLEGAL REQUEST
> asc=0x
> 24 ascq=0x00 status=50<READY,DSC> error=0
> Feb 29 18:16:00 ulb last message repeated 2 times
> Feb 29 18:16:00 ulb kernel: acd1: FAILURE - REQUEST_SENSE ILLEGAL REQUEST
> asc=0x
> 64 ascq=0x01 status=50<READY,DSC> error=0
> Feb 29 18:16:00 ulb kernel: Mounting root from ufs:/dev/ad3s2a
>
> Paulius Bulotas <paulius at kaktusas.org> wrote:
>
> >Hello,
> >
> >after upgrading to new ata code (REQUEST_SENSE feature), I'm unable to
> >boot from disk without media in my cdrom ;)
> >Everything looks like:
> >acd0: CDRW <TOSHIBA DVD-ROM SD-R9012> at ata1-master UDMA33
> >acd0: FAILURE - REQUEST_SENSE ILLEGAL REQUEST asc=0x24 ascq=0x00
> >sks=0x40 0x00 0x01 status=50<READY,DSC> error=0
> >and pause [if I boot with -v, I see a lot of
> >(probe0:ata1:0:0:0): Retrying Command
> >]
> >
> >after inserting cd, everything goes almost fine:
> >acd0: FAILURE - REQUEST_SENSE ILLEGAL REQUEST asc=0x24 ascq=0x00
> >sks=0x40 0x00 0
Me too. :-)
Back out the patches sos made on Feb 28 (ata-all.h 1.74 and ata-queue.c
1.22 and it works again. (cvsup src/sys/dev/ata with a date of
2004.02.28.17.30.00)
These patches:
Issue a request sense command automagically when ATAPI commands fail
with a valid sense key.
Sounds like it's getting something it thinks is and invalid status and
just keeps asking for status forever. I'm reading over the patch now,
but I have no idea if I can figure out what's wrong. It will probably
have to wait for sos to fix it. It's almost certainly HW specific.
--
R. Kevin Oberman, Network Engineer
Energy Sciences Network (ESnet)
Ernest O. Lawrence Berkeley National Laboratory (Berkeley Lab)
E-mail: oberman at es.net Phone: +1 510 486-8634
More information about the freebsd-current
mailing list