From owner-freebsd-questions@FreeBSD.ORG Fri May 14 18:22:42 2004 Return-Path: Delivered-To: freebsd-questions@freebsd.org Received: from mx1.FreeBSD.org (mx1.freebsd.org [216.136.204.125]) by hub.freebsd.org (Postfix) with ESMTP id 2FDE616A4CE for ; Fri, 14 May 2004 18:22:42 -0700 (PDT) Received: from galilee.polands.org (CPE-24-208-53-234.new.rr.com [24.208.53.234]) by mx1.FreeBSD.org (Postfix) with ESMTP id 056C743D41 for ; Fri, 14 May 2004 18:22:40 -0700 (PDT) (envelope-from djp@polands.org) Received: from galilee.polands.org (localhost [127.0.0.1]) by galilee.polands.org (8.12.9/8.12.9) with ESMTP id i4F1Mcmq013039 for ; Fri, 14 May 2004 20:22:38 -0500 (CDT) (envelope-from djp@galilee.polands.org) Received: (from djp@localhost) by galilee.polands.org (8.12.9/8.12.9/Submit) id i4F1MblG013038 for questions@freebsd.org; Fri, 14 May 2004 20:22:37 -0500 (CDT) Date: Fri, 14 May 2004 20:22:37 -0500 (CDT) From: Doug Poland Message-Id: <200405150122.i4F1MblG013038@galilee.polands.org> To: questions@freebsd.org Subject: Vinum striped volume has corrupt plex, please help X-BeenThere: freebsd-questions@freebsd.org X-Mailman-Version: 2.1.1 Precedence: list List-Id: User questions List-Unsubscribe: , List-Archive: List-Post: List-Help: List-Subscribe: , X-List-Received-Date: Sat, 15 May 2004 01:22:42 -0000 Hello, I've been running a striped vinum configuration on 7 2.1GB SCSI drives for almost three years. I recently returned from a vacation to find my vinum fileserver had crashed. The logs indicated some type of problem with my Adaptec 2940AU host adapter. The 2940 seems be working now but now I'm having a problem with my vinum volume. The error messages I'm seeing are... vinum: dataraid.p0.s1 is stale by force vinum: dataraid.p0 is corrupt I've spent no small amount of time searching the web google, and newsgroups. From what I've found I think I should be able to run a vinum create and the volume will re-build. But before I do that, I was hoping to get confirmation that my procedure would work. In accordance with the instructions found at http://www.vinumvm.org/vinum/how-to-debug.html, I'm including the requested information as follows: Problem: Corrupt plex # uname -a FreeBSD judeah.polands.org 4.8-STABLE FreeBSD 4.8-STABLE #1: Fri Apr 4 13:46:21 CST 2003 root@sheba.polands.org:/usr/obj/usr/src/sys/JUDEAH i386 Changes: I've made no changes to the system # vinum -list 7 drives: D a State: up Device /dev/da0s1e Avail: 0/1920 MB (0%) D b State: up Device /dev/da1s1e Avail: 0/1920 MB (0%) D c State: up Device /dev/da2s1e Avail: 0/1920 MB (0%) D d State: up Device /dev/da3s1e Avail: 0/1920 MB (0%) D e State: up Device /dev/da4s1e Avail: 0/1920 MB (0%) D f State: up Device /dev/da5s1e Avail: 0/1920 MB (0%) D g State: up Device /dev/da6s1e Avail: 0/1920 MB (0%) 1 volumes: V dataraid State: up Plexes: 1 Size: 13 GB 1 plexes: P dataraid.p0 S State: corrupt Subdisks: 7 Size: 13 GB 7 subdisks: S dataraid.p0.s0 State: up PO: 0 B Size: 1920 MB S dataraid.p0.s1 State: stale PO: 256 kB Size: 1920 MB S dataraid.p0.s2 State: up PO: 512 kB Size: 1920 MB S dataraid.p0.s3 State: up PO: 768 kB Size: 1920 MB S dataraid.p0.s4 State: up PO: 1024 kB Size: 1920 MB S dataraid.p0.s5 State: up PO: 1280 kB Size: 1920 MB S dataraid.p0.s6 State: up PO: 1536 kB Size: 1920 MB /var/log/vinum_history: (There is nothing of interest in vinum_history, as far as I can tell, but am including snippets just in case I'm wrong) 19 Jan 2004 09:37:20.557022 l 10 May 2004 12:54:05.361480 *** vinum started *** 10 May 2004 12:54:05.374629 list 10 May 2004 14:15:31.087747 *** vinum started *** 10 May 2004 14:15:31.091893 stop 10 May 2004 14:15:36.425300 *** vinum started *** 10 May 2004 14:15:36.429465 list 10 May 2004 14:15:42.067335 *** vinum started *** 10 May 2004 14:15:42.071553 start 10 May 2004 14:15:46.176967 *** Created devices *** 10 May 2004 14:16:01.368646 *** vinum started *** 10 May 2004 14:16:01.372825 list /var/log/messages: May 3 11:17:31 judeah /kernel: (da1:ahc0:0:1:0): SCB 0x5a - timed out May 3 11:17:31 judeah /kernel: >>>>>>>>>>>>>>>>>> Dump Card State Begins <<<<<<<<<<<<<<<<< May 3 11:17:31 judeah /kernel: ahc0: Dumping Card State while idle, at SEQADDR 0x7 May 3 11:17:31 judeah /kernel: Card was paused May 3 11:17:31 judeah /kernel: ACCUM = 0x97, SINDEX = 0x52, DINDEX = 0x8c, ARG_2 = 0x0 May 3 11:17:31 judeah /kernel: HCNT = 0x0 SCBPTR = 0x1 May 3 11:17:31 judeah /kernel: SCSISIGI[0x0] ERROR[0x40] SCSIBUSL[0x0] LASTPHASE[0x1] May 3 11:17:31 judeah /kernel: SCSISEQ[0x12] SBLKCTL[0x0] SCSIRATE[0x0] SEQCTL[0x10] May 3 11:17:31 judeah /kernel: SEQ_FLAGS[0xc0] SSTAT0[0x5] SSTAT1[0xa] SSTAT2[0x0] May 3 11:17:31 judeah /kernel: SSTAT3[0x0] SIMODE0[0x0] SIMODE1[0xa4] SXFRCTL0[0x80] May 3 11:17:31 judeah /kernel: DFCNTRL[0x0] DFSTATUS[0x29] May 3 11:17:31 judeah /kernel: STACK: 0x0 0x166 0x109 0x3 May 3 11:17:31 judeah /kernel: SCB count = 130 May 3 11:17:31 judeah /kernel: Kernel NEXTQSCB = 30 May 3 11:17:31 judeah /kernel: Card NEXTQSCB = 30 May 3 11:17:31 judeah /kernel: QINFIFO entries: May 3 11:17:31 judeah /kernel: Waiting Queue entries: May 3 11:17:31 judeah /kernel: Disconnected Queue entries: 2:90 May 3 11:17:31 judeah /kernel: QOUTFIFO entries: May 3 11:17:31 judeah /kernel: Sequencer Free SCB List: 1 0 May 3 11:17:31 judeah /kernel: Sequencer SCB Info: May 3 11:17:31 judeah /kernel: 0 SCB_CONTROL[0xe2] SCB_SCSIID[0x67] SCB_LUN[0x0] SCB_TAG[0xff] May 3 11:17:31 judeah /kernel: 1 SCB_CONTROL[0xe2] SCB_SCSIID[0x67] SCB_LUN[0x0] SCB_TAG[0xff] May 3 11:17:31 judeah /kernel: 2 SCB_CONTROL[0x66] SCB_SCSIID[0x17] SCB_LUN[0x0] SCB_TAG[0x5a] May 3 11:17:31 judeah /kernel: Pending list: May 3 11:17:31 judeah /kernel: 90 SCB_CONTROL[0x62] SCB_SCSIID[0x17] SCB_LUN[0x0] May 3 11:17:31 judeah /kernel: Kernel Free SCB list: 82 88 14 115 12 83 120 92 45 8 16 5 59 124 31 29 38 18 73 42 93 64 19 7 74 100 113 75 24 3 86 71 20 108 6 67 68 125 105 97 110 34 54 87 106 25 61 109 123 47 44 66 53 94 84 76 65 77 72 9 69 32 17 55 119 1 22 91 4 112 56 27 102 62 13 15 128 50 33 51 81 37 57 28 99 117 85 36 41 11 121 49 0 80 35 39 40 95 26 96 10 58 118 122 127 111 2 126 70 98 89 21 60 46 48 78 43 101 23 79 52 63 129 103 104 107 116 114 May 3 11:17:31 judeah /kernel: May 3 11:17:31 judeah /kernel: <<<<<<<<<<<<<<<< Dump Card State Ends >>>>>>>>>>>>>>>>>> May 3 11:17:31 judeah /kernel: sg[0] - Addr 0x1ddd000 : Length 4096 May 3 11:17:31 judeah /kernel: sg[1] - Addr 0x7be000 : Length 4096 May 3 11:17:31 judeah /kernel: (da1:ahc0:0:1:0): Queuing a BDR SCB May 3 11:17:31 judeah /kernel: (da1:ahc0:0:1:0): Bus Device Reset Message Sent May 3 11:17:33 judeah /kernel: (da1:ahc0:0:1:0): SCB 0x5a - timed out May 3 11:17:33 judeah /kernel: >>>>>>>>>>>>>>>>>> Dump Card State Begins <<<<<<<<<<<<<<<<< May 3 11:17:33 judeah /kernel: ahc0: Dumping Card State in Message-out phase, at SEQADDR 0x16c May 3 11:17:33 judeah /kernel: Card was paused May 3 11:17:33 judeah /kernel: ACCUM = 0xa0, SINDEX = 0x61, DINDEX = 0xc0, ARG_2 = 0x16 May 3 11:17:33 judeah /kernel: HCNT = 0x0 SCBPTR = 0x2 May 3 11:17:33 judeah /kernel: SCSISIGI[0xa4] ERROR[0x40] SCSIBUSL[0xc] LASTPHASE[0xa0] May 3 11:17:33 judeah /kernel: SCSISEQ[0x12] SBLKCTL[0x0] SCSIRATE[0xf] SEQCTL[0x10] May 3 11:17:33 judeah /kernel: SEQ_FLAGS[0x40] SSTAT0[0x5] SSTAT1[0x2] SSTAT2[0x0] May 3 11:17:33 judeah /kernel: SSTAT3[0x0] SIMODE0[0x0] SIMODE1[0xac] SXFRCTL0[0x88] May 3 11:17:33 judeah /kernel: DFCNTRL[0x4] DFSTATUS[0x6d] May 3 11:17:33 judeah /kernel: STACK: 0xe8 0x0 0x166 0x1a7 May 3 11:17:33 judeah /kernel: SCB count = 130 May 3 11:17:33 judeah /kernel: Kernel NEXTQSCB = 30 May 3 11:17:33 judeah /kernel: Card NEXTQSCB = 30 May 3 11:17:33 judeah /kernel: QINFIFO entries: May 3 11:17:33 judeah /kernel: Waiting Queue entries: May 3 11:17:33 judeah /kernel: Disconnected Queue entries: May 3 11:17:33 judeah /kernel: QOUTFIFO entries: May 3 11:17:33 judeah /kernel: Sequencer Free SCB List: 1 0 May 3 11:17:33 judeah /kernel: Sequencer SCB Info: May 3 11:17:33 judeah /kernel: 0 SCB_CONTROL[0xe2] SCB_SCSIID[0x67] SCB_LUN[0x0] SCB_TAG[0xff] May 3 11:17:33 judeah /kernel: 1 SCB_CONTROL[0xe2] SCB_SCSIID[0x67] SCB_LUN[0x0] SCB_TAG[0xff] May 3 11:17:33 judeah /kernel: 2 SCB_CONTROL[0x66] SCB_SCSIID[0x17] SCB_LUN[0x0] SCB_TAG[0x5a] May 3 11:17:33 judeah /kernel: Pending list: May 3 11:17:33 judeah /kernel: 90 SCB_CONTROL[0x66] SCB_SCSIID[0x17] SCB_LUN[0x0] May 3 11:17:33 judeah /kernel: Kernel Free SCB list: 82 88 14 115 12 83 120 92 45 8 16 5 59 124 31 29 38 18 73 42 93 64 19 7 74 100 113 75 24 3 86 71 20 108 6 67 68 125 105 97 110 34 54 87 106 25 61 109 123 47 44 66 53 94 84 76 65 77 72 9 69 32 17 55 119 1 22 91 4 112 56 27 102 62 13 15 128 50 33 51 81 37 57 28 99 117 85 36 41 11 121 49 0 80 35 39 40 95 26 96 10 58 118 122 127 111 2 126 70 98 89 21 60 46 48 78 43 101 23 79 52 63 129 103 104 107 116 114 May 3 11:17:33 judeah /kernel: May 3 11:17:33 judeah /kernel: <<<<<<<<<<<<<<<< Dump Card State Ends >>>>>>>>>>>>>>>>>> May 3 11:17:33 judeah /kernel: sg[0] - Addr 0x1ddd000 : Length 4096 May 3 11:17:33 judeah /kernel: sg[1] - Addr 0x7be000 : Length 4096 May 3 11:17:33 judeah /kernel: (da1:ahc0:0:1:0): no longer in timeout, status = 34b May 3 11:17:33 judeah /kernel: ahc0: Issued Channel A Bus Reset. 1 SCBs aborted May 3 11:18:38 judeah /kernel: (da1:ahc0:0:1:0): SCB 0x5a - timed out May 3 11:18:38 judeah /kernel: >>>>>>>>>>>>>>>>>> Dump Card State Begins <<<<<<<<<<<<<<<<< May 3 11:18:38 judeah /kernel: ahc0: Dumping Card State while idle, at SEQADDR 0x7 May 3 11:18:38 judeah /kernel: Card was paused May 3 11:18:38 judeah /kernel: ACCUM = 0x9b, SINDEX = 0x64, DINDEX = 0x65, ARG_2 = 0x16 May 3 11:18:38 judeah /kernel: HCNT = 0x0 SCBPTR = 0x2 May 3 11:18:38 judeah /kernel: SCSISIGI[0x0] ERROR[0x40] SCSIBUSL[0x0] LASTPHASE[0x1] May 3 11:18:38 judeah /kernel: SCSISEQ[0x12] SBLKCTL[0x0] SCSIRATE[0x0] SEQCTL[0x10] May 3 11:18:38 judeah /kernel: SEQ_FLAGS[0xc0] SSTAT0[0x5] SSTAT1[0xa] SSTAT2[0x0] May 3 11:18:38 judeah /kernel: SSTAT3[0x0] SIMODE0[0x0] SIMODE1[0xa4] SXFRCTL0[0x80] May 3 11:18:38 judeah /kernel: DFCNTRL[0x0] DFSTATUS[0x2d] May 3 11:18:38 judeah /kernel: STACK: 0xe8 0x166 0x1a7 0x3 May 3 11:18:38 judeah /kernel: SCB count = 130 May 3 11:18:38 judeah /kernel: Kernel NEXTQSCB = 30 May 3 11:18:38 judeah /kernel: Card NEXTQSCB = 30 May 3 11:18:38 judeah /kernel: QINFIFO entries: May 3 11:18:38 judeah /kernel: Waiting Queue entries: May 3 11:18:38 judeah /kernel: Disconnected Queue entries: 2:90 May 3 11:18:38 judeah /kernel: QOUTFIFO entries: May 3 11:18:38 judeah /kernel: Sequencer Free SCB List: 1 0 May 3 11:18:38 judeah /kernel: Sequencer SCB Info: May 3 11:18:38 judeah /kernel: 0 SCB_CONTROL[0xe2] SCB_SCSIID[0x67] SCB_LUN[0x0] SCB_TAG[0xff] May 3 11:18:38 judeah /kernel: 1 SCB_CONTROL[0xe2] SCB_SCSIID[0x67] SCB_LUN[0x0] SCB_TAG[0xff] May 3 11:18:38 judeah /kernel: 2 SCB_CONTROL[0x66] SCB_SCSIID[0x17] SCB_LUN[0x0] SCB_TAG[0x5a] May 3 11:18:38 judeah /kernel: Pending list: May 3 11:18:38 judeah /kernel: 90 SCB_CONTROL[0x62] SCB_SCSIID[0x17] SCB_LUN[0x0] May 3 11:18:38 judeah /kernel: Kernel Free SCB list: 82 88 14 115 12 83 120 92 45 8 16 5 59 124 31 29 38 18 73 42 93 64 19 7 74 100 113 75 24 3 86 71 20 108 6 67 68 125 105 97 110 34 54 87 106 25 61 109 123 47 44 66 53 94 84 76 65 77 72 9 69 32 17 55 119 1 22 91 4 112 56 27 102 62 13 15 128 50 33 51 81 37 57 28 99 117 85 36 41 11 121 49 0 80 35 39 40 95 26 96 10 58 118 122 127 111 2 126 70 98 89 21 60 46 48 78 43 101 23 79 52 63 129 103 104 107 116 114 May 3 11:18:38 judeah /kernel: May 3 11:18:38 judeah /kernel: <<<<<<<<<<<<<<<< Dump Card State Ends >>>>>>>>>>>>>>>>>> May 3 11:18:38 judeah /kernel: sg[0] - Addr 0x1ddd000 : Length 4096 May 3 11:18:38 judeah /kernel: sg[1] - Addr 0x7be000 : Length 4096 May 3 11:18:38 judeah /kernel: (da1:ahc0:0:1:0): Queuing a BDR SCB May 3 11:18:38 judeah /kernel: (da1:ahc0:0:1:0): Bus Device Reset Message Sent May 3 11:18:40 judeah /kernel: (da1:ahc0:0:1:0): SCB 0x5a - timed out May 3 11:18:40 judeah /kernel: >>>>>>>>>>>>>>>>>> Dump Card State Begins <<<<<<<<<<<<<<<<< May 3 11:18:40 judeah /kernel: ahc0: Dumping Card State in Message-out phase, at SEQADDR 0x16c May 3 11:18:40 judeah /kernel: Card was paused May 3 11:18:40 judeah /kernel: ACCUM = 0xa0, SINDEX = 0x61, DINDEX = 0xc0, ARG_2 = 0x16 May 3 11:18:40 judeah /kernel: HCNT = 0x0 SCBPTR = 0x2 May 3 11:18:40 judeah /kernel: SCSISIGI[0xa4] ERROR[0x40] SCSIBUSL[0xc] LASTPHASE[0xa0] May 3 11:18:40 judeah /kernel: SCSISEQ[0x12] SBLKCTL[0x0] SCSIRATE[0xf] SEQCTL[0x10] May 3 11:18:40 judeah /kernel: SEQ_FLAGS[0x40] SSTAT0[0x5] SSTAT1[0x2] SSTAT2[0x0] May 3 11:18:40 judeah /kernel: SSTAT3[0x0] SIMODE0[0x0] SIMODE1[0xac] SXFRCTL0[0x88] May 3 11:18:40 judeah /kernel: DFCNTRL[0x4] DFSTATUS[0x6d] May 3 11:18:40 judeah /kernel: STACK: 0xe8 0xe8 0x166 0x1a7 May 3 11:18:40 judeah /kernel: SCB count = 130 May 3 11:18:40 judeah /kernel: Kernel NEXTQSCB = 30 May 3 11:18:40 judeah /kernel: Card NEXTQSCB = 30 May 3 11:18:40 judeah /kernel: QINFIFO entries: May 3 11:18:40 judeah /kernel: Waiting Queue entries: May 3 11:18:40 judeah /kernel: Disconnected Queue entries: May 3 11:18:40 judeah /kernel: QOUTFIFO entries: May 3 11:18:40 judeah /kernel: Sequencer Free SCB List: 1 0 May 3 11:18:40 judeah /kernel: Sequencer SCB Info: May 3 11:18:40 judeah /kernel: 0 SCB_CONTROL[0xe2] SCB_SCSIID[0x67] SCB_LUN[0x0] SCB_TAG[0xff] May 3 11:18:40 judeah /kernel: 1 SCB_CONTROL[0xe2] SCB_SCSIID[0x67] SCB_LUN[0x0] SCB_TAG[0xff] May 3 11:18:40 judeah /kernel: 2 SCB_CONTROL[0x66] SCB_SCSIID[0x17] SCB_LUN[0x0] SCB_TAG[0x5a] May 3 11:18:40 judeah /kernel: Pending list: May 3 11:18:40 judeah /kernel: 90 SCB_CONTROL[0x66] SCB_SCSIID[0x17] SCB_LUN[0x0] May 3 11:18:40 judeah /kernel: Kernel Free SCB list: 82 88 14 115 12 83 120 92 45 8 16 5 59 124 31 29 38 18 73 42 93 64 19 7 74 100 113 75 24 3 86 71 20 108 6 67 68 125 105 97 110 34 54 87 106 25 61 109 123 47 44 66 53 94 84 76 65 77 72 9 69 32 17 55 119 1 22 91 4 112 56 27 102 62 13 15 128 50 33 51 81 37 57 28 99 117 85 36 41 11 121 49 0 80 35 39 40 95 26 96 10 58 118 122 127 111 2 126 70 98 89 21 60 46 48 78 43 101 23 79 52 63 129 103 104 107 116 114 May 3 11:18:40 judeah /kernel: May 3 11:18:40 judeah /kernel: <<<<<<<<<<<<<<<< Dump Card State Ends >>>>>>>>>>>>>>>>>> May 3 11:18:40 judeah /kernel: sg[0] - Addr 0x1ddd000 : Length 4096 May 3 11:18:40 judeah /kernel: sg[1] - Addr 0x7be000 : Length 4096 May 3 11:18:40 judeah /kernel: (da1:ahc0:0:1:0): no longer in timeout, status = 34b May 3 11:18:40 judeah /kernel: ahc0: Issued Channel A Bus Reset. 1 SCBs aborted May 3 11:19:45 judeah /kernel: (da1:ahc0:0:1:0): SCB 0x5a - timed out May 3 11:19:45 judeah /kernel: >>>>>>>>>>>>>>>>>> Dump Card State Begins <<<<<<<<<<<<<<<<< May 3 11:19:45 judeah /kernel: ahc0: Dumping Card State while idle, at SEQADDR 0x7 May 3 11:19:45 judeah /kernel: Card was paused May 3 11:19:45 judeah /kernel: ACCUM = 0x9f, SINDEX = 0x64, DINDEX = 0x65, ARG_2 = 0x16 May 3 11:19:45 judeah /kernel: HCNT = 0x0 SCBPTR = 0x2 May 3 11:19:45 judeah /kernel: SCSISIGI[0x0] ERROR[0x40] SCSIBUSL[0x0] LASTPHASE[0x1] May 3 11:19:45 judeah /kernel: SCSISEQ[0x12] SBLKCTL[0x0] SCSIRATE[0x0] SEQCTL[0x10] May 3 11:19:45 judeah /kernel: SEQ_FLAGS[0xc0] SSTAT0[0x5] SSTAT1[0xa] SSTAT2[0x0] May 3 11:19:45 judeah /kernel: SSTAT3[0x0] SIMODE0[0x0] SIMODE1[0xa4] SXFRCTL0[0x80] May 3 11:19:45 judeah /kernel: DFCNTRL[0x0] DFSTATUS[0x2d] May 3 11:19:45 judeah /kernel: STACK: 0xe8 0x166 0x1a7 0x3 May 3 11:19:45 judeah /kernel: SCB count = 130 May 3 11:19:45 judeah /kernel: Kernel NEXTQSCB = 30 May 3 11:19:45 judeah /kernel: Card NEXTQSCB = 30 May 3 11:19:45 judeah /kernel: QINFIFO entries: May 3 11:19:45 judeah /kernel: Waiting Queue entries: May 3 11:19:45 judeah /kernel: Disconnected Queue entries: 2:90 May 3 11:19:45 judeah /kernel: QOUTFIFO entries: May 3 11:19:45 judeah /kernel: Sequencer Free SCB List: 1 0 May 3 11:19:45 judeah /kernel: Sequencer SCB Info: May 3 11:19:45 judeah /kernel: 0 SCB_CONTROL[0xe2] SCB_SCSIID[0x67] SCB_LUN[0x0] SCB_TAG[0xff] May 3 11:19:45 judeah /kernel: 1 SCB_CONTROL[0xe2] SCB_SCSIID[0x67] SCB_LUN[0x0] SCB_TAG[0xff] May 3 11:19:45 judeah /kernel: 2 SCB_CONTROL[0x66] SCB_SCSIID[0x17] SCB_LUN[0x0] SCB_TAG[0x5a] May 3 11:19:45 judeah /kernel: Pending list: May 3 11:19:45 judeah /kernel: 90 SCB_CONTROL[0x62] SCB_SCSIID[0x17] SCB_LUN[0x0] May 3 11:19:45 judeah /kernel: Kernel Free SCB list: 82 88 14 115 12 83 120 92 45 8 16 5 59 124 31 29 38 18 73 42 93 64 19 7 74 100 113 75 24 3 86 71 20 108 6 67 68 125 105 97 110 34 54 87 106 25 61 109 123 47 44 66 53 94 84 76 65 77 72 9 69 32 17 55 119 1 22 91 4 112 56 27 102 62 13 15 128 50 33 51 81 37 57 28 99 117 85 36 41 11 121 49 0 80 35 39 40 95 26 96 10 58 118 122 127 111 2 126 70 98 89 21 60 46 48 78 43 101 23 79 52 63 129 103 104 107 116 114 May 3 11:19:45 judeah /kernel: May 3 11:19:45 judeah /kernel: <<<<<<<<<<<<<<<< Dump Card State Ends >>>>>>>>>>>>>>>>>> May 3 11:19:45 judeah /kernel: sg[0] - Addr 0x1ddd000 : Length 4096 May 3 11:19:45 judeah /kernel: sg[1] - Addr 0x7be000 : Length 4096 May 3 11:19:45 judeah /kernel: (da1:ahc0:0:1:0): Queuing a BDR SCB May 3 11:19:45 judeah /kernel: (da1:ahc0:0:1:0): Bus Device Reset Message Sent May 3 11:19:47 judeah /kernel: (da1:ahc0:0:1:0): SCB 0x5a - timed out May 3 11:19:47 judeah /kernel: >>>>>>>>>>>>>>>>>> Dump Card State Begins <<<<<<<<<<<<<<<<< May 3 11:19:47 judeah /kernel: ahc0: Dumping Card State in Message-out phase, at SEQADDR 0x16c May 3 11:19:47 judeah /kernel: Card was paused May 3 11:19:47 judeah /kernel: ACCUM = 0xa0, SINDEX = 0x61, DINDEX = 0xc0, ARG_2 = 0x16 May 3 11:19:47 judeah /kernel: HCNT = 0x0 SCBPTR = 0x2 May 3 11:19:47 judeah /kernel: SCSISIGI[0xa4] ERROR[0x40] SCSIBUSL[0xc] LASTPHASE[0xa0] May 3 11:19:47 judeah /kernel: SCSISEQ[0x12] SBLKCTL[0x0] SCSIRATE[0xf] SEQCTL[0x10] May 3 11:19:47 judeah /kernel: SEQ_FLAGS[0x40] SSTAT0[0x5] SSTAT1[0x2] SSTAT2[0x0] May 3 11:19:47 judeah /kernel: SSTAT3[0x0] SIMODE0[0x0] SIMODE1[0xac] SXFRCTL0[0x88] May 3 11:19:47 judeah /kernel: DFCNTRL[0x4] DFSTATUS[0x6d] May 3 11:19:47 judeah /kernel: STACK: 0xe8 0xe8 0x166 0x1a7 May 3 11:19:47 judeah /kernel: SCB count = 130 May 3 11:19:47 judeah /kernel: Kernel NEXTQSCB = 30 May 3 11:19:47 judeah /kernel: Card NEXTQSCB = 30 May 3 11:19:47 judeah /kernel: QINFIFO entries: May 3 11:19:47 judeah /kernel: Waiting Queue entries: May 3 11:19:47 judeah /kernel: Disconnected Queue entries: May 3 11:19:47 judeah /kernel: QOUTFIFO entries: May 3 11:19:47 judeah /kernel: Sequencer Free SCB List: 1 0 May 3 11:19:47 judeah /kernel: Sequencer SCB Info: May 3 11:19:47 judeah /kernel: 0 SCB_CONTROL[0xe2] SCB_SCSIID[0x67] SCB_LUN[0x0] SCB_TAG[0xff] May 3 11:19:47 judeah /kernel: 1 SCB_CONTROL[0xe2] SCB_SCSIID[0x67] SCB_LUN[0x0] SCB_TAG[0xff] May 3 11:19:47 judeah /kernel: 2 SCB_CONTROL[0x66] SCB_SCSIID[0x17] SCB_LUN[0x0] SCB_TAG[0x5a] May 3 11:19:47 judeah /kernel: Pending list: May 3 11:19:47 judeah /kernel: 90 SCB_CONTROL[0x66] SCB_SCSIID[0x17] SCB_LUN[0x0] May 3 11:19:47 judeah /kernel: Kernel Free SCB list: 82 88 14 115 12 83 120 92 45 8 16 5 59 124 31 29 38 18 73 42 93 64 19 7 74 100 113 75 24 3 86 71 20 108 6 67 68 125 105 97 110 34 54 87 106 25 61 109 123 47 44 66 53 94 84 76 65 77 72 9 69 32 17 55 119 1 22 91 4 112 56 27 102 62 13 15 128 50 33 51 81 37 57 28 99 117 85 36 41 11 121 49 0 80 35 39 40 95 26 96 10 58 118 122 127 111 2 126 70 98 89 21 60 46 48 78 43 101 23 79 52 63 129 103 104 107 116 114 May 3 11:19:47 judeah /kernel: May 3 11:19:47 judeah /kernel: <<<<<<<<<<<<<<<< Dump Card State Ends >>>>>>>>>>>>>>>>>> May 3 11:19:47 judeah /kernel: sg[0] - Addr 0x1ddd000 : Length 4096 May 3 11:19:47 judeah /kernel: sg[1] - Addr 0x7be000 : Length 4096 May 3 11:19:47 judeah /kernel: (da1:ahc0:0:1:0): no longer in timeout, status = 34b May 3 11:19:47 judeah /kernel: ahc0: Issued Channel A Bus Reset. 1 SCBs aborted May 3 11:20:52 judeah /kernel: (da1:ahc0:0:1:0): SCB 0x5a - timed out May 3 11:20:52 judeah /kernel: >>>>>>>>>>>>>>>>>> Dump Card State Begins <<<<<<<<<<<<<<<<< May 3 11:20:52 judeah /kernel: ahc0: Dumping Card State while idle, at SEQADDR 0x7 May 3 11:20:52 judeah /kernel: Card was paused May 3 11:20:52 judeah /kernel: ACCUM = 0xa3, SINDEX = 0x64, DINDEX = 0x65, ARG_2 = 0x16 May 3 11:20:52 judeah /kernel: HCNT = 0x0 SCBPTR = 0x2 May 3 11:20:52 judeah /kernel: SCSISIGI[0x0] ERROR[0x40] SCSIBUSL[0x0] LASTPHASE[0x1] May 3 11:20:52 judeah /kernel: SCSISEQ[0x12] SBLKCTL[0x0] SCSIRATE[0x0] SEQCTL[0x10] May 3 11:20:52 judeah /kernel: SEQ_FLAGS[0xc0] SSTAT0[0x5] SSTAT1[0xa] SSTAT2[0x0] May 3 11:20:52 judeah /kernel: SSTAT3[0x0] SIMODE0[0x0] SIMODE1[0xa4] SXFRCTL0[0x80] May 3 11:20:52 judeah /kernel: DFCNTRL[0x0] DFSTATUS[0x2d] May 3 11:20:52 judeah /kernel: STACK: 0xe8 0x166 0x1a7 0x3 May 3 11:20:52 judeah /kernel: SCB count = 130 May 3 11:20:52 judeah /kernel: Kernel NEXTQSCB = 30 May 3 11:20:52 judeah /kernel: Card NEXTQSCB = 30 May 3 11:20:52 judeah /kernel: QINFIFO entries: May 3 11:20:52 judeah /kernel: Waiting Queue entries: May 3 11:20:52 judeah /kernel: Disconnected Queue entries: 2:90 May 3 11:20:52 judeah /kernel: QOUTFIFO entries: May 3 11:20:52 judeah /kernel: Sequencer Free SCB List: 1 0 May 3 11:20:52 judeah /kernel: Sequencer SCB Info: May 3 11:20:52 judeah /kernel: 0 SCB_CONTROL[0xe2] SCB_SCSIID[0x67] SCB_LUN[0x0] SCB_TAG[0xff] May 3 11:20:52 judeah /kernel: 1 SCB_CONTROL[0xe2] SCB_SCSIID[0x67] SCB_LUN[0x0] SCB_TAG[0xff] May 3 11:20:52 judeah /kernel: 2 SCB_CONTROL[0x66] SCB_SCSIID[0x17] SCB_LUN[0x0] SCB_TAG[0x5a] May 3 11:20:52 judeah /kernel: Pending list: May 3 11:20:52 judeah /kernel: 90 SCB_CONTROL[0x62] SCB_SCSIID[0x17] SCB_LUN[0x0] May 3 11:20:52 judeah /kernel: Kernel Free SCB list: 82 88 14 115 12 83 120 92 45 8 16 5 59 124 31 29 38 18 73 42 93 64 19 7 74 100 113 75 24 3 86 71 20 108 6 67 68 125 105 97 110 34 54 87 106 25 61 109 123 47 44 66 53 94 84 76 65 77 72 9 69 32 17 55 119 1 22 91 4 112 56 27 102 62 13 15 128 50 33 51 81 37 57 28 99 117 85 36 41 11 121 49 0 80 35 39 40 95 26 96 10 58 118 122 127 111 2 126 70 98 89 21 60 46 48 78 43 101 23 79 52 63 129 103 104 107 116 114 May 3 11:20:52 judeah /kernel: May 3 11:20:52 judeah /kernel: <<<<<<<<<<<<<<<< Dump Card State Ends >>>>>>>>>>>>>>>>>> May 3 11:20:52 judeah /kernel: sg[0] - Addr 0x1ddd000 : Length 4096 May 3 11:20:52 judeah /kernel: sg[1] - Addr 0x7be000 : Length 4096 May 3 11:20:52 judeah /kernel: (da1:ahc0:0:1:0): Queuing a BDR SCB May 3 11:20:52 judeah /kernel: (da1:ahc0:0:1:0): Bus Device Reset Message Sent May 3 11:20:54 judeah /kernel: (da1:ahc0:0:1:0): SCB 0x5a - timed out May 3 11:20:54 judeah /kernel: >>>>>>>>>>>>>>>>>> Dump Card State Begins <<<<<<<<<<<<<<<<< May 3 11:20:54 judeah /kernel: ahc0: Dumping Card State in Message-out phase, at SEQADDR 0x16c May 3 11:20:54 judeah /kernel: Card was paused May 3 11:20:54 judeah /kernel: ACCUM = 0xa0, SINDEX = 0x61, DINDEX = 0xc0, ARG_2 = 0x16 May 3 11:20:54 judeah /kernel: HCNT = 0x0 SCBPTR = 0x2 May 3 11:20:54 judeah /kernel: SCSISIGI[0xa4] ERROR[0x40] SCSIBUSL[0xc] LASTPHASE[0xa0] May 3 11:20:54 judeah /kernel: SCSISEQ[0x12] SBLKCTL[0x0] SCSIRATE[0xf] SEQCTL[0x10] May 3 11:20:54 judeah /kernel: SEQ_FLAGS[0x40] SSTAT0[0x5] SSTAT1[0x2] SSTAT2[0x0] May 3 11:20:54 judeah /kernel: SSTAT3[0x0] SIMODE0[0x0] SIMODE1[0xac] SXFRCTL0[0x88] May 3 11:20:54 judeah /kernel: DFCNTRL[0x4] DFSTATUS[0x6d] May 3 11:20:54 judeah /kernel: STACK: 0xe8 0xe8 0x166 0x1a7 May 3 11:20:54 judeah /kernel: SCB count = 130 May 3 11:20:54 judeah /kernel: Kernel NEXTQSCB = 30 May 3 11:20:54 judeah /kernel: Card NEXTQSCB = 30 May 3 11:20:54 judeah /kernel: QINFIFO entries: May 3 11:20:54 judeah /kernel: Waiting Queue entries: May 3 11:20:54 judeah /kernel: Disconnected Queue entries: May 3 11:20:54 judeah /kernel: QOUTFIFO entries: May 3 11:20:54 judeah /kernel: Sequencer Free SCB List: 1 0 May 3 11:20:54 judeah /kernel: Sequencer SCB Info: May 3 11:20:54 judeah /kernel: 0 SCB_CONTROL[0xe2] SCB_SCSIID[0x67] SCB_LUN[0x0] SCB_TAG[0xff] May 3 11:20:54 judeah /kernel: 1 SCB_CONTROL[0xe2] SCB_SCSIID[0x67] SCB_LUN[0x0] SCB_TAG[0xff] May 3 11:20:54 judeah /kernel: 2 SCB_CONTROL[0x66] SCB_SCSIID[0x17] SCB_LUN[0x0] SCB_TAG[0x5a] May 3 11:20:54 judeah /kernel: Pending list: May 3 11:20:54 judeah /kernel: 90 SCB_CONTROL[0x66] SCB_SCSIID[0x17] SCB_LUN[0x0] May 3 11:20:54 judeah /kernel: Kernel Free SCB list: 82 88 14 115 12 83 120 92 45 8 16 5 59 124 31 29 38 18 73 42 93 64 19 7 74 100 113 75 24 3 86 71 20 108 6 67 68 125 105 97 110 34 54 87 106 25 61 109 123 47 44 66 53 94 84 76 65 77 72 9 69 32 17 55 119 1 22 91 4 112 56 27 102 62 13 15 128 50 33 51 81 37 57 28 99 117 85 36 41 11 121 49 0 80 35 39 40 95 26 96 10 58 118 122 127 111 2 126 70 98 89 21 60 46 48 78 43 101 23 79 52 63 129 103 104 107 116 114 May 3 11:20:54 judeah /kernel: May 3 11:20:54 judeah /kernel: <<<<<<<<<<<<<<<< Dump Card State Ends >>>>>>>>>>>>>>>>>> May 3 11:20:54 judeah /kernel: sg[0] - Addr 0x1ddd000 : Length 4096 May 3 11:20:54 judeah /kernel: sg[1] - Addr 0x7be000 : Length 4096 May 3 11:20:54 judeah /kernel: (da1:ahc0:0:1:0): no longer in timeout, status = 34b May 3 11:20:54 judeah /kernel: ahc0: Issued Channel A Bus Reset. 1 SCBs aborted May 3 11:21:59 judeah /kernel: (da1:ahc0:0:1:0): SCB 0x5a - timed out May 3 11:21:59 judeah /kernel: >>>>>>>>>>>>>>>>>> Dump Card State Begins <<<<<<<<<<<<<<<<< May 3 11:21:59 judeah /kernel: ahc0: Dumping Card State while idle, at SEQADDR 0x7 May 3 11:21:59 judeah /kernel: Card was paused May 3 11:21:59 judeah /kernel: ACCUM = 0xa7, SINDEX = 0x64, DINDEX = 0x65, ARG_2 = 0x16 May 3 11:21:59 judeah /kernel: HCNT = 0x0 SCBPTR = 0x2 May 3 11:21:59 judeah /kernel: SCSISIGI[0x0] ERROR[0x40] SCSIBUSL[0x0] LASTPHASE[0x1] May 3 11:21:59 judeah /kernel: SCSISEQ[0x12] SBLKCTL[0x0] SCSIRATE[0x0] SEQCTL[0x10] May 3 11:21:59 judeah /kernel: SEQ_FLAGS[0xc0] SSTAT0[0x5] SSTAT1[0xa] SSTAT2[0x0] May 3 11:21:59 judeah /kernel: SSTAT3[0x0] SIMODE0[0x0] SIMODE1[0xa4] SXFRCTL0[0x80] May 3 11:21:59 judeah /kernel: DFCNTRL[0x0] DFSTATUS[0x2d] May 3 11:21:59 judeah /kernel: STACK: 0xe8 0x166 0x1a7 0x3 May 3 11:21:59 judeah /kernel: SCB count = 130 May 3 11:21:59 judeah /kernel: Kernel NEXTQSCB = 30 May 3 11:21:59 judeah /kernel: Card NEXTQSCB = 30 May 3 11:21:59 judeah /kernel: QINFIFO entries: May 3 11:21:59 judeah /kernel: Waiting Queue entries: May 3 11:21:59 judeah /kernel: Disconnected Queue entries: 2:90 May 3 11:21:59 judeah /kernel: QOUTFIFO entries: May 3 11:21:59 judeah /kernel: Sequencer Free SCB List: 1 0 May 3 11:21:59 judeah /kernel: Sequencer SCB Info: May 3 11:21:59 judeah /kernel: 0 SCB_CONTROL[0xe2] SCB_SCSIID[0x67] SCB_LUN[0x0] SCB_TAG[0xff] May 3 11:21:59 judeah /kernel: 1 SCB_CONTROL[0xe2] SCB_SCSIID[0x67] SCB_LUN[0x0] SCB_TAG[0xff] May 3 11:21:59 judeah /kernel: 2 SCB_CONTROL[0x66] SCB_SCSIID[0x17] SCB_LUN[0x0] SCB_TAG[0x5a] May 3 11:21:59 judeah /kernel: Pending list: May 3 11:21:59 judeah /kernel: 90 SCB_CONTROL[0x62] SCB_SCSIID[0x17] SCB_LUN[0x0] May 3 11:21:59 judeah /kernel: Kernel Free SCB list: 82 88 14 115 12 83 120 92 45 8 16 5 59 124 31 29 38 18 73 42 93 64 19 7 74 100 113 75 24 3 86 71 20 108 6 67 68 125 105 97 110 34 54 87 106 25 61 109 123 47 44 66 53 94 84 76 65 77 72 9 69 32 17 55 119 1 22 91 4 112 56 27 102 62 13 15 128 50 33 51 81 37 57 28 99 117 85 36 41 11 121 49 0 80 35 39 40 95 26 96 10 58 118 122 127 111 2 126 70 98 89 21 60 46 48 78 43 101 23 79 52 63 129 103 104 107 116 114 May 3 11:21:59 judeah /kernel: May 3 11:21:59 judeah /kernel: <<<<<<<<<<<<<<<< Dump Card State Ends >>>>>>>>>>>>>>>>>> May 3 11:21:59 judeah /kernel: sg[0] - Addr 0x1ddd000 : Length 4096 May 3 11:21:59 judeah /kernel: sg[1] - Addr 0x7be000 : Length 4096 May 3 11:21:59 judeah /kernel: (da1:ahc0:0:1:0): Queuing a BDR SCB May 3 11:21:59 judeah /kernel: (da1:ahc0:0:1:0): Bus Device Reset Message Sent May 3 11:22:01 judeah /kernel: (da1:ahc0:0:1:0): SCB 0x5a - timed out May 3 11:22:01 judeah /kernel: >>>>>>>>>>>>>>>>>> Dump Card State Begins <<<<<<<<<<<<<<<<< May 3 11:22:01 judeah /kernel: ahc0: Dumping Card State in Message-out phase, at SEQADDR 0x16c May 3 11:22:01 judeah /kernel: Card was paused May 3 11:22:01 judeah /kernel: ACCUM = 0xa0, SINDEX = 0x61, DINDEX = 0xc0, ARG_2 = 0x16 May 3 11:22:01 judeah /kernel: HCNT = 0x0 SCBPTR = 0x2 May 3 11:22:01 judeah /kernel: SCSISIGI[0xa4] ERROR[0x40] SCSIBUSL[0xc] LASTPHASE[0xa0] May 3 11:22:01 judeah /kernel: SCSISEQ[0x12] SBLKCTL[0x0] SCSIRATE[0xf] SEQCTL[0x10] May 3 11:22:01 judeah /kernel: SEQ_FLAGS[0x40] SSTAT0[0x5] SSTAT1[0x2] SSTAT2[0x0] May 3 11:22:01 judeah /kernel: SSTAT3[0x0] SIMODE0[0x0] SIMODE1[0xac] SXFRCTL0[0x88] May 3 11:22:01 judeah /kernel: DFCNTRL[0x4] DFSTATUS[0x6d] May 3 11:22:01 judeah /kernel: STACK: 0xe8 0xe8 0x166 0x1a7 May 3 11:22:01 judeah /kernel: SCB count = 130 May 3 11:22:01 judeah /kernel: Kernel NEXTQSCB = 30 May 3 11:22:01 judeah /kernel: Card NEXTQSCB = 30 May 3 11:22:01 judeah /kernel: QINFIFO entries: May 3 11:22:01 judeah /kernel: Waiting Queue entries: May 3 11:22:01 judeah /kernel: Disconnected Queue entries: May 3 11:22:01 judeah /kernel: QOUTFIFO entries: May 3 11:22:01 judeah /kernel: Sequencer Free SCB List: 1 0 May 3 11:22:01 judeah /kernel: Sequencer SCB Info: May 3 11:22:01 judeah /kernel: 0 SCB_CONTROL[0xe2] SCB_SCSIID[0x67] SCB_LUN[0x0] SCB_TAG[0xff] May 3 11:22:01 judeah /kernel: 1 SCB_CONTROL[0xe2] SCB_SCSIID[0x67] SCB_LUN[0x0] SCB_TAG[0xff] May 3 11:22:01 judeah /kernel: 2 SCB_CONTROL[0x66] SCB_SCSIID[0x17] SCB_LUN[0x0] SCB_TAG[0x5a] May 3 11:22:01 judeah /kernel: Pending list: May 3 11:22:01 judeah /kernel: 90 SCB_CONTROL[0x66] SCB_SCSIID[0x17] SCB_LUN[0x0] May 3 11:22:01 judeah /kernel: Kernel Free SCB list: 82 88 14 115 12 83 120 92 45 8 16 5 59 124 31 29 38 18 73 42 93 64 19 7 74 100 113 75 24 3 86 71 20 108 6 67 68 125 105 97 110 34 54 87 106 25 61 109 123 47 44 66 53 94 84 76 65 77 72 9 69 32 17 55 119 1 22 91 4 112 56 27 102 62 13 15 128 50 33 51 81 37 57 28 99 117 85 36 41 11 121 49 0 80 35 39 40 95 26 96 10 58 118 122 127 111 2 126 70 98 89 21 60 46 48 78 43 101 23 79 52 63 129 103 104 107 116 114 May 3 11:22:01 judeah /kernel: May 3 11:22:01 judeah /kernel: <<<<<<<<<<<<<<<< Dump Card State Ends >>>>>>>>>>>>>>>>>> May 3 11:22:01 judeah /kernel: sg[0] - Addr 0x1ddd000 : Length 4096 May 3 11:22:01 judeah /kernel: sg[1] - Addr 0x7be000 : Length 4096 May 3 11:22:01 judeah /kernel: (da1:ahc0:0:1:0): no longer in timeout, status = 34b May 3 11:22:01 judeah /kernel: ahc0: Issued Channel A Bus Reset. 1 SCBs aborted May 3 11:22:01 judeah /kernel: vinum: dataraid.p0.s1 is stale by force May 3 11:22:01 judeah /kernel: vinum: dataraid.p0 is corrupt May 3 11:22:01 judeah /kernel: fatal :dataraid.p0.s1 write error, block 1905465 for 8192 bytes May 3 11:22:01 judeah /kernel: dataraid.p0.s1: user buffer block 13336624 for 8192 bytes