BCM338011 TP0 1 Sync:1 346890 MemSize: 32 M BootLoader Version: 2.3.0 Release Gnu spiboot normal DDR drive Build Date: Aug 31 2009 Build Time: 13:46:13 SPI flash ID 0xc22017, size 8MB, block size 64KB, write buffer 256, busy bit 1 Signature/PID: d027 Image 1 Program Header: Signature: d027 Control: 0005 Major Rev: 0003 Minor Rev: 0000 Build Time: 2011/7/20 23:58:06 Z File Length: 1210834 bytes Load Address: 80004000 Filename: SC-CM-3380-BFC551mp3-20110721_sto.bin HCS: a0ac CRC: 99eb4993 Found image 1 at offset 20000 Enter '1', '2', or 'p' within 2 seconds or take default... . . Performing CRC on Image 1... CRC time = 19146559 Detected LZMA compressed image... decompressing... Target Address: 0x80004000 decompressSpace is 0x2000000 Elapsed time 362991747 Decompressed length: 5778860 Executing Image 1... eCos - hal_diag_init Init device '/dev/ttydiag' Init tty channel: 80586840 Init device '/dev/tty0' Init tty channel: 80586860 Init device '/dev/haldiag' HAL/diag SERIAL init Init device '/dev/ser0' BCM 33XX SERIAL init - dev: 0.2 Set output buffer - buf: 0x805e8870 len: 2048 Set input buffer - buf: 0x805e9070 len: 2048 BCM 33XX SERIAL config [00:00:00 01/01/1970] [tStartup] BcmBfcStdEmbeddedTarget::InitStorageDrivers: (BFC Target) Configuring/Loading Flash driver... [00:00:00 01/01/1970] [tStartup] BcmSpiFlashDevice::DetectFlash: (SPI Flash Device Factory) WARNING - Detected SPI flash with JEDEC ID =0xc22017 [00:00:00 01/01/1970] [tStartup] FlashDeviceDriver::SpiFlashPlaceRegions: (Flash Driver C API) WARNING - Permanent NonVol would fit in the boot block of this flash device, but I found existing NonVol in the following block; using this location instead... [00:00:00 01/01/1970] [tStartup] BcmBfcStdEmbeddedTarget::InitStorageDrivers: (BFC Target) Loading BootloaderStore driver... [00:00:00 01/01/1970] [tStartup] BcmBfcStdEmbeddedTarget::InitStorageDrivers: (BFC Target) Loading ProgramStore driver... [00:00:00 01/01/1970] [tStartup] BcmBfcStdEmbeddedTarget::InitStorageDrivers: (BFC Target) Loading NonVol driver... [00:00:00 01/01/1970] [tStartup] BcmBfcStdEmbeddedTarget::InitStorageDrivers: (BFC Target) Storage drivers initialized successfully. [00:00:00 01/01/1970] [tStartup] BcmBfcStdEmbeddedTarget::InitDeviceAbstractions: (BFC Target) Creating singletons for ProgramStore/BootloaderStore/NonVol devices... Detecting the next image number that we will store to by default... Bootloader indicates we are running image 1 By default, we will dload to image number 2! [00:00:00 01/01/1970] [tStartup] BcmBfcStdEmbeddedTarget::InitDeviceAbstractions: (BFC Target) Device abstraction singletons created successfully. CleanMiniMibList Reading Permanent settings from non-vol... Checksum for permanent settings: 0x57aa4b89 Settings were read and verified. Reading Dynamic settings from non-vol... Checksum for dynamic settings: 0xb8bd853e CleanMiniMibList Settings were read and verified. [ASKEY] Checking Golden List Version DONE Creating SNMP agent cablemodem agent cablemodem agent disabling management. cablemodem agent defering traps. WARNING - Couldn't find table 1.3.6.1.4.1.4491.2.1.20.1.29 on Vendor CM Agent w/ BRCM Factory Support If you pressed the 's' key before this point, we will skip driver initialization... Creating DOCSIS Control Thread... 0x81751abc 0x817515e4 0x81751530 0x8175147c 0x817513c8 0x81751314 0x81751260 0x817511ac vvv Interface creation and driver startup beginning vvv -> Begin DOCSIS CM WAN interface Creating HAL object for the DOCSIS CableModem interface Registering DOCSIS CableModem driver Initial Boost Status=0. Tilt Status=0 (Boost=Tilt=1)LNA Gain = 0x1f Final(Boost/Tilt=1/0) STATUS_READ2_REG=0x101f. The Rock's buffer address to use in read_memory commands is 0xa17123e0 The Rock's buffer address for the chip to use is 0x017123e0 Initializing all 8 downstreams - this takes a while. Patience, Grasshopper... 1 2 3 4 5 6 7 8 Fxtal is 48000000 Fclk_us_vco is 2088000000 Fclk_us_pll is 522000000 Fxtal is 48000000 Fclk_us_vco is 2088000000 Fclk_us_pll is 522000000 Fxtal is 48000000 Fclk_us_vco is 2088000000 Fclk_us_pll is 522000000 Fxtal is 48000000 Fclk_us_vco is 2088000000 Fclk_us_pll is 522000000 Fxtal is 48000000 Fclk_us_vco is 2088000000 Fclk_us_pll is 522000000 BcmMacInit: advMapRunAheadTimeMin = 5120 (0x00001400) 10.24 MHz ticks, 500 usec Initializing DS Docsis 3.0 MAC Initializing CalcPhyPico BcmInitCalcPhyPico:Copying CalcPhy PicoCode rev 1.1.0 : 06/25/07 ...................................................................... Verifying CalcPhy PicoCode. ...................................................................... BcmInitCalcPhyPico:PicoCode verified. [00:00:06 01/01/1970] [tStartup] BcmDocsisCmHalIf::Register: (DOCSIS CableModem HalIf) CM HAL reports h/w support for PHS, bitmask=0x3 [00:00:06 01/01/1970] [tStartup] BcmDocsisCmHalIf::Register: (DOCSIS CableModem HalIf) CM HAL reports h/w support for PHS, US size=64, DS size=256 bytes. -> End DOCSIS CM WAN interface -> Begin Ethernet LAN interfaces Creating HAL object for the Ethernet interface Registering Ethernet driver ... initializing QAMTUNER REF PLL **** SETTING PHY DEFAULTS **** **** PEFORMING PHY CHECK **** Etherenet Statistics. Ethernet Link Down! -> End Ethernet LAN interfaces -> Begin IP Stack interfaces -> Starting BFC DHCP Client subsystem... -> Starting BFC DHCPv6 Client subsystem... -> Setting default DUID using IP1 MAC address (you can override this if necessary)... Creating HAL object for IP Stack1 (MAC Addr=00:21:63:62:6d:d8) DHCPc: Created default DHCP lease for IP Stack1 using client id htype=255, value=63 62 6d d8 00 03 00 01 00 21 63 62 6d d8; auto-config enabled (IP, subnet, router). Registering IP Stack1 driver Tcpip NI: Init - RegisteredStackCount = 1 Creating HAL object for IP Stack2 (MAC Addr=00:21:63:62:6d:d9) DHCPc: Created default DHCP lease for IP Stack2 using client id htype=255, value=63 62 6d d9 00 03 00 01 00 21 63 62 6d d9; auto-config enabled (IP, subnet, router). Registering IP Stack2 driver Tcpip NI: Init - RegisteredStackCount = 2 IP Stack3 not enabled or failed to create and start interface; no other stacks will be loaded. -> End IP Stack interfaces ^^^ Interface creation and driver startup complete ^^^ Creating the DOCSIS Forwarder... Adding DOCSIS CableModem HalIf as the default interface to the DOCSIS Forwarder Adding Ethernet HalIf to the DOCSIS Forwarder Adding IP Stack1 HalIf to the DOCSIS Forwarder Adding IP Stack2 HalIf to the DOCSIS Forwarder Current IP address is default 0.0.0.0. [00:00:06 01/01/1970] [tStartup] BcmEcosIpHalIf::ConfigureLeaseImpl: (IP Stack2 HalIf) Configuring IP stack 2: IP Address = 192.168.100.1 (primary IP address) Subnet Mask = 255.255.255.0 Router = 192.168.100.254 IsPrimaryInterface = 0 bcm: ifid: 02:10:18:ff:fe:48:14:15 [00:00:07 01/01/1970] [tStartup] BcmEcosIpHalIf::AddIpv6LinkLocalAddress: (IP Stack2 HalIf) Configuring link-local IPv6 address fe80::221:63ff:fe62:6dd9/64 Creating Propane Control Thread... Propane version: 2.0.1 (28 Oct 2002) [00:00:07 01/01/1970] [tStartup] BcmDocsisCmHalIf::AddSnoop: (DOCSIS CableModem HalIf) WARNING - DOCSIS Mcast/IGMP Snoop: unsafe modification of the Snoop lists after the interface is up! [00:00:07 01/01/1970] [tStartup] BcmDocsisCmHalIf::SortSnoops: (DOCSIS CableModem HalIf) WARNING - Unsafe modification of the Snoop lists after the interface is up! [00:00:07 01/01/1970] [tStartup] BcmDocsisCmHalIf::SortSnoops: (DOCSIS CableModem HalIf) WARNING - Unsafe modification of the Snoop lists after the interface is up! Instantiating CmSnmpAgent object. Starting SNMP subsystem Registering STP Filter Snoop with all interfaces. Registering DOCSIS MIB Filter Snoop with CPE and WAN interfaces. [00:00:07 01/01/1970] [tStartup] BcmDocsisCmHalIf::AddSnoop: (DOCSIS CableModem HalIf) WARNING - docsDevFilter Snoop: unsafe modification of the Snoop lists after the interface is up! [00:00:07 01/01/1970] [tStartup] BcmDocsisCmHalIf::SortSnoops: (DOCSIS CableModem HalIf) WARNING - Unsafe modification of the Snoop lists after the interface is up! Creating SNMP agent CPE diag agent CPE diag agent disabling management. CPE diag agent defering traps. BcmSnmpThread starting thread operation. Initializing Net-SNMP transport for IPv4 Couldn't match IP address, using IP stack 0. Initializing Net-SNMP transport for IPv6 IPv6 - register netsnmp_brcmV6_ctor to get our brcm V6 UDP domain IPv6 init_bcmV2SessionAndTransport: Open a session and hook our callbacks Couldn't match IP address, using IP stack 0. WARNING - Couldn't find table 1.3.6.1.2.1.69.1.7.3 on Vendor CM Agent w/ BRCM Factory Support WARNING - Failed to find docsDevCpeTable [00:00:08 01/01/1970] [tStartup] BcmDocsisCmHalIf::RegisterSnmpObjects: (DOCSIS CableModem HalIf) Interface 10 additional registration w/ SNMP agent OK. WARNING - Couldn't find group 1.3.6.1.2.1.69.1.7 on Vendor CM Agent w/ BRCM Factory Support ===> WARNING: Failed to register ScalarMibBridge 1.3.6.1.2.1.69.1.7 to agent Vendor CM Agent w/ BRCM Factory Support ===> Object not found on agent. Setting DS cal singleton instance to 0 Setting US cal singleton instance to 0 **** PEFORMING PHY CHECK **** CmSnmpAgent installing views... Vendor CM Agent w/ BRCM Factory Support setting V1/V2 view to unrestricted Vendor CM Agent w/ BRCM Factory Support IpStackEvent Vendor CM Agent w/ BRCM Factory Support installing engine ID... Vendor CM Agent w/ BRCM Factory Support installing context... SNMP startup complete. GetSingletonInstance: Created DHCP server thread [00:00:09 01/01/1970] [tStartup] BcmVendorCmApplication::CreateDhcpServer: (VendorExtension CmApp) Configuring the DHCP server with 50 leases from 192.168.100.10 -> 192.168.100.60; lease time is 30 seconds. [00:00:09 01/01/1970] [tStartup] BcmVendorCmApplication::StartDhcpServer: (VendorExtension CmApp) NOT Starting DHCP Server! BcmCommandTable::AddInstance: ERROR - Attempted to add duplicate instance 'HttpServerThread' (0x81586094) to command table 'Message Log Settings Commands'. [00:00:09 01/01/1970] [tStartup] BcmHttpServerThread::Enable: (HttpServerThread) Broadcom HttpServerThread running status = 1 [00:00:09 01/01/1970] [tStartup] BcmDocsisCmHalIf::AddSnoop: (DOCSIS CableModem HalIf) WARNING - Mini Firewall Snoop: unsafe modification of the Snoop lists after the interface is up! [00:00:09 01/01/1970] [tStartup] BcmDocsisCmHalIf::SortSnoops: (DOCSIS CableModem HalIf) WARNING - Unsafe modification of the Snoop lists after the interface is up! Checking board manufacturing state... Board appears to be manufactured OK. [[00:00:09 01/01/1970] [ND Thread for IP Stack1] ThreadMain: (ND Thread for IP Stack1) FUNC - Entering... 00:00:09 01/01/1970] [FTP Lite Client Thread for IP Stack1] FtpLiteClientThread::ThreadMain: (FTP Lite Client Thread for IP Stack1) Broadcom FTP Lite Client thread starting... Vendor CM Event Log initializing with stored events. Vendor CPE Agent w/ BRCM Factory Support setting V1/V2 view to unrestricted Vendor CPE Agent w/ BRCM Factory Support IpStackEvent Vendor CPE Agent w/ BRCM Factory Support enabling management. Vendor CPE Agent w/ BRCM Factory Support sending deferred traps... Done w/ deferred traps. Vendor CPE Agent w/ BRCM Factory Support installing engine ID... Vendor CPE Agent w/ BRCM Factory Support installing context... Vendor CPE Agent w/ BRCM Factory Support setting V1/V2 view to docsisCpeView Event log initialization complete. * * * * * * * * * * * * * * * * * * * * * * * * * * * * * * * * * * * * * * * * * *** * * * * * * * * ******************* * * * * * * * * Broadcom Corporation Reference Design +----------------------------------------------------------------------------+ | | _/_/ _/_/_/_/ _/_/ | | _/ _/ _/ _/ _/ Broadband | | _/ _/ _/ _/ | | _/_/ _/_/_/ _/ Foundation | | _/ _/ _/ _/ | | _/ _/ _/ _/ _/ Classes | | _/_/_/ _/ _/_/ | | | | Copyright (c) 1999 - 2009 Broadcom Corporation | | | | Revision: 5.5.1.mp3 | | | | Features: SC-CM-3380 Console Nonvol Fat HeapManager SNMP Networking | | Features: USB2.0 IPv6 (script SC_CM_3380) +----------------------------------------------------------------------------+ | | Standard Embedded Target Support for BFC | | | | Copyright (c) 2003-2009 Broadcom Corporation | | | | Revision: 3.0.1 | | | | Features: PID=0xd027 Bootloader-Rev=2.3.0 | | Features: Bootloader-Compression-Support=0x11 +----------------------------------------------------------------------------+ | | eCos BFC Application Layer | | | | Copyright (c) 1999 - 2009 Broadcom Corporation | | | | Revision: 3.0.2 | | | | Features: eCos Console Cmds, (no Idle Loop Profiler) +----------------------------------------------------------------------------+ | | _/_/ _/ _/ | | _/ _/ _/_/ _/_/ DOCSIS Cable Modem | | _/ _/ _/ _/ | | _/ _/ _/ | | _/ _/ _/ | | _/ _/ _/ _/ | | _/_/ _/ _/ | | | | Copyright (c) 1999 - 2009 Broadcom Corporation | | | | Revision: 5.5.1.mp3 | | | | Features: AckCel(tm) DOCSIS 1.0/1.1/2.0/3.0 Propane(tm) CM SNMP w/Factory | | Features: MIB Support CM Vendor Extension D3.0 Drop Classifiers EURO +----------------------------------------------------------------------------+ | | Broadcom Data-Only CM Vendor Extension | | | | Copyright (c) 1999 - 2009 Broadcom Corporation | | | | Revision: 3.0.2 | | | | Features: DHCP Server HTTP Server OSS2-N-03025 Visualization LED | | Features: Controller +----------------------------------------------------------------------------+ | | Build Date: Jul 21 2011 | | Build Time: 07:58:02 | | Built By: CM_5.5.1mp3_110721 +----------------------------------------------------------------------------+ Running the system... Beginning Cable Modem operation... Vendor CPE Agent w/ BRCM Factory Support setting UDP port to 45161 V[endor CM Agent w/ BRCM Factory Support enabling management. 0Vendor CM Agent w/ BRCM Factory Support sending deferred traps... 0Done w/ deferred traps. :00:11 01/01/1970] [Scan Downstream Thread] BcmGenericCmDownstreamScanThread::ThreadMain: (Scan Downstream Thread) Scanning for a Downstream Channel... [00:00:11 01/01/1970] [Scan Downstream Thread] BcmGenericCmDownstreamScanThread::FullLoop_RFI_N_03_0086: (Scan Downstream Thread) Default scanning algorithm has been 'round the horn' 1 times. Scanning DS Channel at 4294717296 Hz... Vendor CM Event Log sending deferred async messages... Done w/ deferred msgs Type 'help' or '?' for a list of commands... CM> [00:00:12 01/01/1970] [HttpServerThread] BcmHttpServerThread::ThreadMain: (HttpServerThread) Recv'd event to resynchronize sockets! CM> Found energy at frequency 4294717296Hz! Publishing event kEventEnergyDetected... Scanning DS Channel at 394000000 Hz...(from scan list) [00:00:15 01/01/1970] [CmDocsisCtlThread] BcmCmDsPrimaryChan::DsLockOk: Locked on the downstream. [00:00:15 01/01/1970] [CmDocsisCtlThread] BcmCmDsPrimaryChan::ResumeDocsisInitAfterDcdPublishing: Resuming DOCSIS initialization... [00:00:15 01/01/1970] [CmDocsisCtlThread] BcmCmMultiUsHelper::ResetStartupRngMode: target hwTxId=0 [00:00:15 01/01/1970] [CmDocsisCtlThread] BcmCmDsPrimaryChan::StartDsMacMddInit: ********************************************** Waiting for MDDs... ********************************************** ****************************************** DOWNSTREAM STATUS ****************************************** HW Channel ID = 0 Target Freq, HZ = 394000000 Target Dcid = 0 CM HW Detected DS Phy Settings: Center Freq, Hz = 394000000 Carrier Freq Offset, kHz = 4 Channel Width, Hz = 8000000 Modulation = kDsModQam256 Interleaver = kDsIlvTaps12Incr17 Symbol Rate, sym/sec = 6952000 ****************************************** CM> [00:00:16 01/01/1970] [CmDocsisCtlThread] BcmCmMultiUsHelper::ResetStartupRngMode: target hwTxId=0 [00:00:16 01/01/1970] [CmDocsisCtlThread] BcmCmDsPrimaryChan::TrimSgSetWithoutThisDcid: 1 candidate MD-DS-SG remain after TrimSgSetWithoutThisDcid( target_dcid ) for target_dcid=0x03 (3) [00:00:16 01/01/1970] [CmDocsisCtlThread] BcmCmDsPrimaryChan::StartMdDsSgDisc: special case: one and only one MD-DS-SG contains mdd_dcid. fMdDsSgId=0x1 (1) [00:00:16 01/01/1970] [CmDocsisCtlThread] BcmCmDsPrimaryChan::SgDiscRestorePrimaryDs: return to primary ds freqHz=394000000 MD-DS-SG discovery info: fCmMdDsSgDiscState = 5 (kMdDsSgDiscRestorePrimaryFreq) fMdDsSgId = 0x01 (1) fMdDsSgDiscovered = 1 Trimmed Candidate Downstream Service Group Settings List: list size = 1 id size member ds chan id's --- ---- ------------------- 1 8 1 2 3 4 5 6 7 8 Trimmed Downstream Ambiguity Resolution Frequency List: list size = 8 378000000 386000000 394000000 402000000 410000000 418000000 426000000 434000000 visible dcid set = 3 freq with visible dcid set = 394000000 CM> Scanning DS Channel at 394000000 Hz... Found carrier at 394000000 Hz! Signal quality = 32.7 dB SNR MD-DS-SG discovery info: fCmMdDsSgDiscState = 5 (kMdDsSgDiscRestorePrimaryFreq) fMdDsSgId = 0x01 (1) fMdDsSgDiscovered = 1 Trimmed Candidate Downstream Service Group Settings List: list size = 1 id size member ds chan id's --- ---- ------------------- 1 8 1 2 3 4 5 6 7 8 Trimmed Downstream Ambiguity Resolution Frequency List: list size = 8 378000000 386000000 394000000 402000000 410000000 418000000 426000000 434000000 visible dcid set = 3 freq with visible dcid set = 394000000 [00:00:18 01/01/1970] [CmDocsisCtlThread] BcmCmDsPrimaryChan::DsLockOk: restored lock to primary ds freq after service group discovery. start upstream init. [Askey Debug]: SetCmInD20bMode to Disabled [Askey Debug]: ForceD20bMode is NOT set MD-DS-SG discovery info: fCmMdDsSgDiscState = 6 (kMdDsSgDiscDone) fMdDsSgId = 0x01 (1) fMdDsSgDiscovered = 1 Trimmed Candidate Downstream Service Group Settings List: list size = 1 id size member ds chan id's --- ---- ------------------- 1 8 1 2 3 4 5 6 7 8 Trimmed Downstream Ambiguity Resolution Frequency List: list size = 8 378000000 386000000 394000000 402000000 410000000 418000000 426000000 434000000 visible dcid set = 3 freq with visible dcid set = 394000000 [00:00:18 01/01/1970] [CmDocsisCtlThread] BcmCmMultiUsHelper::StartPreRegUsInit: targeting context=0 (kStartup) [00:00:18 01/01/1970] [CmDocsisCtlThread] BcmCmMultiUsHelper::StartPreRegUsInit: targeting context is error recovery or startup. Always use last good upstream target chan id=1 [00:00:18 01/01/1970] [CmDocsisCtlThread] BcmCmMultiUsHelper::StartPreRegUsInit: Locked on the downstream. Waiting for UCDs... ****************************************** DOWNSTREAM STATUS ****************************************** HW Channel ID = 0 Target Freq, HZ = 394000000 Target Dcid = 3 CM HW Detected DS Phy Settings: Center Freq, Hz = 394000000 Carrier Freq Offset, kHz = 4 Channel Width, Hz = 8000000 Modulation = kDsModQam256 Interleaver = kDsIlvTaps12Incr17 Symbol Rate, sym/sec = 6952000 ****************************************** CM> [00:00:20 01/01/1970] [CmDocsisCtlThread] BcmCmMultiUsHelper::ComputeStartupUcdSelectionStrategy: startup fRngMode at entry=0 (kRngNotStarted) [00:00:20 01/01/1970] [CmDocsisCtlThread] BcmCmMultiUsHelper::TmUcdRxTimerEvent: startup ucd selection strategy is kUcdSelDocs3StartupTargetNextCandidate [00:00:20 01/01/1970] [CmDocsisCtlThread] BcmCmMultiUsHelper::TargetNextDocs3CandidateUcid: state at entry: Channel targeting: Downstream: fTargetDsFreqHz = 0x177bf680 (394000000) fCurrentDsFreqHz = 0x177bf680 (394000000) fStoredDsFreqHz = 0x177bf680 (394000000) Upstream: fDestSingleTxTargetUsChanId = 0x1 (1) fTargetingContext = 0 (kStartup) Startup UCD Selection Info: startup ranging mode = 2 (kDocs3BondedBcastInitRng) last oper us tx mode = 0 (kUsTxModeUnknown) high priority candidate ucid list = 1 3 4 low priority candidate ucid list = 6 5 2 happy home ucid set = 3 4 BcmCmUsTargetMset: US target info: us Phy type: 0x3 us chan id: 0x3 config change count: 0xa UCD rx count: 0x1 init ranging tried?: 0 US target info: us Phy type: 0x3 us chan id: 0x4 config change count: 0xa UCD rx count: 0x1 init ranging tried?: 0 US target info: us Phy type: 0x3 us chan id: 0x5 config change count: 0x9 UCD rx count: 0x1 init ranging tried?: 0 US target info: us Phy type: 0x3 us chan id: 0x6 config change count: 0x9 UCD rx count: 0x1 init ranging tried?: 0 US target info: us Phy type: 0x3 us chan id: 0x1 config change count: 0xc UCD rx count: 0x1 init ranging tried?: 0 US target info: us Phy type: 0x3 us chan id: 0x2 config change count: 0xa UCD rx count: 0x1 init ranging tried?: 0 [00:00:20 01/01/1970] [CmDocsisCtlThread] BcmCmMultiUsHelper::TargetNextDocs3CandidateUcid: starting docs3 upstream initialization on target ucid=1 via contrived TCC replace cmd. BcmCmUsChan::TccReplaceCmd() CM tx chan 0 starting TCC replace command. == TCC command == TCC ref id = 0 (not specified) action = 4 (kTccReplace) us chan id = 0 new us chan id = 1 ranging sid = 0 (not specified) ranging strategy = 1 (kTccRngBcastInit) (not specified) dyn ranging window = 0 (not specified) rng mode (CM spec) = 2 UCD = specified but suppressed ranging params = (not specified) TCC error = (not specified) BcmCmUsChan::InstallUsSets() Selecting UCD w/ucid=1 for CM tx chan 0 ***kUseAllDataIucPresent*** ***kUseAllDataIucPresent*** [00:00:21 01/01/1970] [CmDocsisCtlThread] BcmCmUsSetsState::TestAndLaunchUsTimeSync: - starting upstream time sync acquisition... CM> BcmCmUsChan::InstallUsSets() - state after us sets installation CM Upstream channel info: fHwTxId = 0 TargetUsChanId() = 1 fRngSid = 0 fCmTccCmdInstallState = 1 (kTccInstallInProg) Upstream settings state info: fUcdSetsState = 1 (kUcdSetsOk) fUsTimeRefState = 1 (kComputingUsTimeRef) Ranging state info: fRngMode = 2 (kDocs3BondedBcastInitRng) fRngMsgTxRxState = 0 (kRngMsgNotStarted) fUnicastRngOpState = 0 (kRngOpInitial) fRxRngRspState = 0 (kRxRngRspInitial) fRngSuccess = 0 fLastRngRspStatus = 0 (RESERVED) [00:00:21 01/01/1970] [CmDocsisCtlThread] BcmCmMultiUsHelper::UsTimeRefOk: target hwTxId=0 [00:00:21 01/01/1970] [CmDocsisCtlThread] BcmCmUsChan::UsTimeRefOk: upstream time sync acquired for fHwTxId=0 [00:00:21 01/01/1970] [CmDocsisCtlThread] BcmCmUsChan::UsTimeRefOkResumeUsInit: starting initial ranging... == Beginning initial ranging for Docsis UCID 1 == Using default initial upstream power = 17 dBmV hwTxId = 0 docsis UCID = 1 BcmCmUsChan::UsTimeRefOk() - state at exit CM Upstream channel info: fHwTxId = 0 TargetUsChanId() = 1 fRngSid = 0 fCmTccCmdInstallState = 1 (kTccInstallInProg) Upstream settings state info: fUcdSetsState = 1 (kUcdSetsOk) fUsTimeRefState = 2 (kUsTimeRefOk) Ranging state info: fRngMode = 2 (kDocs3BondedBcastInitRng) fRngMsgTxRxState = 2 (kInitRngWaitingToRngReq) fUnicastRngOpState = 0 (kRngOpInitial) fRxRngRspState = 0 (kRxRngRspInitial) fRngSuccess = 0 fLastRngRspStatus = 0 (RESERVED) [00:00:21 01/01/1970] [CmDocsisCtlThread] BcmCmMultiUsHelper::UsTimeRefOk: target hwTxId=0 CM> BcmCmUsChanTimerMuxACT::HandleEvent() @time=21960 fTimerType=4 (kT3NoRngRsp) hwTxId=0 docs ucid=1 Adjusting the initial ranging power to 37.5 dBmV... hwTxId = 0 docsis UCID = 1 Logging event: No Ranging Response received - T3 time-out;CM-MAC=00:21:63:62:6d:d8;CMTS-MAC=64:9e:f3:66:0d:b3;CM-QOS=1.0;CM-VER=3.0; CM> BcmCmUsChanTimerMuxACT::HandleEvent() @time=22380 fTimerType=4 (kT3NoRngRsp) hwTxId=0 docs ucid=1 Adjusting the initial ranging power to 47.75 dBmV... hwTxId = 0 docsis UCID = 1 Logging event: No Ranging Response received - T3 time-out;CM-MAC=00:21:63:62:6d:d8;CMTS-MAC=64:9e:f3:66:0d:b3;CM-QOS=1.0;CM-VER=3.0; CM> BcmCmUsChanTimerMuxACT::HandleEvent() @time=25740 fTimerType=4 (kT3NoRngRsp) hwTxId=0 docs ucid=1 Adjusting the initial ranging power to 27.25 dBmV... hwTxId = 0 docsis UCID = 1 Logging event: No Ranging Response received - T3 time-out;CM-MAC=00:21:63:62:6d:d8;CMTS-MAC=64:9e:f3:66:0d:b3;CM-QOS=1.0;CM-VER=3.0; CM> BcmCmUsChanTimerMuxACT::HandleEvent() @time=34200 fTimerType=4 (kT3NoRngRsp) hwTxId=0 docs ucid=1 Adjusting the initial ranging power to 53 dBmV... hwTxId = 0 docsis UCID = 1 Logging event: No Ranging Response received - T3 time-out;CM-MAC=00:21:63:62:6d:d8;CMTS-MAC=64:9e:f3:66:0d:b3;CM-QOS=1.0;CM-VER=3.0; CM> BcmCmUsChanTimerMuxACT::HandleEvent() @time=39420 fTimerType=4 (kT3NoRngRsp) hwTxId=0 docs ucid=1 Adjusting the initial ranging power to 42.75 dBmV... hwTxId = 0 docsis UCID = 1 Logging event: No Ranging Response received - T3 time-out;CM-MAC=00:21:63:62:6d:d8;CMTS-MAC=64:9e:f3:66:0d:b3;CM-QOS=1.0;CM-VER=3.0; CM> [00:00:41 01/01/1970] [DHCP Server Thread] BcmDhcpServerThread::ThreadMain: (DHCP Server Thread) WARNING - Processing an ARP packet - Unable to find associated ServerIf for 192.168.100.100 CM> BcmCmUsChanTimerMuxACT::HandleEvent() @time=45960 fTimerType=4 (kT3NoRngRsp) hwTxId=0 docs ucid=1 Adjusting the initial ranging power to 32.5 dBmV... hwTxId = 0 docsis UCID = 1 Logging event: No Ranging Response received - T3 time-out;CM-MAC=00:21:63:62:6d:d8;CMTS-MAC=64:9e:f3:66:0d:b3;CM-QOS=1.0;CM-VER=3.0; CM> BcmCmUsChanTimerMuxACT::HandleEvent() @time=51000 fTimerType=4 (kT3NoRngRsp) hwTxId=0 docs ucid=1 Adjusting the initial ranging power to 22.25 dBmV... hwTxId = 0 docsis UCID = 1 Logging event: No Ranging Response received - T3 time-out;CM-MAC=00:21:63:62:6d:d8;CMTS-MAC=64:9e:f3:66:0d:b3;CM-QOS=1.0;CM-VER=3.0; CM> BcmCmUsChanTimerMuxACT::HandleEvent() @time=59580 fTimerType=4 (kT3NoRngRsp) hwTxId=0 docs ucid=1 Adjusting the initial ranging power to 55.5 dBmV... hwTxId = 0 docsis UCID = 1 Logging event: No Ranging Response received - T3 time-out;CM-MAC=00:21:63:62:6d:d8;CMTS-MAC=64:9e:f3:66:0d:b3;CM-QOS=1.0;CM-VER=3.0; CM> [00:01:00 01/01/1970] [CmDsxHelper] BcmCmDsxHelper::SyncDeleteFlowSetsLocal: (CmDsxHelper) ERROR - SF not found [00:01:01 01/01/1970] [CmDsxHelper] BcmCmDsxHelper::SyncDeleteFlowSetsLocal: (CmDsxHelper) ERROR - SF not found [00:01:01 01/01/1970] [CmDsxHelper] BcmCmDsxHelper::SyncDeleteFlowSetsLocal: (CmDsxHelper) ERROR - SF not found [00:01:01 01/01/1970] [CmDsxHelper] BcmCmDsxHelper::SyncDeleteFlowSetsLocal: (CmDsxHelper) ERROR - SF not found Logging event: DSD USID=0 deleted from CM Logging event: DSD DSID=0 deleted from CM Logging event: DSD USID=0 deleted from CM Logging event: DSD DSID=0 deleted from CM Logging event: DSD USID=0 deleted from CM Logging event: DSD DSID=0 deleted from CM Logging event: DSD USID=0 deleted from CM Logging event: DSD DSID=0 deleted from CM CM> BcmCmUsChanTimerMuxACT::HandleEvent() @time=64200 fTimerType=4 (kT3NoRngRsp) hwTxId=0 docs ucid=1 Adjusting the initial ranging power to 50.5 dBmV... hwTxId = 0 docsis UCID = 1 Logging event: No Ranging Response received - T3 time-out;CM-MAC=00:21:63:62:6d:d8;CMTS-MAC=64:9e:f3:66:0d:b3;CM-QOS=1.0;CM-VER=3.0; CM> BcmCmUsChanTimerMuxACT::HandleEvent() @time=72660 fTimerType=4 (kT3NoRngRsp) hwTxId=0 docs ucid=1 Adjusting the initial ranging power to 45.25 dBmV... hwTxId = 0 docsis UCID = 1 Logging event: No Ranging Response received - T3 time-out;CM-MAC=00:21:63:62:6d:d8;CMTS-MAC=64:9e:f3:66:0d:b3;CM-QOS=1.0;CM-VER=3.0; CM> BcmCmUsChanTimerMuxACT::HandleEvent() @time=81120 fTimerType=4 (kT3NoRngRsp) hwTxId=0 docs ucid=1 Adjusting the initial ranging power to 40.25 dBmV... hwTxId = 0 docsis UCID = 1 Logging event: No Ranging Response received - T3 time-out;CM-MAC=00:21:63:62:6d:d8;CMTS-MAC=64:9e:f3:66:0d:b3;CM-QOS=1.0;CM-VER=3.0; CM> BcmCmUsChanTimerMuxACT::HandleEvent() @time=84540 fTimerType=4 (kT3NoRngRsp) hwTxId=0 docs ucid=1 Adjusting the initial ranging power to 35 dBmV... hwTxId = 0 docsis UCID = 1 Logging event: No Ranging Response received - T3 time-out;CM-MAC=00:21:63:62:6d:d8;CMTS-MAC=64:9e:f3:66:0d:b3;CM-QOS=1.0;CM-VER=3.0; CM> BcmCmUsChanTimerMuxACT::HandleEvent() @time=88080 fTimerType=4 (kT3NoRngRsp) hwTxId=0 docs ucid=1 Adjusting the initial ranging power to 30 dBmV... hwTxId = 0 docsis UCID = 1 Logging event: No Ranging Response received - T3 time-out;CM-MAC=00:21:63:62:6d:d8;CMTS-MAC=64:9e:f3:66:0d:b3;CM-QOS=1.0;CM-VER=3.0; CM> BcmCmUsChanTimerMuxACT::HandleEvent() @time=90660 fTimerType=4 (kT3NoRngRsp) hwTxId=0 docs ucid=1 Adjusting the initial ranging power to 24.75 dBmV... hwTxId = 0 docsis UCID = 1 Logging event: No Ranging Response received - T3 time-out;CM-MAC=00:21:63:62:6d:d8;CMTS-MAC=64:9e:f3:66:0d:b3;CM-QOS=1.0;CM-VER=3.0; CM> BcmCmUsChanTimerMuxACT::HandleEvent() @time=93660 fTimerType=4 (kT3NoRngRsp) hwTxId=0 docs ucid=1 Adjusting the initial ranging power to 19.75 dBmV... hwTxId = 0 docsis UCID = 1 Logging event: No Ranging Response received - T3 time-out;CM-MAC=00:21:63:62:6d:d8;CMTS-MAC=64:9e:f3:66:0d:b3;CM-QOS=1.0;CM-VER=3.0; CM> BcmCmUsChanTimerMuxACT::HandleEvent() @time=95400 fTimerType=4 (kT3NoRngRsp) hwTxId=0 docs ucid=1 Adjusting the initial ranging power to 58 dBmV... hwTxId = 0 docsis UCID = 1 Logging event: No Ranging Response received - T3 time-out;CM-MAC=00:21:63:62:6d:d8;CMTS-MAC=64:9e:f3:66:0d:b3;CM-QOS=1.0;CM-VER=3.0; CM> BcmCmUsChanTimerMuxACT::HandleEvent() @time=96540 fTimerType=4 (kT3NoRngRsp) hwTxId=0 docs ucid=1 [00:01:36 01/01/1970] [CmDocsisCtlThread] BcmCmUsRangingState::T3NoRngRspEvent: ERROR - No initial ranging response from CMTS. [00:01:36 01/01/1970] [CmDocsisCtlThread] BcmCmUsRangingState::CommonRngErrorHandler: reason=8 (kMaxT3NoRngRspTimeouts) hwTxId=0 docs ucid=1 [00:01:36 01/01/1970] [CmDocsisCtlThread] BcmCmDocsisCtlThread::TargetNextDocs3CandidateUcid: (CmDocsisCtlThread) [00:01:36 01/01/1970] [CmDocsisCtlThread] BcmCmMultiUsHelper::TargetNextDocs3CandidateUcid: state at entry: Channel targeting: Downstream: fTargetDsFreqHz = 0x177bf680 (394000000) fCurrentDsFreqHz = 0x177bf680 (394000000) fStoredDsFreqHz = 0x177bf680 (394000000) Upstream: fDestSingleTxTargetUsChanId = 0x1 (1) fTargetingContext = 0 (kStartup) Startup UCD Selection Info: startup ranging mode = 2 (kDocs3BondedBcastInitRng) last oper us tx mode = 0 (kUsTxModeUnknown) high priority candidate ucid list = 3 4 low priority candidate ucid list = 6 5 2 happy home ucid set = 3 4 BcmCmUsTargetMset: US target info: us Phy type: 0x3 us chan id: 0x3 config change count: 0xa UCD rx count: 0x1 init ranging tried?: 0 US target info: us Phy type: 0x3 us chan id: 0x4 config change count: 0xa UCD rx count: 0x1 init ranging tried?: 0 US target info: us Phy type: 0x3 us chan id: 0x5 config change count: 0x9 UCD rx count: 0x1 init ranging tried?: 0 US target info: us Phy type: 0x3 us chan id: 0x6 config change count: 0x9 UCD rx count: 0x1 init ranging tried?: 0 US target info: us Phy type: 0x3 us chan id: 0x1 config change count: 0xc UCD rx count: 0x1 init ranging tried?: 0x1 US target info: us Phy type: 0x3 us chan id: 0x2 config change count: 0xa UCD rx count: 0x1 init ranging tried?: 0 [00:01:36 01/01/1970] [CmDocsisCtlThread] BcmCmMultiUsHelper::TargetNextDocs3CandidateUcid: starting docs3 upstream initialization on target ucid=3 via contrived TCC replace cmd. BcmCmUsChan::TccReplaceCmd() CM tx chan 0 starting TCC replace command. == TCC command == TCC ref id = 0 (not specified) action = 4 (kTccReplace) us chan id = 0 new us chan id = 3 ranging sid = 0 (not specified) ranging strategy = 1 (kTccRngBcastInit) (not specified) dyn ranging window = 0 (not specified) rng mode (CM spec) = 2 UCD = specified but suppressed ranging params = (not specified) TCC error = (not specified) BcmCmUsChan::InstallUsSets() Selecting UCD w/ucid=3 for CM tx chan 0 ***kUseAllDataIucPresent*** ***kUseAllDataIucPresent*** [00:01:36 01/01/1970] [CmDocsisCtlThread] BcmCmUsSetsState::TestAndLaunchUsTimeSync: - starting upstream time sync acquisition... Logging event: No Ranging Response received - T3 time-out;CM-MAC=00:21:63:62:6d:d8;CMTS-MAC=64:9e:f3:66:0d:b3;CM-QOS=1.0;CM-VER=3.0; Logging event: B-INIT-RNG Failure - Retries exceeded;CM-MAC=00:21:63:62:6d:d8;CMTS-MAC=64:9e:f3:66:0d:b3;CM-QOS=1.0;CM-VER=3.0; CM> BcmCmUsChan::InstallUsSets() - state after us sets installation CM Upstream channel info: fHwTxId = 0 TargetUsChanId() = 3 fRngSid = 0 fCmTccCmdInstallState = 1 (kTccInstallInProg) Upstream settings state info: fUcdSetsState = 1 (kUcdSetsOk) fUsTimeRefState = 1 (kComputingUsTimeRef) Ranging state info: fRngMode = 2 (kDocs3BondedBcastInitRng) fRngMsgTxRxState = 0 (kRngMsgNotStarted) fUnicastRngOpState = 0 (kRngOpInitial) fRxRngRspState = 0 (kRxRngRspInitial) fRngSuccess = 0 fLastRngRspStatus = 0 (RESERVED) [00:01:37 01/01/1970] [CmDocsisCtlThread] BcmCmMultiUsHelper::UsTimeRefOk: target hwTxId=0 [00:01:37 01/01/1970] [CmDocsisCtlThread] BcmCmUsChan::UsTimeRefOk: upstream time sync acquired for fHwTxId=0 [00:01:37 01/01/1970] [CmDocsisCtlThread] BcmCmUsChan::UsTimeRefOkResumeUsInit: starting initial ranging... == Beginning initial ranging for Docsis UCID 3 == Stored power level for UCID 3 is 48.75 dBmV Using per transmitter stored initial upstream power = 48.75 dBmV hwTxId = 0 docsis UCID = 3 BcmCmUsChan::UsTimeRefOk() - state at exit CM Upstream channel info: fHwTxId = 0 TargetUsChanId() = 3 fRngSid = 0 fCmTccCmdInstallState = 1 (kTccInstallInProg) Upstream settings state info: fUcdSetsState = 1 (kUcdSetsOk) fUsTimeRefState = 2 (kUsTimeRefOk) Ranging state info: fRngMode = 2 (kDocs3BondedBcastInitRng) fRngMsgTxRxState = 2 (kInitRngWaitingToRngReq) fUnicastRngOpState = 0 (kRngOpInitial) fRxRngRspState = 0 (kRxRngRspInitial) fRngSuccess = 0 fLastRngRspStatus = 0 (RESERVED) [00:01:37 01/01/1970] [CmDocsisCtlThread] BcmCmMultiUsHelper::UsTimeRefOk: target hwTxId=0 CM> RNG-RSP UsChanId=3 Adj: tim=2193 power=0 freq=0 Stat=Continue CM> RNG-RSP UsChanId=3 Adj: tim=0 power=0 freq=0 Stat=Continue CM> RNG-RSP UsChanId=3 Adj: tim=0 power=0 freq=0 Stat=Continue CM> RNG-RSP UsChanId=3 Adj: tim=0 power=0 freq=0 Stat=Continue CM> RNG-RSP UsChanId=3 Adj: tim=0 power=0 freq=0 Stat=Success [00:01:42 01/01/1970] [CmDocsisCtlThread] BcmCmDocsisCtlThread::FirstRngSuccess: (CmDocsisCtlThread) first RNG-RSP w/status==SUCCESS for hwTxId=0 and DOCSIS ucid=3 Calculating maximum number of Drop Classifiers: Each Drop Classifiers consumes ~3272 bytes of RAM. Current free RAM is 15690100 bytes. Max heap reserved for Drop Classifiers (25%) = 3922525 We can support 1198 Drop Classifiers. Advertising fewer Drop Classifiers than we can really support: 255 == Starting IP Initialization in IPv4 Only provisioning mode == Starting IPv4 Initialization with DHCP... DHCPc: Sending Discover packet; client id htype=255, value=63 62 6d d8 00 03 00 01 00 21 63 62 6d d8 CM> DHCPc: Received an Offer from DHCP server 64:9e:f3:66:0d:d9 (10.112.0.1); lease client id htype=255, value=63 62 6d d8 00 03 00 01 00 21 63 62 6d d8 DHCPc: Received an Offer from DHCP server 64:9e:f3:66:0d:d9 (10.112.0.1); lease client id htype=255, value=63 62 6d d8 00 03 00 01 00 21 63 62 6d d8 DHCPc: Offer isn't better than what I already have; ignoring... CM> DHCPc: Timed out waiting for offers for lease with client id htype=255, value=63 62 6d d8 00 03 00 01 00 21 63 62 6d d8 DHCPc: Sending Request packet; client id htype=255, value=63 62 6d d8 00 03 00 01 00 21 63 62 6d d8 DHCPc: Received an Ack from DHCP server 64:9e:f3:66:0d:d9 (10.112.0.1); lease client id htype=255, value=63 62 6d d8 00 03 00 01 00 21 63 62 6d d8 Current IP address is default 0.0.0.0. [00:01:45 01/01/1970] [DHCP Client Thread] BcmEcosIpHalIf::ConfigureLeaseImpl: (IP Stack1 HalIf) Configuring IP stack 1: IP Address = 10.112.0.230 (primary IP address) Subnet Mask = 255.255.192.0 Router = 10.112.0.1 IsPrimaryInterface = 1 CM> bcm: ifid: 02:10:18:ff:fe:48:14:14 Vendor CM Agent w/ BRCM Factory Support IpStackEvent Initiating TFTP over IPv4 in IPv4 only provisioning mode Starting Time Of Day... [00:01:46 01/01/1970] [CmDocsisIpThread] BcmDocsisTimeOfDayThread::SetTodServerIpAddress: (Time Of Day Thread) ToD servers: 212.198.0.161 Connecting to ToD server 212.198.0.161... Sending UDP ToD request to server... UTC returned by ToD server 3553952623; UTC offset 7200 Current system time -> Tue Aug 14 19:03:43 2012 System start time -> Tue Aug 14 19:01:57 2012 Using siaddr or option 66 for TFTP server. Starting Tftp of configuration file... TFTP server index 0 IP: 212.198.0.125 Opening file 'byt_f3784b_100m_5m.cm' on 212.198.0.125 for reading... [19:03:44 08/14/2012] [CmDocsisIpThread] Tftp Client::Send: (Tftp Client) TFTP blocksize value returned by server: 1448 Tftp transfer complete! TFTP Settings: Stack Interface = 1 Server Ip Address = 212.198.0.125 Server Port Number = 50594 Total Blocks Read = 1 Total Bytes Read = 968 Config file was read! IP Initialization completed... MAX CPE per CM is being set to 5 Time Of Day completed... DefaultSnmpAgentClass::SystemTimeChangeEvent for Vendor CM Agent w/ BRCM Factory Support CM> Logging event: Missing BP Configuration Setting TLV Type: 17.1;CM-MAC=00:21:63:62:6d:d8;CMTS-MAC=64:9e:f3:66:0d:b3;CM-QOS=1.1;CM-VER=3.0; Logging event: Missing BP Configuration Setting TLV Type: 17.2;CM-MAC=00:21:63:62:6d:d8;CMTS-MAC=64:9e:f3:66:0d:b3;CM-QOS=1.1;CM-VER=3.0; Logging event: Missing BP Configuration Setting TLV Type: 17.3;CM-MAC=00:21:63:62:6d:d8;CMTS-MAC=64:9e:f3:66:0d:b3;CM-QOS=1.1;CM-VER=3.0; Logging event: Missing BP Configuration Setting TLV Type: 17.4;CM-MAC=00:21:63:62:6d:d8;CMTS-MAC=64:9e:f3:66:0d:b3;CM-QOS=1.1;CM-VER=3.0; Logging event: Missing BP Configuration Setting TLV Type: 17.5;CM-MAC=00:21:63:62:6d:d8;CMTS-MAC=64:9e:f3:66:0d:b3;CM-QOS=1.1;CM-VER=3.0; Logging event: Missing BP Configuration Setting TLV Type: 17.6;CM-MAC=00:21:63:62:6d:d8;CMTS-MAC=64:9e:f3:66:0d:b3;CM-QOS=1.1;CM-VER=3.0; Vendor CM Agent w/ BRCM Factory Support processing 33 TLV-11's Sending SNMP packet to 10.112.0.230 33 TLV-11's OK. Sending a REG-REQ to the CMTS... Applying legacy rules for copying cfg file TLVs to REG-REQ... Logging event: Missing BP Configuration Setting TLV Type: 17.7;CM-MAC=00:21:63:62:6d:d8;CMTS-MAC=64:9e:f3:66:0d:b3;CM-QOS=1.1;CM-VER=3.0; [19:03:44 08/14/2012] [CmDocsisCtlThread] BcmCmDocsisCtlThread::RegRspMsgEvent: (CmDocsisCtlThread) Received a REG-RSP-MP message from the CMTS... [19:03:45 08/14/2012] [CmDocsisCtlThread] BcmCmDocsisCtlThread::RegRspMsgEvent: (CmDocsisCtlThread) We registered with a DOCSIS 1.1 config file! [19:03:45 08/14/2012] [CmDocsisCtlThread] BcmCmMultiDsHelper::ConnectBondedDsChans: Beginning RCC installation. [19:03:45 08/14/2012] [CmDocsisCtlThread] BcmCmMultiDsHelper::ConnectBondedDsChans: pfDocsisCmHalIf->TunerFirstChannelCenterFrequencyHz() = 394000000 pCmRxModuleConfig->FirstChannelCenterFrequencyAssignmentHz() = 378000000 Logging event: Missing BP Configuration Setting TLV Type: 17.8;CM-MAC=00:21:63:62:6d:d8;CMTS-MAC=64:9e:f3:66:0d:b3;CM-QOS=1.1;CM-VER=3.0; Logging event: Missing BP Configuration Setting TLV Type: 17.9;CM-MAC=00:21:63:62:6d:d8;CMTS-MAC=64:9e:f3:66:0d:b3;CM-QOS=1.1;CM-VER=3.0; Vendor CM Event Log sending deferred async messages... Done w/ deferred msgs CM> Scanning DS Channel at 394000000 Hz... Found carrier at 394000000 Hz! Signal quality = 32.8 dB SNR BcmSetDocsis3TransmitMode=1 [19:03:47 08/14/2012] [CmDocsisCtlThread] BcmCmDsPrimaryChan::MddMsgEvent: refreshing primary downstream MDD. [19:03:47 08/14/2012] [CmDocsisCtlThread] BcmCmDsPrimaryChan::DsLockOk: hwRxId=0 freq=394000000 docs dcid=3 CM> [19:03:48 08/14/2012] [CmDocsisCtlThread] BcmCmDsChan::DsLockOk: hwRxId=1 freq=378000000 docs dcid=1 [19:03:49 08/14/2012] [CmDocsisCtlThread] BcmCmDsChan::DsLockOk: hwRxId=2 freq=386000000 docs dcid=2 [19:03:49 08/14/2012] [CmDocsisCtlThread] BcmCmDsChan::DsLockOk: hwRxId=3 freq=402000000 docs dcid=4 [19:03:49 08/14/2012] [CmDocsisCtlThread] BcmCmDsChan::DsLockOk: hwRxId=4 freq=410000000 docs dcid=5 [19:03:49 08/14/2012] [CmDocsisCtlThread] BcmCmDsChan::DsLockOk: hwRxId=5 freq=418000000 docs dcid=6 [19:03:49 08/14/2012] [CmDocsisCtlThread] BcmCmDsChan::DsLockOk: hwRxId=6 freq=426000000 docs dcid=7 [19:03:49 08/14/2012] [CmDocsisCtlThread] BcmCmDsChan::DsLockOk: hwRxId=7 freq=434000000 docs dcid=8 [19:03:49 08/14/2012] [CmDocsisCtlThread] BcmCmDocsisCtlThread::DetectRccInstallDone: (CmDocsisCtlThread) RCC installation finished. all ds chans ok. [19:03:49 08/14/2012] [CmDocsisCtlThread] BcmCmDocsisCtlThread::ResumeDocs11RegAfterRccOutcome: (CmDocsisCtlThread) Resuming registration sequence after waiting for RCC installation outcome. [19:03:49 08/14/2012] [CmDocsisCtlThread] BcmCmMultiUsHelper::DynamicRangeWindowQtrDb: Dynamic Range Window set to: 10 (1/4 dB units) BcmCmUsChan::TccAddCmd() CM tx chan 1 starting TCC add command. == TCC command == TCC ref id = 1 action = 1 (kTccAdd) us chan id = 4 new us chan id = 0 (not specified) ranging sid = 0x178c ranging strategy = 1 (kTccRngBcastInit) dyn ranging window = 0 (not specified) rng mode (CM spec) = 0 (not specified) UCD = specified but suppressed TCC ranging parameters: Ranging Ref Chan ID = 3 Timing Off, Int Part = -256 Timing Off, Frac Part = 0 Power offset = 0 Frequency offset = 0 (not specified) TCC error = (not specified) BcmCmUsChan::InstallUsSets() Selecting UCD w/ucid=4 for CM tx chan 1 [19:03:49 08/14/2012] [CmDocsisCtlThread] BcmCmUsSetsState::TestAndLaunchUsTimeSync: - starting upstream time sync acquisition... CM> BcmCmUsChan::InstallUsSets() - state after us sets installation CM Upstream channel info: fHwTxId = 1 TargetUsChanId() = 4 fRngSid = 0x178c fCmTccCmdInstallState = 1 (kTccInstallInProg) Upstream settings state info: fUcdSetsState = 1 (kUcdSetsOk) fUsTimeRefState = 1 (kComputingUsTimeRef) Ranging state info: fRngMode = 0 (kRngNotStarted) fRngMsgTxRxState = 0 (kRngMsgNotStarted) fUnicastRngOpState = 0 (kRngOpInitial) fRxRngRspState = 0 (kRxRngRspInitial) fRngSuccess = 0 fLastRngRspStatus = 0 (RESERVED) BcmCm3dfDocsisMsgACT::HandleEvent() @time=113050 event_code=47 (kCmDbcOtfTccChange) [19:03:50 08/14/2012] [CmDocsisCtlThread] BcmCmMultiUsHelper::UsTimeRefOk: target hwTxId=1 [19:03:50 08/14/2012] [CmDocsisCtlThread] BcmCmUsChan::UsTimeRefOk: upstream time sync acquired for fHwTxId=1 [19:03:50 08/14/2012] [CmDocsisCtlThread] BcmCmUsChan::UsTimeRefOkResumeUsInit: starting initial ranging... == Beginning initial ranging for Docsis UCID 4 == Dynamic Range Window is from 39.5dBmV to 51.5 dBmV Stored power level for UCID 4 is 49.75 dBmV Using per transmitter stored initial upstream power = 49.75 dBmV hwTxId = 1 docsis UCID = 4 BcmCmUsChan::UsTimeRefOk() - state at exit CM Upstream channel info: fHwTxId = 1 TargetUsChanId() = 4 fRngSid = 0x178c fCmTccCmdInstallState = 1 (kTccInstallInProg) Upstream settings state info: fUcdSetsState = 1 (kUcdSetsOk) fUsTimeRefState = 2 (kUsTimeRefOk) Ranging state info: fRngMode = 1 (kBcastInitRng) fRngMsgTxRxState = 2 (kInitRngWaitingToRngReq) fUnicastRngOpState = 0 (kRngOpInitial) fRxRngRspState = 0 (kRxRngRspInitial) fRngSuccess = 0 fLastRngRspStatus = 0 (RESERVED) [19:03:50 08/14/2012] [CmDocsisCtlThread] BcmCmMultiUsHelper::UsTimeRefOk: target hwTxId=1 RNG-RSP UsChanId=4 Adj: tim=2193 power=0 freq=0 Stat=Continue CM> RNG-RSP UsChanId=4 Adj: tim=0 power=0 freq=0 Stat=Continue CM> RNG-RSP UsChanId=4 Adj: tim=0 power=0 freq=0 Stat=Continue CM> RNG-RSP UsChanId=4 Adj: tim=0 power=0 freq=0 Stat=Continue CM> RNG-RSP UsChanId=4 Adj: tim=0 power=0 freq=0 Stat=Success [19:03:54 08/14/2012] [CmDocsisCtlThread] BcmCmDocsisCtlThread::FirstRngSuccess: (CmDocsisCtlThread) first RNG-RSP w/status==SUCCESS for hwTxId=1 and DOCSIS ucid=4 [19:03:54 08/14/2012] [CmDocsisCtlThread] BcmCmDocsisCtlThread::DetectTccInstallDone: (CmDocsisCtlThread) fCmMultiUsHelper.AnyWaitingForTccOutcome() returned false. TCC installation is finished. [19:03:54 08/14/2012] [CmDocsisCtlThread] BcmCmDocsisCtlThread::DetectTccInstallDone: (CmDocsisCtlThread) resume registration sequence. [19:03:54 08/14/2012] [CmDocsisCtlThread] BcmCmDocsisCtlThread::ResumeRegAfterTccOutcome: (CmDocsisCtlThread) Resuming registration sequence after waiting for TCC installation outcome. Registration complete! Process CVC [19:03:54 08/14/2012] [CmDocsisCtlThread] CmSecureDownload::ProcessConfigFileManufAndCosignerCvcs: (Secure Software Download) WARNING - No CVC included in config file; software upgrade can't be performed! [19:03:54 08/14/2012] [CmDocsisCtlThread] BcmCmDocsisCtlThread::ProcessCVC: (CmDocsisCtlThread) ERROR - Config file does not include a valid CVC! DOCSIS CoS/QoS rate shaping enable is now 1 CmSnmpAgent::CmOperationalEvent for Vendor CM Agent w/ BRCM Factory Support +++ No DH kickstart profiles or snmpCommunityTable entries installed. We will operate in NMACCESS mode. Vendor CM Agent w/ BRCM Factory Support setting V1/V2 view to docsisNmAccessView [19:03:54 08/14/2012] [CmDocsisCtlThread] BcmCmDocsisCtlThread::TestAndLaunchBpkm: (CmDocsisCtlThread) BPKM disabled via provisioned config file setting. Enabling network access for all CPE ports. Multicast Dsid Forwading Mode: GMAC Promiscuous [19:03:54 08/14/2012] [CmDocsisCtlThread] BcmDocsisCmHalIf::SetMulticastMode: (DOCSIS CableModem HalIf) CM HAL Multicast mode = 2 [19:03:54 08/14/2012] [CmDocsisCtlThread] BcmDocsisCmHalIf::InstallMulticastDsid: (DOCSIS CableModem HalIf) Installing multicast DSID = 0xef0ae (979118) [19:03:54 08/14/2012] [CmDocsisCtlThread] BcmDocsisCmHalIf::InstallMulticastDsid: (DOCSIS CableModem HalIf) Installing multicast DSID = 0xef0ab (979115) [19:03:54 08/14/2012] [CmDocsisCtlThread] BcmDocsisCmHalIf::InstallMulticastDsid: (DOCSIS CableModem HalIf) Installing multicast DSID = 0xef0ad (979117) BcmCm3dfDocsisMsgACT::HandleEvent() @time=117460 event_code=34 (kCmIsOperational) BcmCmDocsisStatusEventCodes::kCmIsOperational [19:03:54 08/14/2012] [CmDocsisCtlThread] BcmVendorCmApplication::StopDhcpServer: (VendorExtension CmApp) Shutting down DHCP Server... [19:03:54 08/14/2012] [IGMP Thread] BcmIgmpThread::Stopping Igmp Thread...: (IGMP Thread) Vendor CM Event Log sending deferred async messages... Done w/ deferred msgs CM> BcmCmUsChanTimerMuxACT::HandleEvent() @time=154640 fTimerType=5 (kT4NoStationMaint) hwTxId=0 docs ucid=3 [19:04:31 08/14/2012] [CmDocsisCtlThread] BcmCmUsRangingState::T4NoStationMaintEvent: ERROR - no Station Maint map op error. hwTxId=0 docs ucid=3 [19:04:31 08/14/2012] [CmDocsisCtlThread] BcmCmUsRangingState::CommonRngErrorHandler: reason=9 (kT4NoStationMaintTimeout) hwTxId=0 docs ucid=3 BcmCm3dfDocsisMsgACT::HandleEvent() @time=154670 event_code=68 (kCmT4NoStationMaintOpFailMsg) 3 BcmCm3dfEventCensor::T4NoStationMaintOpFailTrans() with DOCSIS ucid = 3 BcmCm3dfEventCensor::T4NoStationMaintOpFailTrans() - state at exit: BcmCm3dfEventCensor: fTstmp3dfHoldoffStarted = 0 fLastHoldoffPeriodMillisec = 0 fNextHoldoffPeriodMillisec = 0 fOvrdNonChSpEvRptEnableSet = 0 fOvrdNonChSpEvRptEnableSetSpecified = 0 Assigned Non-Primary Downstream Active Channel Settings List: id freq, hz modulation/annex primary stat bmask --- --------- ------------------ ------- ---------- 1 378000000 kMod256Qam/kDsAnnexA y 0x36 2 386000000 kMod256Qam/kDsAnnexA y 0x36 4 402000000 kMod256Qam/kDsAnnexA y 0x36 5 410000000 kMod256Qam/kDsAnnexA y 0x36 6 418000000 kMod256Qam/kDsAnnexA y 0x36 7 426000000 kMod256Qam/kDsAnnexA y 0x36 8 434000000 kMod256Qam/kDsAnnexA y 0x36 Assigned Upstream Active Channel Settings List: id stat bmask --- ---------- 3 0 4 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 1 (kCmEvNonPriDsMddFail) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 4 (kCmEvNonPriDsMddRescue) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 2 (kCmEvDsPhyLockFail) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 5 (kCmEvDsPhyLockRescue) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 3 (kCmEvDsDataReseqFail) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 6 (kCmEvT4NoStationMaintOpTimeout) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 3 (kRptOffViaCmStatCtrlSets) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 fOnEventParamSet = [ 3 ] CM-STATUS 3df Msg Tx State Machine: fEventType = 7 (kCmEvMaxT3NoRngRspTimeouts) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 8 (kCmEvMaxT3NoRngRspRescue) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 9 (kCmEvAcPowerFail) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 10 (kCmEvAcPowerRescue) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 Logging event: Received Response to Broadcast Maintenance Request, But no Unicast Maintenance opportunities received - T4 time out;CM-MAC=00:21:63:62:6d:d8;CMTS-MAC=64:9e:f3:66:0d:b3;CM-QOS=1.1;CM-VER=3.0; CM> BcmCm3dfDocsisMsgACT::HandleEvent() @time=161870 event_code=69 (kCmT4NoStationMaintOpRescueMsg) 3 BcmCm3dfEventCensor::T4NoStationMaintOpRescueTrans() with DOCSIS ucid = 3 BcmCm3dfEventCensor::T4NoStationMaintOpRescueTrans() - state at exit: BcmCm3dfEventCensor: fTstmp3dfHoldoffStarted = 0 fLastHoldoffPeriodMillisec = 0 fNextHoldoffPeriodMillisec = 0 fOvrdNonChSpEvRptEnableSet = 0 fOvrdNonChSpEvRptEnableSetSpecified = 0 Assigned Non-Primary Downstream Active Channel Settings List: id freq, hz modulation/annex primary stat bmask --- --------- ------------------ ------- ---------- 1 378000000 kMod256Qam/kDsAnnexA y 0x36 2 386000000 kMod256Qam/kDsAnnexA y 0x36 4 402000000 kMod256Qam/kDsAnnexA y 0x36 5 410000000 kMod256Qam/kDsAnnexA y 0x36 6 418000000 kMod256Qam/kDsAnnexA y 0x36 7 426000000 kMod256Qam/kDsAnnexA y 0x36 8 434000000 kMod256Qam/kDsAnnexA y 0x36 Assigned Upstream Active Channel Settings List: id stat bmask --- ---------- 3 0 4 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 1 (kCmEvNonPriDsMddFail) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 4 (kCmEvNonPriDsMddRescue) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 2 (kCmEvDsPhyLockFail) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 5 (kCmEvDsPhyLockRescue) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 3 (kCmEvDsDataReseqFail) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 6 (kCmEvT4NoStationMaintOpTimeout) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 7 (kCmEvMaxT3NoRngRspTimeouts) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 8 (kCmEvMaxT3NoRngRspRescue) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 9 (kCmEvAcPowerFail) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 10 (kCmEvAcPowerRescue) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 BcmCmUsChanTimerMuxACT::HandleEvent() @time=174500 fTimerType=5 (kT4NoStationMaint) hwTxId=1 docs ucid=4 [19:04:51 08/14/2012] [CmDocsisCtlThread] BcmCmUsRangingState::T4NoStationMaintEvent: ERROR - no Station Maint map op error. hwTxId=1 docs ucid=4 [19:04:51 08/14/2012] [CmDocsisCtlThread] BcmCmUsRangingState::CommonRngErrorHandler: reason=9 (kT4NoStationMaintTimeout) hwTxId=1 docs ucid=4 BcmCm3dfDocsisMsgACT::HandleEvent() @time=174530 event_code=68 (kCmT4NoStationMaintOpFailMsg) 4 BcmCm3dfEventCensor::T4NoStationMaintOpFailTrans() with DOCSIS ucid = 4 BcmCm3dfEventCensor::T4NoStationMaintOpFailTrans() - state at exit: BcmCm3dfEventCensor: fTstmp3dfHoldoffStarted = 0 fLastHoldoffPeriodMillisec = 0 fNextHoldoffPeriodMillisec = 0 fOvrdNonChSpEvRptEnableSet = 0 fOvrdNonChSpEvRptEnableSetSpecified = 0 Assigned Non-Primary Downstream Active Channel Settings List: id freq, hz modulation/annex primary stat bmask --- --------- ------------------ ------- ---------- 1 378000000 kMod256Qam/kDsAnnexA y 0x36 2 386000000 kMod256Qam/kDsAnnexA y 0x36 4 402000000 kMod256Qam/kDsAnnexA y 0x36 5 410000000 kMod256Qam/kDsAnnexA y 0x36 6 418000000 kMod256Qam/kDsAnnexA y 0x36 7 426000000 kMod256Qam/kDsAnnexA y 0x36 8 434000000 kMod256Qam/kDsAnnexA y 0x36 Assigned Upstream Active Channel Settings List: id stat bmask --- ---------- 3 0 4 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 1 (kCmEvNonPriDsMddFail) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 4 (kCmEvNonPriDsMddRescue) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 2 (kCmEvDsPhyLockFail) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 5 (kCmEvDsPhyLockRescue) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 3 (kCmEvDsDataReseqFail) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 6 (kCmEvT4NoStationMaintOpTimeout) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 3 (kRptOffViaCmStatCtrlSets) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 fOnEventParamSet = [ 4 ] CM-STATUS 3df Msg Tx State Machine: fEventType = 7 (kCmEvMaxT3NoRngRspTimeouts) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 8 (kCmEvMaxT3NoRngRspRescue) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 9 (kCmEvAcPowerFail) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 10 (kCmEvAcPowerRescue) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 Logging event: Received Response to Broadcast Maintenance Request, But no Unicast Maintenance opportunities received - T4 time out;CM-MAC=00:21:63:62:6d:d8;CMTS-MAC=64:9e:f3:66:0d:b3;CM-QOS=1.1;CM-VER=3.0; CM> BcmCm3dfDocsisMsgACT::HandleEvent() @time=181730 event_code=69 (kCmT4NoStationMaintOpRescueMsg) 4 BcmCm3dfEventCensor::T4NoStationMaintOpRescueTrans() with DOCSIS ucid = 4 BcmCm3dfEventCensor::T4NoStationMaintOpRescueTrans() - state at exit: BcmCm3dfEventCensor: fTstmp3dfHoldoffStarted = 0 fLastHoldoffPeriodMillisec = 0 fNextHoldoffPeriodMillisec = 0 fOvrdNonChSpEvRptEnableSet = 0 fOvrdNonChSpEvRptEnableSetSpecified = 0 Assigned Non-Primary Downstream Active Channel Settings List: id freq, hz modulation/annex primary stat bmask --- --------- ------------------ ------- ---------- 1 378000000 kMod256Qam/kDsAnnexA y 0x36 2 386000000 kMod256Qam/kDsAnnexA y 0x36 4 402000000 kMod256Qam/kDsAnnexA y 0x36 5 410000000 kMod256Qam/kDsAnnexA y 0x36 6 418000000 kMod256Qam/kDsAnnexA y 0x36 7 426000000 kMod256Qam/kDsAnnexA y 0x36 8 434000000 kMod256Qam/kDsAnnexA y 0x36 Assigned Upstream Active Channel Settings List: id stat bmask --- ---------- 3 0 4 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 1 (kCmEvNonPriDsMddFail) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 4 (kCmEvNonPriDsMddRescue) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 2 (kCmEvDsPhyLockFail) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 5 (kCmEvDsPhyLockRescue) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 3 (kCmEvDsDataReseqFail) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 6 (kCmEvT4NoStationMaintOpTimeout) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 7 (kCmEvMaxT3NoRngRspTimeouts) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 8 (kCmEvMaxT3NoRngRspRescue) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 9 (kCmEvAcPowerFail) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 10 (kCmEvAcPowerRescue) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 BcmCmUsChanTimerMuxACT::HandleEvent() @time=194890 fTimerType=5 (kT4NoStationMaint) hwTxId=0 docs ucid=3 [19:05:11 08/14/2012] [CmDocsisCtlThread] BcmCmUsRangingState::T4NoStationMaintEvent: ERROR - no Station Maint map op error. hwTxId=0 docs ucid=3 [19:05:11 08/14/2012] [CmDocsisCtlThread] BcmCmUsRangingState::CommonRngErrorHandler: reason=9 (kT4NoStationMaintTimeout) hwTxId=0 docs ucid=3 BcmCm3dfDocsisMsgACT::HandleEvent() @time=194920 event_code=68 (kCmT4NoStationMaintOpFailMsg) 3 BcmCm3dfEventCensor::T4NoStationMaintOpFailTrans() with DOCSIS ucid = 3 BcmCm3dfEventCensor::T4NoStationMaintOpFailTrans() - state at exit: BcmCm3dfEventCensor: fTstmp3dfHoldoffStarted = 0 fLastHoldoffPeriodMillisec = 0 fNextHoldoffPeriodMillisec = 0 fOvrdNonChSpEvRptEnableSet = 0 fOvrdNonChSpEvRptEnableSetSpecified = 0 Assigned Non-Primary Downstream Active Channel Settings List: id freq, hz modulation/annex primary stat bmask --- --------- ------------------ ------- ---------- 1 378000000 kMod256Qam/kDsAnnexA y 0x36 2 386000000 kMod256Qam/kDsAnnexA y 0x36 4 402000000 kMod256Qam/kDsAnnexA y 0x36 5 410000000 kMod256Qam/kDsAnnexA y 0x36 6 418000000 kMod256Qam/kDsAnnexA y 0x36 7 426000000 kMod256Qam/kDsAnnexA y 0x36 8 434000000 kMod256Qam/kDsAnnexA y 0x36 Assigned Upstream Active Channel Settings List: id stat bmask --- ---------- 3 0 4 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 1 (kCmEvNonPriDsMddFail) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 4 (kCmEvNonPriDsMddRescue) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 2 (kCmEvDsPhyLockFail) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 5 (kCmEvDsPhyLockRescue) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 3 (kCmEvDsDataReseqFail) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 6 (kCmEvT4NoStationMaintOpTimeout) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 3 (kRptOffViaCmStatCtrlSets) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 fOnEventParamSet = [ 3 ] CM-STATUS 3df Msg Tx State Machine: fEventType = 7 (kCmEvMaxT3NoRngRspTimeouts) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 8 (kCmEvMaxT3NoRngRspRescue) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 9 (kCmEvAcPowerFail) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 10 (kCmEvAcPowerRescue) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 Logging event: Received Response to Broadcast Maintenance Request, But no Unicast Maintenance opportunities received - T4 time out;CM-MAC=00:21:63:62:6d:d8;CMTS-MAC=64:9e:f3:66:0d:b3;CM-QOS=1.1;CM-VER=3.0; CM> BcmCm3dfDocsisMsgACT::HandleEvent() @time=201590 event_code=69 (kCmT4NoStationMaintOpRescueMsg) 3 BcmCm3dfEventCensor::T4NoStationMaintOpRescueTrans() with DOCSIS ucid = 3 BcmCm3dfEventCensor::T4NoStationMaintOpRescueTrans() - state at exit: BcmCm3dfEventCensor: fTstmp3dfHoldoffStarted = 0 fLastHoldoffPeriodMillisec = 0 fNextHoldoffPeriodMillisec = 0 fOvrdNonChSpEvRptEnableSet = 0 fOvrdNonChSpEvRptEnableSetSpecified = 0 Assigned Non-Primary Downstream Active Channel Settings List: id freq, hz modulation/annex primary stat bmask --- --------- ------------------ ------- ---------- 1 378000000 kMod256Qam/kDsAnnexA y 0x36 2 386000000 kMod256Qam/kDsAnnexA y 0x36 4 402000000 kMod256Qam/kDsAnnexA y 0x36 5 410000000 kMod256Qam/kDsAnnexA y 0x36 6 418000000 kMod256Qam/kDsAnnexA y 0x36 7 426000000 kMod256Qam/kDsAnnexA y 0x36 8 434000000 kMod256Qam/kDsAnnexA y 0x36 Assigned Upstream Active Channel Settings List: id stat bmask --- ---------- 3 0 4 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 1 (kCmEvNonPriDsMddFail) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 4 (kCmEvNonPriDsMddRescue) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 2 (kCmEvDsPhyLockFail) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 5 (kCmEvDsPhyLockRescue) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 3 (kCmEvDsDataReseqFail) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 6 (kCmEvT4NoStationMaintOpTimeout) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 7 (kCmEvMaxT3NoRngRspTimeouts) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 8 (kCmEvMaxT3NoRngRspRescue) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 9 (kCmEvAcPowerFail) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 10 (kCmEvAcPowerRescue) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 BcmCmUsChanTimerMuxACT::HandleEvent() @time=214750 fTimerType=5 (kT4NoStationMaint) hwTxId=1 docs ucid=4 [19:05:31 08/14/2012] [CmDocsisCtlThread] BcmCmUsRangingState::T4NoStationMaintEvent: ERROR - no Station Maint map op error. hwTxId=1 docs ucid=4 [19:05:31 08/14/2012] [CmDocsisCtlThread] BcmCmUsRangingState::CommonRngErrorHandler: reason=9 (kT4NoStationMaintTimeout) hwTxId=1 docs ucid=4 BcmCm3dfDocsisMsgACT::HandleEvent() @time=214780 event_code=68 (kCmT4NoStationMaintOpFailMsg) 4 BcmCm3dfEventCensor::T4NoStationMaintOpFailTrans() with DOCSIS ucid = 4 BcmCm3dfEventCensor::T4NoStationMaintOpFailTrans() - state at exit: BcmCm3dfEventCensor: fTstmp3dfHoldoffStarted = 0 fLastHoldoffPeriodMillisec = 0 fNextHoldoffPeriodMillisec = 0 fOvrdNonChSpEvRptEnableSet = 0 fOvrdNonChSpEvRptEnableSetSpecified = 0 Assigned Non-Primary Downstream Active Channel Settings List: id freq, hz modulation/annex primary stat bmask --- --------- ------------------ ------- ---------- 1 378000000 kMod256Qam/kDsAnnexA y 0x36 2 386000000 kMod256Qam/kDsAnnexA y 0x36 4 402000000 kMod256Qam/kDsAnnexA y 0x36 5 410000000 kMod256Qam/kDsAnnexA y 0x36 6 418000000 kMod256Qam/kDsAnnexA y 0x36 7 426000000 kMod256Qam/kDsAnnexA y 0x36 8 434000000 kMod256Qam/kDsAnnexA y 0x36 Assigned Upstream Active Channel Settings List: id stat bmask --- ---------- 3 0 4 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 1 (kCmEvNonPriDsMddFail) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 4 (kCmEvNonPriDsMddRescue) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 2 (kCmEvDsPhyLockFail) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 5 (kCmEvDsPhyLockRescue) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 3 (kCmEvDsDataReseqFail) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 6 (kCmEvT4NoStationMaintOpTimeout) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 3 (kRptOffViaCmStatCtrlSets) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 fOnEventParamSet = [ 4 ] CM-STATUS 3df Msg Tx State Machine: fEventType = 7 (kCmEvMaxT3NoRngRspTimeouts) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 8 (kCmEvMaxT3NoRngRspRescue) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 9 (kCmEvAcPowerFail) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 10 (kCmEvAcPowerRescue) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 Logging event: Received Response to Broadcast Maintenance Request, But no Unicast Maintenance opportunities received - T4 time out;CM-MAC=00:21:63:62:6d:d8;CMTS-MAC=64:9e:f3:66:0d:b3;CM-QOS=1.1;CM-VER=3.0; CM> BcmCm3dfDocsisMsgACT::HandleEvent() @time=221460 event_code=69 (kCmT4NoStationMaintOpRescueMsg) 4 BcmCm3dfEventCensor::T4NoStationMaintOpRescueTrans() with DOCSIS ucid = 4 BcmCm3dfEventCensor::T4NoStationMaintOpRescueTrans() - state at exit: BcmCm3dfEventCensor: fTstmp3dfHoldoffStarted = 0 fLastHoldoffPeriodMillisec = 0 fNextHoldoffPeriodMillisec = 0 fOvrdNonChSpEvRptEnableSet = 0 fOvrdNonChSpEvRptEnableSetSpecified = 0 Assigned Non-Primary Downstream Active Channel Settings List: id freq, hz modulation/annex primary stat bmask --- --------- ------------------ ------- ---------- 1 378000000 kMod256Qam/kDsAnnexA y 0x36 2 386000000 kMod256Qam/kDsAnnexA y 0x36 4 402000000 kMod256Qam/kDsAnnexA y 0x36 5 410000000 kMod256Qam/kDsAnnexA y 0x36 6 418000000 kMod256Qam/kDsAnnexA y 0x36 7 426000000 kMod256Qam/kDsAnnexA y 0x36 8 434000000 kMod256Qam/kDsAnnexA y 0x36 Assigned Upstream Active Channel Settings List: id stat bmask --- ---------- 3 0 4 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 1 (kCmEvNonPriDsMddFail) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 4 (kCmEvNonPriDsMddRescue) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 2 (kCmEvDsPhyLockFail) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 5 (kCmEvDsPhyLockRescue) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 3 (kCmEvDsDataReseqFail) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 6 (kCmEvT4NoStationMaintOpTimeout) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 7 (kCmEvMaxT3NoRngRspTimeouts) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 8 (kCmEvMaxT3NoRngRspRescue) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 9 (kCmEvAcPowerFail) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0 CM-STATUS 3df Msg Tx State Machine: fEventType = 10 (kCmEvAcPowerRescue) fMsgTxState = 1 (k3dfIdle) fReasonLastTransToIdle = 1 (kAllEventsOff) fTransactionId = 0 fFirstReport = 1 fReportsLeft = 0 fMaxHoldoffPeriod20Millisec = 0 fMaxReportsPerTrans = 0 fLastHoldoffPeriodMillisec = 0 fWaitingSinceSysTimeTicks = 0