Most recent kernel where this bug did not occur: Unknown Distribution: FC4 Hardware Environment: ATI 437A and 4379 SATA controllers, plus "Standard Dual Channel PCI IDE Controller ATI (rev 80) (prog-if 82 [Master PriP])" driving just a single PATA interface Software Environment: FC6, Kernel 2.6.22.2-42.fc6 (no binary NVIDIA drivers :-)) Problem Description: With just a DVD drive on the PATA interface (configured as slave as it happens) there's no problem. Add a HD (configured as master, obviously) and the HD runs fine (DMA seems to be working, 53Mb/sec reported from 'hdparm'). However, the DVD drive is now unavailable. "Dmesg" does report initially spotting the DVD drive: "hdb: PHILIPS DVDR1628P1, ATAPI CD/DVD-ROM drive", but then reports a couple of "drive not ready" errors and that's the last you see of it. Steps to reproduce: See above, but I've also tried swapping the plugin-positions of master and slave on the cable (no effect) and changing the "UDMA100" cable for a boring old-fashioned "coarse pitch" cable. This halved the bandwidth to the HD to about 26Mb/sec, but otherwise no effect. Not tried: running the DVD drive as master, HD as slave. I have tried configuring the DVD drive to turn off the DMA. 'hdparm' initially reports "DMA on" for the drive, and allows you to set it to "off" but then won't let you turn it on again. Tried setting the DVD drive to work in PIO mode, but still no joy. Noticeable other effects: "udev" gets stuck for several minutes in the boot-up sequence when the HD is present. Remove the HD and "udev" has no trouble. Other notes: looks like Windows XP has a problem with this configuration too, but it (eventually) recovers and can at least use the DVD drive after several minutes delay after boot up. Can't tell if XP can see the HD on the PATA interface - there happen to be no windoze partitions on it.
The "component" for this bug has been listed as "Serial ATA", but really it's parallel ATA of course. Interestingly, there isn't a "Parallel ATA" listed in the "component" drop-down list. "IDE" is there....
I'm a bit baffled by this report as you say FC4, and you quote "hdb: PHILIPS DVDR1628P1, ATAPI CD/DVD-ROM" which is a driver not present in FC6 for x86
Hi Alan: It's certainly FC6 - though the kernel version just went up with a new kernel last night. The message about the DVD drive was quoted verbatim from 'dmesg' (I just double-checked). It reads data disks, and plays DVDs (with Xine anyway). Not bad for a drive with no driver :-) Did you mean FC4 or FC6 in your reply, Alan? You mentioned both. It's FC6. I just assumed it would use the default ATAPI driver over the PATA interface.
I notice that my description of this bug listed it as "Distribution FC4". If I typed that, then my apologies - evidently this what prompted AC's comment (above) which surprised me at the time. Whatever: - I just used "dmidecode" to find out what the MOBO is and here's what I get: Handle 0x0001, DMI type 1, 25 bytes. System Information Manufacturer: Packard Bell NEC Product Name: 00000000000000000000000 Version: 00000001 Serial Number: a123456789 UUID: F414B06D-CFF0-DA11-8000-4E45435F4349 Wake-up Type: Power Switch Handle 0x0002, DMI type 2, 8 bytes. Base Board Information Manufacturer: NEC COMPUTERS INTERNATIONAL Product Name: GA-8TRC410M-NF Version: Serial Number: Not much but possibly useful. Below is the output of 'lsmod', taken with a data CD in the drive and mounted: Module Size Used by nls_utf8 6209 1 autofs4 24773 2 hidp 26689 2 l2cap 30401 5 hidp bluetooth 57893 2 hidp,l2cap sunrpc 161981 1 nf_conntrack_netbios_ns 7105 0 ipt_REJECT 8641 1 nf_conntrack_ipv4 21837 2 xt_state 6593 2 nf_conntrack 64713 3 nf_conntrack_netbios_ns,nf_conntrack_ipv4,xt_state nfnetlink 9945 2 nf_conntrack_ipv4,nf_conntrack iptable_filter 7105 1 ip_tables 16517 1 iptable_filter ip6t_REJECT 9537 1 xt_tcpudp 7233 9 ip6table_filter 6849 1 ip6_tables 17669 1 ip6table_filter x_tables 18629 6 ipt_REJECT,xt_state,ip_tables,ip6t_REJECT,xt_tcpudp,ip6_tables dm_multipath 21961 0 video 21065 0 sbs 22729 0 button 12113 0 dock 13921 0 battery 14149 0 ac 9285 0 ipv6 277957 21 ip6t_REJECT parport_pc 30821 0 lp 16105 0 parport 38281 2 parport_pc,lp sg 37469 0 snd_hda_intel 243417 1 snd_seq_dummy 7877 0 snd_seq_oss 33473 0 snd_seq_midi_event 11073 1 snd_seq_oss snd_seq 50609 5 snd_seq_dummy,snd_seq_oss,snd_seq_midi_event snd_seq_device 11981 3 snd_seq_dummy,snd_seq_oss,snd_seq snd_pcm_oss 43457 0 snd_mixer_oss 19521 1 snd_pcm_oss snd_pcm 74949 2 snd_hda_intel,snd_pcm_oss ide_cd 40545 1 i2c_piix4 12493 0 snd_timer 24901 2 snd_seq,snd_pcm rtc_cmos 12001 0 cdrom 37089 1 ide_cd snd 53317 10 snd_hda_intel,snd_seq_oss,snd_seq,snd_seq_device,snd_pcm_oss,snd_mixer_oss,snd_pcm,snd_timer i2c_core 27841 1 i2c_piix4 ohci1394 36977 0 8139cp 26433 0 8139too 29249 0 serio_raw 10821 0 soundcore 11681 1 snd mii 9409 2 8139cp,8139too snd_page_alloc 13769 2 snd_hda_intel,snd_pcm dm_snapshot 20709 0 dm_zero 6209 0 dm_mirror 25153 0 dm_mod 56833 9 dm_multipath,dm_snapshot,dm_zero,dm_mirror sata_sil 14921 2 libata 120241 1 sata_sil sd_mod 31297 3 scsi_mod 140621 3 sg,libata,sd_mod ext3 125513 2 jbd 59881 1 ext3 mbcache 12485 1 ext3 ehci_hcd 35405 0 ohci_hcd 23877 0 uhci_hcd 27089 0 I recall a bug a while ago dealing with PATA HDD issues when installed on a machine with SATA HDDs. The cause was IIRC to do with the SATA drivers stealing the IRQs or the DMA channels from under the PATA drivers. A partial solution was to force the PATA drivers to load first. I don't think this is any way like that, but the 'lsmod' listing might be interesting if module load-order is still significant here. I notice that the only drivers listed above that look to be at all involved with the DVD/CDROM drive are "ide-cd" and "cdrom" - no surprise there! And nothing drive-specific by the look of it.
Ok right that makes sense now. So its an FC6 box with legacy IDE drivers and ide-cd layer. I'd be interested to know what an FC7 boot.iso reports if you've got one around. That will load the libata driver which is basically the same core logic (so I don't think it'll fix your problem whatever it is) but it is a lot more verbose so should provide a lot of info in dmesg/boot logs. Post boot the dmeg log for the FC6 as an attachment would be useful first of all however and that might give enough info to guess whats up.
"FC6 box with legacy IDE drivers and ide-cd layer" - yup that's it, though the main disk is a 160Gb SATA drive (and that's what the system boots from). I don't have an FC7.iso, but will get one if it helps. In the meantime, here are a pair of 'dmesg' dumps for you to laugh^W look at. (Annoyingly, the kernel changed from 2.6.22.2-42 to 2.6.22.4-45 between dumps) First a dump with the CD working correctly (scan for "#####" to locate the second dump): Linux version 2.6.22.2-42.fc6 (brewbuilder@hs20-bc1-5.build.redhat.com) (gcc version 4.1.2 20070626 (Red Hat 4.1.2-13)) #1 SMP Wed Aug 15 11:32:12 EDT 2007 BIOS-provided physical RAM map: BIOS-e820: 0000000000000000 - 000000000009f000 (usable) BIOS-e820: 000000000009f000 - 00000000000a0000 (reserved) BIOS-e820: 00000000000f0000 - 0000000000100000 (reserved) BIOS-e820: 0000000000100000 - 000000003fef0000 (usable) BIOS-e820: 000000003fef0000 - 000000003fef3000 (ACPI NVS) BIOS-e820: 000000003fef3000 - 000000003ff00000 (ACPI data) BIOS-e820: 00000000e0000000 - 00000000f0000000 (reserved) BIOS-e820: 00000000fec00000 - 0000000100000000 (reserved) 126MB HIGHMEM available. 896MB LOWMEM available. found SMP MP-table at 000f3ec0 Using x86 segment limits to approximate NX protection Entering add_active_range(0, 0, 261872) 0 entries of 256 used Zone PFN ranges: DMA 0 -> 4096 Normal 4096 -> 229376 HighMem 229376 -> 261872 early_node_map[1] active PFN ranges 0: 0 -> 261872 On node 0 totalpages: 261872 DMA zone: 32 pages used for memmap DMA zone: 0 pages reserved DMA zone: 4064 pages, LIFO batch:0 Normal zone: 1760 pages used for memmap Normal zone: 223520 pages, LIFO batch:31 HighMem zone: 253 pages used for memmap HighMem zone: 32243 pages, LIFO batch:7 DMI 2.3 present. Using APIC driver default ACPI: RSDP 000F8180, 0014 (r0 RC410 ) ACPI: RSDT 3FEF3040, 0030 (r1 RC410 AWRDACPI 42302E31 AWRD 0) ACPI: FACP 3FEF30C0, 0074 (r1 RC410 AWRDACPI 42302E31 AWRD 0) ACPI: DSDT 3FEF3180, 2F28 (r1 RC410 AWRDACPI 1000 MSFT 100000E) ACPI: FACS 3FEF0000, 0040 ACPI: MCFG 3FEF61C0, 003C (r1 RC410 AWRDACPI 42302E31 AWRD 0) ACPI: APIC 3FEF6100, 0068 (r1 RC410 AWRDACPI 42302E31 AWRD 0) ATI board detected. Disabling timer routing over 8254. ACPI: PM-Timer IO Port: 0x4008 ACPI: Local APIC address 0xfee00000 ACPI: LAPIC (acpi_id[0x00] lapic_id[0x00] enabled) Processor #0 15:4 APIC version 20 ACPI: LAPIC (acpi_id[0x01] lapic_id[0x01] enabled) Processor #1 15:4 APIC version 20 ACPI: LAPIC_NMI (acpi_id[0x00] high edge lint[0x1]) ACPI: LAPIC_NMI (acpi_id[0x01] high edge lint[0x1]) ACPI: IOAPIC (id[0x02] address[0xfec00000] gsi_base[0]) IOAPIC[0]: apic_id 2, version 33, address 0xfec00000, GSI 0-23 ACPI: INT_SRC_OVR (bus 0 bus_irq 0 global_irq 2 dfl dfl) ACPI: INT_SRC_OVR (bus 0 bus_irq 9 global_irq 21 low level) ACPI: IRQ0 used by override. ACPI: IRQ2 used by override. Enabling APIC mode: Flat. Using 1 I/O APICs Using ACPI (MADT) for SMP configuration information Allocating PCI resources starting at 40000000 (gap: 3ff00000:a0100000) Built 1 zonelists. Total pages: 259827 Kernel command line: ro root=/dev/VolGroup00/LogVol00 rhgb quiet mapped APIC to ffffd000 (fee00000) mapped IOAPIC to ffffc000 (fec00000) Enabling fast FPU save and restore... done. Enabling unmasked SIMD FPU exception support... done. Initializing CPU#0 CPU 0 irqstacks, hard=c07bd000 soft=c079d000 PID hash table entries: 4096 (order: 12, 16384 bytes) Detected 3059.545 MHz processor. Console: colour VGA+ 80x25 Dentry cache hash table entries: 131072 (order: 7, 524288 bytes) Inode-cache hash table entries: 65536 (order: 6, 262144 bytes) Memory: 1030840k/1047488k available (2219k kernel code, 15888k reserved, 1177k data, 260k init, 129984k highmem) virtual kernel memory layout: fixmap : 0xffc55000 - 0xfffff000 (3752 kB) pkmap : 0xff800000 - 0xffc00000 (4096 kB) vmalloc : 0xf8800000 - 0xff7fe000 ( 111 MB) lowmem : 0xc0000000 - 0xf8000000 ( 896 MB) .init : 0xc0757000 - 0xc0798000 ( 260 kB) .data : 0xc062adc6 - 0xc0751584 (1177 kB) .text : 0xc0400000 - 0xc062adc6 (2219 kB) Checking if this processor honours the WP bit even in supervisor mode... Ok. SLUB: Genslabs=22, HWalign=64, Order=0-1, MinObjects=4, CPUs=2, Nodes=1 Calibrating delay using timer specific routine.. 6122.95 BogoMIPS (lpj=3061477) Security Framework v1.0.0 initialized SELinux: Initializing. SELinux: Starting in permissive mode selinux_register_security: Registering secondary module capability Capability LSM initialized as secondary Mount-cache hash table entries: 512 CPU: After generic identify, caps: bfebfbff 20100000 00000000 00000000 0000651d 00000000 00000001 monitor/mwait feature present. using mwait in idle threads. CPU: Trace cache: 12K uops, L1 D cache: 16K CPU: L2 cache: 1024K CPU: Physical Processor ID: 0 CPU: After all inits, caps: bfebf3ff 20100000 00000000 0000b180 0000651d 00000000 00000001 Intel machine check architecture supported. Intel machine check reporting enabled on CPU#0. CPU0: Intel P4/Xeon Extended MCE MSRs (24) available Compat vDSO mapped to ffffe000. Checking 'hlt' instruction... OK. SMP alternatives: switching to UP code ACPI: Core revision 20070126 CPU0: Intel(R) Pentium(R) 4 CPU 3.06GHz stepping 09 SMP alternatives: switching to SMP code Booting processor 1/1 eip 3000 CPU 1 irqstacks, hard=c07be000 soft=c079e000 Initializing CPU#1 Calibrating delay using timer specific routine.. 6117.18 BogoMIPS (lpj=3058590) CPU: After generic identify, caps: bfebfbff 20100000 00000000 00000000 0000651d 00000000 00000001 monitor/mwait feature present. CPU: Trace cache: 12K uops, L1 D cache: 16K CPU: L2 cache: 1024K CPU: Physical Processor ID: 0 CPU: After all inits, caps: bfebf3ff 20100000 00000000 0000b180 0000651d 00000000 00000001 Intel machine check architecture supported. Intel machine check reporting enabled on CPU#1. CPU1: Intel P4/Xeon Extended MCE MSRs (24) available CPU1: Intel(R) Pentium(R) 4 CPU 3.06GHz stepping 09 Total of 2 processors activated (12240.13 BogoMIPS). ENABLING IO-APIC IRQs ..TIMER: vector=0x31 apic1=0 pin1=2 apic2=-1 pin2=-1 checking TSC synchronization [CPU#0 -> CPU#1]: passed. Brought up 2 CPUs sizeof(vma)=84 bytes sizeof(page)=32 bytes sizeof(inode)=336 bytes sizeof(dentry)=132 bytes sizeof(ext3inode)=488 bytes sizeof(buffer_head)=56 bytes sizeof(skbuff)=176 bytes sizeof(task_struct)=1536 bytes Time: 21:22:53 Date: 08/06/107 NET: Registered protocol family 16 ACPI: bus type pci registered PCI: PCI BIOS revision 3.00 entry at 0xf9ef0, last bus=2 PCI: Using configuration type 1 Setting up standard PCI resources ACPI: Interpreter enabled ACPI: (supports S0 S3 S4 S5) ACPI: Using IOAPIC for interrupt routing ACPI: PCI Root Bridge [PCI0] (0000:00) PCI: Probing PCI hardware (bus 00) PCI: Transparent bridge - 0000:00:14.4 ACPI: PCI Interrupt Routing Table [\_SB_.PCI0._PRT] ACPI: PCI Interrupt Routing Table [\_SB_.PCI0.P2P_._PRT] ACPI: PCI Interrupt Routing Table [\_SB_.PCI0.PCE2._PRT] ACPI: PCI Interrupt Link [LNKA] (IRQs 3 4 5 6 7 10 11) *0, disabled. ACPI: PCI Interrupt Link [LNKB] (IRQs 3 4 5 6 7 10 11) *0, disabled. ACPI: PCI Interrupt Link [LNKC] (IRQs 3 4 5 6 7 10 11) *0, disabled. ACPI: PCI Interrupt Link [LNKD] (IRQs 3 4 5 6 7 10 11) *0, disabled. ACPI: PCI Interrupt Link [LNKE] (IRQs 3 4 5 6 7 10 11) *0, disabled. ACPI: PCI Interrupt Link [LNKF] (IRQs 3 4 *5 6 7 10 11) ACPI: PCI Interrupt Link [LNK0] (IRQs 3 4 5 6 7 *10 11) ACPI: PCI Interrupt Link [LNK1] (IRQs 3 4 5 6 7 10 *11) Linux Plug and Play Support v0.97 (c) Adam Belay pnp: PnP ACPI init ACPI: bus type pnp registered pnp: PnP ACPI: found 11 devices ACPI: ACPI bus type pnp unregistered usbcore: registered new interface driver usbfs usbcore: registered new interface driver hub usbcore: registered new device driver usb PCI: Using ACPI for IRQ routing PCI: If a device doesn't work, try "pci=routeirq". If it helps, post a report PCI: Cannot allocate resource region 3 of device 0000:00:00.0 NetLabel: Initializing NetLabel: domain hash size = 128 NetLabel: protocols = UNLABELED CIPSOv4 NetLabel: unlabeled traffic allowed by default ACPI: RTC can wake from S4 pnp: 00:01: ioport range 0x140-0x15f has been reserved pnp: 00:01: ioport range 0x228-0x22f has been reserved pnp: 00:01: ioport range 0x4d6-0x4d6 has been reserved pnp: 00:01: ioport range 0xc00-0xc01 has been reserved pnp: 00:01: ioport range 0xc14-0xc14 has been reserved pnp: 00:01: ioport range 0xc50-0xc52 has been reserved pnp: 00:01: ioport range 0xc6c-0xc6d has been reserved pnp: 00:01: ioport range 0xc6f-0xc6f has been reserved pnp: 00:09: iomem range 0xe0000000-0xefffffff could not be reserved pnp: 00:0a: iomem range 0xd0000-0xd3fff has been reserved pnp: 00:0a: iomem range 0xd5000-0xd7fff has been reserved pnp: 00:0a: iomem range 0xf0000-0xfbfff could not be reserved pnp: 00:0a: iomem range 0xfc000-0xfffff could not be reserved Time: tsc clocksource has been installed. PCI: Bridge: 0000:00:02.0 IO window: e000-efff MEM window: fa000000-fcffffff PREFETCH window: d0000000-dfffffff PCI: Bridge: 0000:00:14.4 IO window: d000-dfff MEM window: fdd00000-fddfffff PREFETCH window: fde00000-fdefffff PCI: Setting latency timer of device 0000:00:02.0 to 64 NET: Registered protocol family 2 IP route cache hash table entries: 32768 (order: 5, 131072 bytes) TCP established hash table entries: 131072 (order: 8, 1572864 bytes) TCP bind hash table entries: 65536 (order: 7, 524288 bytes) TCP: Hash tables configured (established 131072 bind 65536) TCP reno registered checking if image is initramfs... it is Freeing initrd memory: 2273k freed apm: BIOS version 1.2 Flags 0x07 (Driver version 1.16ac) apm: disabled - APM is not SMP safe. audit: initializing netlink socket (disabled) audit(1189113773.416:1): initialized highmem bounce pool size: 64 pages Total HugeTLB memory allocated, 0 VFS: Disk quotas dquot_6.5.1 Dquot-cache hash table entries: 1024 (order 0, 4096 bytes) SELinux: Registering netfilter hooks ksign: Installing public key data Loading keyring - Added public key 1ADEE2DC68AD2ABA - User ID: Red Hat, Inc. (Kernel Module GPG key) io scheduler noop registered io scheduler anticipatory registered io scheduler deadline registered io scheduler cfq registered (default) PCI: MSI quirk detected. MSI deactivated. 0000:00:13.2 EHCI: BIOS handoff failed (BIOS bug ?) 01010001 Boot video device is 0000:01:00.0 PCI: Setting latency timer of device 0000:00:02.0 to 64 assign_interrupt_mode Found MSI capability Allocate Port Service[0000:00:02.0:pcie00] ACPI: Processor [CPU0] (supports 8 throttling states) ACPI: Processor [CPU1] (supports 8 throttling states) ACPI Exception (processor_core-0781): AE_NOT_FOUND, Processor Device is not present [20070126] ACPI Exception (processor_core-0781): AE_NOT_FOUND, Processor Device is not present [20070126] isapnp: Scanning for PnP cards... isapnp: No Plug & Play device found Generic RTC Driver v1.07 Non-volatile memory driver v1.2 Linux agpgart interface v0.102 (c) Dave Jones Serial: 8250/16550 driver $Revision: 1.90 $ 4 ports, IRQ sharing enabled ACPI: PCI Interrupt 0000:02:01.0[A] -> GSI 23 (level, low) -> IRQ 16 0000:02:01.0: ttyS0 at I/O 0xda08 (irq = 16) is a 16450 0000:02:01.0: ttyS1 at I/O 0xda10 (irq = 16) is a 8250 0000:02:01.0: ttyS2 at I/O 0xda18 (irq = 16) is a 16450 0000:02:01.0: ttyS3 at I/O 0xda20 (irq = 16) is a 8250 Couldn't register serial port 0000:02:01.0: -28 RAMDISK driver initialized: 16 RAM disks of 16384K size 4096 blocksize input: Macintosh mouse button emulation as /class/input/input0 Uniform Multi-Platform E-IDE driver Revision: 7.00alpha2 ide: Assuming 33MHz system bus speed for PIO modes; override with idebus=xx ATIIXP: IDE controller at PCI slot 0000:00:14.1 ACPI: PCI Interrupt 0000:00:14.1[A] -> GSI 16 (level, low) -> IRQ 17 ATIIXP: chipset revision 128 ATIIXP: not 100% native mode: will probe irqs later ide0: BM-DMA at 0xf400-0xf407, BIOS settings: hda:pio, hdb:DMA ATIIXP: simplex device: DMA disabled ide1: ATIIXP Bus-Master DMA disabled (BIOS) Probing IDE interface ide0... hdb: PHILIPS DVDR1628P1, ATAPI CD/DVD-ROM drive hdb: selected mode 0x42 ide0 at 0x1f0-0x1f7,0x3f6 on irq 14 Probing IDE interface ide1... Probing IDE interface ide1... ide-floppy driver 0.99.newide PNP: PS/2 Controller [PNP0303:PS2K,PNP0f13:PS2M] at 0x60,0x64 irq 1,12 serio: i8042 KBD port at 0x60,0x64 irq 1 serio: i8042 AUX port at 0x60,0x64 irq 12 mice: PS/2 mouse device common for all mice input: AT Translated Set 2 keyboard as /class/input/input1 usbcore: registered new interface driver hiddev usbcore: registered new interface driver usbhid drivers/hid/usbhid/hid-core.c: v2.6:USB HID core driver TCP cubic registered Initializing XFRM netlink socket NET: Registered protocol family 1 NET: Registered protocol family 17 Using IPI No-Shortcut mode Magic number: 7:519:398 drivers/rtc/hctosys.c: unable to open rtc device (rtc0) Freeing unused kernel memory: 260k freed Write protecting the kernel read-only data: 904k input: GenPS/2 Genius Mouse as /class/input/input2 USB Universal Host Controller Interface driver v3.0 ohci_hcd: 2006 August 04 USB 1.1 'Open' Host Controller (OHCI) Driver ACPI: PCI Interrupt 0000:00:13.0[A] -> GSI 19 (level, low) -> IRQ 18 ohci_hcd 0000:00:13.0: OHCI Host Controller ohci_hcd 0000:00:13.0: new USB bus registered, assigned bus number 1 ohci_hcd 0000:00:13.0: irq 18, io mem 0xfdffc000 usb usb1: configuration #1 chosen from 1 choice hub 1-0:1.0: USB hub found hub 1-0:1.0: 4 ports detected ACPI: PCI Interrupt 0000:00:13.1[A] -> GSI 19 (level, low) -> IRQ 18 ohci_hcd 0000:00:13.1: OHCI Host Controller ohci_hcd 0000:00:13.1: new USB bus registered, assigned bus number 2 ohci_hcd 0000:00:13.1: irq 18, io mem 0xfdffb000 usb usb2: configuration #1 chosen from 1 choice hub 2-0:1.0: USB hub found hub 2-0:1.0: 4 ports detected ACPI: PCI Interrupt 0000:00:13.2[A] -> GSI 19 (level, low) -> IRQ 18 ehci_hcd 0000:00:13.2: EHCI Host Controller ehci_hcd 0000:00:13.2: new USB bus registered, assigned bus number 3 ehci_hcd 0000:00:13.2: irq 18, io mem 0xfdffa000 ehci_hcd 0000:00:13.2: USB 2.0 started, EHCI 1.00, driver 10 Dec 2004 usb usb3: configuration #1 chosen from 1 choice hub 3-0:1.0: USB hub found hub 3-0:1.0: 8 ports detected SCSI subsystem initialized libata version 2.21 loaded. sata_sil 0000:00:11.0: version 2.2 ACPI: PCI Interrupt 0000:00:11.0[A] -> GSI 23 (level, low) -> IRQ 16 scsi0 : sata_sil scsi1 : sata_sil ata1: SATA max UDMA/100 cmd 0xf8844080 ctl 0xf884408a bmdma 0xf8844000 irq 16 ata2: SATA max UDMA/100 cmd 0xf88440c0 ctl 0xf88440ca bmdma 0xf8844008 irq 16 ata1: SATA link down (SStatus 0 SControl 310) ata2: SATA link down (SStatus 0 SControl 310) ACPI: PCI Interrupt 0000:00:12.0[A] -> GSI 22 (level, low) -> IRQ 19 scsi2 : sata_sil scsi3 : sata_sil ata3: SATA max UDMA/100 cmd 0xf8846080 ctl 0xf884608a bmdma 0xf8846000 irq 19 ata4: SATA max UDMA/100 cmd 0xf88460c0 ctl 0xf88460ca bmdma 0xf8846008 irq 19 ata3: SATA link up 1.5 Gbps (SStatus 113 SControl 310) ata3.00: ATA-7: ST3160812AS, 3.AAE, max UDMA/133 ata3.00: 312581808 sectors, multi 16: LBA48 NCQ (depth 0/32) ata3.00: configured for UDMA/100 ata4: SATA link down (SStatus 0 SControl 310) scsi 2:0:0:0: Direct-Access ATA ST3160812AS 3.AA PQ: 0 ANSI: 5 sd 2:0:0:0: [sda] 312581808 512-byte hardware sectors (160042 MB) sd 2:0:0:0: [sda] Write Protect is off sd 2:0:0:0: [sda] Mode Sense: 00 3a 00 00 sd 2:0:0:0: [sda] Write cache: enabled, read cache: enabled, doesn't support DPO or FUA sd 2:0:0:0: [sda] 312581808 512-byte hardware sectors (160042 MB) sd 2:0:0:0: [sda] Write Protect is off sd 2:0:0:0: [sda] Mode Sense: 00 3a 00 00 sd 2:0:0:0: [sda] Write cache: enabled, read cache: enabled, doesn't support DPO or FUA sda: sda1 sda2 sda3 sda4 < sda5 sda6 > sd 2:0:0:0: [sda] Attached SCSI disk device-mapper: ioctl: 4.11.0-ioctl (2006-10-12) initialised: dm-devel@redhat.com kjournald starting. Commit interval 5 seconds EXT3-fs: mounted filesystem with ordered data mode. audit(1189113784.398:2): enforcing=1 old_enforcing=0 auid=4294967295 security: 3 users, 6 roles, 1657 types, 211 bools, 1 sens, 1024 cats security: 61 classes, 56319 rules SELinux: Completing initialization. SELinux: Setting up existing superblocks. SELinux: initialized (dev dm-0, type ext3), uses xattr SELinux: initialized (dev usbfs, type usbfs), uses genfs_contexts SELinux: initialized (dev tmpfs, type tmpfs), uses transition SIDs SELinux: initialized (dev debugfs, type debugfs), uses genfs_contexts SELinux: initialized (dev selinuxfs, type selinuxfs), uses genfs_contexts SELinux: initialized (dev mqueue, type mqueue), uses transition SIDs SELinux: initialized (dev hugetlbfs, type hugetlbfs), uses genfs_contexts SELinux: initialized (dev devpts, type devpts), uses transition SIDs SELinux: initialized (dev inotifyfs, type inotifyfs), uses genfs_contexts SELinux: initialized (dev tmpfs, type tmpfs), uses transition SIDs SELinux: initialized (dev futexfs, type futexfs), uses genfs_contexts SELinux: initialized (dev anon_inodefs, type anon_inodefs), not configured for labeling SELinux: initialized (dev pipefs, type pipefs), uses task SIDs SELinux: initialized (dev sockfs, type sockfs), uses task SIDs SELinux: initialized (dev cpuset, type cpuset), uses genfs_contexts SELinux: initialized (dev proc, type proc), uses genfs_contexts SELinux: initialized (dev bdev, type bdev), uses genfs_contexts SELinux: initialized (dev rootfs, type rootfs), uses genfs_contexts SELinux: initialized (dev sysfs, type sysfs), uses genfs_contexts audit(1189113784.575:3): policy loaded auid=4294967295 8139too Fast Ethernet driver 0.9.28 ACPI: PCI Interrupt 0000:02:05.0[A] -> GSI 21 (level, low) -> IRQ 21 eth0: RealTek RTL8139 at 0xf88fa000, 00:14:85:fb:3b:b3, IRQ 21 eth0: Identified 8139 chip type 'RTL-8100B/8139D' ACPI: PCI Interrupt 0000:02:06.0[A] -> GSI 22 (level, low) -> IRQ 19 rtc_cmos 00:03: rtc core: registered rtc_cmos as rtc0 rtc0: alarms up to one month ohci1394: fw-host0: OHCI-1394 1.1 (PCI): IRQ=[19] MMIO=[fddfd000-fddfd7ff] Max Packet=[1024] IR/IT contexts=[4/8] hdb: ATAPI 48X DVD-ROM DVD-R CD-R/RW drive, 2048kB Cache, UDMA(33) Uniform CD-ROM driver Revision: 3.20 piix4_smbus 0000:00:14.0: Found 0000:00:14.0 device 8139cp: 10/100 PCI Ethernet driver v1.3 (Mar 22, 2004) ACPI: PCI Interrupt 0000:00:14.2[A] -> GSI 16 (level, low) -> IRQ 17 hda_codec: Unknown model for ALC880, trying auto-probe from BIOS... sd 2:0:0:0: Attached scsi generic sg0 type 0 ieee1394: Host added: ID:BUS[0-00:1023] GUID[0000148500fb3996] floppy0: no floppy controllers found lp: driver loaded but no devices found sonypi: Sony Programmable I/O Controller Driver v1.26. SELinux: initialized (dev ramfs, type ramfs), uses genfs_contexts NET: Registered protocol family 10 lo: Disabled Privacy Extensions Mobile IPv6 No dock devices found. input: Power Button (FF) as /class/input/input3 ACPI: Power Button (FF) [PWRF] input: Power Button (CM) as /class/input/input4 ACPI: Power Button (CM) [PWRB] md: Autodetecting RAID arrays. md: autorun ... md: ... autorun DONE. device-mapper: multipath: version 1.0.5 loaded EXT3 FS on dm-0, internal journal kjournald starting. Commit interval 5 seconds EXT3 FS on sda5, internal journal EXT3-fs: mounted filesystem with ordered data mode. SELinux: initialized (dev sda5, type ext3), uses xattr SELinux: initialized (dev tmpfs, type tmpfs), uses transition SIDs Adding 2031608k swap on /dev/VolGroup00/LogVol01. Priority:-1 extents:1 across:2031608k SELinux: initialized (dev binfmt_misc, type binfmt_misc), uses genfs_contexts ip6_tables: (C) 2000-2006 Netfilter Core Team ip_tables: (C) 2000-2006 Netfilter Core Team Netfilter messages via NETLINK v0.30. nf_conntrack version 0.5.0 (8183 buckets, 65464 max) eth0: link up, 100Mbps, full-duplex, lpa 0x45E1 SELinux: initialized (dev rpc_pipefs, type rpc_pipefs), uses genfs_contexts Bluetooth: Core ver 2.11 NET: Registered protocol family 31 Bluetooth: HCI device and connection manager initialized Bluetooth: HCI socket layer initialized Bluetooth: L2CAP ver 2.8 Bluetooth: L2CAP socket layer initialized Bluetooth: HIDP (Human Interface Emulation) ver 1.2 SELinux: initialized (dev autofs, type autofs), uses genfs_contexts SELinux: initialized (dev autofs, type autofs), uses genfs_contexts SELinux: initialized (dev autofs, type autofs), uses genfs_contexts eth0: no IPv6 routers present audit(1189110221.361:4): avc: denied { use } for pid=2718 comm="hald" name="0" dev=devpts ino=2 scontext=system_u:system_r:hald_t:s0 tcontext=system_u:system_r:init_t:s0 tclass=fd audit(1189110221.361:5): avc: denied { use } for pid=2718 comm="hald" name="0" dev=devpts ino=2 scontext=system_u:system_r:hald_t:s0 tcontext=system_u:system_r:init_t:s0 tclass=fd audit(1189110221.361:6): avc: denied { use } for pid=2718 comm="hald" name="0" dev=devpts ino=2 scontext=system_u:system_r:hald_t:s0 tcontext=system_u:system_r:init_t:s0 tclass=fd ata3.00: exception Emask 0x0 SAct 0x0 SErr 0x0 action 0x0 ata3.00: cmd b0/da:00:00:4f:c2/00:00:00:00:00/00 tag 0 cdb 0x0 data 0 res 51/04:00:00:4f:c2/00:00:00:00:00/00 Emask 0x1 (device error) ata3.00: configured for UDMA/100 ata3: EH complete ata3.00: exception Emask 0x0 SAct 0x0 SErr 0x0 action 0x0 ata3.00: cmd b0/da:00:00:4f:c2/00:00:00:00:00/00 tag 0 cdb 0x0 data 0 res 51/04:00:00:4f:c2/00:00:00:00:00/00 Emask 0x1 (device error) ata3.00: configured for UDMA/100 ata3: EH complete ata3.00: exception Emask 0x0 SAct 0x0 SErr 0x0 action 0x0 ata3.00: cmd b0/da:00:00:4f:c2/00:00:00:00:00/00 tag 0 cdb 0x0 data 0 res 51/04:00:00:4f:c2/00:00:00:00:00/00 Emask 0x1 (device error) ata3.00: configured for UDMA/100 ata3: EH complete ata3.00: exception Emask 0x0 SAct 0x0 SErr 0x0 action 0x0 ata3.00: cmd b0/da:00:00:4f:c2/00:00:00:00:00/00 tag 0 cdb 0x0 data 0 res 51/04:00:00:4f:c2/00:00:00:00:00/00 Emask 0x1 (device error) ata3.00: configured for UDMA/100 ata3: EH complete ata3.00: exception Emask 0x0 SAct 0x0 SErr 0x0 action 0x0 ata3.00: cmd b0/da:00:00:4f:c2/00:00:00:00:00/00 tag 0 cdb 0x0 data 0 res 51/04:00:00:4f:c2/00:00:00:00:00/00 Emask 0x1 (device error) ata3.00: configured for UDMA/100 ata3: EH complete ata3.00: exception Emask 0x0 SAct 0x0 SErr 0x0 action 0x0 ata3.00: cmd b0/da:00:00:4f:c2/00:00:00:00:00/00 tag 0 cdb 0x0 data 0 res 51/04:00:00:4f:c2/00:00:00:00:00/00 Emask 0x1 (device error) ata3.00: configured for UDMA/100 ata3: EH complete sd 2:0:0:0: [sda] 312581808 512-byte hardware sectors (160042 MB) sd 2:0:0:0: [sda] Write Protect is off sd 2:0:0:0: [sda] Mode Sense: 00 3a 00 00 sd 2:0:0:0: [sda] Write cache: enabled, read cache: enabled, doesn't support DPO or FUA sd 2:0:0:0: [sda] 312581808 512-byte hardware sectors (160042 MB) sd 2:0:0:0: [sda] Write Protect is off sd 2:0:0:0: [sda] Mode Sense: 00 3a 00 00 sd 2:0:0:0: [sda] Write cache: enabled, read cache: enabled, doesn't support DPO or FUA ############################# And now, a similar 'dmesg' dump with the HD added to the ide cable stopping the DVD drive being recognised..... ############################# Linux version 2.6.22.4-45.fc6 (brewbuilder@ls20-bc1-14.build.redhat.com) (gcc version 4.1.2 20070626 (Red Hat 4.1.2-13)) #1 SMP Tue Aug 21 17:15:15 EDT 2007 BIOS-provided physical RAM map: BIOS-e820: 0000000000000000 - 000000000009f000 (usable) BIOS-e820: 000000000009f000 - 00000000000a0000 (reserved) BIOS-e820: 00000000000f0000 - 0000000000100000 (reserved) BIOS-e820: 0000000000100000 - 000000003fef0000 (usable) BIOS-e820: 000000003fef0000 - 000000003fef3000 (ACPI NVS) BIOS-e820: 000000003fef3000 - 000000003ff00000 (ACPI data) BIOS-e820: 00000000e0000000 - 00000000f0000000 (reserved) BIOS-e820: 00000000fec00000 - 0000000100000000 (reserved) 126MB HIGHMEM available. 896MB LOWMEM available. found SMP MP-table at 000f3ec0 Using x86 segment limits to approximate NX protection Entering add_active_range(0, 0, 261872) 0 entries of 256 used Zone PFN ranges: DMA 0 -> 4096 Normal 4096 -> 229376 HighMem 229376 -> 261872 early_node_map[1] active PFN ranges 0: 0 -> 261872 On node 0 totalpages: 261872 DMA zone: 32 pages used for memmap DMA zone: 0 pages reserved DMA zone: 4064 pages, LIFO batch:0 Normal zone: 1760 pages used for memmap Normal zone: 223520 pages, LIFO batch:31 HighMem zone: 253 pages used for memmap HighMem zone: 32243 pages, LIFO batch:7 DMI 2.3 present. Using APIC driver default ACPI: RSDP 000F8180, 0014 (r0 RC410 ) ACPI: RSDT 3FEF3040, 0030 (r1 RC410 AWRDACPI 42302E31 AWRD 0) ACPI: FACP 3FEF30C0, 0074 (r1 RC410 AWRDACPI 42302E31 AWRD 0) ACPI: DSDT 3FEF3180, 2F28 (r1 RC410 AWRDACPI 1000 MSFT 100000E) ACPI: FACS 3FEF0000, 0040 ACPI: MCFG 3FEF61C0, 003C (r1 RC410 AWRDACPI 42302E31 AWRD 0) ACPI: APIC 3FEF6100, 0068 (r1 RC410 AWRDACPI 42302E31 AWRD 0) ATI board detected. Disabling timer routing over 8254. ACPI: PM-Timer IO Port: 0x4008 ACPI: Local APIC address 0xfee00000 ACPI: LAPIC (acpi_id[0x00] lapic_id[0x00] enabled) Processor #0 15:4 APIC version 20 ACPI: LAPIC (acpi_id[0x01] lapic_id[0x01] enabled) Processor #1 15:4 APIC version 20 ACPI: LAPIC_NMI (acpi_id[0x00] high edge lint[0x1]) ACPI: LAPIC_NMI (acpi_id[0x01] high edge lint[0x1]) ACPI: IOAPIC (id[0x02] address[0xfec00000] gsi_base[0]) IOAPIC[0]: apic_id 2, version 33, address 0xfec00000, GSI 0-23 ACPI: INT_SRC_OVR (bus 0 bus_irq 0 global_irq 2 dfl dfl) ACPI: INT_SRC_OVR (bus 0 bus_irq 9 global_irq 21 low level) ACPI: IRQ0 used by override. ACPI: IRQ2 used by override. Enabling APIC mode: Flat. Using 1 I/O APICs Using ACPI (MADT) for SMP configuration information Allocating PCI resources starting at 40000000 (gap: 3ff00000:a0100000) Built 1 zonelists. Total pages: 259827 Kernel command line: ro root=/dev/VolGroup00/LogVol00 rhgb quiet mapped APIC to ffffd000 (fee00000) mapped IOAPIC to ffffc000 (fec00000) Enabling fast FPU save and restore... done. Enabling unmasked SIMD FPU exception support... done. Initializing CPU#0 CPU 0 irqstacks, hard=c07bd000 soft=c079d000 PID hash table entries: 4096 (order: 12, 16384 bytes) Detected 3059.315 MHz processor. Console: colour VGA+ 80x25 Dentry cache hash table entries: 131072 (order: 7, 524288 bytes) Inode-cache hash table entries: 65536 (order: 6, 262144 bytes) Memory: 1030840k/1047488k available (2219k kernel code, 15888k reserved, 1177k data, 260k init, 129984k highmem) virtual kernel memory layout: fixmap : 0xffc55000 - 0xfffff000 (3752 kB) pkmap : 0xff800000 - 0xffc00000 (4096 kB) vmalloc : 0xf8800000 - 0xff7fe000 ( 111 MB) lowmem : 0xc0000000 - 0xf8000000 ( 896 MB) .init : 0xc0757000 - 0xc0798000 ( 260 kB) .data : 0xc062ae30 - 0xc0751584 (1177 kB) .text : 0xc0400000 - 0xc062ae30 (2219 kB) Checking if this processor honours the WP bit even in supervisor mode... Ok. SLUB: Genslabs=22, HWalign=64, Order=0-1, MinObjects=4, CPUs=2, Nodes=1 Calibrating delay using timer specific routine.. 6122.91 BogoMIPS (lpj=3061455) Security Framework v1.0.0 initialized SELinux: Initializing. SELinux: Starting in permissive mode selinux_register_security: Registering secondary module capability Capability LSM initialized as secondary Mount-cache hash table entries: 512 CPU: After generic identify, caps: bfebfbff 20100000 00000000 00000000 0000651d 00000000 00000001 monitor/mwait feature present. using mwait in idle threads. CPU: Trace cache: 12K uops, L1 D cache: 16K CPU: L2 cache: 1024K CPU: Physical Processor ID: 0 CPU: After all inits, caps: bfebf3ff 20100000 00000000 0000b180 0000651d 00000000 00000001 Intel machine check architecture supported. Intel machine check reporting enabled on CPU#0. CPU0: Intel P4/Xeon Extended MCE MSRs (24) available Compat vDSO mapped to ffffe000. Checking 'hlt' instruction... OK. SMP alternatives: switching to UP code ACPI: Core revision 20070126 CPU0: Intel(R) Pentium(R) 4 CPU 3.06GHz stepping 09 SMP alternatives: switching to SMP code Booting processor 1/1 eip 3000 CPU 1 irqstacks, hard=c07be000 soft=c079e000 Initializing CPU#1 Calibrating delay using timer specific routine.. 6117.16 BogoMIPS (lpj=3058581) CPU: After generic identify, caps: bfebfbff 20100000 00000000 00000000 0000651d 00000000 00000001 monitor/mwait feature present. CPU: Trace cache: 12K uops, L1 D cache: 16K CPU: L2 cache: 1024K CPU: Physical Processor ID: 0 CPU: After all inits, caps: bfebf3ff 20100000 00000000 0000b180 0000651d 00000000 00000001 Intel machine check architecture supported. Intel machine check reporting enabled on CPU#1. CPU1: Intel P4/Xeon Extended MCE MSRs (24) available CPU1: Intel(R) Pentium(R) 4 CPU 3.06GHz stepping 09 Total of 2 processors activated (12240.07 BogoMIPS). ENABLING IO-APIC IRQs ..TIMER: vector=0x31 apic1=0 pin1=2 apic2=-1 pin2=-1 checking TSC synchronization [CPU#0 -> CPU#1]: passed. Brought up 2 CPUs sizeof(vma)=84 bytes sizeof(page)=32 bytes sizeof(inode)=336 bytes sizeof(dentry)=132 bytes sizeof(ext3inode)=488 bytes sizeof(buffer_head)=56 bytes sizeof(skbuff)=176 bytes sizeof(task_struct)=1536 bytes Time: 11:12:55 Date: 08/10/107 NET: Registered protocol family 16 ACPI: bus type pci registered PCI: PCI BIOS revision 3.00 entry at 0xf9ef0, last bus=2 PCI: Using configuration type 1 Setting up standard PCI resources ACPI: Interpreter enabled ACPI: (supports S0 S3 S4 S5) ACPI: Using IOAPIC for interrupt routing ACPI: PCI Root Bridge [PCI0] (0000:00) PCI: Probing PCI hardware (bus 00) PCI: Transparent bridge - 0000:00:14.4 ACPI: PCI Interrupt Routing Table [\_SB_.PCI0._PRT] ACPI: PCI Interrupt Routing Table [\_SB_.PCI0.P2P_._PRT] ACPI: PCI Interrupt Routing Table [\_SB_.PCI0.PCE2._PRT] ACPI: PCI Interrupt Link [LNKA] (IRQs 3 4 5 6 7 10 11) *0, disabled. ACPI: PCI Interrupt Link [LNKB] (IRQs 3 4 5 6 7 10 11) *0, disabled. ACPI: PCI Interrupt Link [LNKC] (IRQs 3 4 5 6 7 10 11) *0, disabled. ACPI: PCI Interrupt Link [LNKD] (IRQs 3 4 5 6 7 10 11) *0, disabled. ACPI: PCI Interrupt Link [LNKE] (IRQs 3 4 5 6 7 10 11) *0, disabled. ACPI: PCI Interrupt Link [LNKF] (IRQs 3 4 *5 6 7 10 11) ACPI: PCI Interrupt Link [LNK0] (IRQs 3 4 5 6 7 *10 11) ACPI: PCI Interrupt Link [LNK1] (IRQs 3 4 5 6 7 10 *11) Linux Plug and Play Support v0.97 (c) Adam Belay pnp: PnP ACPI init ACPI: bus type pnp registered pnp: PnP ACPI: found 11 devices ACPI: ACPI bus type pnp unregistered usbcore: registered new interface driver usbfs usbcore: registered new interface driver hub usbcore: registered new device driver usb PCI: Using ACPI for IRQ routing PCI: If a device doesn't work, try "pci=routeirq". If it helps, post a report PCI: Cannot allocate resource region 3 of device 0000:00:00.0 NetLabel: Initializing NetLabel: domain hash size = 128 NetLabel: protocols = UNLABELED CIPSOv4 NetLabel: unlabeled traffic allowed by default ACPI: RTC can wake from S4 pnp: 00:01: ioport range 0x140-0x15f has been reserved pnp: 00:01: ioport range 0x228-0x22f has been reserved pnp: 00:01: ioport range 0x4d6-0x4d6 has been reserved Time: tsc clocksource has been installed. pnp: 00:01: ioport range 0xc00-0xc01 has been reserved pnp: 00:01: ioport range 0xc14-0xc14 has been reserved pnp: 00:01: ioport range 0xc50-0xc52 has been reserved pnp: 00:01: ioport range 0xc6c-0xc6d has been reserved pnp: 00:01: ioport range 0xc6f-0xc6f has been reserved pnp: 00:09: iomem range 0xe0000000-0xefffffff could not be reserved pnp: 00:0a: iomem range 0xd0000-0xd3fff has been reserved pnp: 00:0a: iomem range 0xd5000-0xd7fff has been reserved pnp: 00:0a: iomem range 0xf0000-0xfbfff could not be reserved pnp: 00:0a: iomem range 0xfc000-0xfffff could not be reserved PCI: Bridge: 0000:00:02.0 IO window: e000-efff MEM window: fa000000-fcffffff PREFETCH window: d0000000-dfffffff PCI: Bridge: 0000:00:14.4 IO window: d000-dfff MEM window: fdd00000-fddfffff PREFETCH window: fde00000-fdefffff PCI: Setting latency timer of device 0000:00:02.0 to 64 NET: Registered protocol family 2 IP route cache hash table entries: 32768 (order: 5, 131072 bytes) TCP established hash table entries: 131072 (order: 8, 1572864 bytes) TCP bind hash table entries: 65536 (order: 7, 524288 bytes) TCP: Hash tables configured (established 131072 bind 65536) TCP reno registered checking if image is initramfs... it is Freeing initrd memory: 2273k freed apm: BIOS version 1.2 Flags 0x07 (Driver version 1.16ac) apm: disabled - APM is not SMP safe. audit: initializing netlink socket (disabled) audit(1189422774.419:1): initialized highmem bounce pool size: 64 pages Total HugeTLB memory allocated, 0 VFS: Disk quotas dquot_6.5.1 Dquot-cache hash table entries: 1024 (order 0, 4096 bytes) SELinux: Registering netfilter hooks ksign: Installing public key data Loading keyring - Added public key 32A314957AFE5BD9 - User ID: Red Hat, Inc. (Kernel Module GPG key) io scheduler noop registered io scheduler anticipatory registered io scheduler deadline registered io scheduler cfq registered (default) PCI: MSI quirk detected. MSI deactivated. 0000:00:13.2 EHCI: BIOS handoff failed (BIOS bug ?) 01010001 Boot video device is 0000:01:00.0 PCI: Setting latency timer of device 0000:00:02.0 to 64 assign_interrupt_mode Found MSI capability Allocate Port Service[0000:00:02.0:pcie00] ACPI: Processor [CPU0] (supports 8 throttling states) ACPI: Processor [CPU1] (supports 8 throttling states) ACPI Exception (processor_core-0781): AE_NOT_FOUND, Processor Device is not present [20070126] ACPI Exception (processor_core-0781): AE_NOT_FOUND, Processor Device is not present [20070126] isapnp: Scanning for PnP cards... isapnp: No Plug & Play device found Generic RTC Driver v1.07 Non-volatile memory driver v1.2 Linux agpgart interface v0.102 (c) Dave Jones Serial: 8250/16550 driver $Revision: 1.90 $ 4 ports, IRQ sharing enabled ACPI: PCI Interrupt 0000:02:01.0[A] -> GSI 23 (level, low) -> IRQ 16 0000:02:01.0: ttyS0 at I/O 0xda08 (irq = 16) is a 16450 0000:02:01.0: ttyS1 at I/O 0xda10 (irq = 16) is a 8250 0000:02:01.0: ttyS2 at I/O 0xda18 (irq = 16) is a 16450 0000:02:01.0: ttyS3 at I/O 0xda20 (irq = 16) is a 8250 Couldn't register serial port 0000:02:01.0: -28 RAMDISK driver initialized: 16 RAM disks of 16384K size 4096 blocksize input: Macintosh mouse button emulation as /class/input/input0 Uniform Multi-Platform E-IDE driver Revision: 7.00alpha2 ide: Assuming 33MHz system bus speed for PIO modes; override with idebus=xx ATIIXP: IDE controller at PCI slot 0000:00:14.1 ACPI: PCI Interrupt 0000:00:14.1[A] -> GSI 16 (level, low) -> IRQ 17 ATIIXP: chipset revision 128 ATIIXP: not 100% native mode: will probe irqs later ide0: BM-DMA at 0xf400-0xf407, BIOS settings: hda:DMA, hdb:DMA ATIIXP: simplex device: DMA disabled ide1: ATIIXP Bus-Master DMA disabled (BIOS) Probing IDE interface ide0... hda: ExcelStor Technology J880, ATA DISK drive hdb: PHILIPS DVDR1628P1, ATAPI CD/DVD-ROM drive hda: host side 80-wire cable detection failed, limiting max speed to UDMA33 hda: selected mode 0x42 hdb: selected mode 0x42 ide0 at 0x1f0-0x1f7,0x3f6 on irq 14 Probing IDE interface ide1... Probing IDE interface ide1... hda: max request size: 512KiB hda: 160836480 sectors (82348 MB) w/1719KiB Cache, CHS=16383/255/63, UDMA(33) hda: cache flushes supported hda: hda1 ide-floppy driver 0.99.newide PNP: PS/2 Controller [PNP0303:PS2K,PNP0f13:PS2M] at 0x60,0x64 irq 1,12 serio: i8042 KBD port at 0x60,0x64 irq 1 serio: i8042 AUX port at 0x60,0x64 irq 12 mice: PS/2 mouse device common for all mice input: AT Translated Set 2 keyboard as /class/input/input1 usbcore: registered new interface driver hiddev usbcore: registered new interface driver usbhid drivers/hid/usbhid/hid-core.c: v2.6:USB HID core driver TCP cubic registered Initializing XFRM netlink socket NET: Registered protocol family 1 NET: Registered protocol family 17 Using IPI No-Shortcut mode Magic number: 7:103:226 drivers/rtc/hctosys.c: unable to open rtc device (rtc0) Freeing unused kernel memory: 260k freed Write protecting the kernel read-only data: 904k input: GenPS/2 Genius Mouse as /class/input/input2 USB Universal Host Controller Interface driver v3.0 ohci_hcd: 2006 August 04 USB 1.1 'Open' Host Controller (OHCI) Driver ACPI: PCI Interrupt 0000:00:13.0[A] -> GSI 19 (level, low) -> IRQ 18 ohci_hcd 0000:00:13.0: OHCI Host Controller ohci_hcd 0000:00:13.0: new USB bus registered, assigned bus number 1 ohci_hcd 0000:00:13.0: irq 18, io mem 0xfdffc000 usb usb1: configuration #1 chosen from 1 choice hub 1-0:1.0: USB hub found hub 1-0:1.0: 4 ports detected ACPI: PCI Interrupt 0000:00:13.1[A] -> GSI 19 (level, low) -> IRQ 18 ohci_hcd 0000:00:13.1: OHCI Host Controller ohci_hcd 0000:00:13.1: new USB bus registered, assigned bus number 2 ohci_hcd 0000:00:13.1: irq 18, io mem 0xfdffb000 usb usb2: configuration #1 chosen from 1 choice hub 2-0:1.0: USB hub found hub 2-0:1.0: 4 ports detected ACPI: PCI Interrupt 0000:00:13.2[A] -> GSI 19 (level, low) -> IRQ 18 ehci_hcd 0000:00:13.2: EHCI Host Controller ehci_hcd 0000:00:13.2: new USB bus registered, assigned bus number 3 ehci_hcd 0000:00:13.2: irq 18, io mem 0xfdffa000 ehci_hcd 0000:00:13.2: USB 2.0 started, EHCI 1.00, driver 10 Dec 2004 usb usb3: configuration #1 chosen from 1 choice hub 3-0:1.0: USB hub found hub 3-0:1.0: 8 ports detected SCSI subsystem initialized libata version 2.21 loaded. sata_sil 0000:00:11.0: version 2.2 ACPI: PCI Interrupt 0000:00:11.0[A] -> GSI 23 (level, low) -> IRQ 16 scsi0 : sata_sil scsi1 : sata_sil ata1: SATA max UDMA/100 cmd 0xf8844080 ctl 0xf884408a bmdma 0xf8844000 irq 16 ata2: SATA max UDMA/100 cmd 0xf88440c0 ctl 0xf88440ca bmdma 0xf8844008 irq 16 ata1: SATA link down (SStatus 0 SControl 310) ata2: SATA link down (SStatus 0 SControl 310) ACPI: PCI Interrupt 0000:00:12.0[A] -> GSI 22 (level, low) -> IRQ 19 scsi2 : sata_sil scsi3 : sata_sil ata3: SATA max UDMA/100 cmd 0xf8846080 ctl 0xf884608a bmdma 0xf8846000 irq 19 ata4: SATA max UDMA/100 cmd 0xf88460c0 ctl 0xf88460ca bmdma 0xf8846008 irq 19 ata3: SATA link up 1.5 Gbps (SStatus 113 SControl 310) ata3.00: ATA-7: ST3160812AS, 3.AAE, max UDMA/133 ata3.00: 312581808 sectors, multi 16: LBA48 NCQ (depth 0/32) ata3.00: configured for UDMA/100 ata4: SATA link down (SStatus 0 SControl 310) scsi 2:0:0:0: Direct-Access ATA ST3160812AS 3.AA PQ: 0 ANSI: 5 sd 2:0:0:0: [sda] 312581808 512-byte hardware sectors (160042 MB) sd 2:0:0:0: [sda] Write Protect is off sd 2:0:0:0: [sda] Mode Sense: 00 3a 00 00 sd 2:0:0:0: [sda] Write cache: enabled, read cache: enabled, doesn't support DPO or FUA sd 2:0:0:0: [sda] 312581808 512-byte hardware sectors (160042 MB) sd 2:0:0:0: [sda] Write Protect is off sd 2:0:0:0: [sda] Mode Sense: 00 3a 00 00 sd 2:0:0:0: [sda] Write cache: enabled, read cache: enabled, doesn't support DPO or FUA sda: sda1 sda2 sda3 sda4 < sda5 sda6 > sd 2:0:0:0: [sda] Attached SCSI disk device-mapper: ioctl: 4.11.0-ioctl (2006-10-12) initialised: dm-devel@redhat.com kjournald starting. Commit interval 5 seconds EXT3-fs: mounted filesystem with ordered data mode. audit(1189422785.194:2): enforcing=1 old_enforcing=0 auid=4294967295 security: 3 users, 6 roles, 1657 types, 211 bools, 1 sens, 1024 cats security: 61 classes, 56319 rules SELinux: Completing initialization. SELinux: Setting up existing superblocks. SELinux: initialized (dev dm-0, type ext3), uses xattr SELinux: initialized (dev usbfs, type usbfs), uses genfs_contexts SELinux: initialized (dev tmpfs, type tmpfs), uses transition SIDs SELinux: initialized (dev debugfs, type debugfs), uses genfs_contexts SELinux: initialized (dev selinuxfs, type selinuxfs), uses genfs_contexts SELinux: initialized (dev mqueue, type mqueue), uses transition SIDs SELinux: initialized (dev hugetlbfs, type hugetlbfs), uses genfs_contexts SELinux: initialized (dev devpts, type devpts), uses transition SIDs SELinux: initialized (dev inotifyfs, type inotifyfs), uses genfs_contexts SELinux: initialized (dev tmpfs, type tmpfs), uses transition SIDs SELinux: initialized (dev futexfs, type futexfs), uses genfs_contexts SELinux: initialized (dev anon_inodefs, type anon_inodefs), not configured for labeling SELinux: initialized (dev pipefs, type pipefs), uses task SIDs SELinux: initialized (dev sockfs, type sockfs), uses task SIDs SELinux: initialized (dev cpuset, type cpuset), uses genfs_contexts SELinux: initialized (dev proc, type proc), uses genfs_contexts SELinux: initialized (dev bdev, type bdev), uses genfs_contexts SELinux: initialized (dev rootfs, type rootfs), uses genfs_contexts SELinux: initialized (dev sysfs, type sysfs), uses genfs_contexts audit(1189422785.371:3): policy loaded auid=4294967295 rtc_cmos 00:03: rtc core: registered rtc_cmos as rtc0 rtc0: alarms up to one month hdb: status timeout: status=0xd0 { Busy } ide: failed opcode was: unknown hdb: ATAPI CD-ROM drive, 0kB Cache, UDMA(33) Uniform CD-ROM driver Revision: 3.20 hdb: status timeout: status=0xd0 { Busy } ide: failed opcode was: unknown hdb: drive not ready for command ACPI: PCI Interrupt 0000:02:06.0[A] -> GSI 22 (level, low) -> IRQ 19 ohci1394: fw-host0: OHCI-1394 1.1 (PCI): IRQ=[19] MMIO=[fddfd000-fddfd7ff] Max Packet=[1024] IR/IT contexts=[4/8] hdb: status timeout: status=0xd0 { Busy } ide: failed opcode was: unknown hdb: drive not ready for command hdb: status timeout: status=0xd0 { Busy } ide: failed opcode was: unknown hdb: drive not ready for command hdb: status timeout: status=0xd0 { Busy } ide: failed opcode was: unknown hdb: drive not ready for command hdb: status timeout: status=0xd0 { Busy } ide: failed opcode was: unknown hdb: drive not ready for command 8139too Fast Ethernet driver 0.9.28 ACPI: PCI Interrupt 0000:02:05.0[A] -> GSI 21 (level, low) -> IRQ 21 eth0: RealTek RTL8139 at 0xf8918000, 00:14:85:fb:3b:b3, IRQ 21 eth0: Identified 8139 chip type 'RTL-8100B/8139D' hdb: status timeout: status=0xd0 { Busy } ide: failed opcode was: unknown hdb: drive not ready for command Clocksource tsc unstable (delta = 4685619202 ns) Time: acpi_pm clocksource has been installed. hdb: status timeout: status=0xd0 { Busy } ide: failed opcode was: unknown hdb: drive not ready for command ieee1394: Host added: ID:BUS[0-00:1023] GUID[0000148500fb3996] piix4_smbus 0000:00:14.0: Found 0000:00:14.0 device sd 2:0:0:0: Attached scsi generic sg0 type 0 8139cp: 10/100 PCI Ethernet driver v1.3 (Mar 22, 2004) ACPI: PCI Interrupt 0000:00:14.2[A] -> GSI 16 (level, low) -> IRQ 17 hda_codec: Unknown model for ALC880, trying auto-probe from BIOS... hdb: status timeout: status=0xd0 { Busy } ide: failed opcode was: unknown hdb: drive not ready for command hdb: status timeout: status=0xd0 { Busy } ide: failed opcode was: unknown hdb: drive not ready for command floppy0: no floppy controllers found lp: driver loaded but no devices found sonypi: Sony Programmable I/O Controller Driver v1.26. SELinux: initialized (dev ramfs, type ramfs), uses genfs_contexts NET: Registered protocol family 10 lo: Disabled Privacy Extensions Mobile IPv6 No dock devices found. input: Power Button (FF) as /class/input/input3 ACPI: Power Button (FF) [PWRF] input: Power Button (CM) as /class/input/input4 ACPI: Power Button (CM) [PWRB] md: Autodetecting RAID arrays. md: autorun ... md: ... autorun DONE. device-mapper: multipath: version 1.0.5 loaded EXT3 FS on dm-0, internal journal kjournald starting. Commit interval 5 seconds EXT3 FS on sda5, internal journal EXT3-fs: mounted filesystem with ordered data mode. SELinux: initialized (dev sda5, type ext3), uses xattr SELinux: initialized (dev tmpfs, type tmpfs), uses transition SIDs Adding 2031608k swap on /dev/VolGroup00/LogVol01. Priority:-1 extents:1 across:2031608k SELinux: initialized (dev binfmt_misc, type binfmt_misc), uses genfs_contexts ip6_tables: (C) 2000-2006 Netfilter Core Team ip_tables: (C) 2000-2006 Netfilter Core Team Netfilter messages via NETLINK v0.30. nf_conntrack version 0.5.0 (8183 buckets, 65464 max) eth0: link up, 100Mbps, full-duplex, lpa 0x45E1 eth0: link up, 100Mbps, full-duplex, lpa 0x45E1 SELinux: initialized (dev rpc_pipefs, type rpc_pipefs), uses genfs_contexts Bluetooth: Core ver 2.11 NET: Registered protocol family 31 Bluetooth: HCI device and connection manager initialized Bluetooth: HCI socket layer initialized Bluetooth: L2CAP ver 2.8 Bluetooth: L2CAP socket layer initialized Bluetooth: HIDP (Human Interface Emulation) ver 1.2 SELinux: initialized (dev autofs, type autofs), uses genfs_contexts SELinux: initialized (dev autofs, type autofs), uses genfs_contexts SELinux: initialized (dev autofs, type autofs), uses genfs_contexts eth0: no IPv6 routers present audit(1189419275.866:4): avc: denied { use } for pid=2815 comm="hald" name="0" dev=devpts ino=2 scontext=system_u:system_r:hald_t:s0 tcontext=system_u:system_r:init_t:s0 tclass=fd audit(1189419275.866:5): avc: denied { use } for pid=2815 comm="hald" name="0" dev=devpts ino=2 scontext=system_u:system_r:hald_t:s0 tcontext=system_u:system_r:init_t:s0 tclass=fd audit(1189419275.866:6): avc: denied { use } for pid=2815 comm="hald" name="0" dev=devpts ino=2 scontext=system_u:system_r:hald_t:s0 tcontext=system_u:system_r:init_t:s0 tclass=fd hdb: status timeout: status=0xd0 { Busy } ide: failed opcode was: unknown hdb: drive not ready for command hdb: status timeout: status=0xd0 { Busy } ide: failed opcode was: unknown hdb: drive not ready for command hda: drive_cmd: status=0x51 { DriveReady SeekComplete Error } hda: drive_cmd: error=0x04 { DriveStatusError } ide: failed opcode was: 0xb0 ata3.00: exception Emask 0x0 SAct 0x0 SErr 0x0 action 0x0 ata3.00: cmd b0/da:00:00:4f:c2/00:00:00:00:00/00 tag 0 cdb 0x0 data 0 res 51/04:00:00:4f:c2/00:00:00:00:00/00 Emask 0x1 (device error) ata3.00: configured for UDMA/100 ata3: EH complete ata3.00: exception Emask 0x0 SAct 0x0 SErr 0x0 action 0x0 ata3.00: cmd b0/da:00:00:4f:c2/00:00:00:00:00/00 tag 0 cdb 0x0 data 0 res 51/04:00:00:4f:c2/00:00:00:00:00/00 Emask 0x1 (device error) ata3.00: configured for UDMA/100 ata3: EH complete ata3.00: exception Emask 0x0 SAct 0x0 SErr 0x0 action 0x0 ata3.00: cmd b0/da:00:00:4f:c2/00:00:00:00:00/00 tag 0 cdb 0x0 data 0 res 51/04:00:00:4f:c2/00:00:00:00:00/00 Emask 0x1 (device error) ata3.00: configured for UDMA/100 ata3: EH complete ata3.00: exception Emask 0x0 SAct 0x0 SErr 0x0 action 0x0 ata3.00: cmd b0/da:00:00:4f:c2/00:00:00:00:00/00 tag 0 cdb 0x0 data 0 res 51/04:00:00:4f:c2/00:00:00:00:00/00 Emask 0x1 (device error) ata3.00: configured for UDMA/100 ata3: EH complete ata3.00: exception Emask 0x0 SAct 0x0 SErr 0x0 action 0x0 ata3.00: cmd b0/da:00:00:4f:c2/00:00:00:00:00/00 tag 0 cdb 0x0 data 0 res 51/04:00:00:4f:c2/00:00:00:00:00/00 Emask 0x1 (device error) ata3.00: configured for UDMA/100 ata3: EH complete ata3.00: exception Emask 0x0 SAct 0x0 SErr 0x0 action 0x0 ata3.00: cmd b0/da:00:00:4f:c2/00:00:00:00:00/00 tag 0 cdb 0x0 data 0 res 51/04:00:00:4f:c2/00:00:00:00:00/00 Emask 0x1 (device error) ata3.00: configured for UDMA/100 ata3: EH complete sd 2:0:0:0: [sda] 312581808 512-byte hardware sectors (160042 MB) sd 2:0:0:0: [sda] Write Protect is off sd 2:0:0:0: [sda] Mode Sense: 00 3a 00 00 sd 2:0:0:0: [sda] Write cache: enabled, read cache: enabled, doesn't support DPO or FUA sd 2:0:0:0: [sda] 312581808 512-byte hardware sectors (160042 MB) sd 2:0:0:0: [sda] Write Protect is off sd 2:0:0:0: [sda] Mode Sense: 00 3a 00 00 sd 2:0:0:0: [sda] Write cache: enabled, read cache: enabled, doesn't support DPO or FUA kjournald starting. Commit interval 5 seconds EXT3 FS on hda1, internal journal EXT3-fs: mounted filesystem with ordered data mode. SELinux: initialized (dev hda1, type ext3), uses xattr hda-intel: Invalid position buffer, using LPIB read method instead.
Notice that by the time I did the second of the two dumps (above) I had swapped the UDMA100 cable for an old fashioned 40-wire UDMA33 cable as an experiment. So the 'dmesg' comment that it failed to spot an 80-wire cable is legit. Notice also that even in the "failed" case, the lines following "Probing IDE interface ide0..." show that both the HDD and the DVDROM drive were spotted at that point. The trouble seems to come later (reported from the "ide" module maybe?).
0xD0 means the device set its busy status and never cleared it so its a problem the device end of the bus. If the disk works ok on its own and the CD works ok on its own then check both are jumpered specifically for master and slave (not 'only drive' and slave, or one using cable select the other hard coding its position). The fact you see a stuck busy and also a slightly odd command abort from the CD makes me suspect the two devices are falling out.
I'm no expert on IDE but I know enough to know that I needed to hand-configure the two drives as master and slave before reporting a bug like this! I've not tried pulling out the two drives and swapping which is which. Not yet. Notice though the tail comment in the original report. Windows XP seems to struggle with the two drives sharing the cable but somehow manages to get it all working after a while. Or at least, it manages to recover control of the DVDROM drive after a while - it wouldn't recognise the partitions on the HDD, they're all linux stuff.
Yet more news: 1) "hdparm -i" reported the DVDROM drive as having firmware Q1.1, yet Philips's site had an upgrade to Q2.4 available. So I upgraded. No joy on linux. <sigh> 2) The story about XP managing to get the HD/DVDROM pairing on IDE to work after a delay is still true, but I was wrong about what happens when the HD is removed. Under that scenario, XP *still* has difficulties with the DVD drive so it seems. In fact it had generic difficulties with plug-n-play media for a good few minutes after power-up. Pen drives don't get recognised, nor SD cards. When the system comes to its senses they all came alive. It's as if a boot-time daemon or driver or something gets wedged and times out after three or four minutes and only after that can the PnP work right.
Steve, any updates on the problem? The above sounded more like a HW/motherboard or cabling issue...
I'll close it for now (please re-open if the issue happens with the recent kernels).