Topic
  • 11 replies
  • Latest Post - ‏2010-04-18T09:12:49Z by Novikov_Alexander
cisco_ibm
cisco_ibm
7 Posts

Pinned topic Upgrade from older 6.xx.xx to 6.60.22.00 after activate, Controller is down

‏2010-04-17T09:58:23Z |
People, help me!

After upgrade firmware from older 6.xx.xx to 6.60.22.00 on DS4700 Controller is Down. Last version StorageManager no working. Controllers periodical reboot.
Older firware (Version: 06.16.97.0) do not load, because system after activate write -
WARNING!!!!!!
This controller is not running the correct firmware release. SOD is now suspended. In order to prevent any configuration loss, you must download **
04/17/10-09:57:37 (GMT) (tRAID): WARN: ** x6.60.xx.xx release. !!!

Command sysWipe, may help me, what she do It. Data must no delete!
Updated on 2010-04-18T09:12:49Z at 2010-04-18T09:12:49Z by Novikov_Alexander
  • Novikov_Alexander
    Novikov_Alexander
    1409 Posts

    Re: Upgrade from older 6.xx.xx to 6.60.22.00 after activate, Controller is down

    ‏2010-04-17T14:16:57Z  
    Dear cisco_ibm,

    could you provide DS4700 Support Archive (or any other logs and screenshots).

    > Data must no delete!

    Does it means that backup missed? It was bad idea update firmware without backup.

    Regards,
    Alexander Novikov
    Russia, Moscow
  • cisco_ibm
    cisco_ibm
    7 Posts

    Re: Upgrade from older 6.xx.xx to 6.60.22.00 after activate, Controller is down

    ‏2010-04-17T14:46:10Z  
    Dear cisco_ibm,

    could you provide DS4700 Support Archive (or any other logs and screenshots).

    > Data must no delete!

    Does it means that backup missed? It was bad idea update firmware without backup.

    Regards,
    Alexander Novikov
    Russia, Moscow
    StorageManager no working.
    Networkon DS4700 controller is working. Controller A port2 - Network ON, Controller B port1 - Network ON, both ports in one subnets.

    If I Launch SM autodiscover find Controller and when I connect to DS4700 Controller, controlle not respond.

    On both Controller working only console access to command line over Serial interface.

    Controller B firmware 6.60.22.00.

    Controller A firmware 06.16.97.00.

    Now, I load firmware 6.60.17.00 in Controller A.

    Answer, command sysWipe can help me, or what can I do in this case ???

    BackData is partial.

    If I remove partial Disk, which consist actaul Data, and perform sysWipe on both controllers, and put disk back, they should be work ??
  • Novikov_Alexander
    Novikov_Alexander
    1409 Posts

    Re: Upgrade from older 6.xx.xx to 6.60.22.00 after activate, Controller is down

    ‏2010-04-17T14:56:56Z  
    • cisco_ibm
    • ‏2010-04-17T14:46:10Z
    StorageManager no working.
    Networkon DS4700 controller is working. Controller A port2 - Network ON, Controller B port1 - Network ON, both ports in one subnets.

    If I Launch SM autodiscover find Controller and when I connect to DS4700 Controller, controlle not respond.

    On both Controller working only console access to command line over Serial interface.

    Controller B firmware 6.60.22.00.

    Controller A firmware 06.16.97.00.

    Now, I load firmware 6.60.17.00 in Controller A.

    Answer, command sysWipe can help me, or what can I do in this case ???

    BackData is partial.

    If I remove partial Disk, which consist actaul Data, and perform sysWipe on both controllers, and put disk back, they should be work ??
    cisco_ibm,

    try start DS4700 with one controller only. I guess plan can be next:

    • power off DS4700;
    • remove Controller A;
    • power on DS4700;
    • if system working good put Controller A back in DS4700.

    > If I remove partial Disk, which consist actaul Data, and perform sysWipe on both controllers, and put disk back, they should be work ??

    Who knows? Try.

    Do you have previous DS4700 Support Archive or profile? Post it.

    Regards,
    Alexander Novikov
    Russia, Moscow
  • cisco_ibm
    cisco_ibm
    7 Posts

    Re: Upgrade from older 6.xx.xx to 6.60.22.00 after activate, Controller is down

    ‏2010-04-17T15:10:04Z  
    cisco_ibm,

    try start DS4700 with one controller only. I guess plan can be next:

    • power off DS4700;
    • remove Controller A;
    • power on DS4700;
    • if system working good put Controller A back in DS4700.

    > If I remove partial Disk, which consist actaul Data, and perform sysWipe on both controllers, and put disk back, they should be work ??

    Who knows? Try.

    Do you have previous DS4700 Support Archive or profile? Post it.

    Regards,
    Alexander Novikov
    Russia, Moscow
    I have DS4700 profile, before firmware upade I do It!

    Do you have previous DS4700 Support Archive - NO.

    Now, I do steps what you answer.
  • cisco_ibm
    cisco_ibm
    7 Posts

    Re: Upgrade from older 6.xx.xx to 6.60.22.00 after activate, Controller is down

    ‏2010-04-17T16:04:21Z  
    cisco_ibm,

    try start DS4700 with one controller only. I guess plan can be next:

    • power off DS4700;
    • remove Controller A;
    • power on DS4700;
    • if system working good put Controller A back in DS4700.

    > If I remove partial Disk, which consist actaul Data, and perform sysWipe on both controllers, and put disk back, they should be work ??

    Who knows? Try.

    Do you have previous DS4700 Support Archive or profile? Post it.

    Regards,
    Alexander Novikov
    Russia, Moscow
    I do what you say.

    Controller still not working.

    Firmware not synchronised.

    Now, I manual sinchronize firmawe on both controller over serial connection (Xmodem).

    I look this thing, then Controller boot, in any firmware level (6.60.20,6.60.17,6.16.97) I see
    ==============================================
    Title: Disk Array Controller
    Copyright 2004-2008, LSI Logic Corporation

    Name: RC
    Version: 06.60.17.00
    Date: 07/17/2008
    Time: 12:27:21
    Models: 3992 3994
    Manager: devmgr.v0960api00.Manager
    ==============================================

    this string constant
    Manager: devmgr.v0960api00.Manager

    Can be Manager - consist broken data ???
    Only if I connect SM - then controller reboot!!!
  • cisco_ibm
    cisco_ibm
    7 Posts

    Re: Upgrade from older 6.xx.xx to 6.60.22.00 after activate, Controller is down

    ‏2010-04-17T16:07:58Z  
    cisco_ibm,

    try start DS4700 with one controller only. I guess plan can be next:

    • power off DS4700;
    • remove Controller A;
    • power on DS4700;
    • if system working good put Controller A back in DS4700.

    > If I remove partial Disk, which consist actaul Data, and perform sysWipe on both controllers, and put disk back, they should be work ??

    Who knows? Try.

    Do you have previous DS4700 Support Archive or profile? Post it.

    Regards,
    Alexander Novikov
    Russia, Moscow
    Alexandr, are you Russian ?

    Your speak russian, because My English is very BAD ?
  • Novikov_Alexander
    Novikov_Alexander
    1409 Posts

    Re: Upgrade from older 6.xx.xx to 6.60.22.00 after activate, Controller is down

    ‏2010-04-17T16:27:36Z  
    • cisco_ibm
    • ‏2010-04-17T16:07:58Z
    Alexandr, are you Russian ?

    Your speak russian, because My English is very BAD ?
    cisco_ibm,

    if you prefer russian lamguage you can use russian IBM Forum:

    Системы хранения данных IBM
    http://www.ibm.com/developerworks/forums/forum.jspa?forumID=1443&start=0

    Regards,
    Alexander Novikov
    Russia, Moscow
  • cisco_ibm
    cisco_ibm
    7 Posts

    Re: Upgrade from older 6.xx.xx to 6.60.22.00 after activate, Controller is down

    ‏2010-04-17T16:31:28Z  
    cisco_ibm,

    try start DS4700 with one controller only. I guess plan can be next:

    • power off DS4700;
    • remove Controller A;
    • power on DS4700;
    • if system working good put Controller A back in DS4700.

    > If I remove partial Disk, which consist actaul Data, and perform sysWipe on both controllers, and put disk back, they should be work ??

    Who knows? Try.

    Do you have previous DS4700 Support Archive or profile? Post it.

    Regards,
    Alexander Novikov
    Russia, Moscow
    Firmware on both controllers - identical.

    But if I connect on Controller A, It - reboot.
    If I connect on Controller B, It - reboot.

    `a ,H)!`a -б!!)Ж!#лIµaЙ@Ј!я!хбbЗr¤„„Ћ¦&Bю
    Set baud rate: press <space> within 5 seconds 04/17/10-16:26:21 (GMT) (iacTask4): NOTE: spm: checkinAlt Peering Enabled
    bЃ„…„¤„д„…ҐД…¤д¤†Ж‡„…е‡…
    !bo[Ф»Ю6B~j#я!#лIѓ!a)р#!я(!aбGЉЅ
    Set baud rate: press <space> within 5 seconds
    Baud rate set to 9600
    Current date: 04/17/10 time: 10:04:47

    Enter password to access shell:
    LSI Logic RAID Controller
    Copyright 2004-2009 LSI Logic Corporation. All Rights Reserved.
    Copyright Wind River Systems, Inc., 1984-2003
    VxWorks: VxWorks5.5.1 Kernel: WIND version 2.6
    Model: 3992 Firmware version: 06.60.22.00

    -> 04/17/10-16:26:47 (GMT) (symTask2)мc
    я„Фй„ЗОЊЎ9c&^jЮОю->

    Current date: 04/17/10 time: 10:05:02

    Send <BREAK> for Service Interface or baud rate change

    Press within 5 seconds: for Service Interface, <BREAK> for baud rate 04/17/10-16:26:59 (GMT) (tRAID): NOTE: rpaBattMgr instantiation starting.
    04/17/10-16:26:59 (GMT) (tRAID): NOTE: rpaBattery Init starting.
    04/17/10-16:26:59 (GMT) (tRAID): NOTE: rpaBattMgr instantiation complete.
    04/17/10-16:27:00 (GMT) (iacTask1): NOTE: RPM: Unable to find remotePeer - msgId: 28 peerId 10
    04/17/10-16:27:00 (GMT) (tRAID): NOTE: Inter-Controller Communication Channels Opened
    04/17/10-16:27:01 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1
    esmc0: LinkUp event
    04/17/10-16:27:02 (GMT) (IOSched): NOTE: lockMgr Role is Master
    04/17/10-16:27:02 (GMT) (tRAID): NOTE: lockMgr Role is Slave
    04/17/10-16:27:03 (GMT) (tRAID): NOTE: WWN baseName 000600a0-b811f852 (valid==>SoftRst)
    04/17/10-16:27:03 (GMT) (tRAID): NOTE: spmEarlyData: Using cached data
    04/17/10-16:27:03 (GMT) (tRAID): NOTE: CCM instantiation starting.
    04/17/10-16:27:03 (GMT) (tRAID): NOTE: CCM instantiation complete
    04/17/10-16:27:03 (GMT) (tRAID): NOTE: CCM Listener Registration started.
    04/17/10-16:27:03 (GMT) (tRAID): NOTE: CCM Listener Registration complete.
    04/17/10-*** Expired
    04/17/10-16:27:05 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 -2 -3
    04/17/10-16:27:10 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 =2 =3
    ==============================================
    Title: Disk Array Controller
    Copyright 2004-2009, LSI Logic Corporation

    Name: RC
    Version: 06.60.22.00
    Date: 02/13/2009
    Time: 17:57:57
    Models: 3992 3994
    Manager: devmgr.v0960api00.Manager
    ==============================================
    Network Ready
    04/17/10-16:27:17 (GMT) (tRAID): NOTE: CCM: MirrorInit, clearing MOS (2)
    04/17/10-16:27:18 (GMT) (tRAID): NOTE: Volume discovery...
    04/17/10-16:27:18 (GMT) (tRAID): NOTE: Scanning usable NATIVE drives
    04/17/10-16:27:20 (GMT) (ssmTimer): NOTE: CCM BMG: Battery is OK
    04/17/10-16:27:21 (GMT) (tRAID): NOTE: Bringing Volumes On-Line...
    04/17/10-16:27:21 (GMT) (tRAID): NOTE: Total Volumes 16: Optimal 16
    04/17/10-16:27:21 (GMT) (tRAID): NOTE: spm: Peering Enabled (SOD checkin)
    04/17/10-16:27:24 (GMT) (NvsramDacstore): NOTE: NVSRAM Dacstore updated successfully
    04/17/10-16:27:24 (GMT) (tRAID): NOTE: RDAC Mode is Dual-Active. Controllers synchronized.
    04/17/10-16:27:24 (GMT) (tRAID): NOTE: Duplex Environment
    04/17/10-16:27:24 (GMT) (tRAID): NOTE: Controller Mode Active. SCSI IDs (host 5, drive 7).
    04/17/10-16:27:24 (GMT) (tRAID): NOTE: 3 Volumes Owned
    04/17/10-16:27:24 (GMT) (tRAID): NOTE: Alt. Ctrl. Mode Active (Present/Not Failed). SCSI IDs (host 4, drive 6).
    04/17/10-16:27:24 (GMT) (tRAID): NOTE: 13 Volumes Owned
    04/17/10-16:27:25 (GMT) (tRAID): NOTE: sodMain sequence finished, elapsed time = 26 seconds
    04/17/10-16:27:25 (GMT) (tRAID): NOTE: sodMain complete
    04/17/10-16:27:30 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 1 =2 =3
    04/17/10-16:28:03 (GMT) (utlTimer): WARN: Extended Link Down Timeout on channel 2
    04/17/10-16:28:03 (GMT) (utlTimer): WARN: Extended Link Down Timeout on channel 3
    мc
    я„Фй„ЗОЊЎ9c&^jЮОю->

    Current date: 04/17/10 time: 10:08:15

    Send <BREAK> for Service Interface or baud rate change
    Reset, Power-Up Diagnostics - Loop 1 of 1
    3600 Processor DRAM
    01 Data lines Passed
    02 Address lines Passed
    3300 NVSRAM
    01 Data lines Passed
    5900 Ethernet 91c111 #1
    01 Register read Passed
    02 Register test Passed
    5901 Ethernet 91c111 #2
    01 Register read Passed
    02 Register test Passed
    3A00 NAND Flash
    06 Bad Blocks Test Passed
    2310 Application Accelerator Unit
    01 AAU Register Test Passed
    65B0 Host Channel 1--Tachyon DX4 Plus
    01 TachLite Register Test Passed
    65B1 Host Channel 2--Tachyon DX4 Plus
    01 TachLite Register Test Passed
    6BC1 Drive Channel 1--Tachyon DX4 Plus
    01 TachLite Register Test Passed
    6BC2 Drive Channel 2--Tachyon DX4 Plus
    01 TachLite Register Test Passed
    3900 Real-Time Clock
    01 RT Clock Tick Passed
    Diagnostic Manager exited normally.

    Send <BREAK> for Service Interface or baud rate change
    04/17/10-16:30:14 (GMT) (tRAID): NOTE: rpaBattMgr instantiation starting.
    04/17/10-16:30:14 (GMT) (tRAID): NOTE: rpaBattery Init starting.
    04/17/10-16:30:14 (GMT) (tRAID): NOTE: rpaBattMgr instantiation complete.
    04/17/10-16:30:16 (GMT) (tRAID): NOTE: Inter-Controller Communication Channels Opened
    04/17/10-16:30:16 (GMT) (IOSched): NOTE: lockMgr Role is Master
    04/17/10-16:30:17 (GMT) (utlTimer): NOTE: fcnChannelReport ==> -0 ~1
    04/17/10-16:30:17 (GMT) (iacTask1): NOTE: RPM: Unable to find remotePeer - msgId: 1 peerId 10
    04/17/10-16:30:17 (GMT) (tRAID): NOTE: lockMgr Role is Master
    esmc0: LinkUp event
    04/17/10-16:30:18 (GMT) (tRAID): NOTE: WWN baseName 000600a0-b811f852 (valid==>AltMacMatch)
    04/17/10-16:30:19 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 2 3
    04/17/10-16:30:19 (GMT) (tRAID): NOTE: spmEarlyData: Using cached data
    04/17/10-16:30:19 (GMT) (tRAID): NOTE: CCM instantiation starting.
    04/17/10-16:30:19 (GMT) (tRAID): NOTE: CCM instantiation complete
    04/17/10-16:30:19 (GMT) (tRAID): NOTE: CCM Listener Registration started.
    04/17/10-16:30:19 (GMT) (tRAID): NOTE: CCM Listener Registration complete.
    04/17/10-16:30:19 (GMT) (tRAID): NOTE: rpaBattMgr listener registration starting.
    04/17/10-16:30:19 (GMT) (tRAID): NOTE: rpaBattMgr listener registration complete.
    04/17/10-16:30:19 (GMT) (IOSched): NOTE: FC speed negotiation initiated on chip 2
    04/17/10-16:30:19 (GMT) (IOSched): NOTE: FC speed negotiation initiated on chip 3
    04/17/10-16:30:19 (GMT) (iconMgr2): NOTE: CCM BMG: Alternate's battery is low
    04/17/10-16:30:19 (GMT) (IOSched): NOTE: FC speed negotiation complete on chip 3
    04/17/10-16:30:19 (GMT) (IOSched): NOTE: FC speed negotiation complete on chip 2
    04/17/10-16:30:20 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 -2 -3
    04/17/10-16:30:24 (GMT) (IOSched): NOTE: FC speed negotiation initiated on chip 3
    04/17/10-16:30:24 (GMT) (IOSched): NOTE: FC speed negotiation initiated on chip 2
    04/17/10-16:30:25 (GMT) (IOSched): NOTE: FC speed negotiation complete on chip 3
    04/17/10-16:30:25 (GMT) (IOSched): NOTE: FC speed negotiation complete on chip 2
    04/17/10-16:30:25 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 =2 =3
    04/17/10-16:30:25 (GMT) (IOSched): WARN: Extended Link Down is over on channel 3 - lasted 6 seconds
    04/17/10-16:30:25 (GMT) (IOSched): WARN: Extended Link Down is over on channel 2 - lasted 6 seconds
    04/17/10-16:30:26 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 ~3

    Network Ready
    ==============================================
    Title: Disk Array Controller
    Copyright 2004-2009, LSI Logic Corporation

    Name: RC
    Version: 06.60.22.00
    Date: 02/13/2009
    Time: 17:57:57
    Models: 3992 3994
    Manager: devmgr.v0960api00.Manager
    ==============================================

    04/17/10-16:30:53 (GMT) (tRAID): NOTE: Volume discovery...
    04/17/10-16:30:53 (GMT) (tRAID): NOTE: Scanning usable NATIVE drives
    04/17/10-16:30:55 (GMT) (iconMgr3): NOTE: CCM BMG: Alternate's battery is OK
    04/17/10-16:30:55 (GMT) (ssmTimer): NOTE: CCM BMG: Battery is OK
    04/17/10-16:30:56 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 1 2 3
    04/17/10-16:30:58 (GMT) (tRAID): NOTE: evf - Peering Disabled (Alt in SOD)
    04/17/10-16:30:58 (GMT) (iacTask1): NOTE: evf - Peering Enabled (Alt Check In)
    04/17/10-16:30:58 (GMT) (tRAID): NOTE: Bringing Volumes On-Line...
    04/17/10-16:30:59 (GMT) (tRAID): NOTE: Total Volumes 16: Optimal 16
    04/17/10-16:30:59 (GMT) (tRAID): NOTE: spm: Peering Disabled (Alt in SOD)
    04/17/10-16:30:59 (GMT) (tRAID): NOTE: spm itn::setOnline - no ITA found ri:Blade12_KGKESX2 0000013 Blade12_KGKESX2 persist 1 posc ltFC_Target_A&Bh no_security 8B-200600a0b811f852 persist 12 !posc 0
    04/17/10-16:30:59 (GMT) (tRAID): NOTE: spm itn::setOnline - no ITA found ri:Blade12_KGKESX2 0000013 Blade12_KGKESX2 persist 1 posc ltFC_Target_A&Bh no_security 8B-200600a0b811f852 persist 12 !posc 0
    04/17/10-16:30:59 (GMT) (iacTask2): NOTE: spm: checkinAlt Peering Enabled
    04/17/10-16:31:04 (GMT) (NvsramDacstore): NOTE: NVSRAM Dacstore updated successfully
    04/17/10-16:31:04 (GMT) (tRAID): NOTE: RDAC Mode is Dual-Active. Controllers synchronized.
    04/17/10-16:31:04 (GMT) (tRAID): NOTE: Duplex Environment
    04/17/10-16:31:04 (GMT) (tRAID): NOTE: Controller Mode Active. SCSI IDs (host 5, drive 7).
    04/17/10-16:31:04 (GMT) (tRAID): NOTE: 3 Volumes Owned
    04/17/10-16:31:04 (GMT) (tRAID): NOTE: Alt. Ctrl. Mode Active (Present/Not Failed). SCSI IDs (host 4, drive 6).
    04/17/10-16:31:04 (GMT) (tRAID): NOTE: 13 Volumes Owned
    04/17/10-16:31:05 (GMT) (tRAID): NOTE: sodMain sequence finished, elapsed time = 50 seconds
    04/17/10-16:31:05 (GMT) (tRAID): NOTE: sodMain complete
    04/17/10-16:31:21 (GMT) (utlTimer): NOTE: fcnChannelReport ==> +0 -1 2 3
    04/17/10-16:31:25 (GMT) (IOSched): NOTE: Extended Link Down ==> Chan 1
    04/17/10-16:31:26 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 =1 2 3
    04/17/10-16:31:33 (GMT) (IOSched): WARN: Extended Link Down is over on channel 1 - lasted 13 seconds
    04/17/10-16:31:34 (GMT) (iconMgr3): NOTE: spm: Peering Disabled (Health Check) Event: -3
    04/17/10-16:31:34 (GMT) (iconMgr3): NOTE: fcn: Peering Disabled (Health Check) Event: -3
    04/17/10-16:31:36 (GMT) (utlTimer): NOTE: fcnChannelReport ==> +0 +1 2 3
    04/17/10-16:31:36 (GMT) (IonTask): WARN: unable to retrieve alt ctlr encl properties - NoTargetException Error
    04/17/10-16:31:36 (GMT) (ccmEventTask): WARN: CCM: HandleMirrorOutOfSync, setting MOS
    04/17/10-16:31:36 (GMT) (iacTask2): NOTE: fcn: checkInAlt Peering Enabled
    04/17/10-16:31:37 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 +1 2 3
    04/17/10-16:31:37 (GMT) (HealthCheck): NOTE: fcn: Peering Disabled (Health Check) Event: -3
    04/17/10-16:31:37 (GMT) (iacTask4): NOTE: RPM: Unable to find RemoteResponse - msgId: 72
    04/17/10-16:31:37 (GMT) (IOSched): WARN: SPM createITNexus - no ITA for POSC IPort Blade12_KGKESX2 x000e Host FCP 2100001b32097b1a Blade12_KGKESX2 persist 0 posc
    04/17/10-16:31:48 (GMT) (ccmEventTask): NOTE: CCM: ccmHandleLateCheckIn
    04/17/10-16:31:48 (GMT) (ccmEventTask): NOTE: CCM: HandleLateCheckIn, clearing MOS
    04/17/10-16:31:54 (GMT) (iacTask3): NOTE: evf - Peering Enabled (Alt Check In)
    04/17/10-16:31:55 (GMT) (iacTask2): NOTE: spm: checkinAlt Peering Enabled
    04/17/10-16:32:23 (GMT) (utlTimer): NOTE: fcnChannelReport ==> +0 -1 2 3
    04/17/10-16:32:26 (GMT) (IOSched): NOTE: Extended Link Down ==> Chan 1
    04/17/10-16:32:28 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 =1 2 3
    04/17/10-16:32:34 (GMT) (IOSched): WARN: Extended Link Down is over on channel 1 - lasted 13 seconds
    04/17/10-16:32:34 (GMT) (IonTask): WARN: unable to retrieve alt ctlr encl properties - NoTargetException Error
    04/17/10-16:32:35 (GMT) (iconMgr5): NOTE: spm: Peering Disabled (Health Check) Event: -3
    04/17/10-16:32:37 (GMT) (utlTimer): NOTE: fcnChannelReport ==> +0 +1 2 3
    04/17/10-16:32:37 (GMT) (ccmEventTask): WARN: CCM: HandleMirrorOutOfSync, setting MOS
    04/17/10-16:32:37 (GMT) (iacTask3): NOTE: fcn: checkInAlt Peering Enabled
    04/17/10-16:32:38 (GMT) (HealthCheck): NOTE: fcn: Peering Disabled (Health Check) Event: -3
    04/17/10-16:32:38 (GMT) (iacTask4): NOTE: RPM: Unable to find RemoteResponse - msgId: 82
    04/17/10-16:32:49 (GMT) (ccmEventTask): NOTE: CCM: ccmHandleLateCheckIn
    04/17/10-16:32:49 (GMT) (ccmEventTask): NOTE: CCM: HandleLateCheckIn, clearing MOS
    04/17/10-16:32:55 (GMT) (iacTask1): NOTE: evf - Peering Enabled (Alt Check In)
    04/17/10-16:32:56 (GMT) (iacTask3): NOTE: spm: checkinAlt Peering Enabled
    04/17/10-16:33:23 (GMT) (symTask1)мc
    я„Фй„ЗОЊЎ9c&^jЮОю->

    Current date: 04/17/10 time: 10:11:38

    Send <BREAK> for Service Interface or baud rate change
    04/17/10-16:33:35 (GMT) (tRAID): NOTE: rpaBattMgr instantiation starting.
    04/17/10-16:33:35 (GMT) (tRAID): NOTE: rpaBattery Init starting.
    04/17/10-16:33:35 (GMT) (tRAID): NOTE: rpaBattMgr instantiation complete.
    04/17/10-16:33:36 (GMT) (iacTask1): NOTE: RPM: Unable to find remotePeer - msgId: 26 peerId 10
    04/17/10-16:33:36 (GMT) (tRAID): NOTE: Inter-Controller Communication Channels Opened
    04/17/10-16:33:37 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1
    esmc0: LinkUp event
    04/17/10-16:33:38 (GMT) (IOSched): NOTE: lockMgr Role is Master
    04/17/10-16:33:38 (GMT) (tRAID): NOTE: lockMgr Role is Slave
    04/17/10-16:33:39 (GMT) (tRAID): NOTE: WWN baseName 000600a0-b811f852 (valid==>SoftRst)
    04/17/10-16:33:39 (GMT) (tRAID): NOTE: spmEarlyData: Using cached data
    04/17/10-16:33:39 (GMT) (tRAID): NOTE: CCM instantiation starting.
    04/17/10-16:33:39 (GMT) (tRAID): NOTE: CCM instantiation complete
    04/17/10-16:33:39 (GMT) (tRAID): NOTE: CCM Listener Registration started.
    04/17/10-16:33:39 (GMT) (tRAID): NOTE: CCM Listener Registration complete.
    04/17/10-16:33:39 (GMT) (tRAID): NOTE: rpaBattMgr listener registration starting.
    04/17/10-16:33:39 (GMT) (tRAID): NOTE: rpaBattMgr listener registration complete.
    04/17/10-16:33:39 (GMT) (IOSched): NOTE: FC speed negotiation initiated on chip 2
    04/17/10-16:33:39 (GMT) (IOSched): NOTE: FC speed negotiation initiated on chip 3
    04/17/10-16:33:40 (GMT) (IOSched): NOTE: FC speed negotiation complete on chip 2
    04/17/10-16:33:40 (GMT) (IOSched): NOTE: FC speed negotiation complete on chip 3
    04/17/10-16:33:41 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 ~3
    ==============================================
    Title: Disk Array Controller
    Copyright 2004-2009, LSI Logic Corporation

    Name: RC
    Version: 06.60.22.00
    Date: 02/13/2009
    Time: 17:57:57
    Models: 3992 3994
    Manager: devmgr.v0960api00.Manager
    ==============================================
    Network Ready
    04/17/10-16:33:53 (GMT) (tRAID): NOTE: CCM: MirrorInit, clearing MOS (2)
    04/17/10-16:33:54 (GMT) (tRAID): NOTE: Volume discovery...
    04/17/10-16:33:54 (GMT) (tRAID): NOTE: Scanning usable NATIVE drives
    04/17/10-16:33:56 (GMT) (ssmTimer): NOTE: CCM BMG: Battery is OK
    04/17/10-16:33:57 (GMT) (tRAID): NOTE: Bringing Volumes On-Line...
    04/17/10-16:33:57 (GMT) (tRAID): NOTE: Total Volumes 16: Optimal 16
    04/17/10-16:33:57 (GMT) (tRAID): NOTE: spm: Peering Enabled (SOD checkin)
    04/17/10-16:33:57 (GMT) (tRAID): NOTE: spm itn::setOnline - no ITA found ri:Blade12_KGKESX2 0000013 Blade12_KGKESX2 persist 1 posc ltFC_Target_A&Bh no_security 8B-200600a0b811f852 persist 12 !posc 0
    04/17/10-16:33:57 (GMT) (tRAID): NOTE: spm itn::setOnline - no ITA found ri:Blade12_KGKESX2 0000013 Blade12_KGKESX2 persist 1 posc ltFC_Target_A&Bh no_security 8B-200600a0b811f852 persist 12 !posc 0
    04/17/10-16:34:00 (GMT) (NvsramDacstore): NOTE: NVSRAM Dacstore updated successfully
    04/17/10-16:34:00 (GMT) (tRAID): NOTE: RDAC Mode is Dual-Active. Controllers synchronized.
    04/17/10-16:34:00 (GMT) (tRAID): NOTE: Duplex Environment
    04/17/10-16:34:00 (GMT) (tRAID): NOTE: Controller Mode Active. SCSI IDs (host 5, drive 7).
    04/17/10-16:34:00 (GMT) (tRAID): NOTE: 3 Volumes Owned
    04/17/10-16:34:00 (GMT) (tRAID): NOTE: Alt. Ctrl. Mode Active (Present/Not Failed). SCSI IDs (host 4, drive 6).
    04/17/10-16:34:00 (GMT) (tRAID): NOTE: 13 Volumes Owned
    04/17/10-16:34:01 (GMT) (tRAID): NOTE: sodMain sequence finished, elapsed time = 27 seconds
    04/17/10-16:34:01 (GMT) (tRAID): NOTE: sodMain complete
    04/17/10-16:34:11 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 1 2 3
  • Novikov_Alexander
    Novikov_Alexander
    1409 Posts

    Re: Upgrade from older 6.xx.xx to 6.60.22.00 after activate, Controller is down

    ‏2010-04-17T16:32:47Z  
    • cisco_ibm
    • ‏2010-04-17T16:04:21Z
    I do what you say.

    Controller still not working.

    Firmware not synchronised.

    Now, I manual sinchronize firmawe on both controller over serial connection (Xmodem).

    I look this thing, then Controller boot, in any firmware level (6.60.20,6.60.17,6.16.97) I see
    ==============================================
    Title: Disk Array Controller
    Copyright 2004-2008, LSI Logic Corporation

    Name: RC
    Version: 06.60.17.00
    Date: 07/17/2008
    Time: 12:27:21
    Models: 3992 3994
    Manager: devmgr.v0960api00.Manager
    ==============================================

    this string constant
    Manager: devmgr.v0960api00.Manager

    Can be Manager - consist broken data ???
    Only if I connect SM - then controller reboot!!!
    cisco_ibm,

    > Controller still not working.

    one Controller B still not working or both controllers together?

    > Firmware not synchronised.

    what does it mean? Could you explain.

    > Only if I connect SM - then controller reboot!!!

    how you did it, in-band or out-of-band? Do you have any servers/SAN connected to DS?

    Regards,
    Alexander Novikov
    Russia, Moscow
  • cisco_ibm
    cisco_ibm
    7 Posts

    Re: Upgrade from older 6.xx.xx to 6.60.22.00 after activate, Controller is down

    ‏2010-04-17T18:27:14Z  
    cisco_ibm,

    > Controller still not working.

    one Controller B still not working or both controllers together?

    > Firmware not synchronised.

    what does it mean? Could you explain.

    > Only if I connect SM - then controller reboot!!!

    how you did it, in-band or out-of-band? Do you have any servers/SAN connected to DS?

    Regards,
    Alexander Novikov
    Russia, Moscow
    > one Controller B still not working or both controllers together?

    Both controllers.

    Now Controllers synchronized

    04/17/10-18:14:21 (GMT) (tRAID): NOTE: CCM: MirrorInit, clearing MOS (2)
    04/17/10-18:14:21 (GMT) (tRAID): NOTE: Volume discovery...
    04/17/10-18:14:21 (GMT) (tRAID): NOTE: Scanning usable NATIVE drives
    04/17/10-18:14:23 (GMT) (ssmTimer): NOTE: CCM BMG: Battery is OK
    04/17/10-18:14:24 (GMT) (tRAID): NOTE: Bringing Volumes On-Line...
    04/17/10-18:14:25 (GMT) (tRAID): NOTE: Total Volumes 16: Optimal 16
    04/17/10-18:14:25 (GMT) (tRAID): NOTE: spm: Peering Enabled (SOD checkin)
    04/17/10-18:14:25 (GMT) (tRAID): NOTE: spm itn::setOnline - no ITA found ri:Blade12_KGKESX2 0000013 Blade12_KGKESX2 persist 1 posc ltFC_Target_A&Bh no_security 8B-200600a0b811f852 persist 12 !posc 0
    04/17/10-18:14:28 (GMT) (NvsramDacstore): NOTE: NVSRAM Dacstore updated successfully
    04/17/10-18:14:28 (GMT) (tRAID): NOTE: RDAC Mode is Dual-Active. Controllers synchronized.
    04/17/10-18:14:28 (GMT) (tRAID): NOTE: Duplex Environment
    04/17/10-18:14:28 (GMT) (tRAID): NOTE: Controller Mode Active. SCSI IDs (host 5, drive 7).
    04/17/10-18:14:28 (GMT) (tRAID): NOTE: 10 Volumes Owned
    04/17/10-18:14:28 (GMT) (tRAID): NOTE: Alt. Ctrl. Mode Active (Present/Not Failed). SCSI IDs (host 4, drive 6).
    04/17/10-18:14:28 (GMT) (tRAID): NOTE: 6 Volumes Owned
    04/17/10-18:14:29 (GMT) (tRAID): NOTE: sodMain sequence finished, elapsed time = 28 seconds
    04/17/10-18:14:29 (GMT) (tRAID): NOTE: sodMain complete
    04/17/10-18:14:32 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 1 ~2 =3
    04/17/10-18:14:36 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 1 2 =3
    04/17/10-18:15:05 (GMT) (utlTimer): WARN: Extended Link Down Timeout on channel 3

    >how you did it, in-band or out-of-band? Do you have any servers/SAN connected to DS?

    I use connect type Out-of-band.

    I have 4 servers connect over FC to DS. its works normal. But if I run StorageManager any version reload controlers.
    ==============================
    Now ControllerA - reboot, load then reboot,load then reboots, load and reboot!!!
    Current date: 04/17/10 time: 11:44:07

    Send <BREAK> for Service Interface or baud rate change
    04/17/10-18:06:04 (GMT) (tRAID): NOTE: rpaBattMgr instantiation starting.
    04/17/10-18:06:04 (GMT) (tRAID): NOTE: rpaBattery Init starting.
    04/17/10-18:06:04 (GMT) (tRAID): NOTE: rpaBattMgr instantiation complete.
    04/17/10-18:06:05 (GMT) (iacTask1): NOTE: RPM: Unable to find remotePeer - msgId: 26 peerId 10
    04/17/10-18:06:05 (GMT) (tRAID): NOTE: Inter-Controller Communication Channels Opened
    04/17/10-18:06:06 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1
    esmc0: LinkUp event
    04/17/10-18:06:07 (GMT) (iacTask2): NOTE: RPM: Unable to find remotePeer - msgId: 27 peerId 10
    04/17/10-18:06:07 (GMT) (tRAID): NOTE: lockMgr Role is Slave
    04/17/10-18:06:08 (GMT) (tRAID): NOTE: WWN baseName 000600a0-b811f852 (valid==>SoftRst)
    04/17/10-18:06:08 (GMT) (tRAID): NOTE: spmEarlyData: Using cached data
    04/17/10-18:06:08 (GMT) (tRAID): NOTE: CCM instantiation starting.
    04/17/10-18:06:08 (GMT) (tRAID): NOTE: CCM instantiation complete
    04/17/10-18:06:08 (GMT) (tRAID): NOTE: CCM Listener Registration started.
    04/17/10-18:06:08 (GMT) (tRAID): NOTE: CCM Listener Registration complete.
    04/17/10-18:06:08 (GMT) (tRAID): NOTE: rpaBattMgr listener registration starting.
    04/17/10-18:06:08 (GMT) (tRAID): NOTE: rpaBattMgr listener registration complete.
    04/17/10-18:06:08 (GMT) (IOSched): NOTE: FC speed negotiation initiated on chip 2
    04/17/10-18:06:09 (GMT) (IOSched): NOTE: FC speed negotiation complete on chip 2
    04/17/10-18:06:10 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 -3
    04/17/10-18:06:15 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 =3
    ==============================================
    Title: Disk Array Controller
    Copyright 2004-2009, LSI Logic Corporation

    Name: RC
    Version: 06.60.22.00
    Date: 02/13/2009
    Time: 17:57:57
    Models: 3992 3994
    Manager: devmgr.v0960api00.Manager
    ==============================================
    Network Ready
    04/17/10-18:06:22 (GMT) (tRAID): NOTE: CCM: MirrorInit, clearing MOS (2)
    04/17/10-18:06:23 (GMT) (tRAID): NOTE: Volume discovery...
    04/17/10-18:06:23 (GMT) (tRAID): NOTE: Scanning usable NATIVE drives
    04/17/10-18:06:25 (GMT) (ssmTimer): NOTE: CCM BMG: Battery is OK
    04/17/10-18:06:26 (GMT) (tRAID): NOTE: Bringing Volumes On-Line...
    04/17/10-18:06:26 (GMT) (tRAID): NOTE: Total Volumes 16: Optimal 16
    04/17/10-18:06:26 (GMT) (tRAID): NOTE: spm: Peering Enabled (SOD checkin)
    04/17/10-18:06:27 (GMT) (tRAID): NOTE: spm itn::setOnline - no ITA found ri:Blade12_KGKESX2 0000013 Blade12_KGKESX2 persist 1 posc ltFC_Target_A&Bh no_security 8B-200600a0b811f852 persist 12 !posc 0
    04/17/10-18:06:30 (GMT) (NvsramDacstore): NOTE: NVSRAM Dacstore updated successfully
    04/17/10-18:06:30 (GMT) (tRAID): NOTE: RDAC Mode is Dual-Active. Controllers synchronized.
    04/17/10-18:06:30 (GMT) (tRAID): NOTE: Duplex Environment
    04/17/10-18:06:30 (GMT) (tRAID): NOTE: Controller Mode Active. SCSI IDs (host 5, drive 7).
    04/17/10-18:06:30 (GMT) (tRAID): NOTE: 10 Volumes Owned
    04/17/10-18:06:30 (GMT) (tRAID): NOTE: Alt. Ctrl. Mode Active (Present/Not Failed). SCSI IDs (host 4, drive 6).
    04/17/10-18:06:30 (GMT) (tRAID): NOTE: 6 Volumes Owned
    04/17/10-18:06:30 (GMT) (tRAID): NOTE: sodMain sequence finished, elapsed time = 27 seconds
    04/17/10-18:06:30 (GMT) (tRAID): NOTE: sodMain complete
    04/17/10-18:06:35 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 1 ~2 =3
    04/17/10-18:06:39 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 1 2 =3
    04/17/10-18:07:08 (GMT) (utlTimer): WARN: Extended Link Down Timeout on channel 3
    04/17/10-18:08:49 (GMT) (symTask1)мc
    я„Фй„ЗОЊЎ9c&^jЮОю->

    Current date: 04/17/10 time: 11:47:05

    Send <BREAK> for Service Interface or baud rate change
    04/17/10-18:09:02 (GMT) (tRAID): NOTE: rpaBattMgr instantiation starting.
    04/17/10-18:09:02 (GMT) (tRAID): NOTE: rpaBattery Init starting.
    04/17/10-18:09:02 (GMT) (tRAID): NOTE: rpaBattMgr instantiation complete.
    04/17/10-18:09:03 (GMT) (tRAID): NOTE: Inter-Controller Communication Channels Opened
    04/17/10-18:09:04 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1
    esmc0: LinkUp event
    04/17/10-18:09:05 (GMT) (tRAID): NOTE: lockMgr Role is Slave
    04/17/10-18:09:06 (GMT) (tRAID): NOTE: WWN baseName 000600a0-b811f852 (valid==>SoftRst)
    04/17/10-18:09:06 (GMT) (tRAID): NOTE: spmEarlyData: Using cached data
    04/17/10-18:09:06 (GMT) (tRAID): NOTE: CCM instantiation starting.
    04/17/10-18:09:06 (GMT) (tRAID): NOTE: CCM instantiation complete
    04/17/10-18:09:06 (GMT) (tRAID): NOTE: CCM Listener Registration started.
    04/17/10-18:09:06 (GMT) (tRAID): NOTE: CCM Listener Registration complete.
    04/17/10-18:09:06 (GMT) (tRAID): NOTE: rpaBattMgr listener registration starting.
    04/17/10-18:09:06 (GMT) (tRAID): NOTE: rpaBattMgr listener registration complete.
    04/17/10-18:09:06 (GMT) (IOSched): NOTE: FC speed negotiation initiated on chip 2
    04/17/10-18:09:07 (GMT) (IOSched): NOTE: FC speed negotiation complete on chip 2
    04/17/10-18:09:08 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 -3
    04/17/10-18:09:13 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 =3
    ==============================================
    Title: Disk Array Controller
    Copyright 2004-2009, LSI Logic Corporation

    Name: RC
    Version: 06.60.22.00
    Date: 02/13/2009
    Time: 17:57:57
    Models: 3992 3994
    Manager: devmgr.v0960api00.Manager
    ==============================================
    Network Ready
    04/17/10-18:09:21 (GMT) (tRAID): NOTE: CCM: MirrorInit, clearing MOS (2)
    04/17/10-18:09:21 (GMT) (tRAID): NOTE: Volume discovery...
    04/17/10-18:09:21 (GMT) (tRAID): NOTE: Scanning usable NATIVE drives
    04/17/10-18:09:24 (GMT) (ssmTimer): NOTE: CCM BMG: Battery is OK
    04/17/10-18:09:24 (GMT) (tRAID): NOTE: Bringing Volumes On-Line...
    04/17/10-18:09:25 (GMT) (tRAID): NOTE: Total Volumes 16: Optimal 16
    04/17/10-18:09:25 (GMT) (tRAID): NOTE: spm: Peering Enabled (SOD checkin)
    04/17/10-18:09:25 (GMT) (tRAID): NOTE: spm itn::setOnline - no ITA found ri:Blade12_KGKESX2 0000013 Blade12_KGKESX2 persist 1 posc ltFC_Target_A&Bh no_security 8B-200600a0b811f852 persist 12 !posc 0
    04/17/10-18:09:28 (GMT) (NvsramDacstore): NOTE: NVSRAM Dacstore updated successfully
    04/17/10-18:09:29 (GMT) (tRAID): NOTE: RDAC Mode is Dual-Active. Controllers synchronized.
    04/17/10-18:09:29 (GMT) (tRAID): NOTE: Duplex Environment
    04/17/10-18:09:29 (GMT) (tRAID): NOTE: Controller Mode Active. SCSI IDs (host 5, drive 7).
    04/17/10-18:09:29 (GMT) (tRAID): NOTE: 10 Volumes Owned
    04/17/10-18:09:29 (GMT) (tRAID): NOTE: Alt. Ctrl. Mode Active (Present/Not Failed). SCSI IDs (host 4, drive 6).
    04/17/10-18:09:29 (GMT) (tRAID): NOTE: 6 Volumes Owned
    04/17/10-18:09:29 (GMT) (tRAID): NOTE: sodMain sequence finished, elapsed time = 27 seconds
    04/17/10-18:09:29 (GMT) (tRAID): NOTE: sodMain complete
    04/17/10-18:09:33 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 1 ~2 =3
    04/17/10-18:09:34 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 1 ~2 =3
    04/17/10-18:09:37 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 1 2 =3
    04/17/10-18:09:46 (GMT) (symTask1)мc
    я„Фй„ЗОBЎ9c&^jЮОю->

    Current date: 04/17/10 time: 11:48:01

    Send <BREAK> for Service Interface or baud rate change
    04/17/10-18:09:59 (GMT) (tRAID): NOTE: rpaBattMgr instantiation starting.
    04/17/10-18:09:59 (GMT) (tRAID): NOTE: rpaBattery Init starting.
    04/17/10-18:09:59 (GMT) (tRAID): NOTE: rpaBattMgr instantiation complete.
    04/17/10-18:10:00 (GMT) (tRAID): NOTE: Inter-Controller Communication Channels Opened
    04/17/10-18:10:01 (GMT) (utlTimer): NOTE: fcnChannelReport ==> -0 ~1
    esmc0: LinkUp event
    04/17/10-18:10:02 (GMT) (tRAID): NOTE: lockMgr Role is Slave
    04/17/10-18:10:03 (GMT) (tRAID): NOTE: WWN baseName 000600a0-b811f852 (valid==>SoftRst)
    04/17/10-18:10:03 (GMT) (tRAID): NOTE: spmEarlyData: Using cached data
    04/17/10-18:10:03 (GMT) (tRAID): NOTE: CCM instantiation starting.
    04/17/10-18:10:03 (GMT) (tRAID): NOTE: CCM instantiation complete
    04/17/10-18:10:03 (GMT) (tRAID): NOTE: CCM Listener Registration started.
    04/17/10-18:10:03 (GMT) (tRAID): NOTE: CCM Listener Registration complete.
    04/17/10-18:10:03 (GMT) (tRAID): NOTE: rpaBattMgr listener registration starting.
    04/17/10-18:10:03 (GMT) (tRAID): NOTE: rpaBattMgr listener registration complete.
    04/17/10-18:10:03 (GMT) (IOSched): NOTE: FC speed negotiation initiated on chip 2
    04/17/10-18:10:04 (GMT) (IOSched): NOTE: FC speed negotiation complete on chip 2
    04/17/10-18:10:04 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 -3
    04/17/10-18:10:10 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 =3
    ==============================================
    Title: Disk Array Controller
    Copyright 2004-2009, LSI Logic Corporation

    Name: RC
    Version: 06.60.22.00
    Date: 02/13/2009
    Time: 17:57:57
    Models: 3992 3994
    Manager: devmgr.v0960api00.Manager
    ==============================================
    Network Ready
    04/17/10-18:10:18 (GMT) (tRAID): NOTE: CCM: MirrorInit, clearing MOS (2)
    04/17/10-18:10:18 (GMT) (tRAID): NOTE: Volume discovery...
    04/17/10-18:10:18 (GMT) (tRAID): NOTE: Scanning usable NATIVE drives
    04/17/10-18:10:20 (GMT) (ssmTimer): NOTE: CCM BMG: Battery is OK
    04/17/10-18:10:21 (GMT) (tRAID): NOTE: Bringing Volumes On-Line...
    04/17/10-18:10:22 (GMT) (tRAID): NOTE: Total Volumes 16: Optimal 16
    04/17/10-18:10:22 (GMT) (tRAID): NOTE: spm: Peering Enabled (SOD checkin)
    04/17/10-18:10:22 (GMT) (tRAID): NOTE: spm itn::setOnline - no ITA found ri:Blade12_KGKESX2 0000013 Blade12_KGKESX2 persist 1 posc ltFC_Target_A&Bh no_security 8B-200600a0b811f852 persist 12 !posc 0
    04/17/10-18:10:25 (GMT) (NvsramDacstore): NOTE: NVSRAM Dacstore updated successfully
    04/17/10-18:10:25 (GMT) (tRAID): NOTE: RDAC Mode is Dual-Active. Controllers synchronized.
    04/17/10-18:10:25 (GMT) (tRAID): NOTE: Duplex Environment
    04/17/10-18:10:25 (GMT) (tRAID): NOTE: Controller Mode Active. SCSI IDs (host 5, drive 7).
    04/17/10-18:10:25 (GMT) (tRAID): NOTE: 10 Volumes Owned
    04/17/10-18:10:25 (GMT) (tRAID): NOTE: Alt. Ctrl. Mode Active (Present/Not Failed). SCSI IDs (host 4, drive 6).
    04/17/10-18:10:25 (GMT) (tRAID): NOTE: 6 Volumes Owned
    04/17/10-18:10:26 (GMT) (tRAID): NOTE: sodMain sequence finished, elapsed time = 27 seconds
    04/17/10-18:10:26 (GMT) (tRAID): NOTE: sodMain complete
    04/17/10-18:10:31 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 1 ~2 =3
    04/17/10-18:10:34 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 1 2 =3
    04/17/10-18:10:47 (GMT) (symTask1)мc
    я„Фй„ЗОЊЎ9c&^jЮОю->

    Current date: 04/17/10 time: 11:49:02

    Send <BREAK> for Service Interface or baud rate change
    04/17/10-18:10:59 (GMT) (tRAID): NOTE: rpaBattMgr instantiation starting.
    04/17/10-18:10:59 (GMT) (tRAID): NOTE: rpaBattery Init starting.
    04/17/10-18:10:59 (GMT) (tRAID): NOTE: rpaBattMgr instantiation complete.
    04/17/10-18:11:00 (GMT) (tRAID): NOTE: Inter-Controller Communication Channels Opened
    04/17/10-18:11:01 (GMT) (utlTimer): NOTE: fcnChannelReport ==> -0 ~1
    esmc0: LinkUp event
    04/17/10-18:11:02 (GMT) (tRAID): NOTE: lockMgr Role is Slave
    04/17/10-18:11:03 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1
    04/17/10-18:11:03 (GMT) (tRAID): NOTE: WWN baseName 000600a0-b811f852 (valid==>SoftRst)
    04/17/10-18:11:03 (GMT) (tRAID): NOTE: spmEarlyData: Using cached data
    04/17/10-18:11:03 (GMT) (tRAID): NOTE: CCM instantiation starting.
    04/17/10-18:11:03 (GMT) (tRAID): NOTE: CCM instantiation complete
    04/17/10-18:11:03 (GMT) (tRAID): NOTE: CCM Listener Registration started.
    04/17/10-18:11:03 (GMT) (tRAID): NOTE: CCM Listener Registration complete.
    04/17/10-18:11:03 (GMT) (tRAID): NOTE: rpaBattMgr listener registration starting.
    04/17/10-18:11:03 (GMT) (tRAID): NOTE: rpaBattMgr listener registration complete.
    04/17/10-18:11:03 (GMT) (IOSched): NOTE: FC speed negotiation initiated on chip 2
    04/17/10-18:11:04 (GMT) (IOSched): NOTE: FC speed negotiation complete on chip 2
    04/17/10-18:11:05 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 -3
    04/17/10-18:11:10 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 =3
    ==============================================
    Title: Disk Array Controller
    Copyright 2004-2009, LSI Logic Corporation

    Name: RC
    Version: 06.60.22.00
    Date: 02/13/2009
    Time: 17:57:57
    Models: 3992 3994
    Manager: devmgr.v0960api00.Manager
    ==============================================
    Network Ready
    04/17/10-18:11:18 (GMT) (tRAID): NOTE: CCM: MirrorInit, clearing MOS (2)
    04/17/10-18:11:18 (GMT) (tRAID): NOTE: Volume discovery...
    04/17/10-18:11:18 (GMT) (tRAID): NOTE: Scanning usable NATIVE drives
    04/17/10-18:11:20 (GMT) (ssmTimer): NOTE: CCM BMG: Battery is OK
    04/17/10-18:11:21 (GMT) (tRAID): NOTE: Bringing Volumes On-Line...
    04/17/10-18:11:21 (GMT) (tRAID): NOTE: Total Volumes 16: Optimal 16
    04/17/10-18:11:22 (GMT) (tRAID): NOTE: spm: Peering Enabled (SOD checkin)
    04/17/10-18:11:22 (GMT) (tRAID): NOTE: spm itn::setOnline - no ITA found ri:Blade12_KGKESX2 0000013 Blade12_KGKESX2 persist 1 posc ltFC_Target_A&Bh no_security 8B-200600a0b811f852 persist 12 !posc 0
    04/17/10-18:11:25 (GMT) (NvsramDacstore): NOTE: NVSRAM Dacstore updated successfully
    04/17/10-18:11:25 (GMT) (tRAID): NOTE: RDAC Mode is Dual-Active. Controllers synchronized.
    04/17/10-18:11:25 (GMT) (tRAID): NOTE: Duplex Environment
    04/17/10-18:11:25 (GMT) (tRAID): NOTE: Controller Mode Active. SCSI IDs (host 5, drive 7).
    04/17/10-18:11:25 (GMT) (tRAID): NOTE: 10 Volumes Owned
    04/17/10-18:11:25 (GMT) (tRAID): NOTE: Alt. Ctrl. Mode Active (Present/Not Failed). SCSI IDs (host 4, drive 6).
    04/17/10-18:11:25 (GMT) (tRAID): NOTE: 6 Volumes Owned
    04/17/10-18:11:26 (GMT) (tRAID): NOTE: sodMain sequence finished, elapsed time = 27 seconds
    04/17/10-18:11:26 (GMT) (tRAID): NOTE: sodMain complete
    04/17/10-18:11:31 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 1 ~2 =3
    04/17/10-18:11:33 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 1 ~2 =3
    04/17/10-18:11:35 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 1 2 =3
    04/17/10-18:12:04 (GMT) (utlTimer): WARN: Extended Link Down Timeout on channel 3
    04/17/10-18:13:48 (GMT) (symTask2)мc
    я„Фй„ЗОЊЎ9c&^jЮОю->

    Current date: 04/17/10 time: 11:52:04

    Send <BREAK> for Service Interface or baud rate change
    04/17/10-18:14:01 (GMT) (tRAID): NOTE: rpaBattMgr instantiation starting.
    04/17/10-18:14:01 (GMT) (tRAID): NOTE: rpaBattery Init starting.
    04/17/10-18:14:01 (GMT) (tRAID): NOTE: rpaBattMgr instantiation complete.
    04/17/10-18:14:02 (GMT) (iacTask1): NOTE: RPM: Unable to find remotePeer - msgId: 87 peerId 10
    04/17/10-18:14:02 (GMT) (tRAID): NOTE: Inter-Controller Communication Channels Opened
    04/17/10-18:14:03 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1
    esmc0: LinkUp event
    04/17/10-18:14:04 (GMT) (tRAID): NOTE: lockMgr Role is Slave
    04/17/10-18:14:04 (GMT) (iacTask2): NOTE: RPM: Unable to find remotePeer - msgId: 88 peerId 10
    04/17/10-18:14:05 (GMT) (tRAID): NOTE: WWN baseName 000600a0-b811f852 (valid==>SoftRst)
    04/17/10-18:14:05 (GMT) (tRAID): NOTE: spmEarlyData: Using cached data
    04/17/10-18:14:05 (GMT) (tRAID): NOTE: CCM instantiation starting.
    04/17/10-18:14:05 (GMT) (tRAID): NOTE: CCM instantiation complete
    04/17/10-18:14:05 (GMT) (tRAID): NOTE: CCM Listener Registration started.
    04/17/10-18:14:05 (GMT) (tRAID): NOTE: CCM Listener Registration complete.
    04/17/10-18:14:05 (GMT) (tRAID): NOTE: rpaBattMgr listener registration starting.
    04/17/10-18:14:05 (GMT) (tRAID): NOTE: rpaBattMgr listener registration complete.
    04/17/10-18:14:05 (GMT) (IOSched): NOTE: FC speed negotiation initiated on chip 2
    04/17/10-18:14:06 (GMT) (IOSched): NOTE: FC speed negotiation complete on chip 2
    04/17/10-18:14:07 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 -3
    04/17/10-18:14:12 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 =3
    ==============================================
    Title: Disk Array Controller
    Copyright 2004-2009, LSI Logic Corporation

    Name: RC
    Version: 06.60.22.00
    Date: 02/13/2009
    Time: 17:57:57
    Models: 3992 3994
    Manager: devmgr.v0960api00.Manager
    ==============================================
    Network Ready
    04/17/10-18:14:21 (GMT) (tRAID): NOTE: CCM: MirrorInit, clearing MOS (2)
    04/17/10-18:14:21 (GMT) (tRAID): NOTE: Volume discovery...
    04/17/10-18:14:21 (GMT) (tRAID): NOTE: Scanning usable NATIVE drives
    04/17/10-18:14:23 (GMT) (ssmTimer): NOTE: CCM BMG: Battery is OK
    04/17/10-18:14:24 (GMT) (tRAID): NOTE: Bringing Volumes On-Line...
    04/17/10-18:14:25 (GMT) (tRAID): NOTE: Total Volumes 16: Optimal 16
    04/17/10-18:14:25 (GMT) (tRAID): NOTE: spm: Peering Enabled (SOD checkin)
    04/17/10-18:14:25 (GMT) (tRAID): NOTE: spm itn::setOnline - no ITA found ri:Blade12_KGKESX2 0000013 Blade12_KGKESX2 persist 1 posc ltFC_Target_A&Bh no_security 8B-200600a0b811f852 persist 12 !posc 0
    04/17/10-18:14:28 (GMT) (NvsramDacstore): NOTE: NVSRAM Dacstore updated successfully
    04/17/10-18:14:28 (GMT) (tRAID): NOTE: RDAC Mode is Dual-Active. Controllers synchronized.
    04/17/10-18:14:28 (GMT) (tRAID): NOTE: Duplex Environment
    04/17/10-18:14:28 (GMT) (tRAID): NOTE: Controller Mode Active. SCSI IDs (host 5, drive 7).
    04/17/10-18:14:28 (GMT) (tRAID): NOTE: 10 Volumes Owned
    04/17/10-18:14:28 (GMT) (tRAID): NOTE: Alt. Ctrl. Mode Active (Present/Not Failed). SCSI IDs (host 4, drive 6).
    04/17/10-18:14:28 (GMT) (tRAID): NOTE: 6 Volumes Owned
    04/17/10-18:14:29 (GMT) (tRAID): NOTE: sodMain sequence finished, elapsed time = 28 seconds
    04/17/10-18:14:29 (GMT) (tRAID): NOTE: sodMain complete
    04/17/10-18:14:32 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 1 ~2 =3
    04/17/10-18:14:36 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 1 2 =3
    04/17/10-18:15:05 (GMT) (utlTimer): WARN: Extended Link Down Timeout on channel 3
    04/17/10-18:22:45 (GMT) (symTask1)мc
    я„Фй„ЗОЊЎ9c&^jЮОю->

    Current date: 04/17/10 time: 12:01:00

    Send <BREAK> for Service Interface or baud rate change
    04/17/10-18:22:58 (GMT) (tRAID): NOTE: rpaBattMgr instantiation starting.
    04/17/10-18:22:58 (GMT) (tRAID): NOTE: rpaBattery Init starting.
    04/17/10-18:22:58 (GMT) (tRAID): NOTE: rpaBattMgr instantiation complete.
    04/17/10-18:22:59 (GMT) (iacTask1): NOTE: RPM: Unable to find remotePeer - msgId: 149 peerId 10
    04/17/10-18:22:59 (GMT) (tRAID): NOTE: Inter-Controller Communication Channels Opened
    04/17/10-18:23:00 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1
    esmc0: LinkUp event
    04/17/10-18:23:01 (GMT) (tRAID): NOTE: lockMgr Role is Slave
    04/17/10-18:23:02 (GMT) (tRAID): NOTE: WWN baseName 000600a0-b811f852 (valid==>SoftRst)
    04/17/10-18:23:02 (GMT) (tRAID): NOTE: spmEarlyData: Using cached data
    04/17/10-18:23:02 (GMT) (tRAID): NOTE: CCM instantiation starting.
    04/17/10-18:23:02 (GMT) (tRAID): NOTE: CCM instantiation complete
    04/17/10-18:23:02 (GMT) (tRAID): NOTE: CCM Listener Registration started.
    04/17/10-18:23:02 (GMT) (tRAID): NOTE: CCM Listener Registration complete.
    04/17/10-18:23:02 (GMT) (tRAID): NOTE: rpaBattMgr listener registration starting.
    04/17/10-18:23:02 (GMT) (tRAID): NOTE: rpaBattMgr listener registration complete.
    04/17/10-18:23:02 (GMT) (IOSched): NOTE: FC speed negotiation initiated on chip 2
    04/17/10-18:23:03 (GMT) (IOSched): NOTE: FC speed negotiation complete on chip 2
    04/17/10-18:23:04 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 -3
    04/17/10-18:23:09 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 =3
    ==============================================
    Title: Disk Array Controller
    Copyright 2004-2009, LSI Logic Corporation

    Name: RC
    Version: 06.60.22.00
    Date: 02/13/2009
    Time: 17:57:57
    Models: 3992 3994
    Manager: devmgr.v0960api00.Manager
    ==============================================
    Network Ready
    04/17/10-18:23:18 (GMT) (tRAID): NOTE: CCM: MirrorInit, clearing MOS (2)
    04/17/10-18:23:18 (GMT) (tRAID): NOTE: Volume discovery...
    04/17/10-18:23:18 (GMT) (tRAID): NOTE: Scanning usable NATIVE drives
    04/17/10-18:23:20 (GMT) (ssmTimer): NOTE: CCM BMG: Battery is OK
    04/17/10-18:23:21 (GMT) (tRAID): NOTE: Bringing Volumes On-Line...
    04/17/10-18:23:21 (GMT) (tRAID): NOTE: Total Volumes 16: Optimal 16
    04/17/10-18:23:22 (GMT) (tRAID): NOTE: spm: Peering Enabled (SOD checkin)
    04/17/10-18:23:22 (GMT) (tRAID): NOTE: spm itn::setOnline - no ITA found ri:Blade12_KGKESX2 0000013 Blade12_KGKESX2 persist 1 posc ltFC_Target_A&Bh no_security 8B-200600a0b811f852 persist 12 !posc 0
    04/17/10-18:23:25 (GMT) (NvsramDacstore): NOTE: NVSRAM Dacstore updated successfully
    04/17/10-18:23:25 (GMT) (tRAID): NOTE: RDAC Mode is Dual-Active. Controllers synchronized.
    04/17/10-18:23:25 (GMT) (tRAID): NOTE: Duplex Environment
    04/17/10-18:23:25 (GMT) (tRAID): NOTE: Controller Mode Active. SCSI IDs (host 5, drive 7).
    04/17/10-18:23:25 (GMT) (tRAID): NOTE: 10 Volumes Owned
    04/17/10-18:23:25 (GMT) (tRAID): NOTE: Alt. Ctrl. Mode Active (Present/Not Failed). SCSI IDs (host 4, drive 6).
    04/17/10-18:23:25 (GMT) (tRAID): NOTE: 6 Volumes Owned
    04/17/10-18:23:26 (GMT) (tRAID): NOTE: sodMain sequence finished, elapsed time = 28 seconds
    04/17/10-18:23:26 (GMT) (tRAID): NOTE: sodMain complete
    04/17/10-18:23:29 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 1 ~2 =3
    04/17/10-18:23:33 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 1 2 =3
    04/17/10-18:23:46 (GMT) (symTask1)мc
    я„Фй„ЗОЊЎ9c&^jЮОю->

    Current date: 04/17/10 time: 12:02:01

    Send <BREAK> for Service Interface or baud rate change
    04/17/10-18:23:59 (GMT) (tRAID): NOTE: rpaBattMgr instantiation starting.
    04/17/10-18:23:59 (GMT) (tRAID): NOTE: rpaBattery Init starting.
    04/17/10-18:23:59 (GMT) (tRAID): NOTE: rpaBattMgr instantiation complete.
    04/17/10-18:24:00 (GMT) (iacTask1): NOTE: RPM: Unable to find remotePeer - msgId: 159 peerId 10
    04/17/10-18:24:00 (GMT) (tRAID): NOTE: Inter-Controller Communication Channels Opened
    04/17/10-18:24:01 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1
    esmc0: LinkUp event
    04/17/10-18:24:02 (GMT) (tRAID): NOTE: lockMgr Role is Slave
    04/17/10-18:24:03 (GMT) (tRAID): NOTE: WWN baseName 000600a0-b811f852 (valid==>SoftRst)
    04/17/10-18:24:03 (GMT) (tRAID): NOTE: spmEarlyData: Using cached data
    04/17/10-18:24:03 (GMT) (tRAID): NOTE: CCM instantiation starting.
    04/17/10-18:24:03 (GMT) (tRAID): NOTE: CCM instantiation complete
    04/17/10-18:24:03 (GMT) (tRAID): NOTE: CCM Listener Registration started.
    04/17/10-18:24:03 (GMT) (tRAID): NOTE: CCM Listener Registration complete.
    04/17/10-18:24:03 (GMT) (tRAID): NOTE: rpaBattMgr listener registration starting.
    04/17/10-18:24:03 (GMT) (tRAID): NOTE: rpaBattMgr listener registration complete.
    04/17/10-18:24:03 (GMT) (IOSched): NOTE: FC speed negotiation initiated on chip 2
    04/17/10-18:24:04 (GMT) (IOSched): NOTE: FC speed negotiation complete on chip 2
    04/17/10-18:24:05 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 -3
    04/17/10-18:24:10 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 =3
    ==============================================
    Title: Disk Array Controller
    Copyright 2004-2009, LSI Logic Corporation

    Name: RC
    Version: 06.60.22.00
    Date: 02/13/2009
    Time: 17:57:57
    Models: 3992 3994
    Manager: devmgr.v0960api00.Manager
    ==============================================
    Network Ready
    04/17/10-18:24:18 (GMT) (tRAID): NOTE: CCM: MirrorInit, clearing MOS (2)
    04/17/10-18:24:18 (GMT) (tRAID): NOTE: Volume discovery...
    04/17/10-18:24:18 (GMT) (tRAID): NOTE: Scanning usable NATIVE drives
    04/17/10-18:24:20 (GMT) (ssmTimer): NOTE: CCM BMG: Battery is OK
    04/17/10-18:24:21 (GMT) (tRAID): NOTE: Bringing Volumes On-Line...
    04/17/10-18:24:21 (GMT) (tRAID): NOTE: Total Volumes 16: Optimal 16
    04/17/10-18:24:22 (GMT) (tRAID): NOTE: spm: Peering Enabled (SOD checkin)
    04/17/10-18:24:22 (GMT) (tRAID): NOTE: spm itn::setOnline - no ITA found ri:Blade12_KGKESX2 0000013 Blade12_KGKESX2 persist 1 posc ltFC_Target_A&Bh no_security 8B-200600a0b811f852 persist 12 !posc 0
    04/17/10-18:24:25 (GMT) (NvsramDacstore): NOTE: NVSRAM Dacstore updated successfully
    04/17/10-18:24:25 (GMT) (tRAID): NOTE: RDAC Mode is Dual-Active. Controllers synchronized.
    04/17/10-18:24:25 (GMT) (tRAID): NOTE: Duplex Environment
    04/17/10-18:24:25 (GMT) (tRAID): NOTE: Controller Mode Active. SCSI IDs (host 5, drive 7).
    04/17/10-18:24:25 (GMT) (tRAID): NOTE: 10 Volumes Owned
    04/17/10-18:24:25 (GMT) (tRAID): NOTE: Alt. Ctrl. Mode Active (Present/Not Failed). SCSI IDs (host 4, drive 6).
    04/17/10-18:24:25 (GMT) (tRAID): NOTE: 6 Volumes Owned
    04/17/10-18:24:26 (GMT) (tRAID): NOTE: sodMain sequence finished, elapsed time = 27 seconds
    04/17/10-18:24:26 (GMT) (tRAID): NOTE: sodMain complete
    04/17/10-18:24:30 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 1 ~2 =3
    04/17/10-18:24:34 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 1 2 =3
    04/17/10-18:25:03 (GMT) (utlTimer): WARN: Extended Link Down Timeout on channel 3
    04/17/10-18:25:38 (GMT) (symTask1)мc
    я„Фй„ЗОЊЎ9c&^jЮОю->

    Current date: 04/17/10 time: 12:03:53

    Send <BREAK> for Service Interface or baud rate change
    04/17/10-18:25:50 (GMT) (tRAID): NOTE: rpaBattMgr instantiation starting.
    04/17/10-18:25:50 (GMT) (tRAID): NOTE: rpaBattery Init starting.
    04/17/10-18:25:50 (GMT) (tRAID): NOTE: rpaBattMgr instantiation complete.
    04/17/10-18:25:51 (GMT) (iacTask1): NOTE: RPM: Unable to find remotePeer - msgId: 175 peerId 10
    04/17/10-18:25:51 (GMT) (tRAID): NOTE: Inter-Controller Communication Channels Opened
    04/17/10-18:25:52 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1
    esmc0: LinkUp event
    04/17/10-18:25:53 (GMT) (tRAID): NOTE: lockMgr Role is Slave
    04/17/10-18:25:54 (GMT) (tRAID): NOTE: WWN baseName 000600a0-b811f852 (valid==>SoftRst)
    04/17/10-18:25:54 (GMT) (tRAID): NOTE: spmEarlyData: Using cached data
    04/17/10-18:25:54 (GMT) (tRAID): NOTE: CCM instantiation starting.
    04/17/10-18:25:54 (GMT) (tRAID): NOTE: CCM instantiation complete
    04/17/10-18:25:54 (GMT) (tRAID): NOTE: CCM Listener Registration started.
    04/17/10-18:25:54 (GMT) (tRAID): NOTE: CCM Listener Registration complete.
    04/17/10-18:25:54 (GMT) (tRAID): NOTE: rpaBattMgr listener registration starting.
    04/17/10-18:25:54 (GMT) (tRAID): NOTE: rpaBattMgr listener registration complete.
    04/17/10-18:25:54 (GMT) (IOSched): NOTE: FC speed negotiation initiated on chip 2
    04/17/10-18:25:55 (GMT) (IOSched): NOTE: FC speed negotiation complete on chip 2
    04/17/10-18:25:56 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 -3
    04/17/10-18:26:01 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 =3
    ==============================================
    Title: Disk Array Controller
    Copyright 2004-2009, LSI Logic Corporation

    Name: RC
    Version: 06.60.22.00
    Date: 02/13/2009
    Time: 17:57:57
    Models: 3992 3994
    Manager: devmgr.v0960api00.Manager
    ==============================================
    Network Ready
    04/17/10-18:26:09 (GMT) (tRAID): NOTE: CCM: MirrorInit, clearing MOS (2)
    04/17/10-18:26:09 (GMT) (tRAID): NOTE: Volume discovery...
    04/17/10-18:26:09 (GMT) (tRAID): NOTE: Scanning usable NATIVE drives
    04/17/10-18:26:11 (GMT) (ssmTimer): NOTE: CCM BMG: Battery is OK
    04/17/10-18:26:12 (GMT) (tRAID): NOTE: Bringing Volumes On-Line...
    04/17/10-18:26:13 (GMT) (tRAID): NOTE: Total Volumes 16: Optimal 16
    04/17/10-18:26:13 (GMT) (tRAID): NOTE: spm: Peering Enabled (SOD checkin)
    04/17/10-18:26:13 (GMT) (tRAID): NOTE: spm itn::setOnline - no ITA found ri:Blade12_KGKESX2 0000013 Blade12_KGKESX2 persist 1 posc ltFC_Target_A&Bh no_security 8B-200600a0b811f852 persist 12 !posc 0
    04/17/10-18:26:16 (GMT) (NvsramDacstore): NOTE: NVSRAM Dacstore updated successfully
    04/17/10-18:26:16 (GMT) (tRAID): NOTE: RDAC Mode is Dual-Active. Controllers synchronized.
    04/17/10-18:26:16 (GMT) (tRAID): NOTE: Duplex Environment
    04/17/10-18:26:16 (GMT) (tRAID): NOTE: Controller Mode Active. SCSI IDs (host 5, drive 7).
    04/17/10-18:26:16 (GMT) (tRAID): NOTE: 10 Volumes Owned
    04/17/10-18:26:16 (GMT) (tRAID): NOTE: Alt. Ctrl. Mode Active (Present/Not Failed). SCSI IDs (host 4, drive 6).
    04/17/10-18:26:16 (GMT) (tRAID): NOTE: 6 Volumes Owned
    04/17/10-18:26:17 (GMT) (tRAID): NOTE: sodMain sequence finished, elapsed time = 27 seconds
    04/17/10-18:26:17 (GMT) (tRAID): NOTE: sodMain complete
  • Novikov_Alexander
    Novikov_Alexander
    1409 Posts

    Re: Upgrade from older 6.xx.xx to 6.60.22.00 after activate, Controller is down

    ‏2010-04-18T09:12:49Z  
    • cisco_ibm
    • ‏2010-04-17T18:27:14Z
    > one Controller B still not working or both controllers together?

    Both controllers.

    Now Controllers synchronized

    04/17/10-18:14:21 (GMT) (tRAID): NOTE: CCM: MirrorInit, clearing MOS (2)
    04/17/10-18:14:21 (GMT) (tRAID): NOTE: Volume discovery...
    04/17/10-18:14:21 (GMT) (tRAID): NOTE: Scanning usable NATIVE drives
    04/17/10-18:14:23 (GMT) (ssmTimer): NOTE: CCM BMG: Battery is OK
    04/17/10-18:14:24 (GMT) (tRAID): NOTE: Bringing Volumes On-Line...
    04/17/10-18:14:25 (GMT) (tRAID): NOTE: Total Volumes 16: Optimal 16
    04/17/10-18:14:25 (GMT) (tRAID): NOTE: spm: Peering Enabled (SOD checkin)
    04/17/10-18:14:25 (GMT) (tRAID): NOTE: spm itn::setOnline - no ITA found ri:Blade12_KGKESX2 0000013 Blade12_KGKESX2 persist 1 posc ltFC_Target_A&Bh no_security 8B-200600a0b811f852 persist 12 !posc 0
    04/17/10-18:14:28 (GMT) (NvsramDacstore): NOTE: NVSRAM Dacstore updated successfully
    04/17/10-18:14:28 (GMT) (tRAID): NOTE: RDAC Mode is Dual-Active. Controllers synchronized.
    04/17/10-18:14:28 (GMT) (tRAID): NOTE: Duplex Environment
    04/17/10-18:14:28 (GMT) (tRAID): NOTE: Controller Mode Active. SCSI IDs (host 5, drive 7).
    04/17/10-18:14:28 (GMT) (tRAID): NOTE: 10 Volumes Owned
    04/17/10-18:14:28 (GMT) (tRAID): NOTE: Alt. Ctrl. Mode Active (Present/Not Failed). SCSI IDs (host 4, drive 6).
    04/17/10-18:14:28 (GMT) (tRAID): NOTE: 6 Volumes Owned
    04/17/10-18:14:29 (GMT) (tRAID): NOTE: sodMain sequence finished, elapsed time = 28 seconds
    04/17/10-18:14:29 (GMT) (tRAID): NOTE: sodMain complete
    04/17/10-18:14:32 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 1 ~2 =3
    04/17/10-18:14:36 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 1 2 =3
    04/17/10-18:15:05 (GMT) (utlTimer): WARN: Extended Link Down Timeout on channel 3

    >how you did it, in-band or out-of-band? Do you have any servers/SAN connected to DS?

    I use connect type Out-of-band.

    I have 4 servers connect over FC to DS. its works normal. But if I run StorageManager any version reload controlers.
    ==============================
    Now ControllerA - reboot, load then reboot,load then reboots, load and reboot!!!
    Current date: 04/17/10 time: 11:44:07

    Send <BREAK> for Service Interface or baud rate change
    04/17/10-18:06:04 (GMT) (tRAID): NOTE: rpaBattMgr instantiation starting.
    04/17/10-18:06:04 (GMT) (tRAID): NOTE: rpaBattery Init starting.
    04/17/10-18:06:04 (GMT) (tRAID): NOTE: rpaBattMgr instantiation complete.
    04/17/10-18:06:05 (GMT) (iacTask1): NOTE: RPM: Unable to find remotePeer - msgId: 26 peerId 10
    04/17/10-18:06:05 (GMT) (tRAID): NOTE: Inter-Controller Communication Channels Opened
    04/17/10-18:06:06 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1
    esmc0: LinkUp event
    04/17/10-18:06:07 (GMT) (iacTask2): NOTE: RPM: Unable to find remotePeer - msgId: 27 peerId 10
    04/17/10-18:06:07 (GMT) (tRAID): NOTE: lockMgr Role is Slave
    04/17/10-18:06:08 (GMT) (tRAID): NOTE: WWN baseName 000600a0-b811f852 (valid==>SoftRst)
    04/17/10-18:06:08 (GMT) (tRAID): NOTE: spmEarlyData: Using cached data
    04/17/10-18:06:08 (GMT) (tRAID): NOTE: CCM instantiation starting.
    04/17/10-18:06:08 (GMT) (tRAID): NOTE: CCM instantiation complete
    04/17/10-18:06:08 (GMT) (tRAID): NOTE: CCM Listener Registration started.
    04/17/10-18:06:08 (GMT) (tRAID): NOTE: CCM Listener Registration complete.
    04/17/10-18:06:08 (GMT) (tRAID): NOTE: rpaBattMgr listener registration starting.
    04/17/10-18:06:08 (GMT) (tRAID): NOTE: rpaBattMgr listener registration complete.
    04/17/10-18:06:08 (GMT) (IOSched): NOTE: FC speed negotiation initiated on chip 2
    04/17/10-18:06:09 (GMT) (IOSched): NOTE: FC speed negotiation complete on chip 2
    04/17/10-18:06:10 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 -3
    04/17/10-18:06:15 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 =3
    ==============================================
    Title: Disk Array Controller
    Copyright 2004-2009, LSI Logic Corporation

    Name: RC
    Version: 06.60.22.00
    Date: 02/13/2009
    Time: 17:57:57
    Models: 3992 3994
    Manager: devmgr.v0960api00.Manager
    ==============================================
    Network Ready
    04/17/10-18:06:22 (GMT) (tRAID): NOTE: CCM: MirrorInit, clearing MOS (2)
    04/17/10-18:06:23 (GMT) (tRAID): NOTE: Volume discovery...
    04/17/10-18:06:23 (GMT) (tRAID): NOTE: Scanning usable NATIVE drives
    04/17/10-18:06:25 (GMT) (ssmTimer): NOTE: CCM BMG: Battery is OK
    04/17/10-18:06:26 (GMT) (tRAID): NOTE: Bringing Volumes On-Line...
    04/17/10-18:06:26 (GMT) (tRAID): NOTE: Total Volumes 16: Optimal 16
    04/17/10-18:06:26 (GMT) (tRAID): NOTE: spm: Peering Enabled (SOD checkin)
    04/17/10-18:06:27 (GMT) (tRAID): NOTE: spm itn::setOnline - no ITA found ri:Blade12_KGKESX2 0000013 Blade12_KGKESX2 persist 1 posc ltFC_Target_A&Bh no_security 8B-200600a0b811f852 persist 12 !posc 0
    04/17/10-18:06:30 (GMT) (NvsramDacstore): NOTE: NVSRAM Dacstore updated successfully
    04/17/10-18:06:30 (GMT) (tRAID): NOTE: RDAC Mode is Dual-Active. Controllers synchronized.
    04/17/10-18:06:30 (GMT) (tRAID): NOTE: Duplex Environment
    04/17/10-18:06:30 (GMT) (tRAID): NOTE: Controller Mode Active. SCSI IDs (host 5, drive 7).
    04/17/10-18:06:30 (GMT) (tRAID): NOTE: 10 Volumes Owned
    04/17/10-18:06:30 (GMT) (tRAID): NOTE: Alt. Ctrl. Mode Active (Present/Not Failed). SCSI IDs (host 4, drive 6).
    04/17/10-18:06:30 (GMT) (tRAID): NOTE: 6 Volumes Owned
    04/17/10-18:06:30 (GMT) (tRAID): NOTE: sodMain sequence finished, elapsed time = 27 seconds
    04/17/10-18:06:30 (GMT) (tRAID): NOTE: sodMain complete
    04/17/10-18:06:35 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 1 ~2 =3
    04/17/10-18:06:39 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 1 2 =3
    04/17/10-18:07:08 (GMT) (utlTimer): WARN: Extended Link Down Timeout on channel 3
    04/17/10-18:08:49 (GMT) (symTask1)мc
    я„Фй„ЗОЊЎ9c&^jЮОю->

    Current date: 04/17/10 time: 11:47:05

    Send <BREAK> for Service Interface or baud rate change
    04/17/10-18:09:02 (GMT) (tRAID): NOTE: rpaBattMgr instantiation starting.
    04/17/10-18:09:02 (GMT) (tRAID): NOTE: rpaBattery Init starting.
    04/17/10-18:09:02 (GMT) (tRAID): NOTE: rpaBattMgr instantiation complete.
    04/17/10-18:09:03 (GMT) (tRAID): NOTE: Inter-Controller Communication Channels Opened
    04/17/10-18:09:04 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1
    esmc0: LinkUp event
    04/17/10-18:09:05 (GMT) (tRAID): NOTE: lockMgr Role is Slave
    04/17/10-18:09:06 (GMT) (tRAID): NOTE: WWN baseName 000600a0-b811f852 (valid==>SoftRst)
    04/17/10-18:09:06 (GMT) (tRAID): NOTE: spmEarlyData: Using cached data
    04/17/10-18:09:06 (GMT) (tRAID): NOTE: CCM instantiation starting.
    04/17/10-18:09:06 (GMT) (tRAID): NOTE: CCM instantiation complete
    04/17/10-18:09:06 (GMT) (tRAID): NOTE: CCM Listener Registration started.
    04/17/10-18:09:06 (GMT) (tRAID): NOTE: CCM Listener Registration complete.
    04/17/10-18:09:06 (GMT) (tRAID): NOTE: rpaBattMgr listener registration starting.
    04/17/10-18:09:06 (GMT) (tRAID): NOTE: rpaBattMgr listener registration complete.
    04/17/10-18:09:06 (GMT) (IOSched): NOTE: FC speed negotiation initiated on chip 2
    04/17/10-18:09:07 (GMT) (IOSched): NOTE: FC speed negotiation complete on chip 2
    04/17/10-18:09:08 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 -3
    04/17/10-18:09:13 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 =3
    ==============================================
    Title: Disk Array Controller
    Copyright 2004-2009, LSI Logic Corporation

    Name: RC
    Version: 06.60.22.00
    Date: 02/13/2009
    Time: 17:57:57
    Models: 3992 3994
    Manager: devmgr.v0960api00.Manager
    ==============================================
    Network Ready
    04/17/10-18:09:21 (GMT) (tRAID): NOTE: CCM: MirrorInit, clearing MOS (2)
    04/17/10-18:09:21 (GMT) (tRAID): NOTE: Volume discovery...
    04/17/10-18:09:21 (GMT) (tRAID): NOTE: Scanning usable NATIVE drives
    04/17/10-18:09:24 (GMT) (ssmTimer): NOTE: CCM BMG: Battery is OK
    04/17/10-18:09:24 (GMT) (tRAID): NOTE: Bringing Volumes On-Line...
    04/17/10-18:09:25 (GMT) (tRAID): NOTE: Total Volumes 16: Optimal 16
    04/17/10-18:09:25 (GMT) (tRAID): NOTE: spm: Peering Enabled (SOD checkin)
    04/17/10-18:09:25 (GMT) (tRAID): NOTE: spm itn::setOnline - no ITA found ri:Blade12_KGKESX2 0000013 Blade12_KGKESX2 persist 1 posc ltFC_Target_A&Bh no_security 8B-200600a0b811f852 persist 12 !posc 0
    04/17/10-18:09:28 (GMT) (NvsramDacstore): NOTE: NVSRAM Dacstore updated successfully
    04/17/10-18:09:29 (GMT) (tRAID): NOTE: RDAC Mode is Dual-Active. Controllers synchronized.
    04/17/10-18:09:29 (GMT) (tRAID): NOTE: Duplex Environment
    04/17/10-18:09:29 (GMT) (tRAID): NOTE: Controller Mode Active. SCSI IDs (host 5, drive 7).
    04/17/10-18:09:29 (GMT) (tRAID): NOTE: 10 Volumes Owned
    04/17/10-18:09:29 (GMT) (tRAID): NOTE: Alt. Ctrl. Mode Active (Present/Not Failed). SCSI IDs (host 4, drive 6).
    04/17/10-18:09:29 (GMT) (tRAID): NOTE: 6 Volumes Owned
    04/17/10-18:09:29 (GMT) (tRAID): NOTE: sodMain sequence finished, elapsed time = 27 seconds
    04/17/10-18:09:29 (GMT) (tRAID): NOTE: sodMain complete
    04/17/10-18:09:33 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 1 ~2 =3
    04/17/10-18:09:34 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 1 ~2 =3
    04/17/10-18:09:37 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 1 2 =3
    04/17/10-18:09:46 (GMT) (symTask1)мc
    я„Фй„ЗОBЎ9c&^jЮОю->

    Current date: 04/17/10 time: 11:48:01

    Send <BREAK> for Service Interface or baud rate change
    04/17/10-18:09:59 (GMT) (tRAID): NOTE: rpaBattMgr instantiation starting.
    04/17/10-18:09:59 (GMT) (tRAID): NOTE: rpaBattery Init starting.
    04/17/10-18:09:59 (GMT) (tRAID): NOTE: rpaBattMgr instantiation complete.
    04/17/10-18:10:00 (GMT) (tRAID): NOTE: Inter-Controller Communication Channels Opened
    04/17/10-18:10:01 (GMT) (utlTimer): NOTE: fcnChannelReport ==> -0 ~1
    esmc0: LinkUp event
    04/17/10-18:10:02 (GMT) (tRAID): NOTE: lockMgr Role is Slave
    04/17/10-18:10:03 (GMT) (tRAID): NOTE: WWN baseName 000600a0-b811f852 (valid==>SoftRst)
    04/17/10-18:10:03 (GMT) (tRAID): NOTE: spmEarlyData: Using cached data
    04/17/10-18:10:03 (GMT) (tRAID): NOTE: CCM instantiation starting.
    04/17/10-18:10:03 (GMT) (tRAID): NOTE: CCM instantiation complete
    04/17/10-18:10:03 (GMT) (tRAID): NOTE: CCM Listener Registration started.
    04/17/10-18:10:03 (GMT) (tRAID): NOTE: CCM Listener Registration complete.
    04/17/10-18:10:03 (GMT) (tRAID): NOTE: rpaBattMgr listener registration starting.
    04/17/10-18:10:03 (GMT) (tRAID): NOTE: rpaBattMgr listener registration complete.
    04/17/10-18:10:03 (GMT) (IOSched): NOTE: FC speed negotiation initiated on chip 2
    04/17/10-18:10:04 (GMT) (IOSched): NOTE: FC speed negotiation complete on chip 2
    04/17/10-18:10:04 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 -3
    04/17/10-18:10:10 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 =3
    ==============================================
    Title: Disk Array Controller
    Copyright 2004-2009, LSI Logic Corporation

    Name: RC
    Version: 06.60.22.00
    Date: 02/13/2009
    Time: 17:57:57
    Models: 3992 3994
    Manager: devmgr.v0960api00.Manager
    ==============================================
    Network Ready
    04/17/10-18:10:18 (GMT) (tRAID): NOTE: CCM: MirrorInit, clearing MOS (2)
    04/17/10-18:10:18 (GMT) (tRAID): NOTE: Volume discovery...
    04/17/10-18:10:18 (GMT) (tRAID): NOTE: Scanning usable NATIVE drives
    04/17/10-18:10:20 (GMT) (ssmTimer): NOTE: CCM BMG: Battery is OK
    04/17/10-18:10:21 (GMT) (tRAID): NOTE: Bringing Volumes On-Line...
    04/17/10-18:10:22 (GMT) (tRAID): NOTE: Total Volumes 16: Optimal 16
    04/17/10-18:10:22 (GMT) (tRAID): NOTE: spm: Peering Enabled (SOD checkin)
    04/17/10-18:10:22 (GMT) (tRAID): NOTE: spm itn::setOnline - no ITA found ri:Blade12_KGKESX2 0000013 Blade12_KGKESX2 persist 1 posc ltFC_Target_A&Bh no_security 8B-200600a0b811f852 persist 12 !posc 0
    04/17/10-18:10:25 (GMT) (NvsramDacstore): NOTE: NVSRAM Dacstore updated successfully
    04/17/10-18:10:25 (GMT) (tRAID): NOTE: RDAC Mode is Dual-Active. Controllers synchronized.
    04/17/10-18:10:25 (GMT) (tRAID): NOTE: Duplex Environment
    04/17/10-18:10:25 (GMT) (tRAID): NOTE: Controller Mode Active. SCSI IDs (host 5, drive 7).
    04/17/10-18:10:25 (GMT) (tRAID): NOTE: 10 Volumes Owned
    04/17/10-18:10:25 (GMT) (tRAID): NOTE: Alt. Ctrl. Mode Active (Present/Not Failed). SCSI IDs (host 4, drive 6).
    04/17/10-18:10:25 (GMT) (tRAID): NOTE: 6 Volumes Owned
    04/17/10-18:10:26 (GMT) (tRAID): NOTE: sodMain sequence finished, elapsed time = 27 seconds
    04/17/10-18:10:26 (GMT) (tRAID): NOTE: sodMain complete
    04/17/10-18:10:31 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 1 ~2 =3
    04/17/10-18:10:34 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 1 2 =3
    04/17/10-18:10:47 (GMT) (symTask1)мc
    я„Фй„ЗОЊЎ9c&^jЮОю->

    Current date: 04/17/10 time: 11:49:02

    Send <BREAK> for Service Interface or baud rate change
    04/17/10-18:10:59 (GMT) (tRAID): NOTE: rpaBattMgr instantiation starting.
    04/17/10-18:10:59 (GMT) (tRAID): NOTE: rpaBattery Init starting.
    04/17/10-18:10:59 (GMT) (tRAID): NOTE: rpaBattMgr instantiation complete.
    04/17/10-18:11:00 (GMT) (tRAID): NOTE: Inter-Controller Communication Channels Opened
    04/17/10-18:11:01 (GMT) (utlTimer): NOTE: fcnChannelReport ==> -0 ~1
    esmc0: LinkUp event
    04/17/10-18:11:02 (GMT) (tRAID): NOTE: lockMgr Role is Slave
    04/17/10-18:11:03 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1
    04/17/10-18:11:03 (GMT) (tRAID): NOTE: WWN baseName 000600a0-b811f852 (valid==>SoftRst)
    04/17/10-18:11:03 (GMT) (tRAID): NOTE: spmEarlyData: Using cached data
    04/17/10-18:11:03 (GMT) (tRAID): NOTE: CCM instantiation starting.
    04/17/10-18:11:03 (GMT) (tRAID): NOTE: CCM instantiation complete
    04/17/10-18:11:03 (GMT) (tRAID): NOTE: CCM Listener Registration started.
    04/17/10-18:11:03 (GMT) (tRAID): NOTE: CCM Listener Registration complete.
    04/17/10-18:11:03 (GMT) (tRAID): NOTE: rpaBattMgr listener registration starting.
    04/17/10-18:11:03 (GMT) (tRAID): NOTE: rpaBattMgr listener registration complete.
    04/17/10-18:11:03 (GMT) (IOSched): NOTE: FC speed negotiation initiated on chip 2
    04/17/10-18:11:04 (GMT) (IOSched): NOTE: FC speed negotiation complete on chip 2
    04/17/10-18:11:05 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 -3
    04/17/10-18:11:10 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 =3
    ==============================================
    Title: Disk Array Controller
    Copyright 2004-2009, LSI Logic Corporation

    Name: RC
    Version: 06.60.22.00
    Date: 02/13/2009
    Time: 17:57:57
    Models: 3992 3994
    Manager: devmgr.v0960api00.Manager
    ==============================================
    Network Ready
    04/17/10-18:11:18 (GMT) (tRAID): NOTE: CCM: MirrorInit, clearing MOS (2)
    04/17/10-18:11:18 (GMT) (tRAID): NOTE: Volume discovery...
    04/17/10-18:11:18 (GMT) (tRAID): NOTE: Scanning usable NATIVE drives
    04/17/10-18:11:20 (GMT) (ssmTimer): NOTE: CCM BMG: Battery is OK
    04/17/10-18:11:21 (GMT) (tRAID): NOTE: Bringing Volumes On-Line...
    04/17/10-18:11:21 (GMT) (tRAID): NOTE: Total Volumes 16: Optimal 16
    04/17/10-18:11:22 (GMT) (tRAID): NOTE: spm: Peering Enabled (SOD checkin)
    04/17/10-18:11:22 (GMT) (tRAID): NOTE: spm itn::setOnline - no ITA found ri:Blade12_KGKESX2 0000013 Blade12_KGKESX2 persist 1 posc ltFC_Target_A&Bh no_security 8B-200600a0b811f852 persist 12 !posc 0
    04/17/10-18:11:25 (GMT) (NvsramDacstore): NOTE: NVSRAM Dacstore updated successfully
    04/17/10-18:11:25 (GMT) (tRAID): NOTE: RDAC Mode is Dual-Active. Controllers synchronized.
    04/17/10-18:11:25 (GMT) (tRAID): NOTE: Duplex Environment
    04/17/10-18:11:25 (GMT) (tRAID): NOTE: Controller Mode Active. SCSI IDs (host 5, drive 7).
    04/17/10-18:11:25 (GMT) (tRAID): NOTE: 10 Volumes Owned
    04/17/10-18:11:25 (GMT) (tRAID): NOTE: Alt. Ctrl. Mode Active (Present/Not Failed). SCSI IDs (host 4, drive 6).
    04/17/10-18:11:25 (GMT) (tRAID): NOTE: 6 Volumes Owned
    04/17/10-18:11:26 (GMT) (tRAID): NOTE: sodMain sequence finished, elapsed time = 27 seconds
    04/17/10-18:11:26 (GMT) (tRAID): NOTE: sodMain complete
    04/17/10-18:11:31 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 1 ~2 =3
    04/17/10-18:11:33 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 1 ~2 =3
    04/17/10-18:11:35 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 1 2 =3
    04/17/10-18:12:04 (GMT) (utlTimer): WARN: Extended Link Down Timeout on channel 3
    04/17/10-18:13:48 (GMT) (symTask2)мc
    я„Фй„ЗОЊЎ9c&^jЮОю->

    Current date: 04/17/10 time: 11:52:04

    Send <BREAK> for Service Interface or baud rate change
    04/17/10-18:14:01 (GMT) (tRAID): NOTE: rpaBattMgr instantiation starting.
    04/17/10-18:14:01 (GMT) (tRAID): NOTE: rpaBattery Init starting.
    04/17/10-18:14:01 (GMT) (tRAID): NOTE: rpaBattMgr instantiation complete.
    04/17/10-18:14:02 (GMT) (iacTask1): NOTE: RPM: Unable to find remotePeer - msgId: 87 peerId 10
    04/17/10-18:14:02 (GMT) (tRAID): NOTE: Inter-Controller Communication Channels Opened
    04/17/10-18:14:03 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1
    esmc0: LinkUp event
    04/17/10-18:14:04 (GMT) (tRAID): NOTE: lockMgr Role is Slave
    04/17/10-18:14:04 (GMT) (iacTask2): NOTE: RPM: Unable to find remotePeer - msgId: 88 peerId 10
    04/17/10-18:14:05 (GMT) (tRAID): NOTE: WWN baseName 000600a0-b811f852 (valid==>SoftRst)
    04/17/10-18:14:05 (GMT) (tRAID): NOTE: spmEarlyData: Using cached data
    04/17/10-18:14:05 (GMT) (tRAID): NOTE: CCM instantiation starting.
    04/17/10-18:14:05 (GMT) (tRAID): NOTE: CCM instantiation complete
    04/17/10-18:14:05 (GMT) (tRAID): NOTE: CCM Listener Registration started.
    04/17/10-18:14:05 (GMT) (tRAID): NOTE: CCM Listener Registration complete.
    04/17/10-18:14:05 (GMT) (tRAID): NOTE: rpaBattMgr listener registration starting.
    04/17/10-18:14:05 (GMT) (tRAID): NOTE: rpaBattMgr listener registration complete.
    04/17/10-18:14:05 (GMT) (IOSched): NOTE: FC speed negotiation initiated on chip 2
    04/17/10-18:14:06 (GMT) (IOSched): NOTE: FC speed negotiation complete on chip 2
    04/17/10-18:14:07 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 -3
    04/17/10-18:14:12 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 =3
    ==============================================
    Title: Disk Array Controller
    Copyright 2004-2009, LSI Logic Corporation

    Name: RC
    Version: 06.60.22.00
    Date: 02/13/2009
    Time: 17:57:57
    Models: 3992 3994
    Manager: devmgr.v0960api00.Manager
    ==============================================
    Network Ready
    04/17/10-18:14:21 (GMT) (tRAID): NOTE: CCM: MirrorInit, clearing MOS (2)
    04/17/10-18:14:21 (GMT) (tRAID): NOTE: Volume discovery...
    04/17/10-18:14:21 (GMT) (tRAID): NOTE: Scanning usable NATIVE drives
    04/17/10-18:14:23 (GMT) (ssmTimer): NOTE: CCM BMG: Battery is OK
    04/17/10-18:14:24 (GMT) (tRAID): NOTE: Bringing Volumes On-Line...
    04/17/10-18:14:25 (GMT) (tRAID): NOTE: Total Volumes 16: Optimal 16
    04/17/10-18:14:25 (GMT) (tRAID): NOTE: spm: Peering Enabled (SOD checkin)
    04/17/10-18:14:25 (GMT) (tRAID): NOTE: spm itn::setOnline - no ITA found ri:Blade12_KGKESX2 0000013 Blade12_KGKESX2 persist 1 posc ltFC_Target_A&Bh no_security 8B-200600a0b811f852 persist 12 !posc 0
    04/17/10-18:14:28 (GMT) (NvsramDacstore): NOTE: NVSRAM Dacstore updated successfully
    04/17/10-18:14:28 (GMT) (tRAID): NOTE: RDAC Mode is Dual-Active. Controllers synchronized.
    04/17/10-18:14:28 (GMT) (tRAID): NOTE: Duplex Environment
    04/17/10-18:14:28 (GMT) (tRAID): NOTE: Controller Mode Active. SCSI IDs (host 5, drive 7).
    04/17/10-18:14:28 (GMT) (tRAID): NOTE: 10 Volumes Owned
    04/17/10-18:14:28 (GMT) (tRAID): NOTE: Alt. Ctrl. Mode Active (Present/Not Failed). SCSI IDs (host 4, drive 6).
    04/17/10-18:14:28 (GMT) (tRAID): NOTE: 6 Volumes Owned
    04/17/10-18:14:29 (GMT) (tRAID): NOTE: sodMain sequence finished, elapsed time = 28 seconds
    04/17/10-18:14:29 (GMT) (tRAID): NOTE: sodMain complete
    04/17/10-18:14:32 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 1 ~2 =3
    04/17/10-18:14:36 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 1 2 =3
    04/17/10-18:15:05 (GMT) (utlTimer): WARN: Extended Link Down Timeout on channel 3
    04/17/10-18:22:45 (GMT) (symTask1)мc
    я„Фй„ЗОЊЎ9c&^jЮОю->

    Current date: 04/17/10 time: 12:01:00

    Send <BREAK> for Service Interface or baud rate change
    04/17/10-18:22:58 (GMT) (tRAID): NOTE: rpaBattMgr instantiation starting.
    04/17/10-18:22:58 (GMT) (tRAID): NOTE: rpaBattery Init starting.
    04/17/10-18:22:58 (GMT) (tRAID): NOTE: rpaBattMgr instantiation complete.
    04/17/10-18:22:59 (GMT) (iacTask1): NOTE: RPM: Unable to find remotePeer - msgId: 149 peerId 10
    04/17/10-18:22:59 (GMT) (tRAID): NOTE: Inter-Controller Communication Channels Opened
    04/17/10-18:23:00 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1
    esmc0: LinkUp event
    04/17/10-18:23:01 (GMT) (tRAID): NOTE: lockMgr Role is Slave
    04/17/10-18:23:02 (GMT) (tRAID): NOTE: WWN baseName 000600a0-b811f852 (valid==>SoftRst)
    04/17/10-18:23:02 (GMT) (tRAID): NOTE: spmEarlyData: Using cached data
    04/17/10-18:23:02 (GMT) (tRAID): NOTE: CCM instantiation starting.
    04/17/10-18:23:02 (GMT) (tRAID): NOTE: CCM instantiation complete
    04/17/10-18:23:02 (GMT) (tRAID): NOTE: CCM Listener Registration started.
    04/17/10-18:23:02 (GMT) (tRAID): NOTE: CCM Listener Registration complete.
    04/17/10-18:23:02 (GMT) (tRAID): NOTE: rpaBattMgr listener registration starting.
    04/17/10-18:23:02 (GMT) (tRAID): NOTE: rpaBattMgr listener registration complete.
    04/17/10-18:23:02 (GMT) (IOSched): NOTE: FC speed negotiation initiated on chip 2
    04/17/10-18:23:03 (GMT) (IOSched): NOTE: FC speed negotiation complete on chip 2
    04/17/10-18:23:04 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 -3
    04/17/10-18:23:09 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 =3
    ==============================================
    Title: Disk Array Controller
    Copyright 2004-2009, LSI Logic Corporation

    Name: RC
    Version: 06.60.22.00
    Date: 02/13/2009
    Time: 17:57:57
    Models: 3992 3994
    Manager: devmgr.v0960api00.Manager
    ==============================================
    Network Ready
    04/17/10-18:23:18 (GMT) (tRAID): NOTE: CCM: MirrorInit, clearing MOS (2)
    04/17/10-18:23:18 (GMT) (tRAID): NOTE: Volume discovery...
    04/17/10-18:23:18 (GMT) (tRAID): NOTE: Scanning usable NATIVE drives
    04/17/10-18:23:20 (GMT) (ssmTimer): NOTE: CCM BMG: Battery is OK
    04/17/10-18:23:21 (GMT) (tRAID): NOTE: Bringing Volumes On-Line...
    04/17/10-18:23:21 (GMT) (tRAID): NOTE: Total Volumes 16: Optimal 16
    04/17/10-18:23:22 (GMT) (tRAID): NOTE: spm: Peering Enabled (SOD checkin)
    04/17/10-18:23:22 (GMT) (tRAID): NOTE: spm itn::setOnline - no ITA found ri:Blade12_KGKESX2 0000013 Blade12_KGKESX2 persist 1 posc ltFC_Target_A&Bh no_security 8B-200600a0b811f852 persist 12 !posc 0
    04/17/10-18:23:25 (GMT) (NvsramDacstore): NOTE: NVSRAM Dacstore updated successfully
    04/17/10-18:23:25 (GMT) (tRAID): NOTE: RDAC Mode is Dual-Active. Controllers synchronized.
    04/17/10-18:23:25 (GMT) (tRAID): NOTE: Duplex Environment
    04/17/10-18:23:25 (GMT) (tRAID): NOTE: Controller Mode Active. SCSI IDs (host 5, drive 7).
    04/17/10-18:23:25 (GMT) (tRAID): NOTE: 10 Volumes Owned
    04/17/10-18:23:25 (GMT) (tRAID): NOTE: Alt. Ctrl. Mode Active (Present/Not Failed). SCSI IDs (host 4, drive 6).
    04/17/10-18:23:25 (GMT) (tRAID): NOTE: 6 Volumes Owned
    04/17/10-18:23:26 (GMT) (tRAID): NOTE: sodMain sequence finished, elapsed time = 28 seconds
    04/17/10-18:23:26 (GMT) (tRAID): NOTE: sodMain complete
    04/17/10-18:23:29 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 1 ~2 =3
    04/17/10-18:23:33 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 1 2 =3
    04/17/10-18:23:46 (GMT) (symTask1)мc
    я„Фй„ЗОЊЎ9c&^jЮОю->

    Current date: 04/17/10 time: 12:02:01

    Send <BREAK> for Service Interface or baud rate change
    04/17/10-18:23:59 (GMT) (tRAID): NOTE: rpaBattMgr instantiation starting.
    04/17/10-18:23:59 (GMT) (tRAID): NOTE: rpaBattery Init starting.
    04/17/10-18:23:59 (GMT) (tRAID): NOTE: rpaBattMgr instantiation complete.
    04/17/10-18:24:00 (GMT) (iacTask1): NOTE: RPM: Unable to find remotePeer - msgId: 159 peerId 10
    04/17/10-18:24:00 (GMT) (tRAID): NOTE: Inter-Controller Communication Channels Opened
    04/17/10-18:24:01 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1
    esmc0: LinkUp event
    04/17/10-18:24:02 (GMT) (tRAID): NOTE: lockMgr Role is Slave
    04/17/10-18:24:03 (GMT) (tRAID): NOTE: WWN baseName 000600a0-b811f852 (valid==>SoftRst)
    04/17/10-18:24:03 (GMT) (tRAID): NOTE: spmEarlyData: Using cached data
    04/17/10-18:24:03 (GMT) (tRAID): NOTE: CCM instantiation starting.
    04/17/10-18:24:03 (GMT) (tRAID): NOTE: CCM instantiation complete
    04/17/10-18:24:03 (GMT) (tRAID): NOTE: CCM Listener Registration started.
    04/17/10-18:24:03 (GMT) (tRAID): NOTE: CCM Listener Registration complete.
    04/17/10-18:24:03 (GMT) (tRAID): NOTE: rpaBattMgr listener registration starting.
    04/17/10-18:24:03 (GMT) (tRAID): NOTE: rpaBattMgr listener registration complete.
    04/17/10-18:24:03 (GMT) (IOSched): NOTE: FC speed negotiation initiated on chip 2
    04/17/10-18:24:04 (GMT) (IOSched): NOTE: FC speed negotiation complete on chip 2
    04/17/10-18:24:05 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 -3
    04/17/10-18:24:10 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 =3
    ==============================================
    Title: Disk Array Controller
    Copyright 2004-2009, LSI Logic Corporation

    Name: RC
    Version: 06.60.22.00
    Date: 02/13/2009
    Time: 17:57:57
    Models: 3992 3994
    Manager: devmgr.v0960api00.Manager
    ==============================================
    Network Ready
    04/17/10-18:24:18 (GMT) (tRAID): NOTE: CCM: MirrorInit, clearing MOS (2)
    04/17/10-18:24:18 (GMT) (tRAID): NOTE: Volume discovery...
    04/17/10-18:24:18 (GMT) (tRAID): NOTE: Scanning usable NATIVE drives
    04/17/10-18:24:20 (GMT) (ssmTimer): NOTE: CCM BMG: Battery is OK
    04/17/10-18:24:21 (GMT) (tRAID): NOTE: Bringing Volumes On-Line...
    04/17/10-18:24:21 (GMT) (tRAID): NOTE: Total Volumes 16: Optimal 16
    04/17/10-18:24:22 (GMT) (tRAID): NOTE: spm: Peering Enabled (SOD checkin)
    04/17/10-18:24:22 (GMT) (tRAID): NOTE: spm itn::setOnline - no ITA found ri:Blade12_KGKESX2 0000013 Blade12_KGKESX2 persist 1 posc ltFC_Target_A&Bh no_security 8B-200600a0b811f852 persist 12 !posc 0
    04/17/10-18:24:25 (GMT) (NvsramDacstore): NOTE: NVSRAM Dacstore updated successfully
    04/17/10-18:24:25 (GMT) (tRAID): NOTE: RDAC Mode is Dual-Active. Controllers synchronized.
    04/17/10-18:24:25 (GMT) (tRAID): NOTE: Duplex Environment
    04/17/10-18:24:25 (GMT) (tRAID): NOTE: Controller Mode Active. SCSI IDs (host 5, drive 7).
    04/17/10-18:24:25 (GMT) (tRAID): NOTE: 10 Volumes Owned
    04/17/10-18:24:25 (GMT) (tRAID): NOTE: Alt. Ctrl. Mode Active (Present/Not Failed). SCSI IDs (host 4, drive 6).
    04/17/10-18:24:25 (GMT) (tRAID): NOTE: 6 Volumes Owned
    04/17/10-18:24:26 (GMT) (tRAID): NOTE: sodMain sequence finished, elapsed time = 27 seconds
    04/17/10-18:24:26 (GMT) (tRAID): NOTE: sodMain complete
    04/17/10-18:24:30 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 1 ~2 =3
    04/17/10-18:24:34 (GMT) (utlTimer): NOTE: fcnChannelReport ==> 0 1 2 =3
    04/17/10-18:25:03 (GMT) (utlTimer): WARN: Extended Link Down Timeout on channel 3
    04/17/10-18:25:38 (GMT) (symTask1)мc
    я„Фй„ЗОЊЎ9c&^jЮОю->

    Current date: 04/17/10 time: 12:03:53

    Send <BREAK> for Service Interface or baud rate change
    04/17/10-18:25:50 (GMT) (tRAID): NOTE: rpaBattMgr instantiation starting.
    04/17/10-18:25:50 (GMT) (tRAID): NOTE: rpaBattery Init starting.
    04/17/10-18:25:50 (GMT) (tRAID): NOTE: rpaBattMgr instantiation complete.
    04/17/10-18:25:51 (GMT) (iacTask1): NOTE: RPM: Unable to find remotePeer - msgId: 175 peerId 10
    04/17/10-18:25:51 (GMT) (tRAID): NOTE: Inter-Controller Communication Channels Opened
    04/17/10-18:25:52 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1
    esmc0: LinkUp event
    04/17/10-18:25:53 (GMT) (tRAID): NOTE: lockMgr Role is Slave
    04/17/10-18:25:54 (GMT) (tRAID): NOTE: WWN baseName 000600a0-b811f852 (valid==>SoftRst)
    04/17/10-18:25:54 (GMT) (tRAID): NOTE: spmEarlyData: Using cached data
    04/17/10-18:25:54 (GMT) (tRAID): NOTE: CCM instantiation starting.
    04/17/10-18:25:54 (GMT) (tRAID): NOTE: CCM instantiation complete
    04/17/10-18:25:54 (GMT) (tRAID): NOTE: CCM Listener Registration started.
    04/17/10-18:25:54 (GMT) (tRAID): NOTE: CCM Listener Registration complete.
    04/17/10-18:25:54 (GMT) (tRAID): NOTE: rpaBattMgr listener registration starting.
    04/17/10-18:25:54 (GMT) (tRAID): NOTE: rpaBattMgr listener registration complete.
    04/17/10-18:25:54 (GMT) (IOSched): NOTE: FC speed negotiation initiated on chip 2
    04/17/10-18:25:55 (GMT) (IOSched): NOTE: FC speed negotiation complete on chip 2
    04/17/10-18:25:56 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 -3
    04/17/10-18:26:01 (GMT) (utlTimer): NOTE: fcnChannelReport ==> ~0 ~1 ~2 =3
    ==============================================
    Title: Disk Array Controller
    Copyright 2004-2009, LSI Logic Corporation

    Name: RC
    Version: 06.60.22.00
    Date: 02/13/2009
    Time: 17:57:57
    Models: 3992 3994
    Manager: devmgr.v0960api00.Manager
    ==============================================
    Network Ready
    04/17/10-18:26:09 (GMT) (tRAID): NOTE: CCM: MirrorInit, clearing MOS (2)
    04/17/10-18:26:09 (GMT) (tRAID): NOTE: Volume discovery...
    04/17/10-18:26:09 (GMT) (tRAID): NOTE: Scanning usable NATIVE drives
    04/17/10-18:26:11 (GMT) (ssmTimer): NOTE: CCM BMG: Battery is OK
    04/17/10-18:26:12 (GMT) (tRAID): NOTE: Bringing Volumes On-Line...
    04/17/10-18:26:13 (GMT) (tRAID): NOTE: Total Volumes 16: Optimal 16
    04/17/10-18:26:13 (GMT) (tRAID): NOTE: spm: Peering Enabled (SOD checkin)
    04/17/10-18:26:13 (GMT) (tRAID): NOTE: spm itn::setOnline - no ITA found ri:Blade12_KGKESX2 0000013 Blade12_KGKESX2 persist 1 posc ltFC_Target_A&Bh no_security 8B-200600a0b811f852 persist 12 !posc 0
    04/17/10-18:26:16 (GMT) (NvsramDacstore): NOTE: NVSRAM Dacstore updated successfully
    04/17/10-18:26:16 (GMT) (tRAID): NOTE: RDAC Mode is Dual-Active. Controllers synchronized.
    04/17/10-18:26:16 (GMT) (tRAID): NOTE: Duplex Environment
    04/17/10-18:26:16 (GMT) (tRAID): NOTE: Controller Mode Active. SCSI IDs (host 5, drive 7).
    04/17/10-18:26:16 (GMT) (tRAID): NOTE: 10 Volumes Owned
    04/17/10-18:26:16 (GMT) (tRAID): NOTE: Alt. Ctrl. Mode Active (Present/Not Failed). SCSI IDs (host 4, drive 6).
    04/17/10-18:26:16 (GMT) (tRAID): NOTE: 6 Volumes Owned
    04/17/10-18:26:17 (GMT) (tRAID): NOTE: sodMain sequence finished, elapsed time = 27 seconds
    04/17/10-18:26:17 (GMT) (tRAID): NOTE: sodMain complete
    Alexander,

    >> one Controller B still not working or both controllers together?
    > Both controllers.

    does it mean that with one controller everything good? In this case collect Support Archive and post it.

    >>how you did it, in-band or out-of-band?
    >I use connect type Out-of-band.

    Try In-Band connection.

    >> Do you have any servers/SAN connected to DS?
    > I have 4 servers connect over FC to DS. its works normal.

    which Storage Manager versions used on this servers?

    Regards,
    Alexander Novikov
    Russia, Moscow