From owner-freebsd-current@FreeBSD.ORG Fri Jul 13 13:51:30 2007 Return-Path: X-Original-To: freebsd-current@freebsd.org Delivered-To: freebsd-current@freebsd.org Received: from mx1.freebsd.org (mx1.freebsd.org [69.147.83.52]) by hub.freebsd.org (Postfix) with ESMTP id 508CC16A409 for ; Fri, 13 Jul 2007 13:51:30 +0000 (UTC) (envelope-from lulf@stud.ntnu.no) Received: from merke.itea.ntnu.no (merke.itea.ntnu.no [129.241.7.61]) by mx1.freebsd.org (Postfix) with ESMTP id 882FC13C491 for ; Fri, 13 Jul 2007 13:51:29 +0000 (UTC) (envelope-from lulf@stud.ntnu.no) Received: from localhost (localhost [127.0.0.1]) by merke.itea.ntnu.no (Postfix) with ESMTP id 86EF113CE69 for ; Fri, 13 Jul 2007 15:51:28 +0200 (CEST) Received: from twoflower.idi.ntnu.no (twoflower.idi.ntnu.no [129.241.104.169]) by merke.itea.ntnu.no (Postfix) with ESMTP for ; Fri, 13 Jul 2007 15:51:27 +0200 (CEST) Received: by twoflower.idi.ntnu.no (Postfix, from userid 1002) id 4B33E1710C; Fri, 13 Jul 2007 15:51:27 +0200 (CEST) Date: Fri, 13 Jul 2007 15:51:27 +0200 From: Ulf Lilleengen To: freebsd-current@freebsd.org Message-ID: <20070713135127.GA86715@twoflower.idi.ntnu.no> Mail-Followup-To: freebsd-current@freebsd.org MIME-Version: 1.0 Content-Type: multipart/mixed; boundary="tThc/1wpZn/ma/RB" Content-Disposition: inline User-Agent: Mutt/1.5.15 (2007-04-06) X-Content-Scanned: with sophos and spamassassin at mailgw.ntnu.no. Subject: Promise SATA300 TX4 problems in CURRENT X-BeenThere: freebsd-current@freebsd.org X-Mailman-Version: 2.1.5 Precedence: list List-Id: Discussions about the use of FreeBSD-current List-Unsubscribe: , List-Archive: List-Post: List-Help: List-Subscribe: , X-List-Received-Date: Fri, 13 Jul 2007 13:51:30 -0000 --tThc/1wpZn/ma/RB Content-Type: text/plain; charset=us-ascii Content-Disposition: inline Hi, I just bought a Promise SATA-300 TX4 card for my computer. I use a SCSI drive on an adaptect controller for the system disk. I started encountering problems when trying to copy data from the filesystem on one of the ATA disks connected to the Promise card. I get these messages: ad10: WARNING - READ_DMA UDMA ICRC error (retrying request) LBA=37814559 ad10: FAILURE - device detached subdisk10: detached ad10: detached g_vfs_done():ad10s3a[WRITE(offset=114688, length=16384)]error = 6 g_vfs_done():ad10s3a[READ(offset=23412736, length=131072)]error = 6 g_vfs_done():ad10s3a[READ(offset=23412736, length=65536)]error = 6 g_vfs_done():ad10s3a[READ(offset=23478272, length=131072)]error = 6 Then if I try to use the system (dhclient in this case), it panics with: panic: vinvalbuf: dirty bufs However, I tried installing 6.2 to see if the issue remains there as well. And it didn't. I works excellent in 6.2. However, I'd like to run CURRENT on this machine. I've attached relevant part of messages, and a core dump can be found at http://twoflower.idi.ntnu.no/crash Is this perhaps a bug in the ata-subsystem? -- Ulf Lilleengen --tThc/1wpZn/ma/RB Content-Type: text/plain; charset=us-ascii Content-Disposition: attachment; filename=msgs Jul 13 13:21:02 ridcully syslogd: kernel boot file is /boot/kernel/kernel Jul 13 13:21:02 ridcully kernel: Copyright (c) 1992-2007 The FreeBSD Project. Jul 13 13:21:02 ridcully kernel: Copyright (c) 1979, 1980, 1983, 1986, 1988, 1989, 1991, 1992, 1993, 1994 Jul 13 13:21:02 ridcully kernel: The Regents of the University of California. All rights reserved. Jul 13 13:21:02 ridcully kernel: FreeBSD is a registered trademark of The FreeBSD Foundation. Jul 13 13:21:02 ridcully kernel: FreeBSD 7.0-CURRENT #0: Sat Jul 7 19:38:03 CEST 2007 Jul 13 13:21:02 ridcully kernel: root@dhcppc4:/usr/obj/usr/src/sys/GENERIC Jul 13 13:21:02 ridcully kernel: WARNING: WITNESS option enabled, expect reduced performance. Jul 13 13:21:02 ridcully kernel: Timecounter "i8254" frequency 1193182 Hz quality 0 Jul 13 13:21:02 ridcully kernel: CPU: Intel Pentium III (698.14-MHz 686-class CPU) Jul 13 13:21:02 ridcully kernel: Origin = "GenuineIntel" Id = 0x683 Stepping = 3 Jul 13 13:21:02 ridcully kernel: Features=0x387fbff Jul 13 13:21:02 ridcully kernel: real memory = 1073676288 (1023 MB) Jul 13 13:21:02 ridcully kernel: avail memory = 1037074432 (989 MB) Jul 13 13:21:02 ridcully kernel: ACPI APIC Table: Jul 13 13:21:02 ridcully kernel: FreeBSD/SMP: Multiprocessor System Detected: 2 CPUs Jul 13 13:21:02 ridcully kernel: cpu0 (BSP): APIC ID: 0 Jul 13 13:21:02 ridcully kernel: cpu1 (AP): APIC ID: 1 Jul 13 13:21:02 ridcully kernel: ioapic0 irqs 0-23 on motherboard Jul 13 13:21:02 ridcully kernel: kbd1 at kbdmux0 Jul 13 13:21:02 ridcully kernel: ath_hal: 0.9.20.3 (AR5210, AR5211, AR5212, RF5111, RF5112, RF2413, RF5413) Jul 13 13:21:02 ridcully kernel: acpi0: on motherboard Jul 13 13:21:02 ridcully kernel: acpi0: [ITHREAD] Jul 13 13:21:02 ridcully kernel: acpi0: Power Button (fixed) Jul 13 13:21:02 ridcully kernel: acpi0: reservation of 0, a0000 (3) failed Jul 13 13:21:02 ridcully kernel: acpi0: reservation of 100000, 3fef0000 (3) failed Jul 13 13:21:02 ridcully kernel: Timecounter "ACPI-safe" frequency 3579545 Hz quality 1000 Jul 13 13:21:02 ridcully kernel: acpi_timer0: <24-bit timer at 3.579545MHz> port 0x4008-0x400b on acpi0 Jul 13 13:21:02 ridcully kernel: cpu0: on acpi0 Jul 13 13:21:02 ridcully kernel: cpu1: on acpi0 Jul 13 13:21:02 ridcully kernel: acpi_button0: on acpi0 Jul 13 13:21:02 ridcully kernel: pcib0: port 0xcf8-0xcff,0x4000-0x4041,0x5000-0x500f on acpi0 Jul 13 13:21:02 ridcully kernel: pci0: on pcib0 Jul 13 13:21:02 ridcully kernel: agp0: on hostb0 Jul 13 13:21:02 ridcully kernel: pcib1: at device 1.0 on pci0 Jul 13 13:21:02 ridcully kernel: pci1: on pcib1 Jul 13 13:21:02 ridcully kernel: vgapci0: port 0xc000-0xc0ff mem 0xdc000000-0xdcffffff,0xde000000-0xde000fff at device 0.0 on pci1 Jul 13 13:21:02 ridcully kernel: isab0: at device 7.0 on pci0 Jul 13 13:21:02 ridcully kernel: isa0: on isab0 Jul 13 13:21:02 ridcully kernel: atapci0: port 0x1f0-0x1f7,0x3f6,0x170-0x177,0x376,0xf000-0xf00f at device 7.1 on pci0 Jul 13 13:21:02 ridcully kernel: ata0: on atapci0 Jul 13 13:21:02 ridcully kernel: ata0: [ITHREAD] Jul 13 13:21:02 ridcully kernel: ata1: on atapci0 Jul 13 13:21:02 ridcully kernel: ata1: [ITHREAD] Jul 13 13:21:02 ridcully kernel: uhci0: port 0xd000-0xd01f irq 19 at device 7.2 on pci0 Jul 13 13:21:02 ridcully kernel: uhci0: [GIANT-LOCKED] Jul 13 13:21:02 ridcully kernel: uhci0: [ITHREAD] Jul 13 13:21:02 ridcully kernel: usb0: on uhci0 Jul 13 13:21:02 ridcully kernel: usb0: USB revision 1.0 Jul 13 13:21:02 ridcully kernel: uhub0: on usb0 Jul 13 13:21:02 ridcully kernel: uhub0: 2 ports with 2 removable, self powered Jul 13 13:21:02 ridcully kernel: pci0: at device 7.3 (no driver attached) Jul 13 13:21:02 ridcully kernel: xl0: <3Com 3c905C-TX Fast Etherlink XL> port 0xd400-0xd47f mem 0xe4021000-0xe402107f irq 17 at device 9.0 on pci0 Jul 13 13:21:02 ridcully kernel: miibus0: on xl0 Jul 13 13:21:02 ridcully kernel: xlphy0: <3c905C 10/100 internal PHY> PHY 24 on miibus0 Jul 13 13:21:02 ridcully kernel: xlphy0: 10baseT, 10baseT-FDX, 100baseTX, 100baseTX-FDX, auto Jul 13 13:21:02 ridcully kernel: xl0: Ethernet address: 00:01:02:ab:b9:b0 Jul 13 13:21:02 ridcully kernel: xl0: [ITHREAD] Jul 13 13:21:02 ridcully kernel: xl1: <3Com 3c905C-TX Fast Etherlink XL> port 0xd800-0xd87f mem 0xe4020000-0xe402007f irq 18 at device 10.0 on pci0 Jul 13 13:21:02 ridcully kernel: miibus1: on xl1 Jul 13 13:21:02 ridcully kernel: xlphy1: <3c905C 10/100 internal PHY> PHY 24 on miibus1 Jul 13 13:21:02 ridcully kernel: xlphy1: 10baseT, 10baseT-FDX, 100baseTX, 100baseTX-FDX, auto Jul 13 13:21:02 ridcully kernel: xl1: Ethernet address: 00:01:02:ab:b9:44 Jul 13 13:21:02 ridcully kernel: xl1: [ITHREAD] Jul 13 13:21:02 ridcully kernel: atapci1: port 0xdc00-0xdc7f,0xe000-0xe0ff mem 0xe4023000-0xe4023fff,0xe4000000-0xe401ffff irq 19 at device 11.0 on pci0 Jul 13 13:21:02 ridcully kernel: atapci1: [ITHREAD] Jul 13 13:21:02 ridcully kernel: atapci1: [ITHREAD] Jul 13 13:21:02 ridcully kernel: ata2: on atapci1 Jul 13 13:21:02 ridcully kernel: ata2: [ITHREAD] Jul 13 13:21:02 ridcully kernel: ata3: on atapci1 Jul 13 13:21:02 ridcully kernel: ata3: [ITHREAD] Jul 13 13:21:02 ridcully kernel: ata4: on atapci1 Jul 13 13:21:02 ridcully kernel: ata4: [ITHREAD] Jul 13 13:21:02 ridcully kernel: ata5: on atapci1 Jul 13 13:21:02 ridcully kernel: ata5: [ITHREAD] Jul 13 13:21:02 ridcully kernel: ahc0: port 0xe400-0xe4ff mem 0xe4022000-0xe4022fff irq 16 at device 12.0 on pci0 Jul 13 13:21:02 ridcully kernel: ahc0: [ITHREAD] Jul 13 13:21:02 ridcully kernel: aic7895C: Ultra Wide Channel A, SCSI Id=7, 32/253 SCBs Jul 13 13:21:02 ridcully kernel: ahc1: port 0xe800-0xe8ff mem 0xe4024000-0xe4024fff irq 16 at device 12.1 on pci0 Jul 13 13:21:02 ridcully kernel: ahc1: [ITHREAD] Jul 13 13:21:02 ridcully kernel: aic7895C: Ultra Wide Channel B, SCSI Id=7, 32/253 SCBs Jul 13 13:21:02 ridcully kernel: acpi_tz0: on acpi0 Jul 13 13:21:02 ridcully kernel: fdc0: port 0x3f2-0x3f5,0x3f7 irq 6 drq 2 on acpi0 Jul 13 13:21:02 ridcully kernel: fdc0: [FILTER] Jul 13 13:21:02 ridcully kernel: sio0: <16550A-compatible COM port> port 0x3f8-0x3ff irq 4 flags 0x10 on acpi0 Jul 13 13:21:02 ridcully kernel: sio0: type 16550A Jul 13 13:21:02 ridcully kernel: sio0: [FILTER] Jul 13 13:21:02 ridcully kernel: sio1: <16550A-compatible COM port> port 0x2f8-0x2ff irq 3 on acpi0 Jul 13 13:21:02 ridcully kernel: sio1: type 16550A Jul 13 13:21:02 ridcully kernel: sio1: [FILTER] Jul 13 13:21:02 ridcully kernel: pmtimer0 on isa0 Jul 13 13:21:02 ridcully kernel: orm0: at iomem 0xc0000-0xc7fff,0xc8000-0xc87ff,0xc9000-0xc97ff,0xca000-0xcefff,0xcf000-0xd57ff pnpid ORM0000 on isa0 Jul 13 13:21:02 ridcully kernel: atkbdc0: at port 0x60,0x64 on isa0 Jul 13 13:21:02 ridcully kernel: atkbd0: irq 1 on atkbdc0 Jul 13 13:21:02 ridcully kernel: kbd0 at atkbd0 Jul 13 13:21:02 ridcully kernel: atkbd0: [GIANT-LOCKED] Jul 13 13:21:02 ridcully kernel: atkbd0: [ITHREAD] Jul 13 13:21:02 ridcully kernel: ppc0: at port 0x378-0x37f irq 7 on isa0 Jul 13 13:21:02 ridcully kernel: ppc0: Generic chipset (NIBBLE-only) in COMPATIBLE mode Jul 13 13:21:02 ridcully kernel: ppbus0: on ppc0 Jul 13 13:21:02 ridcully kernel: plip0: on ppbus0 Jul 13 13:21:02 ridcully kernel: lpt0: on ppbus0 Jul 13 13:21:02 ridcully kernel: lpt0: Interrupt-driven port Jul 13 13:21:02 ridcully kernel: ppi0: on ppbus0 Jul 13 13:21:02 ridcully kernel: ppc0: [GIANT-LOCKED] Jul 13 13:21:02 ridcully kernel: ppc0: [ITHREAD] Jul 13 13:21:02 ridcully kernel: sc0: at flags 0x100 on isa0 Jul 13 13:21:02 ridcully kernel: sc0: VGA <16 virtual consoles, flags=0x300> Jul 13 13:21:02 ridcully kernel: vga0: at port 0x3c0-0x3df iomem 0xa0000-0xbffff on isa0 Jul 13 13:21:02 ridcully kernel: Timecounters tick every 1.000 msec Jul 13 13:21:02 ridcully kernel: acd0: DVDR at ata0-slave UDMA33 Jul 13 13:21:02 ridcully kernel: ad6: 152627MB at ata3-master SATA150 Jul 13 13:21:02 ridcully kernel: ad10: 238475MB at ata5-master SATA300 Jul 13 13:21:02 ridcully kernel: Waiting 5 seconds for SCSI devices to settle Jul 13 13:21:02 ridcully kernel: da0 at ahc0 bus 0 target 1 lun 0 Jul 13 13:21:02 ridcully kernel: da0: Fixed Direct Access SCSI-4 device Jul 13 13:21:02 ridcully kernel: da0: 40.000MB/s transfers (20.000MHz, offset 8, 16bit) Jul 13 13:21:02 ridcully kernel: da0: Command Queueing Enabled Jul 13 13:21:02 ridcully kernel: da0: 8715MB (17850264 512 byte sectors: 255H 63S/T 1111C) Jul 13 13:21:02 ridcully kernel: SMP: AP CPU #1 Launched! Jul 13 13:21:02 ridcully kernel: WARNING: WITNESS option enabled, expect reduced performance. Jul 13 13:21:02 ridcully kernel: Trying to mount root from ufs:/dev/da0s1a Jul 13 13:21:02 ridcully root: /etc/rc: WARNING: Dump directory does not exist. Savecore not run. Jul 13 13:21:08 ridcully login: ROOT LOGIN (root) ON ttyv0 Jul 13 13:21:34 ridcully kernel: WARNING: R/W mount of /mnt denied. Filesystem is not clean - run fsck Jul 13 13:24:06 ridcully kernel: ad10: WARNING - READ_DMA UDMA ICRC error (retrying request) LBA=37814559 Jul 13 13:24:42 ridcully kernel: ad10: FAILURE - device detached Jul 13 13:24:42 ridcully kernel: subdisk10: detached Jul 13 13:24:42 ridcully kernel: ad10: detached Jul 13 13:24:42 ridcully kernel: g_vfs_done():ad10s3a[WRITE(offset=114688, length=16384)]error = 6 Jul 13 13:24:42 ridcully kernel: g_vfs_done():ad10s3a[READ(offset=23412736, length=131072)]error = 6 Jul 13 13:24:42 ridcully kernel: g_vfs_done():ad10s3a[READ(offset=23412736, length=65536)]error = 6 Jul 13 13:24:42 ridcully kernel: g_vfs_done():ad10s3a[READ(offset=23478272, length=131072)]error = 6 --tThc/1wpZn/ma/RB--