2018-05-29T17:06:32.320Z,1527613592.320 [Supervisor](DEBUG): Initializing supervisor.
2018-05-29T17:06:32.324Z,1527613592.324 [SyncHandler](DEBUG): Created PCaller Thread at 404514E0
2018-05-29T17:06:32.325Z,1527613592.325 [SyncHandler](INFO): Protected caller Thread ID is 800
2018-05-29T17:06:32.325Z,1527613592.325 [ComponentRegistry](DEBUG): Component "controlThread" handled in its own thread.
2018-05-29T17:06:32.326Z,1527613592.326 [controlThread ThreadHandler](DEBUG): Created PCaller Thread at 404814E0
2018-05-29T17:06:32.327Z,1527613592.327 [controlThread ThreadHandler](INFO): Protected caller Thread ID is 801
2018-05-29T17:06:32.330Z,1527613592.330 [ComponentRegistry](DEBUG): SyncComponent "CycleStarter" handled in the control thread.
2018-05-29T17:06:32.341Z,1527613592.341 [ComponentRegistry](DEBUG): Component "CommandLine" handled in its own thread.
2018-05-29T17:06:32.342Z,1527613592.342 [CommandLine ThreadHandler](DEBUG): Created PCaller Thread at 404B14E0
2018-05-29T17:06:32.342Z,1527613592.342 [CommandLine ThreadHandler](INFO): Protected caller Thread ID is 802
2018-05-29T17:06:32.343Z,1527613592.343 [ComponentRegistry](DEBUG): Component "logger" handled in its own thread.
2018-05-29T17:06:32.344Z,1527613592.344 [logger ThreadHandler](DEBUG): Created PCaller Thread at 404E14E0
2018-05-29T17:06:32.345Z,1527613592.345 [logger ThreadHandler](INFO): Protected caller Thread ID is 803
2018-05-29T17:06:32.347Z,1527613592.347 [ComponentRegistry](DEBUG): SyncComponent "LogSplitter" handled in the control thread.
2018-05-29T17:06:32.347Z,1527613592.347 [Supervisor](INFO): Looking for Config files in directory: Config/
2018-05-29T17:06:32.351Z,1527613592.351 [Supervisor](INFO): Opening Config file at: Config/Sample.cfg
2018-05-29T17:06:32.450Z,1527613592.450 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Sample
2018-05-29T17:06:32.452Z,1527613592.452 [Supervisor](INFO): Opening Config file at: Config/workSite.cfg
2018-05-29T17:06:32.555Z,1527613592.555 [ComponentRegistry](DEBUG): Loaded Config Component "Config/workSite
2018-05-29T17:06:32.556Z,1527613592.556 [Supervisor](INFO): Opening Config file at: Config/logger.cfg
2018-05-29T17:06:32.768Z,1527613592.768 [ComponentRegistry](DEBUG): Loaded Config Component "Config/logger
2018-05-29T17:06:32.770Z,1527613592.770 [Supervisor](INFO): Opening Config file at: Config/Science.cfg
2018-05-29T17:06:33.107Z,1527613593.107 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Science
2018-05-29T17:06:33.107Z,1527613593.107 [Supervisor](INFO): Opening Config file at: Config/Control.cfg
2018-05-29T17:06:33.467Z,1527613593.467 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Control
2018-05-29T17:06:33.468Z,1527613593.468 [Supervisor](INFO): Opening Config file at: Config/Simulator.cfg
2018-05-29T17:06:33.953Z,1527613593.953 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Simulator
2018-05-29T17:06:33.954Z,1527613593.954 [Supervisor](INFO): Opening Config file at: Config/Sensor.cfg
2018-05-29T17:06:34.365Z,1527613594.365 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Sensor
2018-05-29T17:06:34.367Z,1527613594.367 [Supervisor](INFO): Opening Config file at: Config/vehicle.cfg
2018-05-29T17:06:34.849Z,1527613594.849 [ComponentRegistry](DEBUG): Loaded Config Component "Config/vehicle
2018-05-29T17:06:34.850Z,1527613594.850 [Supervisor](INFO): Opening Config file at: Config/Guidance.cfg
2018-05-29T17:06:34.933Z,1527613594.933 [Supervisor](INFO): Opening Config file at: Config/Servo.cfg
2018-05-29T17:06:35.261Z,1527613595.261 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Servo
2018-05-29T17:06:35.263Z,1527613595.263 [Supervisor](INFO): Opening Config file at: Config/Derivation.cfg
2018-05-29T17:06:35.411Z,1527613595.411 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Derivation
2018-05-29T17:06:35.411Z,1527613595.411 [Supervisor](INFO): Opening Config file at: Config/Navigation.cfg
2018-05-29T17:06:35.626Z,1527613595.626 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Navigation
2018-05-29T17:06:35.628Z,1527613595.628 [Supervisor](INFO): Opening Config file at: Config/BIT.cfg
2018-05-29T17:06:35.894Z,1527613595.894 [ComponentRegistry](DEBUG): Loaded Config Component "Config/BIT
2018-05-29T17:06:35.895Z,1527613595.895 [Supervisor](INFO): Opening Config file at: Config/secure.cfg
2018-05-29T17:06:36.760Z,1527613596.760 [ComponentRegistry](DEBUG): Loaded Config Component "Config/secure
2018-05-29T17:06:36.762Z,1527613596.762 [Supervisor](INFO): Opening Config file at: Config/Estimation.cfg
2018-05-29T17:06:36.906Z,1527613596.906 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Estimation
2018-05-29T17:06:36.908Z,1527613596.908 [Supervisor](INFO): Looking for Config files in directory: Config/lrauv-makai/
2018-05-29T17:06:36.912Z,1527613596.912 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/Battery.cfg
2018-05-29T17:06:37.187Z,1527613597.187 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Battery
2018-05-29T17:06:37.188Z,1527613597.188 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/logger.cfg
2018-05-29T17:06:37.313Z,1527613597.313 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/Science.cfg
2018-05-29T17:06:37.463Z,1527613597.463 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/Control.cfg
2018-05-29T17:06:37.558Z,1527613597.558 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/Simulator.cfg
2018-05-29T17:06:37.645Z,1527613597.645 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/Sensor.cfg
2018-05-29T17:06:37.787Z,1527613597.787 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/vehicle.cfg
2018-05-29T17:06:37.962Z,1527613597.962 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/Servo.cfg
2018-05-29T17:06:38.062Z,1527613598.062 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/Navigation.cfg
2018-05-29T17:06:38.157Z,1527613598.157 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/BIT.cfg
2018-05-29T17:06:38.257Z,1527613598.257 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/secure.cfg
2018-05-29T17:06:38.341Z,1527613598.341 [Supervisor](FAULT): Ignoring configuration overrides from Data/persisted.cfg
2018-05-29T17:06:38.344Z,1527613598.344 [Module Loader](DEBUG): Loading Module at Modules/Simulator.so
2018-05-29T17:06:38.474Z,1527613598.474 [Module Loader](DEBUG): Loaded Module: Simulator (This is the module containing the Simulator)
2018-05-29T17:06:38.474Z,1527613598.474 [Module Loader](DEBUG): Loading Module at Modules/Sample.so
2018-05-29T17:06:38.498Z,1527613598.498 [Module Loader](DEBUG): Loaded Module: Sample (This is a Sample Module of Sample Components)
2018-05-29T17:06:38.499Z,1527613598.499 [Module Loader](DEBUG): Loading Module at Modules/Derivation.so
2018-05-29T17:06:38.554Z,1527613598.554 [DepthRateCalculator] Loaded
2018-05-29T17:06:38.555Z,1527613598.555 [ComponentRegistry](DEBUG): SyncComponent "DepthRateCalculator" handled in the control thread.
2018-05-29T17:06:38.561Z,1527613598.561 [PitchRateCalculator] Loaded
2018-05-29T17:06:38.561Z,1527613598.561 [ComponentRegistry](DEBUG): SyncComponent "PitchRateCalculator" handled in the control thread.
2018-05-29T17:06:38.577Z,1527613598.577 [SpeedCalculator] Loaded
2018-05-29T17:06:38.578Z,1527613598.578 [ComponentRegistry](DEBUG): SyncComponent "SpeedCalculator" handled in the control thread.
2018-05-29T17:06:38.599Z,1527613598.599 [TempGradientCalculator] Loaded
2018-05-29T17:06:38.599Z,1527613598.599 [ComponentRegistry](DEBUG): SyncComponent "TempGradientCalculator" handled in the control thread.
2018-05-29T17:06:38.615Z,1527613598.615 [VerticalTemperatureHomogeneityIndexCalculator] Loaded
2018-05-29T17:06:38.615Z,1527613598.615 [ComponentRegistry](DEBUG): SyncComponent "VerticalTemperatureHomogeneityIndexCalculator" handled in the control thread.
2018-05-29T17:06:38.621Z,1527613598.621 [YawRateCalculator] Loaded
2018-05-29T17:06:38.621Z,1527613598.621 [ComponentRegistry](DEBUG): SyncComponent "YawRateCalculator" handled in the control thread.
2018-05-29T17:06:38.661Z,1527613598.661 [ElevatorOffsetCalculator] Loaded
2018-05-29T17:06:38.662Z,1527613598.662 [ComponentRegistry](DEBUG): SyncComponent "ElevatorOffsetCalculator" handled in the control thread.
2018-05-29T17:06:38.662Z,1527613598.662 [Module Loader](DEBUG): Loaded Module: Derivation (Contains the base derivation components)
2018-05-29T17:06:38.663Z,1527613598.663 [Module Loader](DEBUG): Loading Module at Modules/Trigger.so
2018-05-29T17:06:38.700Z,1527613598.700 [Module Loader](DEBUG): Loaded Module: Trigger (Contains triggers for use in missions)
2018-05-29T17:06:38.700Z,1527613598.700 [Module Loader](DEBUG): Loading Module at Modules/Sensor.so
2018-05-29T17:06:39.184Z,1527613599.184 [AcousticModem_Benthos_ATM900] Loaded
2018-05-29T17:06:39.184Z,1527613599.184 [ComponentRegistry](DEBUG): SyncComponent "AcousticModem_Benthos_ATM900" handled in the control thread.
2018-05-29T17:06:39.320Z,1527613599.320 [DataOverHttps] Loaded
2018-05-29T17:06:39.320Z,1527613599.320 [ComponentRegistry](DEBUG): SyncComponent "DataOverHttps" handled in the control thread.
2018-05-29T17:06:39.334Z,1527613599.334 [Depth_Keller] Loaded
2018-05-29T17:06:39.335Z,1527613599.335 [ComponentRegistry](DEBUG): SyncComponent "Depth_Keller" handled in the control thread.
2018-05-29T17:06:39.339Z,1527613599.339 [DropWeight] Loaded
2018-05-29T17:06:39.340Z,1527613599.340 [ComponentRegistry](DEBUG): SyncComponent "DropWeight" handled in the control thread.
2018-05-29T17:06:39.438Z,1527613599.438 [NAL9602] Loaded
2018-05-29T17:06:39.439Z,1527613599.439 [ComponentRegistry](DEBUG): SyncComponent "NAL9602" handled in the control thread.
2018-05-29T17:06:39.454Z,1527613599.454 [Onboard] Loaded
2018-05-29T17:06:39.455Z,1527613599.455 [ComponentRegistry](DEBUG): SyncComponent "Onboard" handled in the control thread.
2018-05-29T17:06:39.465Z,1527613599.465 [Radio_Surface] Loaded
2018-05-29T17:06:39.466Z,1527613599.466 [ComponentRegistry](DEBUG): Component "Radio_Surface" handled in its own thread.
2018-05-29T17:06:39.467Z,1527613599.467 [Radio_Surface ThreadHandler](DEBUG): Created PCaller Thread at 407B74E0
2018-05-29T17:06:39.467Z,1527613599.467 [Radio_Surface ThreadHandler](INFO): Protected caller Thread ID is 883
2018-05-29T17:06:39.621Z,1527613599.621 [PNI_TCM] Loaded
2018-05-29T17:06:39.621Z,1527613599.621 [ComponentRegistry](DEBUG): SyncComponent "PNI_TCM" handled in the control thread.
2018-05-29T17:06:39.683Z,1527613599.683 [Rowe_600LCM] Loaded
2018-05-29T17:06:39.683Z,1527613599.683 [ComponentRegistry](DEBUG): Component "Rowe_600LCM" handled in its own thread.
2018-05-29T17:06:39.684Z,1527613599.684 [Rowe_600LCM ThreadHandler](DEBUG): Created PCaller Thread at 407E74E0
2018-05-29T17:06:39.684Z,1527613599.684 [Rowe_600LCM ThreadHandler](INFO): Protected caller Thread ID is 884
2018-05-29T17:06:41.778Z,1527613601.778 [BPC1] Loaded
2018-05-29T17:06:41.779Z,1527613601.779 [ComponentRegistry](DEBUG): SyncComponent "BPC1" handled in the control thread.
2018-05-29T17:06:41.779Z,1527613601.779 [Module Loader](DEBUG): Loaded Module: Sensor (Contains the sensor components)
2018-05-29T17:06:41.780Z,1527613601.780 [Module Loader](DEBUG): Loading Module at Modules/BIT.so
2018-05-29T17:06:41.933Z,1527613601.933 [SBIT](DEBUG): Construct Startup Built In Test.
2018-05-29T17:06:41.957Z,1527613601.957 [SBIT] Loaded
2018-05-29T17:06:41.957Z,1527613601.957 [ComponentRegistry](DEBUG): SyncComponent "SBIT" handled in the control thread.
2018-05-29T17:06:41.958Z,1527613601.958 [IBIT](DEBUG): Construct Initiated Built In Test.
2018-05-29T17:06:41.970Z,1527613601.970 [IBIT] Loaded
2018-05-29T17:06:41.970Z,1527613601.970 [ComponentRegistry](DEBUG): SyncComponent "IBIT" handled in the control thread.
2018-05-29T17:06:41.973Z,1527613601.973 [CBIT](DEBUG): Construct Continuous Built In Test.
2018-05-29T17:06:42.125Z,1527613602.125 [CBIT] Loaded
2018-05-29T17:06:42.125Z,1527613602.125 [ComponentRegistry](DEBUG): SyncComponent "CBIT" handled in the control thread.
2018-05-29T17:06:42.125Z,1527613602.125 [Module Loader](DEBUG): Loaded Module: BIT (Contains the BuiltInTest components, such as C Built In Test)
2018-05-29T17:06:42.126Z,1527613602.126 [Module Loader](DEBUG): Loading Module at Modules/Science.so
2018-05-29T17:06:42.310Z,1527613602.310 [Aanderaa_O2] Loaded
2018-05-29T17:06:42.311Z,1527613602.311 [ComponentRegistry](DEBUG): SyncComponent "Aanderaa_O2" handled in the control thread.
2018-05-29T17:06:42.359Z,1527613602.359 [CTD_Seabird] Loaded
2018-05-29T17:06:42.359Z,1527613602.359 [ComponentRegistry](DEBUG): Component "CTD_Seabird" handled in its own thread.
2018-05-29T17:06:42.360Z,1527613602.360 [CTD_Seabird ThreadHandler](DEBUG): Created PCaller Thread at 408A74E0
2018-05-29T17:06:42.361Z,1527613602.361 [CTD_Seabird ThreadHandler](INFO): Protected caller Thread ID is 885
2018-05-29T17:06:42.378Z,1527613602.378 [ESPComponent] Loaded
2018-05-29T17:06:42.378Z,1527613602.378 [ComponentRegistry](DEBUG): SyncComponent "ESPComponent" handled in the control thread.
2018-05-29T17:06:42.393Z,1527613602.393 [PAR_Licor] Loaded
2018-05-29T17:06:42.393Z,1527613602.393 [ComponentRegistry](DEBUG): SyncComponent "PAR_Licor" handled in the control thread.
2018-05-29T17:06:42.443Z,1527613602.443 [WetLabsBB2FL] Loaded
2018-05-29T17:06:42.443Z,1527613602.443 [ComponentRegistry](DEBUG): Component "WetLabsBB2FL" handled in its own thread.
2018-05-29T17:06:42.444Z,1527613602.444 [WetLabsBB2FL ThreadHandler](DEBUG): Created PCaller Thread at 408D74E0
2018-05-29T17:06:42.445Z,1527613602.445 [WetLabsBB2FL ThreadHandler](INFO): Protected caller Thread ID is 886
2018-05-29T17:06:42.445Z,1527613602.445 [Module Loader](DEBUG): Loaded Module: Science (Contains the science components)
2018-05-29T17:06:42.446Z,1527613602.446 [Module Loader](DEBUG): Loading Module at Modules/Guidance.so
2018-05-29T17:06:42.723Z,1527613602.723 [Module Loader](DEBUG): Loaded Module: Guidance (Contains behaviors and commands)
2018-05-29T17:06:42.724Z,1527613602.724 [Module Loader](DEBUG): Loading Module at Modules/Control.so
2018-05-29T17:06:42.811Z,1527613602.811 [VerticalControl](DEBUG): Construct VerticalControl.
2018-05-29T17:06:42.907Z,1527613602.907 [VerticalControl] Loaded
2018-05-29T17:06:42.908Z,1527613602.908 [ComponentRegistry](DEBUG): SyncComponent "VerticalControl" handled in the control thread.
2018-05-29T17:06:42.908Z,1527613602.908 [HorizontalControl](DEBUG): Construct HorizontalControl.
2018-05-29T17:06:42.971Z,1527613602.971 [HorizontalControl] Loaded
2018-05-29T17:06:42.971Z,1527613602.971 [ComponentRegistry](DEBUG): SyncComponent "HorizontalControl" handled in the control thread.
2018-05-29T17:06:42.972Z,1527613602.972 [SpeedControl](DEBUG): Construct SpeedControl.
2018-05-29T17:06:42.977Z,1527613602.977 [SpeedControl] Loaded
2018-05-29T17:06:42.977Z,1527613602.977 [ComponentRegistry](DEBUG): SyncComponent "SpeedControl" handled in the control thread.
2018-05-29T17:06:42.978Z,1527613602.978 [LoopControl](DEBUG): Construct LoopControl.
2018-05-29T17:06:42.978Z,1527613602.978 [LoopControl] Loaded
2018-05-29T17:06:42.979Z,1527613602.979 [ComponentRegistry](DEBUG): SyncComponent "LoopControl" handled in the control thread.
2018-05-29T17:06:42.979Z,1527613602.979 [Module Loader](DEBUG): Loaded Module: Control (Contains the Control components, such as Depth, Heading, and Speed Control)
2018-05-29T17:06:42.980Z,1527613602.980 [Module Loader](DEBUG): Loading Module at Modules/Estimation.so
2018-05-29T17:06:43.101Z,1527613603.101 [StratificationFrontDetector](INFO): threshold set to: 0.399988 degC
2018-05-29T17:06:43.101Z,1527613603.101 [StratificationFrontDetector](DEBUG): (re)initializing
2018-05-29T17:06:43.101Z,1527613603.101 [StratificationFrontDetector] Loaded
2018-05-29T17:06:43.102Z,1527613603.102 [ComponentRegistry](DEBUG): SyncComponent "StratificationFrontDetector" handled in the control thread.
2018-05-29T17:06:43.102Z,1527613603.102 [Module Loader](DEBUG): Loaded Module: Estimation (Contains the base estimation components)
2018-05-29T17:06:43.103Z,1527613603.103 [Module Loader](DEBUG): Loading Module at Modules/Servo.so
2018-05-29T17:06:43.222Z,1527613603.222 [BuoyancyServo] Loaded
2018-05-29T17:06:43.222Z,1527613603.222 [ComponentRegistry](DEBUG): SyncComponent "BuoyancyServo" handled in the control thread.
2018-05-29T17:06:43.234Z,1527613603.234 [ElevatorServo] Loaded
2018-05-29T17:06:43.234Z,1527613603.234 [ComponentRegistry](DEBUG): SyncComponent "ElevatorServo" handled in the control thread.
2018-05-29T17:06:43.246Z,1527613603.246 [MassServo] Loaded
2018-05-29T17:06:43.246Z,1527613603.246 [ComponentRegistry](DEBUG): SyncComponent "MassServo" handled in the control thread.
2018-05-29T17:06:43.257Z,1527613603.257 [RudderServo] Loaded
2018-05-29T17:06:43.258Z,1527613603.258 [ComponentRegistry](DEBUG): SyncComponent "RudderServo" handled in the control thread.
2018-05-29T17:06:43.268Z,1527613603.268 [ThrusterServo] Loaded
2018-05-29T17:06:43.269Z,1527613603.269 [ComponentRegistry](DEBUG): SyncComponent "ThrusterServo" handled in the control thread.
2018-05-29T17:06:43.269Z,1527613603.269 [Module Loader](DEBUG): Loaded Module: Servo (This is the module containing motor controllers)
2018-05-29T17:06:43.271Z,1527613603.271 [Module Loader](DEBUG): Loading Module at Modules/Navigation.so
2018-05-29T17:06:43.385Z,1527613603.385 [DeadReckonUsingMultipleVelocitySources] Loaded
2018-05-29T17:06:43.385Z,1527613603.385 [ComponentRegistry](DEBUG): SyncComponent "DeadReckonUsingMultipleVelocitySources" handled in the control thread.
2018-05-29T17:06:43.441Z,1527613603.441 [DeadReckonUsingSpeedCalculator] Loaded
2018-05-29T17:06:43.441Z,1527613603.441 [ComponentRegistry](DEBUG): SyncComponent "DeadReckonUsingSpeedCalculator" handled in the control thread.
2018-05-29T17:06:43.458Z,1527613603.458 [NavChart] Loaded
2018-05-29T17:06:43.458Z,1527613603.458 [ComponentRegistry](DEBUG): SyncComponent "NavChart" handled in the control thread.
2018-05-29T17:06:43.463Z,1527613603.463 [UniversalFixResidualReporter] Loaded
2018-05-29T17:06:43.463Z,1527613603.463 [ComponentRegistry](DEBUG): SyncComponent "UniversalFixResidualReporter" handled in the control thread.
2018-05-29T17:06:43.463Z,1527613603.463 [Module Loader](DEBUG): Loaded Module: Navigation (Contains the base navigation components)
2018-05-29T17:06:43.467Z,1527613603.467 [ComponentRegistry](DEBUG): SyncComponent "MissionManager" handled in the control thread.
2018-05-29T17:06:43.468Z,1527613603.468 [ComponentRegistry](DEBUG): SyncComponent "Reporter" handled in the control thread.
2018-05-29T17:06:43.475Z,1527613603.475 [ComponentRegistry](DEBUG): Component "NavChartDb" handled in its own thread.
2018-05-29T17:06:43.476Z,1527613603.476 [NavChartDb ThreadHandler](DEBUG): Created PCaller Thread at 40A304E0
2018-05-29T17:06:43.476Z,1527613603.476 [NavChartDb ThreadHandler](INFO): Protected caller Thread ID is 887
2018-05-29T17:06:43.481Z,1527613603.481 [Supervisor](INFO): Main Thread ID is 796
2018-05-29T17:06:43.481Z,1527613603.481 [Supervisor](DEBUG): Running supervisor.
2018-05-29T17:06:43.482Z,1527613603.482 [CommandLine ThreadHandler](INFO): Handler Thread ID is 888
2018-05-29T17:06:43.484Z,1527613603.484 [controlThread ThreadHandler](INFO): Handler Thread ID is 889
2018-05-29T17:06:43.484Z,1527613603.484 [controlThread](DEBUG): Initializing ControlThread
2018-05-29T17:06:43.485Z,1527613603.485 [DepthRateCalculator](DEBUG): Initializing DepthRateCalculator.
2018-05-29T17:06:43.486Z,1527613603.486 [PitchRateCalculator](DEBUG): Initializing PitchRateCalculator.
2018-05-29T17:06:43.486Z,1527613603.486 [SpeedCalculator](DEBUG): Initializing SpeedCalculator.
2018-05-29T17:06:43.486Z,1527613603.486 [TempGradientCalculator](DEBUG): Initializing TempGradientCalculator.
2018-05-29T17:06:43.487Z,1527613603.487 [VerticalTemperatureHomogeneityIndexCalculator](DEBUG): (re)initializing
2018-05-29T17:06:43.488Z,1527613603.488 [YawRateCalculator](DEBUG): Initializing YawRateCalculator.
2018-05-29T17:06:43.488Z,1527613603.488 [ElevatorOffsetCalculator](DEBUG): Initializing ElevatorOffsetCalculator.
2018-05-29T17:06:43.495Z,1527613603.495 [SBIT](INFO): Initialize SBIT Component.
2018-05-29T17:06:43.496Z,1527613603.496 [SBIT](IMPORTANT): git: 2018-05-22-7-gb0071a0
2018-05-29T17:06:43.496Z,1527613603.496 [SBIT](INFO): git hash: b0071a06ae6f4745c5194a3e349d38d425fd7397
2018-05-29T17:06:43.496Z,1527613603.496 [SBIT](IMPORTANT): Kernel Release: 2.6.27.8
2018-05-29T17:06:43.498Z,1527613603.498 [SBIT](INFO): Kernel Reporting Different Version From Configuration.
Kernel Expected: #639 PREEMPT Wed Mar 12 12:53:33 PDT 2014
Kernel Reported: #2 PREEMPT Thu Jan 11 20:13:48 PST 2018
2018-05-29T17:06:43.499Z,1527613603.499 [SBIT](INFO): Beginning SBIT in 63.000000 seconds.
2018-05-29T17:06:43.499Z,1527613603.499 [IBIT](INFO): Initialize IBIT Component.
2018-05-29T17:06:43.500Z,1527613603.500 [CBIT](DEBUG): Initialize CBIT Component.
2018-05-29T17:06:43.500Z,1527613603.500 [CBIT](FAULT): LAST RESTART WAS UNINTENTIONAL.
2018-05-29T17:06:43.501Z,1527613603.501 [CBIT](CRITICAL): LAST REBOOT DUE TO WATCHDOG TIMER RESET.
2018-05-29T17:06:43.502Z,1527613603.502 [logger ThreadHandler](INFO): Handler Thread ID is 890
2018-05-29T17:06:43.521Z,1527613603.521 [Radio_Surface ThreadHandler](INFO): Handler Thread ID is 891
2018-05-29T17:06:43.527Z,1527613603.527 [Radio_Surface](INFO): Powering up
2018-05-29T17:06:43.533Z,1527613603.533 [Rowe_600LCM ThreadHandler](INFO): Handler Thread ID is 892
2018-05-29T17:06:43.534Z,1527613603.534 [Rowe_600LCM](INFO): Initializing
2018-05-29T17:06:43.534Z,1527613603.534 [Rowe_600LCM](INFO): Checking LCM
2018-05-29T17:06:43.625Z,1527613603.625 [CTD_Seabird ThreadHandler](INFO): Handler Thread ID is 893
2018-05-29T17:06:43.629Z,1527613603.629 [CTD_Seabird](INFO): Initializing
2018-05-29T17:06:43.630Z,1527613603.630 [CTD_Seabird](INFO): Checking LCM
2018-05-29T17:06:43.630Z,1527613603.630 [WetLabsBB2FL ThreadHandler](INFO): Handler Thread ID is 894
2018-05-29T17:06:43.632Z,1527613603.632 [WetLabsBB2FL](INFO): Powering down
2018-05-29T17:06:43.645Z,1527613603.645 [VerticalControl](DEBUG): Initialize VerticalControlComponent.
2018-05-29T17:06:43.647Z,1527613603.647 [HorizontalControl](DEBUG): Initialize HorizontalControlComponent.
2018-05-29T17:06:43.648Z,1527613603.648 [SpeedControl](DEBUG): Initialize SpeedControlComponent.
2018-05-29T17:06:43.648Z,1527613603.648 [LoopControl](DEBUG): Initialize LoopControlComponent.
2018-05-29T17:06:43.650Z,1527613603.650 [DeadReckonUsingMultipleVelocitySources](DEBUG): Initializing DeadReckonUsingMultipleVelocitySources component.
2018-05-29T17:06:43.651Z,1527613603.651 [DeadReckonUsingMultipleVelocitySources](INFO): Will consider orientation measurement stale after 120s.
2018-05-29T17:06:43.651Z,1527613603.651 [DeadReckonUsingMultipleVelocitySources](INFO): Will consider velocity measurement stale after 20s.
2018-05-29T17:06:43.651Z,1527613603.651 [DeadReckonUsingSpeedCalculator](DEBUG): Initializing DeadReckonUsingSpeedCalculator component.
2018-05-29T17:06:43.652Z,1527613603.652 [DeadReckonUsingSpeedCalculator](INFO): Will consider orientation measurement stale after 120s.
2018-05-29T17:06:43.652Z,1527613603.652 [DeadReckonUsingSpeedCalculator](INFO): Will consider velocity measurement stale after 20s.
2018-05-29T17:06:43.659Z,1527613603.659 [NavChart](DEBUG): Initialize NavChart Navigation.
2018-05-29T17:06:43.661Z,1527613603.661 [UniversalFixResidualReporter](DEBUG): Initializing UniversalFixResidualReporter component.
2018-05-29T17:06:43.662Z,1527613603.662 [MissionManager](INFO): Loading Mission: Missions/Startup.xml
2018-05-29T17:06:43.759Z,1527613603.759 [NavChartDb ThreadHandler](INFO): Handler Thread ID is 895
2018-05-29T17:06:43.823Z,1527613603.823 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US1WC07M.000
2018-05-29T17:06:43.823Z,1527613603.823 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US1WC07M.000
2018-05-29T17:06:43.824Z,1527613603.824 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US2WC11M.000
2018-05-29T17:06:43.824Z,1527613603.824 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US2WC11M.000
2018-05-29T17:06:43.824Z,1527613603.824 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US3CA52M.000
2018-05-29T17:06:43.824Z,1527613603.824 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US3CA52M.000
2018-05-29T17:06:43.824Z,1527613603.824 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US4CA60M.000
2018-05-29T17:06:43.825Z,1527613603.825 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US4CA60M.000
2018-05-29T17:06:43.825Z,1527613603.825 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US5CA50M.000
2018-05-29T17:06:43.825Z,1527613603.825 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US5CA50M.000
2018-05-29T17:06:43.825Z,1527613603.825 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US5CA61M.000
2018-05-29T17:06:43.826Z,1527613603.826 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US5CA61M.000
2018-05-29T17:06:43.826Z,1527613603.826 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US5CA62M.000
2018-05-29T17:06:43.826Z,1527613603.826 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US5CA62M.000
2018-05-29T17:06:43.826Z,1527613603.826 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US5CA83M.000
2018-05-29T17:06:43.826Z,1527613603.826 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US5CA83M.000
2018-05-29T17:06:43.896Z,1527613603.896 [Startup:A.GoToSurface](DEBUG): Construct GoToSurface.
2018-05-29T17:06:43.909Z,1527613603.909 [CTD_Seabird](INFO): LCM OK
2018-05-29T17:06:43.909Z,1527613603.909 [CTD_Seabird](INFO): Powering up
2018-05-29T17:06:43.909Z,1527613603.909 [Rowe_600LCM](INFO): LCM OK
2018-05-29T17:06:43.909Z,1527613603.909 [Rowe_600LCM](INFO): Powering up
2018-05-29T17:06:43.945Z,1527613603.945 [MissionManager](DEBUG): 
<?xml version="1.0" encoding="UTF-8"?>
<Mission xmlns="Tethys"
       xmlns:Control="Tethys/Control"
       xmlns:Guidance="Tethys/Guidance" 
       xmlns:Units="Tethys/Units"
       xmlns:Universal="Tethys/Universal"
       xmlns:xsi="http://www.w3.org/2001/XMLSchema-instance"
       xsi:schemaLocation="Tethys http://okeanids.mbari.org/tethys/Xml/Tethys.xsd
                           Tethys/Control http://okeanids.mbari.org/tethys/Xml/Control.xsd
                           Tethys/Guidance http://okeanids.mbari.org/tethys/Xml/Guidance.xsd
                           Tethys/Units http://okeanids.mbari.org/tethys/Xml/Units.xsd
                           Tethys/Universal http://okeanids.mbari.org/tethys/Xml/Universal.xsd"
       Id="Startup">

    <Guidance:GoToSurface>
        <Progression/>
    </Guidance:GoToSurface>

    <Aggregate Id="StartupSatComms">

        <Sequence/>

        <ReadDatum>
            <Timeout Duration="P1M" />
            <Universal:latitude_fix/>
        </ReadDatum>

        <ReadDatum>
            <Timeout Duration="P1M" />
            <Universal:platform_communications/>
        </ReadDatum>

    </Aggregate>

</Mission>


2018-05-29T17:06:43.946Z,1527613603.946 [MissionManager](INFO): Loading Mission: Missions/Default.xml
2018-05-29T17:06:44.031Z,1527613604.031 [MissionManager](INFO): DefineArg Default.ElapsedSinceDefaultStarted = 0.000000 min
2018-05-29T17:06:44.032Z,1527613604.032 [Default:A.Wait](DEBUG): Construct Wait.
2018-05-29T17:06:44.058Z,1527613604.058 [Default:B.GoToSurface](DEBUG): Construct GoToSurface.
2018-05-29T17:06:44.083Z,1527613604.083 [Default:CheckIn:Read_Iridium:A_Timeout:A.Execute](DEBUG): Construct Execute.
2018-05-29T17:06:44.086Z,1527613604.086 [Default:CheckIn:C.Wait](DEBUG): Construct Wait.
2018-05-29T17:06:44.112Z,1527613604.112 [Default:E.Execute](DEBUG): Construct Execute.
2018-05-29T17:06:44.115Z,1527613604.115 [MissionManager](DEBUG): 
<?xml version="1.0" encoding="UTF-8"?>
<Mission xmlns:xsi="http://www.w3.org/2001/XMLSchema-instance"
         xmlns="Tethys"
         xmlns:Units="Tethys/Units"
         xmlns:Guidance="Tethys/Guidance"
         xmlns:Universal="Tethys/Universal"
         xsi:schemaLocation="Tethys http://okeanids.mbari.org/tethys/Xml/Tethys.xsd
                             Tethys/Units http://okeanids.mbari.org/tethys/Xml/Units.xsd
                             Tethys/Guidance http://okeanids.mbari.org/tethys/Xml/Guidance.xsd
                             Tethys/Universal http://okeanids.mbari.org/tethys/Xml/Universal.xsd"
         Id="Default">

    <DefineArg Name="ElapsedSinceDefaultStarted"><Units:minute/><Value>0</Value></DefineArg>

    <Guidance:Wait>
        <Description>
            Wait a moment to see if the scheduler starts a new mission before
            starting to actually run Default.
        </Description>
        <Sequence/>
        <Setting><Guidance:Wait.duration/><Units:second/><Value>13</Value></Setting>
    </Guidance:Wait>

    <Guidance:GoToSurface>
        <Progression/>
    </Guidance:GoToSurface>

    <Aggregate Id="CheckIn">

        <Sequence Repeat="288"/>

        <ReadDatum Id="Read_GPS">
            <Timeout Duration="P5M"/>
            <Universal:time_fix/>
        </ReadDatum>

        <ReadDatum Id="Read_Iridium">
            <Timeout Duration="P2H">
                <Guidance:Execute>
                    <Sequence/>
                    <Setting><Guidance:Execute.command/><String>Burn 300</String></Setting>
                </Guidance:Execute>
                <Syslog Severity="Critical">Dropped weight due to communications timeout.</Syslog>
            </Timeout>
            <Universal:platform_communications/>
        </ReadDatum>

        <Guidance:Wait>
            <Sequence/>
            <Setting><Guidance:Wait.duration/><Units:minute/><Value>5</Value></Setting>
        </Guidance:Wait>

        <Assign><Sequence/><Arg Name="ElapsedSinceDefaultStarted"/><Elapsed><Universal:mission_started/></Elapsed></Assign>

        <Syslog Severity="Important">Default mission has been running for <Arg Name="ElapsedSinceDefaultStarted"/><Units:minute/></Syslog>

    </Aggregate>

    <Syslog Severity="Important">Restarting logs and Default mission.</Syslog>

    <Guidance:Execute>
        <Sequence/>
        <Setting><Guidance:Execute.command/><String>restart logs</String></Setting>
    </Guidance:Execute>

</Mission>


2018-05-29T17:06:44.130Z,1527613604.130 [controlThread](DEBUG): Component order: CycleStarter,AcousticModem_Benthos_ATM900,DataOverHttps,Depth_Keller,DropWeight,NAL9602,Onboard,PNI_TCM,BPC1,Aanderaa_O2,ESPComponent,PAR_Licor,Depth_Keller,PAR_Licor,DepthRateCalculator,PitchRateCalculator,SpeedCalculator,TempGradientCalculator,VerticalTemperatureHomogeneityIndexCalculator,YawRateCalculator,ElevatorOffsetCalculator,StratificationFrontDetector,DeadReckonUsingMultipleVelocitySources,DeadReckonUsingSpeedCalculator,NavChart,UniversalFixResidualReporter,MissionManager,VerticalControl,HorizontalControl,SpeedControl,LoopControl,BuoyancyServo,ElevatorServo,MassServo,RudderServo,ThrusterServo,SBIT,IBIT,CBIT,Reporter,LogSplitter,
2018-05-29T17:06:44.163Z,1527613604.163 [AcousticModem_Benthos_ATM900](INFO): Powering up
2018-05-29T17:06:44.163Z,1527613604.163 [AcousticModem_Benthos_ATM900](DEBUG): Initializing AcousticModem_Benthos_ATM900.
2018-05-29T17:06:44.188Z,1527613604.188 [DataOverHttps](DEBUG): dashIP=134.89.2.23 starts with a digit so assuming it is a numeric IP
2018-05-29T17:06:44.608Z,1527613604.608 [ESPComponent](INFO): powering down ESP
2018-05-29T17:06:45.153Z,1527613605.153 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:45.239Z,1527613605.239 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:45.361Z,1527613605.361 [BuoyancyServo](DEBUG): Initializing EZServoServo.
2018-05-29T17:06:45.369Z,1527613605.369 [BuoyancyServo](DEBUG): Initializing BuoyancyServo.
2018-05-29T17:06:45.384Z,1527613605.384 [ElevatorServo](DEBUG): Initializing EZServoServo.
2018-05-29T17:06:45.389Z,1527613605.389 [ElevatorServo](DEBUG): Initializing ElevatorServo.
2018-05-29T17:06:45.411Z,1527613605.411 [MassServo](DEBUG): Initializing EZServoServo.
2018-05-29T17:06:45.417Z,1527613605.417 [MassServo](DEBUG): Initializing MassServo.
2018-05-29T17:06:45.431Z,1527613605.431 [RudderServo](DEBUG): Initializing EZServoServo.
2018-05-29T17:06:45.438Z,1527613605.438 [RudderServo](DEBUG): Initializing RudderServo.
2018-05-29T17:06:45.452Z,1527613605.452 [ThrusterServo](DEBUG): Initializing EZServoServo.
2018-05-29T17:06:45.461Z,1527613605.461 [ThrusterServo](DEBUG): Initializing ThrusterServo.
2018-05-29T17:06:45.514Z,1527613605.514 [CommandLine](FAULT): Scheduling is paused
2018-05-29T17:06:45.514Z,1527613605.514 [CBIT](INFO): Critical error at 20180529T170643
2018-05-29T17:06:45.515Z,1527613605.515 [Supervisor](INFO): Stop Mission called by CBIT::checkCriticals
2018-05-29T17:06:45.654Z,1527613605.654 [DropWeight](CRITICAL): DROP WEIGHT MISSING.

2018-05-29T17:06:45.654Z,1527613605.654 [DropWeight] Hardware Fault, FailCount= 1
2018-05-29T17:06:45.654Z,1527613605.654 [DropWeight](ERROR): Hardware Fault
2018-05-29T17:06:45.741Z,1527613605.741 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:45.742Z,1527613605.742 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:45.766Z,1527613605.766 [CBIT](INFO): Critical error at 20180529T170645
2018-05-29T17:06:45.769Z,1527613605.769 [CBIT](ERROR): Hardware Fault in component: DropWeight
2018-05-29T17:06:45.769Z,1527613605.769 [CBIT](CRITICAL): Hardware Fault in component: DropWeight
2018-05-29T17:06:46.045Z,1527613606.045 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:46.046Z,1527613606.046 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:46.389Z,1527613606.389 [BuoyancyServo](ERROR): Buoyancy initialization uart error serial timeout
2018-05-29T17:06:46.389Z,1527613606.389 [BuoyancyServo](FAULT): Buoyancy failed to initialize
2018-05-29T17:06:46.389Z,1527613606.389 [BuoyancyServo] Communications Fault, FailCount= 1
2018-05-29T17:06:46.389Z,1527613606.389 [BuoyancyServo](ERROR): Communications Fault
2018-05-29T17:06:46.599Z,1527613606.599 [CBIT](INFO): Critical error at 20180529T170645
2018-05-29T17:06:46.601Z,1527613606.601 [CBIT](ERROR): Communications Fault in component: BuoyancyServo
2018-05-29T17:06:46.666Z,1527613606.666 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:46.668Z,1527613606.668 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:46.682Z,1527613606.682 [BuoyancyServo](DEBUG): Uninitialize Buoyancy Servo.
2018-05-29T17:06:46.683Z,1527613606.683 [BuoyancyServo](INFO): Powering down
2018-05-29T17:06:47.073Z,1527613607.073 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:47.075Z,1527613607.075 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:47.477Z,1527613607.477 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:47.478Z,1527613607.478 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:47.762Z,1527613607.762 [Rowe_600LCM](INFO): Stopping potential previous instance(s) of Rowe LCM interface
2018-05-29T17:06:47.860Z,1527613607.860 [Aanderaa_O2](INFO): Powering down
2018-05-29T17:06:47.904Z,1527613607.904 [Rowe_600LCM](INFO): Started Rowe LCM interface with command:nohup ./lrauv-framework/onboard/bin/roweadcp -ldir /mnt/mmc/LRAUV/Logs/latest/ -dev /dev/ttyB4 -b 38400 >& /dev/null &
2018-05-29T17:06:48.016Z,1527613608.016 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:48.034Z,1527613608.034 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:48.046Z,1527613608.046 [Rowe_600LCM](INFO): LCM subscribed to channel:Rowe_600LCM.adcp_dvl.bottom_track
2018-05-29T17:06:48.047Z,1527613608.047 [Rowe_600LCM](INFO): LCM subscribed to channel:Rowe_600LCM.adcp_dvl.vehicle_water_velocity
2018-05-29T17:06:48.048Z,1527613608.048 [Rowe_600LCM](INFO): LCM subscribed to channel:rowe_dvl.rowe
2018-05-29T17:06:48.267Z,1527613608.267 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:48.268Z,1527613608.268 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:48.681Z,1527613608.681 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:48.682Z,1527613608.682 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:48.820Z,1527613608.820 [CBIT](INFO): Clearing failed state for component BuoyancyServo
2018-05-29T17:06:48.821Z,1527613608.821 [BuoyancyServo] No Fault, FailCount= 1
2018-05-29T17:06:49.065Z,1527613609.065 [CTD_Seabird](INFO): Stopping potential previous instance(s) of CTD_Seabird LCM interface
2018-05-29T17:06:49.104Z,1527613609.104 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:49.106Z,1527613609.106 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:49.142Z,1527613609.142 [BuoyancyServo](DEBUG): Initializing EZServoServo.
2018-05-29T17:06:49.142Z,1527613609.142 [BuoyancyServo](DEBUG): Initializing BuoyancyServo.
2018-05-29T17:06:49.276Z,1527613609.276 [CTD_Seabird](INFO): Started Seabird LCM interface with command:nohup ./lrauv-framework/onboard/bin/gpctd -ldir /mnt/mmc/LRAUV/Logs/latest/ -dev /dev/ttyC6 -b 9600 >& /dev/null &
2018-05-29T17:06:49.278Z,1527613609.278 [CTD_Seabird](INFO): LCM subscribed to channel:ctd_t.seabird-gpctd
2018-05-29T17:06:49.471Z,1527613609.471 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:49.474Z,1527613609.474 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:49.631Z,1527613609.631 [CTD_Seabird](INFO): Stopping potential previous instance(s) of CTD_Seabird LCM interface
2018-05-29T17:06:49.631Z,1527613609.631 [CTD_Seabird](INFO): Powering down
2018-05-29T17:06:49.843Z,1527613609.843 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:49.844Z,1527613609.844 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:50.282Z,1527613610.282 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:50.283Z,1527613610.283 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:50.682Z,1527613610.682 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:50.683Z,1527613610.683 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:51.078Z,1527613611.078 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:51.079Z,1527613611.079 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:51.454Z,1527613611.454 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:51.455Z,1527613611.455 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:51.811Z,1527613611.811 [AcousticModem_Benthos_ATM900](DEBUG): 
2018-05-29T17:06:51.886Z,1527613611.886 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:51.887Z,1527613611.887 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:52.231Z,1527613612.231 [PNI_TCM](FAULT): Failed to set parameters during initialization.
2018-05-29T17:06:52.231Z,1527613612.231 [PNI_TCM] Data Fault, FailCount= 1
2018-05-29T17:06:52.231Z,1527613612.231 [PNI_TCM](ERROR): Data Fault
2018-05-29T17:06:52.267Z,1527613612.267 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:52.268Z,1527613612.268 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:52.370Z,1527613612.370 [CBIT](ERROR): Data Fault in component: PNI_TCM
2018-05-29T17:06:52.634Z,1527613612.634 [PNI_TCM](INFO): Powering down
2018-05-29T17:06:52.699Z,1527613612.699 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:52.712Z,1527613612.712 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:53.012Z,1527613613.012 [AcousticModem_Benthos_ATM900](DEBUG): Teledyne Benthos ATM-900 Series OEM w/burn wire
2018-05-29T17:06:53.013Z,1527613613.013 [AcousticModem_Benthos_ATM900](DEBUG): MF Frequency Band
2018-05-29T17:06:53.014Z,1527613613.014 [AcousticModem_Benthos_ATM900](DEBUG): Standard version 8.6.3
2018-05-29T17:06:53.014Z,1527613613.014 [AcousticModem_Benthos_ATM900](DEBUG): Apr  6 2000 19:12:58 
2018-05-29T17:06:53.059Z,1527613613.059 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:53.060Z,1527613613.060 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:53.414Z,1527613613.414 [AcousticModem_Benthos_ATM900](DEBUG): WARNING: battery low
2018-05-29T17:06:53.474Z,1527613613.474 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:53.475Z,1527613613.475 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:53.885Z,1527613613.885 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:53.886Z,1527613613.886 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:53.942Z,1527613613.942 [CBIT](INFO): Clearing failed state for component PNI_TCM
2018-05-29T17:06:53.942Z,1527613613.942 [PNI_TCM] No Fault, FailCount= 1
2018-05-29T17:06:54.217Z,1527613614.217 [AcousticModem_Benthos_ATM900](INFO): entering command mode
2018-05-29T17:06:54.291Z,1527613614.291 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:54.292Z,1527613614.292 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:54.611Z,1527613614.611 [AcousticModem_Benthos_ATM900](DEBUG): checking for command mode acknowledgment
2018-05-29T17:06:54.612Z,1527613614.612 [AcousticModem_Benthos_ATM900](DEBUG): read user prompt 1: user:1>
2018-05-29T17:06:54.612Z,1527613614.612 [AcousticModem_Benthos_ATM900](INFO): command mode acknowledged
2018-05-29T17:06:54.682Z,1527613614.682 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:54.683Z,1527613614.683 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:55.018Z,1527613615.018 [AcousticModem_Benthos_ATM900](INFO): setting local address to 3
2018-05-29T17:06:55.116Z,1527613615.116 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:55.117Z,1527613615.117 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:55.411Z,1527613615.411 [AcousticModem_Benthos_ATM900](DEBUG): checking for local address setting acknowledgment
2018-05-29T17:06:55.412Z,1527613615.412 [AcousticModem_Benthos_ATM900](INFO): set local address to 3
2018-05-29T17:06:55.456Z,1527613615.456 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:55.465Z,1527613615.465 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:55.811Z,1527613615.811 [AcousticModem_Benthos_ATM900](DEBUG): read user prompt 2: user:2>
2018-05-29T17:06:55.856Z,1527613615.856 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:55.857Z,1527613615.857 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:56.278Z,1527613616.278 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:56.279Z,1527613616.279 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:56.679Z,1527613616.679 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:56.680Z,1527613616.680 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:57.055Z,1527613617.055 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:57.056Z,1527613617.056 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:57.462Z,1527613617.462 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:57.464Z,1527613617.464 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:57.871Z,1527613617.871 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:57.872Z,1527613617.872 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:58.255Z,1527613618.255 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:58.256Z,1527613618.256 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:58.745Z,1527613618.745 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:58.755Z,1527613618.755 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:59.188Z,1527613619.188 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:59.199Z,1527613619.199 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:59.482Z,1527613619.482 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:59.483Z,1527613619.483 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:59.858Z,1527613619.858 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:06:59.860Z,1527613619.860 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:00.274Z,1527613620.274 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:00.277Z,1527613620.277 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:00.735Z,1527613620.735 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:00.747Z,1527613620.747 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:01.157Z,1527613621.157 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:01.160Z,1527613621.160 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:01.431Z,1527613621.431 [PNI_TCM](FAULT): Failed to set parameters during initialization.
2018-05-29T17:07:01.431Z,1527613621.431 [PNI_TCM] Data Fault, FailCount= 2
2018-05-29T17:07:01.431Z,1527613621.431 [PNI_TCM](ERROR): Data Fault
2018-05-29T17:07:01.463Z,1527613621.463 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:01.464Z,1527613621.464 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:01.551Z,1527613621.551 [CBIT](ERROR): Data Fault in component: PNI_TCM
2018-05-29T17:07:01.831Z,1527613621.831 [PNI_TCM](INFO): Powering down
2018-05-29T17:07:01.861Z,1527613621.861 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:01.862Z,1527613621.862 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:02.297Z,1527613622.297 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:02.309Z,1527613622.309 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:02.704Z,1527613622.704 [CommandLine](IMPORTANT): got command quit
2018-05-29T17:07:02.730Z,1527613622.730 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:02.732Z,1527613622.732 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:03.113Z,1527613623.113 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:03.116Z,1527613623.116 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:03.230Z,1527613623.230 [CBIT](INFO): Clearing failed state for component PNI_TCM
2018-05-29T17:07:03.230Z,1527613623.230 [PNI_TCM] No Fault, FailCount= 2
2018-05-29T17:07:03.447Z,1527613623.447 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:03.448Z,1527613623.448 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:03.720Z,1527613623.720 [CommandLine ThreadHandler](INFO): Uninitializing protected caller thread.
2018-05-29T17:07:03.720Z,1527613623.720 [CommandLine ThreadHandler](INFO): Thread cancelled.
2018-05-29T17:07:03.821Z,1527613623.821 [Supervisor](DEBUG): Uninitializing supervisor and starting cleanup.  Bye!
2018-05-29T17:07:03.821Z,1527613623.821 [CommandLine ThreadHandler](INFO): Thread cancelled.
2018-05-29T17:07:03.822Z,1527613623.822 [CommandLine](INFO): Join timeout helper Thread ID is 915
2018-05-29T17:07:03.825Z,1527613623.825 [ComponentRegistry](INFO): Shutting down NavChartDb ThreadHandler
2018-05-29T17:07:03.825Z,1527613623.825 [NavChartDb ThreadHandler](INFO): Thread cancelled.
2018-05-29T17:07:03.825Z,1527613623.825 [NavChartDb](INFO): Join timeout helper Thread ID is 916
2018-05-29T17:07:03.872Z,1527613623.872 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:03.881Z,1527613623.881 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:04.345Z,1527613624.345 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:04.348Z,1527613624.348 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:04.740Z,1527613624.740 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:04.746Z,1527613624.746 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:05.116Z,1527613625.116 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:05.127Z,1527613625.127 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:05.477Z,1527613625.477 [NavChartDb ThreadHandler](INFO): Uninitializing protected caller thread.
2018-05-29T17:07:05.477Z,1527613625.477 [NavChartDb ThreadHandler](INFO): Thread cancelled.
2018-05-29T17:07:05.480Z,1527613625.480 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:05.485Z,1527613625.485 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:05.493Z,1527613625.493 [ComponentRegistry](INFO): Shutting down WetLabsBB2FL ThreadHandler
2018-05-29T17:07:05.493Z,1527613625.493 [WetLabsBB2FL ThreadHandler](INFO): Thread cancelled.
2018-05-29T17:07:05.493Z,1527613625.493 [WetLabsBB2FL](INFO): Join timeout helper Thread ID is 917
2018-05-29T17:07:05.677Z,1527613625.677 [WetLabsBB2FL ThreadHandler](INFO): Uninitializing protected caller thread.
2018-05-29T17:07:05.677Z,1527613625.677 [WetLabsBB2FL](INFO): Powering down
2018-05-29T17:07:05.678Z,1527613625.678 [WetLabsBB2FL ThreadHandler](INFO): Thread cancelled.
2018-05-29T17:07:05.685Z,1527613625.685 [ComponentRegistry](INFO): Shutting down CTD_Seabird ThreadHandler
2018-05-29T17:07:05.685Z,1527613625.685 [CTD_Seabird ThreadHandler](INFO): Thread cancelled.
2018-05-29T17:07:05.685Z,1527613625.685 [CTD_Seabird](INFO): Join timeout helper Thread ID is 918
2018-05-29T17:07:05.818Z,1527613625.818 [CTD_Seabird ThreadHandler](INFO): Uninitializing protected caller thread.
2018-05-29T17:07:05.880Z,1527613625.880 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:05.881Z,1527613625.881 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:06.032Z,1527613626.032 [CTD_Seabird](INFO): Stopping potential previous instance(s) of CTD_Seabird LCM interface
2018-05-29T17:07:06.032Z,1527613626.032 [CTD_Seabird](INFO): Powering down
2018-05-29T17:07:06.033Z,1527613626.033 [CTD_Seabird ThreadHandler](INFO): Thread cancelled.
2018-05-29T17:07:06.034Z,1527613626.034 [ComponentRegistry](INFO): Shutting down Rowe_600LCM ThreadHandler
2018-05-29T17:07:06.034Z,1527613626.034 [Rowe_600LCM ThreadHandler](INFO): Thread cancelled.
2018-05-29T17:07:06.035Z,1527613626.035 [Rowe_600LCM](INFO): Join timeout helper Thread ID is 920
2018-05-29T17:07:06.267Z,1527613626.267 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:06.268Z,1527613626.268 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:06.688Z,1527613626.688 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:06.695Z,1527613626.695 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:06.778Z,1527613626.778 [Rowe_600LCM ThreadHandler](INFO): Uninitializing protected caller thread.
2018-05-29T17:07:06.778Z,1527613626.778 [Rowe_600LCM](INFO): Stopping potential previous instance(s) of roweadcp LCM interface
2018-05-29T17:07:07.167Z,1527613627.167 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:07.200Z,1527613627.200 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:07.456Z,1527613627.456 [Rowe_600LCM](INFO): Powering down
2018-05-29T17:07:07.457Z,1527613627.457 [Rowe_600LCM ThreadHandler](INFO): Thread cancelled.
2018-05-29T17:07:07.467Z,1527613627.467 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:07.468Z,1527613627.468 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:07.470Z,1527613627.470 [ComponentRegistry](INFO): Shutting down Radio_Surface ThreadHandler
2018-05-29T17:07:07.470Z,1527613627.470 [Radio_Surface ThreadHandler](INFO): Thread cancelled.
2018-05-29T17:07:07.471Z,1527613627.471 [Radio_Surface](INFO): Join timeout helper Thread ID is 922
2018-05-29T17:07:07.833Z,1527613627.833 [Radio_Surface ThreadHandler](INFO): Uninitializing protected caller thread.
2018-05-29T17:07:07.834Z,1527613627.834 [Radio_Surface ThreadHandler](INFO): Thread cancelled.
2018-05-29T17:07:07.846Z,1527613627.846 [ComponentRegistry](INFO): Shutting down logger ThreadHandler
2018-05-29T17:07:07.846Z,1527613627.846 [logger ThreadHandler](INFO): Thread cancelled.
2018-05-29T17:07:07.846Z,1527613627.846 [logger](INFO): Join timeout helper Thread ID is 923
2018-05-29T17:07:07.870Z,1527613627.870 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:07.871Z,1527613627.871 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2018-05-29T17:07:07.877Z,1527613627.877 [logger ThreadHandler](INFO): Uninitializing protected caller thread.
2018-05-29T17:07:07.878Z,1527613627.878 [logger ThreadHandler](INFO): Thread cancelled.
2018-05-29T17:07:07.898Z,1527613627.898 [ComponentRegistry](INFO): Shutting down CommandLine ThreadHandler
2018-05-29T17:07:07.898Z,1527613627.898 [CommandLine ThreadHandler](INFO): Thread cancelled.
2018-05-29T17:07:07.898Z,1527613627.898 [ComponentRegistry](INFO): Shutting down controlThread ThreadHandler
2018-05-29T17:07:07.898Z,1527613627.898 [controlThread ThreadHandler](INFO): Thread cancelled.
2018-05-29T17:07:07.898Z,1527613627.898 [controlThread](INFO): Join timeout helper Thread ID is 924
2018-05-29T17:07:07.924Z,1527613627.924 [controlThread ThreadHandler](INFO): Uninitializing protected caller thread.
2018-05-29T17:07:07.924Z,1527613627.924 [controlThread](DEBUG): Uninitializing ControlThread
2018-05-29T17:07:07.925Z,1527613627.925 [AcousticModem_Benthos_ATM900](INFO): Powering down
2018-05-29T17:07:08.046Z,1527613628.046 [NAL9602](INFO): Powering down
2018-05-29T17:07:08.069Z,1527613628.069 [PNI_TCM](INFO): Powering down
2018-05-29T17:07:08.158Z,1527613628.158 [Aanderaa_O2](INFO): Powering down
2018-05-29T17:07:08.161Z,1527613628.161 [DepthRateCalculator](DEBUG): Initializing DepthRateCalculator.
2018-05-29T17:07:08.162Z,1527613628.162 [ElevatorOffsetCalculator](DEBUG): Uninitializing ElevatorOffsetCalculator.
2018-05-29T17:07:08.163Z,1527613628.163 [NavChart](DEBUG): Uninitialize NavChart Navigation.
2018-05-29T17:07:08.164Z,1527613628.164 [MissionManager](INFO): Uninitializing Mission Default
2018-05-29T17:07:08.167Z,1527613628.167 [MissionManager](INFO): Uninitializing Mission Startup
2018-05-29T17:07:08.168Z,1527613628.168 [VerticalControl](DEBUG): Uninitialize VerticalControlComponent.
2018-05-29T17:07:08.169Z,1527613628.169 [HorizontalControl](DEBUG): Uninitialize HorizontalControlComponent.
2018-05-29T17:07:08.169Z,1527613628.169 [SpeedControl](DEBUG): Uninitialize SpeedControlComponent.
2018-05-29T17:07:08.170Z,1527613628.170 [LoopControl](DEBUG): Uninitialize LoopControlComponent.
2018-05-29T17:07:08.170Z,1527613628.170 [BuoyancyServo](DEBUG): Uninitialize Buoyancy Servo.
2018-05-29T17:07:08.170Z,1527613628.170 [BuoyancyServo](INFO): Powering down
2018-05-29T17:07:08.185Z,1527613628.185 [ElevatorServo](DEBUG): Uninitialize Elevator Servo.
2018-05-29T17:07:08.185Z,1527613628.185 [ElevatorServo](INFO): Powering down
2018-05-29T17:07:08.207Z,1527613628.207 [MassServo](DEBUG): Uninitialize Mass Servo.
2018-05-29T17:07:08.207Z,1527613628.207 [MassServo](INFO): Powering down
2018-05-29T17:07:08.208Z,1527613628.208 [RudderServo](DEBUG): Uninitialize Rudder Servo.
2018-05-29T17:07:08.208Z,1527613628.208 [RudderServo](INFO): Powering down
2018-05-29T17:07:08.209Z,1527613628.209 [ThrusterServo](DEBUG): Uninitialize Thruster Servo.
2018-05-29T17:07:08.209Z,1527613628.209 [ThrusterServo](INFO): Powering down
2018-05-29T17:07:08.210Z,1527613628.210 [SBIT](DEBUG): Uninitialize SBIT Component.
2018-05-29T17:07:08.211Z,1527613628.211 [IBIT](DEBUG): Uninitialize IBIT Component.
2018-05-29T17:07:08.211Z,1527613628.211 [CBIT](DEBUG): Uninitialize CBIT Component.
2018-05-29T17:07:08.212Z,1527613628.212 [controlThread ThreadHandler](INFO): Thread cancelled.
2018-05-29T17:07:08.303Z,1527613628.303 [Rowe_600LCM ThreadHandler](INFO): Thread cancelled.
2018-05-29T17:07:08.310Z,1527613628.310 [Radio_Surface ThreadHandler](INFO): Thread cancelled.
2018-05-29T17:07:08.348Z,1527613628.348 [WetLabsBB2FL ThreadHandler](INFO): Thread cancelled.
2018-05-29T17:07:08.352Z,1527613628.352 [CTD_Seabird ThreadHandler](INFO): Thread cancelled.
2018-05-29T17:07:08.638Z,1527613628.638 [NavChartDb ThreadHandler](INFO): Thread cancelled.
2018-05-29T17:07:08.686Z,1527613628.686 [logger ThreadHandler](INFO): Thread cancelled.