2017-01-05T17:22:26.178Z,1483636946.178 [Supervisor](DEBUG): Initializing supervisor.
2017-01-05T17:22:26.181Z,1483636946.181 [SyncHandler](DEBUG): Created PCaller Thread at 4051A4E0
2017-01-05T17:22:26.182Z,1483636946.182 [SyncHandler](INFO): Protected caller Thread ID is 775
2017-01-05T17:22:26.182Z,1483636946.182 [ComponentRegistry](DEBUG): Component "controlThread" handled in its own thread.
2017-01-05T17:22:26.185Z,1483636946.185 [controlThread ThreadHandler](DEBUG): Created PCaller Thread at 4054A4E0
2017-01-05T17:22:26.185Z,1483636946.185 [controlThread ThreadHandler](INFO): Protected caller Thread ID is 776
2017-01-05T17:22:26.188Z,1483636946.188 [ComponentRegistry](DEBUG): SyncComponent "CycleStarter" handled in the control thread.
2017-01-05T17:22:26.200Z,1483636946.200 [ComponentRegistry](DEBUG): Component "CommandLine" handled in its own thread.
2017-01-05T17:22:26.201Z,1483636946.201 [CommandLine ThreadHandler](DEBUG): Created PCaller Thread at 4057A4E0
2017-01-05T17:22:26.201Z,1483636946.201 [CommandLine ThreadHandler](INFO): Protected caller Thread ID is 777
2017-01-05T17:22:26.202Z,1483636946.202 [ComponentRegistry](DEBUG): Component "logger" handled in its own thread.
2017-01-05T17:22:26.205Z,1483636946.205 [logger ThreadHandler](DEBUG): Created PCaller Thread at 405AA4E0
2017-01-05T17:22:26.205Z,1483636946.205 [logger ThreadHandler](INFO): Protected caller Thread ID is 778
2017-01-05T17:22:26.208Z,1483636946.208 [ComponentRegistry](DEBUG): SyncComponent "LogSplitter" handled in the control thread.
2017-01-05T17:22:26.208Z,1483636946.208 [Supervisor](INFO): Looking for Config files in directory: Config/
2017-01-05T17:22:26.213Z,1483636946.213 [Supervisor](INFO): Opening Config file at: Config/Control.cfg
2017-01-05T17:22:26.559Z,1483636946.559 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Control
2017-01-05T17:22:26.560Z,1483636946.560 [Supervisor](INFO): Opening Config file at: Config/BIT.cfg
2017-01-05T17:22:26.739Z,1483636946.739 [ComponentRegistry](DEBUG): Loaded Config Component "Config/BIT
2017-01-05T17:22:26.739Z,1483636946.739 [Supervisor](INFO): Opening Config file at: Config/Derivation.cfg
2017-01-05T17:22:26.875Z,1483636946.875 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Derivation
2017-01-05T17:22:26.876Z,1483636946.876 [Supervisor](INFO): Opening Config file at: Config/Estimation.cfg
2017-01-05T17:22:27.019Z,1483636947.019 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Estimation
2017-01-05T17:22:27.020Z,1483636947.020 [Supervisor](INFO): Opening Config file at: Config/Guidance.cfg
2017-01-05T17:22:27.114Z,1483636947.114 [Supervisor](INFO): Opening Config file at: Config/Navigation.cfg
2017-01-05T17:22:27.332Z,1483636947.332 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Navigation
2017-01-05T17:22:27.333Z,1483636947.333 [Supervisor](INFO): Opening Config file at: Config/Sample.cfg
2017-01-05T17:22:27.430Z,1483636947.430 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Sample
2017-01-05T17:22:27.431Z,1483636947.431 [Supervisor](INFO): Opening Config file at: Config/Science.cfg
2017-01-05T17:22:27.717Z,1483636947.717 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Science
2017-01-05T17:22:27.717Z,1483636947.717 [Supervisor](INFO): Opening Config file at: Config/Sensor.cfg
2017-01-05T17:22:28.087Z,1483636948.087 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Sensor
2017-01-05T17:22:28.088Z,1483636948.088 [Supervisor](INFO): Opening Config file at: Config/Servo.cfg
2017-01-05T17:22:28.426Z,1483636948.426 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Servo
2017-01-05T17:22:28.427Z,1483636948.427 [Supervisor](INFO): Opening Config file at: Config/Simulator.cfg
2017-01-05T17:22:28.959Z,1483636948.959 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Simulator
2017-01-05T17:22:28.960Z,1483636948.960 [Supervisor](INFO): Opening Config file at: Config/logger.cfg
2017-01-05T17:22:29.179Z,1483636949.179 [ComponentRegistry](DEBUG): Loaded Config Component "Config/logger
2017-01-05T17:22:29.180Z,1483636949.180 [Supervisor](INFO): Opening Config file at: Config/secure.cfg
2017-01-05T17:22:29.291Z,1483636949.291 [ComponentRegistry](DEBUG): Loaded Config Component "Config/secure
2017-01-05T17:22:29.292Z,1483636949.292 [Supervisor](INFO): Opening Config file at: Config/vehicle.cfg
2017-01-05T17:22:29.768Z,1483636949.768 [ComponentRegistry](DEBUG): Loaded Config Component "Config/vehicle
2017-01-05T17:22:29.769Z,1483636949.769 [Supervisor](INFO): Opening Config file at: Config/workSite.cfg
2017-01-05T17:22:29.888Z,1483636949.888 [ComponentRegistry](DEBUG): Loaded Config Component "Config/workSite
2017-01-05T17:22:29.890Z,1483636949.890 [Supervisor](INFO): Looking for Config files in directory: Config/lrauv-tethys/
2017-01-05T17:22:29.893Z,1483636949.893 [Supervisor](INFO): Opening Config file at: Config/lrauv-tethys/Battery.cfg
2017-01-05T17:22:30.156Z,1483636950.156 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Battery
2017-01-05T17:22:30.157Z,1483636950.157 [Supervisor](INFO): Opening Config file at: Config/lrauv-tethys/BIT.cfg
2017-01-05T17:22:30.281Z,1483636950.281 [Supervisor](INFO): Opening Config file at: Config/lrauv-tethys/Navigation.cfg
2017-01-05T17:22:30.387Z,1483636950.387 [Supervisor](INFO): Opening Config file at: Config/lrauv-tethys/Control.cfg
2017-01-05T17:22:30.493Z,1483636950.493 [Supervisor](INFO): Opening Config file at: Config/lrauv-tethys/Simulator.cfg
2017-01-05T17:22:30.593Z,1483636950.593 [Supervisor](INFO): Opening Config file at: Config/lrauv-tethys/Science.cfg
2017-01-05T17:22:30.742Z,1483636950.742 [Supervisor](INFO): Opening Config file at: Config/lrauv-tethys/Sensor.cfg
2017-01-05T17:22:30.898Z,1483636950.898 [Supervisor](INFO): Opening Config file at: Config/lrauv-tethys/Servo.cfg
2017-01-05T17:22:31.006Z,1483636951.006 [Supervisor](INFO): Opening Config file at: Config/lrauv-tethys/logger.cfg
2017-01-05T17:22:31.100Z,1483636951.100 [Supervisor](INFO): Opening Config file at: Config/lrauv-tethys/secure.cfg
2017-01-05T17:22:31.197Z,1483636951.197 [Supervisor](INFO): Opening Config file at: Config/lrauv-tethys/vehicle.cfg
2017-01-05T17:22:31.307Z,1483636951.307 [Supervisor](INFO): Opening Config file at: Config/lrauv-tethys/workSite.cfg
2017-01-05T17:22:31.410Z,1483636951.410 [Supervisor](FAULT): Ignoring configuration overrides from Data/persisted.cfg
2017-01-05T17:22:31.414Z,1483636951.414 [Module Loader](DEBUG): Loading Module at Modules/BIT.so
2017-01-05T17:22:31.571Z,1483636951.571 [SBIT](DEBUG): Construct Startup Built In Test.
2017-01-05T17:22:31.601Z,1483636951.601 [SBIT] Loaded
2017-01-05T17:22:31.601Z,1483636951.601 [ComponentRegistry](DEBUG): SyncComponent "SBIT" handled in the control thread.
2017-01-05T17:22:31.602Z,1483636951.602 [IBIT](DEBUG): Construct Initiated Built In Test.
2017-01-05T17:22:31.635Z,1483636951.635 [IBIT] Loaded
2017-01-05T17:22:31.635Z,1483636951.635 [ComponentRegistry](DEBUG): SyncComponent "IBIT" handled in the control thread.
2017-01-05T17:22:31.637Z,1483636951.637 [CBIT](DEBUG): Construct Continuous Built In Test.
2017-01-05T17:22:31.790Z,1483636951.790 [CBIT] Loaded
2017-01-05T17:22:31.791Z,1483636951.791 [ComponentRegistry](DEBUG): SyncComponent "CBIT" handled in the control thread.
2017-01-05T17:22:31.791Z,1483636951.791 [Module Loader](DEBUG): Loaded Module: BIT (Contains the BuiltInTest components, such as C Built In Test)
2017-01-05T17:22:31.793Z,1483636951.793 [Module Loader](DEBUG): Loading Module at Modules/Control.so
2017-01-05T17:22:31.867Z,1483636951.867 [VerticalControl](DEBUG): Construct VerticalControl.
2017-01-05T17:22:31.979Z,1483636951.979 [VerticalControl] Loaded
2017-01-05T17:22:31.979Z,1483636951.979 [ComponentRegistry](DEBUG): SyncComponent "VerticalControl" handled in the control thread.
2017-01-05T17:22:31.980Z,1483636951.980 [HorizontalControl](DEBUG): Construct HorizontalControl.
2017-01-05T17:22:32.045Z,1483636952.045 [HorizontalControl] Loaded
2017-01-05T17:22:32.045Z,1483636952.045 [ComponentRegistry](DEBUG): SyncComponent "HorizontalControl" handled in the control thread.
2017-01-05T17:22:32.046Z,1483636952.046 [SpeedControl](DEBUG): Construct SpeedControl.
2017-01-05T17:22:32.056Z,1483636952.056 [SpeedControl] Loaded
2017-01-05T17:22:32.056Z,1483636952.056 [ComponentRegistry](DEBUG): SyncComponent "SpeedControl" handled in the control thread.
2017-01-05T17:22:32.057Z,1483636952.057 [LoopControl](DEBUG): Construct LoopControl.
2017-01-05T17:22:32.057Z,1483636952.057 [LoopControl] Loaded
2017-01-05T17:22:32.058Z,1483636952.058 [ComponentRegistry](DEBUG): SyncComponent "LoopControl" handled in the control thread.
2017-01-05T17:22:32.058Z,1483636952.058 [Module Loader](DEBUG): Loaded Module: Control (Contains the Control components, such as Depth, Heading, and Speed Control)
2017-01-05T17:22:32.059Z,1483636952.059 [Module Loader](DEBUG): Loading Module at Modules/Derivation.so
2017-01-05T17:22:32.104Z,1483636952.104 [DepthRateCalculator] Loaded
2017-01-05T17:22:32.105Z,1483636952.105 [ComponentRegistry](DEBUG): SyncComponent "DepthRateCalculator" handled in the control thread.
2017-01-05T17:22:32.110Z,1483636952.110 [PitchRateCalculator] Loaded
2017-01-05T17:22:32.110Z,1483636952.110 [ComponentRegistry](DEBUG): SyncComponent "PitchRateCalculator" handled in the control thread.
2017-01-05T17:22:32.121Z,1483636952.121 [SpeedCalculator] Loaded
2017-01-05T17:22:32.121Z,1483636952.121 [ComponentRegistry](DEBUG): SyncComponent "SpeedCalculator" handled in the control thread.
2017-01-05T17:22:32.141Z,1483636952.141 [TempGradientCalculator] Loaded
2017-01-05T17:22:32.142Z,1483636952.142 [ComponentRegistry](DEBUG): SyncComponent "TempGradientCalculator" handled in the control thread.
2017-01-05T17:22:32.158Z,1483636952.158 [VerticalTemperatureHomogeneityIndexCalculator] Loaded
2017-01-05T17:22:32.158Z,1483636952.158 [ComponentRegistry](DEBUG): SyncComponent "VerticalTemperatureHomogeneityIndexCalculator" handled in the control thread.
2017-01-05T17:22:32.163Z,1483636952.163 [YawRateCalculator] Loaded
2017-01-05T17:22:32.164Z,1483636952.164 [ComponentRegistry](DEBUG): SyncComponent "YawRateCalculator" handled in the control thread.
2017-01-05T17:22:32.164Z,1483636952.164 [Module Loader](DEBUG): Loaded Module: Derivation (Contains the base derivation components)
2017-01-05T17:22:32.165Z,1483636952.165 [Module Loader](DEBUG): Loading Module at Modules/Estimation.so
2017-01-05T17:22:32.286Z,1483636952.286 [StratificationFrontDetector](INFO): threshold set to: 0.399988 degC
2017-01-05T17:22:32.286Z,1483636952.286 [StratificationFrontDetector](DEBUG): (re)initializing
2017-01-05T17:22:32.287Z,1483636952.287 [StratificationFrontDetector] Loaded
2017-01-05T17:22:32.287Z,1483636952.287 [ComponentRegistry](DEBUG): SyncComponent "StratificationFrontDetector" handled in the control thread.
2017-01-05T17:22:32.287Z,1483636952.287 [Module Loader](DEBUG): Loaded Module: Estimation (Contains the base estimation components)
2017-01-05T17:22:32.288Z,1483636952.288 [Module Loader](DEBUG): Loading Module at Modules/Guidance.so
2017-01-05T17:22:32.577Z,1483636952.577 [Module Loader](DEBUG): Loaded Module: Guidance (Contains behaviors and commands)
2017-01-05T17:22:32.577Z,1483636952.577 [Module Loader](DEBUG): Loading Module at Modules/Navigation.so
2017-01-05T17:22:32.705Z,1483636952.705 [DeadReckonUsingMultipleVelocitySources] Loaded
2017-01-05T17:22:32.705Z,1483636952.705 [ComponentRegistry](DEBUG): SyncComponent "DeadReckonUsingMultipleVelocitySources" handled in the control thread.
2017-01-05T17:22:32.764Z,1483636952.764 [DeadReckonUsingSpeedCalculator] Loaded
2017-01-05T17:22:32.764Z,1483636952.764 [ComponentRegistry](DEBUG): SyncComponent "DeadReckonUsingSpeedCalculator" handled in the control thread.
2017-01-05T17:22:32.769Z,1483636952.769 [UniversalFixResidualReporter] Loaded
2017-01-05T17:22:32.769Z,1483636952.769 [ComponentRegistry](DEBUG): SyncComponent "UniversalFixResidualReporter" handled in the control thread.
2017-01-05T17:22:32.769Z,1483636952.769 [Module Loader](DEBUG): Loaded Module: Navigation (Contains the base navigation components)
2017-01-05T17:22:32.770Z,1483636952.770 [Module Loader](DEBUG): Loading Module at Modules/Sample.so
2017-01-05T17:22:32.779Z,1483636952.779 [Module Loader](DEBUG): Loaded Module: Sample (This is a Sample Module of Sample Components)
2017-01-05T17:22:32.780Z,1483636952.780 [Module Loader](DEBUG): Loading Module at Modules/Science.so
2017-01-05T17:22:33.007Z,1483636953.007 [Aanderaa_O2] Loaded
2017-01-05T17:22:33.007Z,1483636953.007 [ComponentRegistry](DEBUG): SyncComponent "Aanderaa_O2" handled in the control thread.
2017-01-05T17:22:33.019Z,1483636953.019 [CANONSampler] Loaded
2017-01-05T17:22:33.019Z,1483636953.019 [ComponentRegistry](DEBUG): SyncComponent "CANONSampler" handled in the control thread.
2017-01-05T17:22:33.102Z,1483636953.102 [CTD_NeilBrown] Loaded
2017-01-05T17:22:33.102Z,1483636953.102 [ComponentRegistry](DEBUG): Component "CTD_NeilBrown" handled in its own thread.
2017-01-05T17:22:33.104Z,1483636953.104 [CTD_NeilBrown ThreadHandler](DEBUG): Created PCaller Thread at 4076B4E0
2017-01-05T17:22:33.104Z,1483636953.104 [CTD_NeilBrown ThreadHandler](INFO): Protected caller Thread ID is 860
2017-01-05T17:22:33.119Z,1483636953.119 [PAR_Licor] Loaded
2017-01-05T17:22:33.119Z,1483636953.119 [ComponentRegistry](DEBUG): SyncComponent "PAR_Licor" handled in the control thread.
2017-01-05T17:22:33.141Z,1483636953.141 [VemcoVR2C] Loaded
2017-01-05T17:22:33.142Z,1483636953.142 [ComponentRegistry](DEBUG): SyncComponent "VemcoVR2C" handled in the control thread.
2017-01-05T17:22:33.194Z,1483636953.194 [WetLabsBB2FL] Loaded
2017-01-05T17:22:33.195Z,1483636953.195 [ComponentRegistry](DEBUG): Component "WetLabsBB2FL" handled in its own thread.
2017-01-05T17:22:33.196Z,1483636953.196 [WetLabsBB2FL ThreadHandler](DEBUG): Created PCaller Thread at 4079B4E0
2017-01-05T17:22:33.196Z,1483636953.196 [WetLabsBB2FL ThreadHandler](INFO): Protected caller Thread ID is 861
2017-01-05T17:22:33.197Z,1483636953.197 [Module Loader](DEBUG): Loaded Module: Science (Contains the science components)
2017-01-05T17:22:33.197Z,1483636953.197 [Module Loader](DEBUG): Loading Module at Modules/Sensor.so
2017-01-05T17:22:33.931Z,1483636953.931 [DataOverHttps] Loaded
2017-01-05T17:22:33.931Z,1483636953.931 [ComponentRegistry](DEBUG): SyncComponent "DataOverHttps" handled in the control thread.
2017-01-05T17:22:33.945Z,1483636953.945 [Depth_Keller] Loaded
2017-01-05T17:22:33.945Z,1483636953.945 [ComponentRegistry](DEBUG): SyncComponent "Depth_Keller" handled in the control thread.
2017-01-05T17:22:33.950Z,1483636953.950 [DropWeight] Loaded
2017-01-05T17:22:33.951Z,1483636953.951 [ComponentRegistry](DEBUG): SyncComponent "DropWeight" handled in the control thread.
2017-01-05T17:22:34.054Z,1483636954.054 [NAL9602] Loaded
2017-01-05T17:22:34.055Z,1483636954.055 [ComponentRegistry](DEBUG): SyncComponent "NAL9602" handled in the control thread.
2017-01-05T17:22:34.100Z,1483636954.100 [Onboard] Loaded
2017-01-05T17:22:34.100Z,1483636954.100 [ComponentRegistry](DEBUG): SyncComponent "Onboard" handled in the control thread.
2017-01-05T17:22:34.107Z,1483636954.107 [Radio_Surface] Loaded
2017-01-05T17:22:34.108Z,1483636954.108 [ComponentRegistry](DEBUG): Component "Radio_Surface" handled in its own thread.
2017-01-05T17:22:34.109Z,1483636954.109 [Radio_Surface ThreadHandler](DEBUG): Created PCaller Thread at 409E74E0
2017-01-05T17:22:34.110Z,1483636954.110 [Radio_Surface ThreadHandler](INFO): Protected caller Thread ID is 862
2017-01-05T17:22:34.325Z,1483636954.325 [PNI_TCM] Loaded
2017-01-05T17:22:34.326Z,1483636954.326 [ComponentRegistry](DEBUG): SyncComponent "PNI_TCM" handled in the control thread.
2017-01-05T17:22:34.727Z,1483636954.727 [Rowe_600LCM] Loaded
2017-01-05T17:22:34.728Z,1483636954.728 [ComponentRegistry](DEBUG): Component "Rowe_600LCM" handled in its own thread.
2017-01-05T17:22:34.730Z,1483636954.730 [Rowe_600LCM ThreadHandler](DEBUG): Created PCaller Thread at 40A174E0
2017-01-05T17:22:34.731Z,1483636954.731 [Rowe_600LCM ThreadHandler](INFO): Protected caller Thread ID is 863
2017-01-05T17:22:36.781Z,1483636956.781 [BPC1] Loaded
2017-01-05T17:22:36.782Z,1483636956.782 [ComponentRegistry](DEBUG): SyncComponent "BPC1" handled in the control thread.
2017-01-05T17:22:36.782Z,1483636956.782 [Module Loader](DEBUG): Loaded Module: Sensor (Contains the sensor components)
2017-01-05T17:22:36.783Z,1483636956.783 [Module Loader](DEBUG): Loading Module at Modules/Servo.so
2017-01-05T17:22:36.913Z,1483636956.913 [BuoyancyServo] Loaded
2017-01-05T17:22:36.918Z,1483636956.918 [ComponentRegistry](DEBUG): SyncComponent "BuoyancyServo" handled in the control thread.
2017-01-05T17:22:36.930Z,1483636956.930 [ElevatorServo] Loaded
2017-01-05T17:22:36.930Z,1483636956.930 [ComponentRegistry](DEBUG): SyncComponent "ElevatorServo" handled in the control thread.
2017-01-05T17:22:36.942Z,1483636956.942 [MassServo] Loaded
2017-01-05T17:22:36.942Z,1483636956.942 [ComponentRegistry](DEBUG): SyncComponent "MassServo" handled in the control thread.
2017-01-05T17:22:36.954Z,1483636956.954 [RudderServo] Loaded
2017-01-05T17:22:36.954Z,1483636956.954 [ComponentRegistry](DEBUG): SyncComponent "RudderServo" handled in the control thread.
2017-01-05T17:22:36.970Z,1483636956.970 [ThrusterServo] Loaded
2017-01-05T17:22:36.970Z,1483636956.970 [ComponentRegistry](DEBUG): SyncComponent "ThrusterServo" handled in the control thread.
2017-01-05T17:22:36.970Z,1483636956.970 [Module Loader](DEBUG): Loaded Module: Servo (This is the module containing motor controllers)
2017-01-05T17:22:36.971Z,1483636956.971 [Module Loader](DEBUG): Loading Module at Modules/Simulator.so
2017-01-05T17:22:37.111Z,1483636957.111 [Module Loader](DEBUG): Loaded Module: Simulator (This is the module containing the Simulator)
2017-01-05T17:22:37.112Z,1483636957.112 [Module Loader](DEBUG): Loading Module at Modules/Trigger.so
2017-01-05T17:22:37.155Z,1483636957.155 [Module Loader](DEBUG): Loaded Module: Trigger (Contains triggers for use in missions)
2017-01-05T17:22:37.159Z,1483636957.159 [ComponentRegistry](DEBUG): SyncComponent "MissionManager" handled in the control thread.
2017-01-05T17:22:37.160Z,1483636957.160 [ComponentRegistry](DEBUG): SyncComponent "Reporter" handled in the control thread.
2017-01-05T17:22:37.167Z,1483636957.167 [ComponentRegistry](DEBUG): Component "NavChartDb" handled in its own thread.
2017-01-05T17:22:37.170Z,1483636957.170 [NavChartDb ThreadHandler](DEBUG): Created PCaller Thread at 40AC54E0
2017-01-05T17:22:37.170Z,1483636957.170 [NavChartDb ThreadHandler](INFO): Protected caller Thread ID is 865
2017-01-05T17:22:37.175Z,1483636957.175 [Supervisor](INFO): Main Thread ID is 770
2017-01-05T17:22:37.176Z,1483636957.176 [Supervisor](DEBUG): Running supervisor.
2017-01-05T17:22:37.176Z,1483636957.176 [CommandLine ThreadHandler](INFO): Handler Thread ID is 866
2017-01-05T17:22:37.183Z,1483636957.183 [controlThread ThreadHandler](INFO): Handler Thread ID is 867
2017-01-05T17:22:37.183Z,1483636957.183 [controlThread](DEBUG): Initializing ControlThread
2017-01-05T17:22:37.184Z,1483636957.184 [SBIT](INFO): Initialize SBIT Component.
2017-01-05T17:22:37.184Z,1483636957.184 [SBIT](IMPORTANT): git: 2016-10-18
2017-01-05T17:22:37.185Z,1483636957.185 [SBIT](INFO): git hash: ad7ccc23790577c6a8a46372982c4b4e8ce2f0e1
2017-01-05T17:22:37.185Z,1483636957.185 [SBIT](IMPORTANT): Kernel Release: 2.6.27.8
2017-01-05T17:22:37.185Z,1483636957.185 [SBIT](IMPORTANT): Kernel Version:#639 PREEMPT Wed Mar 12 12:53:33 PDT 2014
2017-01-05T17:22:37.186Z,1483636957.186 [SBIT](INFO): Beginning SBIT in 28.000000 seconds.
2017-01-05T17:22:37.187Z,1483636957.187 [IBIT](INFO): Initialize IBIT Component.
2017-01-05T17:22:37.188Z,1483636957.188 [CBIT](DEBUG): Initialize CBIT Component.
2017-01-05T17:22:37.188Z,1483636957.188 [CBIT](FAULT): LAST RESTART WAS UNINTENTIONAL.
2017-01-05T17:22:37.188Z,1483636957.188 [CBIT](CRITICAL): LAST REBOOT DUE TO WATCHDOG TIMER RESET.
2017-01-05T17:22:37.191Z,1483636957.191 [logger ThreadHandler](INFO): Handler Thread ID is 868
2017-01-05T17:22:37.214Z,1483636957.214 [VerticalControl](DEBUG): Initialize VerticalControlComponent.
2017-01-05T17:22:37.216Z,1483636957.216 [HorizontalControl](DEBUG): Initialize HorizontalControlComponent.
2017-01-05T17:22:37.217Z,1483636957.217 [SpeedControl](DEBUG): Initialize SpeedControlComponent.
2017-01-05T17:22:37.217Z,1483636957.217 [LoopControl](DEBUG): Initialize LoopControlComponent.
2017-01-05T17:22:37.217Z,1483636957.217 [DepthRateCalculator](DEBUG): Initializing DepthRateCalculator.
2017-01-05T17:22:37.218Z,1483636957.218 [PitchRateCalculator](DEBUG): Initializing PitchRateCalculator.
2017-01-05T17:22:37.218Z,1483636957.218 [SpeedCalculator](DEBUG): Initializing SpeedCalculator.
2017-01-05T17:22:37.218Z,1483636957.218 [TempGradientCalculator](DEBUG): Initializing TempGradientCalculator.
2017-01-05T17:22:37.219Z,1483636957.219 [VerticalTemperatureHomogeneityIndexCalculator](DEBUG): (re)initializing
2017-01-05T17:22:37.220Z,1483636957.220 [YawRateCalculator](DEBUG): Initializing YawRateCalculator.
2017-01-05T17:22:37.220Z,1483636957.220 [DeadReckonUsingMultipleVelocitySources](DEBUG): Initializing DeadReckonUsingMultipleVelocitySources component.
2017-01-05T17:22:37.221Z,1483636957.221 [DeadReckonUsingMultipleVelocitySources](INFO): Will consider orientation measurement stale after 120s.
2017-01-05T17:22:37.221Z,1483636957.221 [DeadReckonUsingMultipleVelocitySources](INFO): Will consider velocity measurement stale after 20s.
2017-01-05T17:22:37.222Z,1483636957.222 [DeadReckonUsingSpeedCalculator](DEBUG): Initializing DeadReckonUsingSpeedCalculator component.
2017-01-05T17:22:37.222Z,1483636957.222 [DeadReckonUsingSpeedCalculator](INFO): Will consider orientation measurement stale after 120s.
2017-01-05T17:22:37.222Z,1483636957.222 [DeadReckonUsingSpeedCalculator](INFO): Will consider velocity measurement stale after 20s.
2017-01-05T17:22:37.223Z,1483636957.223 [UniversalFixResidualReporter](DEBUG): Initializing UniversalFixResidualReporter component.
2017-01-05T17:22:37.243Z,1483636957.243 [CTD_NeilBrown ThreadHandler](INFO): Handler Thread ID is 869
2017-01-05T17:22:37.244Z,1483636957.244 [CTD_NeilBrown](INFO): Powering down
2017-01-05T17:22:37.259Z,1483636957.259 [MissionManager](INFO): Loading Mission: Missions/Startup.xml
2017-01-05T17:22:37.272Z,1483636957.272 [WetLabsBB2FL ThreadHandler](INFO): Handler Thread ID is 870
2017-01-05T17:22:37.274Z,1483636957.274 [WetLabsBB2FL](INFO): Powering down
2017-01-05T17:22:37.304Z,1483636957.304 [Startup:A.GoToSurface](DEBUG): Construct GoToSurface.
2017-01-05T17:22:37.315Z,1483636957.315 [Radio_Surface ThreadHandler](INFO): Handler Thread ID is 871
2017-01-05T17:22:37.325Z,1483636957.325 [Radio_Surface](INFO): Powering up
2017-01-05T17:22:37.337Z,1483636957.337 [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>


2017-01-05T17:22:37.339Z,1483636957.339 [Rowe_600LCM ThreadHandler](INFO): Handler Thread ID is 872
2017-01-05T17:22:37.340Z,1483636957.340 [Rowe_600LCM](INFO): Initializing
2017-01-05T17:22:37.340Z,1483636957.340 [Rowe_600LCM](INFO): Checking LCM
2017-01-05T17:22:37.340Z,1483636957.340 [Rowe_600LCM](INFO): LCM OK
2017-01-05T17:22:37.341Z,1483636957.341 [Rowe_600LCM](INFO): Powering up
2017-01-05T17:22:37.342Z,1483636957.342 [MissionManager](INFO): Loading Mission: Missions/Default.xml
2017-01-05T17:22:37.355Z,1483636957.355 [NavChartDb ThreadHandler](INFO): Handler Thread ID is 873
2017-01-05T17:22:37.369Z,1483636957.369 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US1WC07M.000
2017-01-05T17:22:37.369Z,1483636957.369 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US1WC07M.000
2017-01-05T17:22:37.369Z,1483636957.369 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US2WC11M.000
2017-01-05T17:22:37.369Z,1483636957.369 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US2WC11M.000
2017-01-05T17:22:37.369Z,1483636957.369 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US3CA52M.000
2017-01-05T17:22:37.370Z,1483636957.370 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US3CA52M.000
2017-01-05T17:22:37.370Z,1483636957.370 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US4CA60M.000
2017-01-05T17:22:37.370Z,1483636957.370 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US4CA60M.000
2017-01-05T17:22:37.370Z,1483636957.370 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US5CA50M.000
2017-01-05T17:22:37.370Z,1483636957.370 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US5CA50M.000
2017-01-05T17:22:37.371Z,1483636957.371 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US5CA61M.000
2017-01-05T17:22:37.371Z,1483636957.371 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US5CA61M.000
2017-01-05T17:22:37.371Z,1483636957.371 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US5CA62M.000
2017-01-05T17:22:37.371Z,1483636957.371 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US5CA62M.000
2017-01-05T17:22:37.371Z,1483636957.371 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US5CA83M.000
2017-01-05T17:22:37.372Z,1483636957.372 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US5CA83M.000
2017-01-05T17:22:37.431Z,1483636957.431 [MissionManager](INFO): DefineArg Default.ElapsedSinceDefaultStarted = 0.000000 min
2017-01-05T17:22:37.432Z,1483636957.432 [Default:A.Wait](DEBUG): Construct Wait.
2017-01-05T17:22:37.433Z,1483636957.433 [Default:B.GoToSurface](DEBUG): Construct GoToSurface.
2017-01-05T17:22:37.481Z,1483636957.481 [Default:CheckIn:Read_Iridium:A_Timeout:A.Execute](DEBUG): Construct Execute.
2017-01-05T17:22:37.483Z,1483636957.483 [Default:CheckIn:C.Wait](DEBUG): Construct Wait.
2017-01-05T17:22:37.505Z,1483636957.505 [Default:E.Execute](DEBUG): Construct Execute.
2017-01-05T17:22:37.508Z,1483636957.508 [MissionManager](DEBUG): 
<?xml version="1.0" encoding="UTF-8"?>
<Mission xmlns="Tethys"
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/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="Default">

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

    <Guidance:Wait>
        <Sequence/>
        <Description>
            Wait a moment to see if the scheduler starts a new mission before
            starting to actually run Default.
        </Description>
        <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">
            <Sequence/>
            <Timeout Duration="P5M"/>
            <Universal:time_fix/>
        </ReadDatum>

        <ReadDatum Id="Read_Iridium">
            <Sequence/>
            <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>


2017-01-05T17:22:37.527Z,1483636957.527 [controlThread](DEBUG): Component order: CycleStarter,Aanderaa_O2,CANONSampler,PAR_Licor,VemcoVR2C,DataOverHttps,Depth_Keller,DropWeight,NAL9602,Onboard,PNI_TCM,BPC1,PAR_Licor,Depth_Keller,DepthRateCalculator,PitchRateCalculator,SpeedCalculator,TempGradientCalculator,VerticalTemperatureHomogeneityIndexCalculator,YawRateCalculator,StratificationFrontDetector,DeadReckonUsingMultipleVelocitySources,DeadReckonUsingSpeedCalculator,UniversalFixResidualReporter,MissionManager,VerticalControl,HorizontalControl,SpeedControl,LoopControl,BuoyancyServo,ElevatorServo,MassServo,RudderServo,ThrusterServo,SBIT,IBIT,CBIT,Reporter,LogSplitter,
2017-01-05T17:22:37.555Z,1483636957.555 [CANONSampler](INFO): Powering down
2017-01-05T17:22:37.769Z,1483636957.769 [VemcoVR2C](INFO): Powering up
2017-01-05T17:22:38.381Z,1483636958.381 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2017-01-05T17:22:38.633Z,1483636958.633 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2017-01-05T17:22:38.728Z,1483636958.728 [BuoyancyServo](DEBUG): Initializing EZServoServo.
2017-01-05T17:22:38.753Z,1483636958.753 [BuoyancyServo](DEBUG): Initializing BuoyancyServo.
2017-01-05T17:22:38.759Z,1483636958.759 [ElevatorServo](DEBUG): Initializing EZServoServo.
2017-01-05T17:22:38.765Z,1483636958.765 [ElevatorServo](DEBUG): Initializing ElevatorServo.
2017-01-05T17:22:38.778Z,1483636958.778 [MassServo](DEBUG): Initializing EZServoServo.
2017-01-05T17:22:38.781Z,1483636958.781 [MassServo](DEBUG): Initializing MassServo.
2017-01-05T17:22:38.803Z,1483636958.803 [RudderServo](DEBUG): Initializing EZServoServo.
2017-01-05T17:22:38.809Z,1483636958.809 [RudderServo](DEBUG): Initializing RudderServo.
2017-01-05T17:22:38.814Z,1483636958.814 [ThrusterServo](DEBUG): Initializing EZServoServo.
2017-01-05T17:22:38.821Z,1483636958.821 [ThrusterServo](DEBUG): Initializing ThrusterServo.
2017-01-05T17:22:38.861Z,1483636958.861 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:38.862Z,1483636958.862 [CommandLine](FAULT): Scheduling is paused
2017-01-05T17:22:39.053Z,1483636959.053 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2017-01-05T17:22:39.054Z,1483636959.054 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2017-01-05T17:22:39.072Z,1483636959.072 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:39.320Z,1483636959.320 [NAL9602](INFO): Powering up NAL9602
2017-01-05T17:22:39.334Z,1483636959.334 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2017-01-05T17:22:39.335Z,1483636959.335 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2017-01-05T17:22:39.662Z,1483636959.662 [BuoyancyServo](ERROR): Buoyancy initialization uart error serial timeout
2017-01-05T17:22:39.662Z,1483636959.662 [BuoyancyServo](FAULT): Buoyancy failed to initialize
2017-01-05T17:22:39.662Z,1483636959.662 [BuoyancyServo] Communications Fault, FailCount= 1
2017-01-05T17:22:39.662Z,1483636959.662 [BuoyancyServo](ERROR): Communications Fault
2017-01-05T17:22:39.868Z,1483636959.868 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:39.868Z,1483636959.868 [CBIT](ERROR): Communications Fault in component: BuoyancyServo
2017-01-05T17:22:39.994Z,1483636959.994 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2017-01-05T17:22:39.995Z,1483636959.995 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2017-01-05T17:22:40.013Z,1483636960.013 [BuoyancyServo](DEBUG): Uninitialize Buoyancy Servo.
2017-01-05T17:22:40.014Z,1483636960.014 [BuoyancyServo](INFO): Powering down
2017-01-05T17:22:40.122Z,1483636960.122 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:40.348Z,1483636960.348 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2017-01-05T17:22:40.349Z,1483636960.349 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2017-01-05T17:22:40.374Z,1483636960.374 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:40.827Z,1483636960.827 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2017-01-05T17:22:40.836Z,1483636960.836 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2017-01-05T17:22:40.852Z,1483636960.852 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:41.156Z,1483636961.156 [DeadReckonUsingMultipleVelocitySources](DEBUG): Starting up and don't have orientation data yet.
2017-01-05T17:22:41.160Z,1483636961.160 [DeadReckonUsingSpeedCalculator](DEBUG): Starting up and don't have orientation data yet.
2017-01-05T17:22:41.266Z,1483636961.266 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:41.660Z,1483636961.660 [Rowe_600LCM](INFO): Stopping potential previous instance(s) of Rowe LCM interface
2017-01-05T17:22:41.811Z,1483636961.811 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:41.893Z,1483636961.893 [Rowe_600LCM](INFO): Started Rowe LCM interface with command:nohup ./bin/roweadcp -ldir /mnt/mmc/LRAUV/Logs/latest/ -dev /dev/ttyB5 -b 38400 >& /dev/null &
2017-01-05T17:22:42.168Z,1483636962.168 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:42.169Z,1483636962.169 [CBIT](INFO): Clearing failed state for component BuoyancyServo
2017-01-05T17:22:42.169Z,1483636962.169 [BuoyancyServo] No Fault, FailCount= 1
2017-01-05T17:22:42.487Z,1483636962.487 [BuoyancyServo](DEBUG): Initializing EZServoServo.
2017-01-05T17:22:42.487Z,1483636962.487 [BuoyancyServo](DEBUG): Initializing BuoyancyServo.
2017-01-05T17:22:42.601Z,1483636962.601 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:43.161Z,1483636963.161 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:43.619Z,1483636963.619 [Rowe_600LCM](INFO): LCM subscribed to channel:Rowe_600LCM.adcp_dvl.bottom_track
2017-01-05T17:22:43.621Z,1483636963.621 [Rowe_600LCM](INFO): LCM subscribed to channel:Rowe_600LCM.adcp_dvl.vehicle_water_velocity
2017-01-05T17:22:43.627Z,1483636963.627 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:43.775Z,1483636963.775 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:44.224Z,1483636964.224 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:44.648Z,1483636964.648 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:45.057Z,1483636965.057 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:45.362Z,1483636965.362 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:45.850Z,1483636965.850 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:46.183Z,1483636966.183 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:46.572Z,1483636966.572 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:46.992Z,1483636966.992 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:47.386Z,1483636967.386 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:47.634Z,1483636967.634 [Aanderaa_O2](FAULT): Timed out starting
2017-01-05T17:22:47.634Z,1483636967.634 [Aanderaa_O2] Communications Fault, FailCount= 1
2017-01-05T17:22:47.634Z,1483636967.634 [Aanderaa_O2](ERROR): Communications Fault
2017-01-05T17:22:47.635Z,1483636967.635 [CANONSampler](FAULT): LCB fault:  Current Limiter Activated.
2017-01-05T17:22:47.635Z,1483636967.635 [CANONSampler] Hardware Fault, FailCount= 1
2017-01-05T17:22:47.635Z,1483636967.635 [CANONSampler](ERROR): Hardware Fault
2017-01-05T17:22:47.810Z,1483636967.810 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:47.811Z,1483636967.811 [CBIT](ERROR): Communications Fault in component: Aanderaa_O2
2017-01-05T17:22:47.811Z,1483636967.811 [CBIT](ERROR): Hardware Fault in component: CANONSampler
2017-01-05T17:22:48.035Z,1483636968.035 [Aanderaa_O2](INFO): Powering down
2017-01-05T17:22:48.200Z,1483636968.200 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:48.201Z,1483636968.201 [CBIT](INFO): Clearing failed state for component CANONSampler
2017-01-05T17:22:48.201Z,1483636968.201 [CANONSampler] No Fault, FailCount= 1
2017-01-05T17:22:48.436Z,1483636968.436 [CANONSampler](INFO): Powering up
2017-01-05T17:22:48.612Z,1483636968.612 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:48.953Z,1483636968.953 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:48.954Z,1483636968.954 [CBIT](INFO): Clearing failed state for component Aanderaa_O2
2017-01-05T17:22:48.954Z,1483636968.954 [Aanderaa_O2] No Fault, FailCount= 1
2017-01-05T17:22:49.381Z,1483636969.381 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:49.639Z,1483636969.639 [CANONSampler](INFO): Powering down
2017-01-05T17:22:49.844Z,1483636969.844 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:50.182Z,1483636970.182 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:50.453Z,1483636970.453 [NAL9602](INFO): NAL9602 initialized
2017-01-05T17:22:50.553Z,1483636970.553 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:50.983Z,1483636970.983 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:51.360Z,1483636971.360 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:51.769Z,1483636971.769 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:52.190Z,1483636972.190 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:52.528Z,1483636972.528 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:52.947Z,1483636972.947 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:53.352Z,1483636973.352 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:53.749Z,1483636973.749 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:54.146Z,1483636974.146 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:54.569Z,1483636974.569 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:54.936Z,1483636974.936 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:55.352Z,1483636975.352 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:55.752Z,1483636975.752 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:56.155Z,1483636976.155 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:56.557Z,1483636976.557 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:56.942Z,1483636976.942 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:57.333Z,1483636977.333 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:57.734Z,1483636977.734 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:58.126Z,1483636978.126 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:58.535Z,1483636978.535 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:58.952Z,1483636978.952 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:59.400Z,1483636979.400 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:59.636Z,1483636979.636 [Aanderaa_O2](FAULT): Timed out starting
2017-01-05T17:22:59.636Z,1483636979.636 [Aanderaa_O2] Communications Fault, FailCount= 2
2017-01-05T17:22:59.636Z,1483636979.636 [Aanderaa_O2](ERROR): Communications Fault
2017-01-05T17:22:59.742Z,1483636979.742 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:22:59.742Z,1483636979.742 [CBIT](ERROR): Communications Fault in component: Aanderaa_O2
2017-01-05T17:23:00.033Z,1483636980.033 [Aanderaa_O2](INFO): Powering down
2017-01-05T17:23:00.126Z,1483636980.126 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:00.578Z,1483636980.578 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:00.951Z,1483636980.951 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:00.960Z,1483636980.960 [CBIT](INFO): Clearing failed state for component Aanderaa_O2
2017-01-05T17:23:00.960Z,1483636980.960 [Aanderaa_O2] No Fault, FailCount= 2
2017-01-05T17:23:01.390Z,1483636981.390 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:01.761Z,1483636981.761 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:02.172Z,1483636982.172 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:02.576Z,1483636982.576 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:02.924Z,1483636982.924 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:03.326Z,1483636983.326 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:03.760Z,1483636983.760 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:04.113Z,1483636984.113 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:04.566Z,1483636984.566 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:04.941Z,1483636984.941 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:05.336Z,1483636985.336 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:05.730Z,1483636985.730 [SBIT](IMPORTANT): Beginning Startup BIT
2017-01-05T17:23:05.736Z,1483636985.736 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:05.737Z,1483636985.737 [CBIT](IMPORTANT): Beginning GF scan
2017-01-05T17:23:06.201Z,1483636986.201 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:06.568Z,1483636986.568 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:06.981Z,1483636986.981 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:07.528Z,1483636987.528 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:08.210Z,1483636988.210 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:08.470Z,1483636988.470 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:08.851Z,1483636988.851 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:09.183Z,1483636989.183 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:09.635Z,1483636989.635 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:09.997Z,1483636989.997 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:10.453Z,1483636990.453 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:10.783Z,1483636990.783 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:11.238Z,1483636991.238 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:11.423Z,1483636991.423 [Aanderaa_O2](FAULT): Timed out starting
2017-01-05T17:23:11.423Z,1483636991.423 [Aanderaa_O2] Communications Fault, FailCount= 3
2017-01-05T17:23:11.423Z,1483636991.423 [Aanderaa_O2](ERROR): Communications Fault
2017-01-05T17:23:11.621Z,1483636991.621 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:11.622Z,1483636991.622 [CBIT](ERROR): Communications Fault in component: Aanderaa_O2
2017-01-05T17:23:11.622Z,1483636991.622 [CBIT](FAULT): Communications Fault in component: Aanderaa_O2
2017-01-05T17:23:11.824Z,1483636991.824 [Aanderaa_O2](INFO): Powering down
2017-01-05T17:23:11.983Z,1483636991.983 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:12.452Z,1483636992.452 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:12.777Z,1483636992.777 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:13.210Z,1483636993.210 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:13.440Z,1483636993.440 [NAL9602](INFO): SBD MO Status=2, MOMSN=44666, MT Status=2, MTMSN=0
2017-01-05T17:23:13.440Z,1483636993.440 [NAL9602](ERROR): Failed to initiate SBD session. Error code: 2
2017-01-05T17:23:13.515Z,1483636993.515 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:14.016Z,1483636994.016 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:14.350Z,1483636994.350 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:14.775Z,1483636994.775 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:15.123Z,1483636995.123 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:15.548Z,1483636995.548 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:15.951Z,1483636995.951 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:16.322Z,1483636996.322 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:16.761Z,1483636996.761 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:17.148Z,1483636997.148 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:17.567Z,1483636997.567 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:17.926Z,1483636997.926 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:18.358Z,1483636998.358 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:18.734Z,1483636998.734 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:19.167Z,1483636999.167 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:19.568Z,1483636999.568 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:19.957Z,1483636999.957 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:20.333Z,1483637000.333 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:20.777Z,1483637000.777 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:21.686Z,1483637001.686 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:21.950Z,1483637001.950 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:22.327Z,1483637002.327 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:22.741Z,1483637002.741 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:23.109Z,1483637003.109 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:23.570Z,1483637003.570 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:23.922Z,1483637003.922 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:24.362Z,1483637004.362 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:24.727Z,1483637004.727 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:25.204Z,1483637005.204 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:25.496Z,1483637005.496 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:25.941Z,1483637005.941 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:26.370Z,1483637006.370 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:26.686Z,1483637006.686 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:27.116Z,1483637007.116 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:27.468Z,1483637007.468 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:27.860Z,1483637007.860 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:28.250Z,1483637008.250 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:28.661Z,1483637008.661 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:29.078Z,1483637009.078 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:29.491Z,1483637009.491 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:29.922Z,1483637009.922 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:30.244Z,1483637010.244 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:30.677Z,1483637010.677 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:31.042Z,1483637011.042 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:31.474Z,1483637011.474 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:31.855Z,1483637011.855 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:32.215Z,1483637012.215 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:32.623Z,1483637012.623 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:32.630Z,1483637012.630 [CBIT](FAULT): Low side GF detected
mA:
CHAN 5 (24V): 0.391695
CHAN 4 (Batt): 0.391695
CHAN 2 (12V): 0.391695
CHAN 1 (5V): 0.391695
CHAN 0 (3.3V): 0.353052
OPEN: 0.000670
Full Scale Calc: 0.392
2017-01-05T17:23:33.014Z,1483637013.014 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:33.424Z,1483637013.424 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:33.832Z,1483637013.832 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:34.225Z,1483637014.225 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:34.616Z,1483637014.616 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:35.072Z,1483637015.072 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:35.431Z,1483637015.431 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:35.885Z,1483637015.885 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:36.200Z,1483637016.200 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:36.630Z,1483637016.630 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:37.029Z,1483637017.029 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:37.451Z,1483637017.451 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:37.846Z,1483637017.846 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:38.226Z,1483637018.226 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:38.599Z,1483637018.599 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:39.026Z,1483637019.026 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:39.399Z,1483637019.399 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:39.800Z,1483637019.800 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:40.233Z,1483637020.233 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:40.614Z,1483637020.614 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:41.027Z,1483637021.027 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:41.435Z,1483637021.435 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:41.790Z,1483637021.790 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:42.284Z,1483637022.284 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:42.627Z,1483637022.627 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:42.992Z,1483637022.992 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:43.404Z,1483637023.404 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:43.793Z,1483637023.793 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:44.193Z,1483637024.193 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:44.602Z,1483637024.602 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:44.989Z,1483637024.989 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:45.396Z,1483637025.396 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:45.784Z,1483637025.784 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:46.185Z,1483637026.185 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:46.654Z,1483637026.654 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:46.000Z,1483637027.000 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:47.419Z,1483637027.419 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:48.011Z,1483637028.011 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:48.648Z,1483637028.648 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:48.945Z,1483637028.945 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:49.281Z,1483637029.281 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:49.674Z,1483637029.674 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:50.018Z,1483637030.018 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:50.459Z,1483637030.459 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:50.899Z,1483637030.899 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:51.169Z,1483637031.169 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:51.553Z,1483637031.553 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:51.958Z,1483637031.958 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:52.354Z,1483637032.354 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:52.777Z,1483637032.777 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:53.152Z,1483637033.152 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:53.556Z,1483637033.556 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:53.973Z,1483637033.973 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:54.319Z,1483637034.319 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:54.710Z,1483637034.710 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:55.107Z,1483637035.107 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:55.540Z,1483637035.540 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:55.922Z,1483637035.921 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:56.315Z,1483637036.315 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:56.715Z,1483637036.715 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:57.116Z,1483637037.116 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:57.518Z,1483637037.518 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:57.914Z,1483637037.914 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:58.309Z,1483637038.309 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:58.664Z,1483637038.664 [NAL9602](INFO): SBD MO Status=0, MOMSN=44666, MT Status=0, MTMSN=0
2017-01-05T17:23:58.664Z,1483637038.664 [NAL9602](INFO): No messages in MT queue
2017-01-05T17:23:58.742Z,1483637038.742 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:59.123Z,1483637039.123 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:59.522Z,1483637039.522 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:23:59.972Z,1483637039.972 [SBIT](IMPORTANT): SBIT PASSED
2017-01-05T17:23:59.974Z,1483637039.974 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:00.322Z,1483637040.322 [MissionManager](IMPORTANT): Started mission Startup
2017-01-05T17:24:00.323Z,1483637040.323 [Startup] Running Loop=1
2017-01-05T17:24:00.323Z,1483637040.323 [Startup](DEBUG): Aggregate::initialize Startup
2017-01-05T17:24:00.323Z,1483637040.323 [Startup:A.GoToSurface] Running Loop=1
2017-01-05T17:24:00.323Z,1483637040.323 [Startup:A.GoToSurface](DEBUG): Initialize GoToSurfaceComponent.
2017-01-05T17:24:00.324Z,1483637040.324 [Startup:A.GoToSurface](DEBUG): No depth rate setting specified. Using default value of nan m/s.
2017-01-05T17:24:00.324Z,1483637040.324 [Startup:A.GoToSurface](DEBUG): No pitch setting specified. Using default value of nan degrees.
2017-01-05T17:24:00.325Z,1483637040.325 [Startup:A.GoToSurface](DEBUG): No speed setting specified. Using default value of 1.000000 m/s.
2017-01-05T17:24:00.325Z,1483637040.325 [Startup:A.GoToSurface](DEBUG): No pitch timeout specified. Using default value of 20.000000 seconds.
2017-01-05T17:24:00.325Z,1483637040.325 [Startup:A.GoToSurface](DEBUG): No surface timeout specified. Using default value of 1000.000000 seconds.
2017-01-05T17:24:00.347Z,1483637040.347 [Startup:StartupSatComms] Running Loop=1
2017-01-05T17:24:00.348Z,1483637040.348 [Startup:StartupSatComms](DEBUG): Aggregate::initialize Startup:StartupSatComms
2017-01-05T17:24:00.348Z,1483637040.348 [Startup:StartupSatComms:A] Running Loop=1
2017-01-05T17:24:00.364Z,1483637040.364 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:00.717Z,1483637040.717 [Startup:StartupSatComms:A](DEBUG): Initialize ReadDataComponent to sense latitude_fix
2017-01-05T17:24:00.731Z,1483637040.731 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:01.124Z,1483637041.124 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:01.531Z,1483637041.531 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:01.931Z,1483637041.931 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:02.330Z,1483637042.330 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:02.760Z,1483637042.760 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:03.138Z,1483637043.138 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:03.530Z,1483637043.530 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:03.922Z,1483637043.922 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:04.318Z,1483637044.318 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:04.731Z,1483637044.731 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:05.151Z,1483637045.151 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:05.525Z,1483637045.525 [BPC1](ERROR): Failed to receive battery data
2017-01-05T17:24:05.525Z,1483637045.525 [BPC1] Communications Fault, FailCount= 1
2017-01-05T17:24:05.525Z,1483637045.525 [BPC1](ERROR): Communications Fault
2017-01-05T17:24:05.543Z,1483637045.543 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:05.544Z,1483637045.544 [CBIT](ERROR): Communications Fault in component: BPC1
2017-01-05T17:24:05.944Z,1483637045.944 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:06.308Z,1483637046.308 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:06.703Z,1483637046.703 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:06.704Z,1483637046.704 [CBIT](INFO): Clearing failed state for component BPC1
2017-01-05T17:24:06.704Z,1483637046.704 [BPC1] No Fault, FailCount= 1
2017-01-05T17:24:07.180Z,1483637047.180 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:07.555Z,1483637047.555 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:07.908Z,1483637047.908 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:08.330Z,1483637048.330 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:08.741Z,1483637048.741 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:09.143Z,1483637049.143 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:09.507Z,1483637049.507 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:09.906Z,1483637049.906 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:10.334Z,1483637050.334 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:10.701Z,1483637050.701 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:11.107Z,1483637051.107 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:11.552Z,1483637051.552 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:11.941Z,1483637051.941 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:12.307Z,1483637052.307 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:12.701Z,1483637052.701 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:13.110Z,1483637053.110 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:13.538Z,1483637053.538 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:13.908Z,1483637053.908 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:14.335Z,1483637054.335 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:14.739Z,1483637054.739 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:15.131Z,1483637055.131 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:15.505Z,1483637055.505 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:15.905Z,1483637055.905 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:16.326Z,1483637056.326 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:16.729Z,1483637056.729 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:17.188Z,1483637057.188 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:17.509Z,1483637057.509 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:17.954Z,1483637057.954 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:18.333Z,1483637058.333 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:18.751Z,1483637058.751 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:19.157Z,1483637059.157 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:19.505Z,1483637059.505 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:19.937Z,1483637059.937 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:20.345Z,1483637060.345 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:20.711Z,1483637060.711 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:21.107Z,1483637061.107 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:21.514Z,1483637061.514 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:21.907Z,1483637061.907 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:22.309Z,1483637062.309 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:22.716Z,1483637062.716 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:23.147Z,1483637063.147 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:23.538Z,1483637063.538 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:23.948Z,1483637063.948 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:24.330Z,1483637064.330 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:24.723Z,1483637064.723 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:25.113Z,1483637065.113 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:25.512Z,1483637065.512 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:25.945Z,1483637065.945 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:26.350Z,1483637066.350 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:26.756Z,1483637066.756 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:27.115Z,1483637067.115 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:27.511Z,1483637067.511 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:27.920Z,1483637067.920 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:28.314Z,1483637068.314 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:28.773Z,1483637068.773 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:29.152Z,1483637069.152 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:29.527Z,1483637069.527 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:29.922Z,1483637069.922 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:30.338Z,1483637070.338 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:30.717Z,1483637070.717 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:31.119Z,1483637071.119 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:31.513Z,1483637071.513 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:31.922Z,1483637071.922 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:32.323Z,1483637072.323 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:32.754Z,1483637072.754 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:33.151Z,1483637073.151 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:33.512Z,1483637073.512 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:33.908Z,1483637073.908 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:34.284Z,1483637074.284 [BPC1](ERROR): Failed to receive battery data
2017-01-05T17:24:34.301Z,1483637074.301 [BPC1] Communications Fault, FailCount= 1
2017-01-05T17:24:34.301Z,1483637074.301 [BPC1](ERROR): Communications Fault
2017-01-05T17:24:34.348Z,1483637074.348 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:34.353Z,1483637074.353 [CBIT](ERROR): Communications Fault in component: BPC1
2017-01-05T17:24:34.730Z,1483637074.730 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:35.137Z,1483637075.137 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:35.538Z,1483637075.538 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:35.539Z,1483637075.539 [CBIT](INFO): Clearing failed state for component BPC1
2017-01-05T17:24:35.539Z,1483637075.539 [BPC1] No Fault, FailCount= 1
2017-01-05T17:24:35.987Z,1483637075.987 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:36.323Z,1483637076.323 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:36.743Z,1483637076.743 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:37.139Z,1483637077.139 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:37.523Z,1483637077.523 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:37.874Z,1483637077.874 [Rowe_600LCM](FAULT): Did not receive valid device response within the specified allowable sample time.
2017-01-05T17:24:37.874Z,1483637077.874 [Rowe_600LCM] Communications Fault, FailCount= 1
2017-01-05T17:24:37.874Z,1483637077.874 [Rowe_600LCM](ERROR): Communications Fault
2017-01-05T17:24:37.969Z,1483637077.969 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:37.974Z,1483637077.974 [CBIT](ERROR): Communications Fault in component: Rowe_600LCM
2017-01-05T17:24:38.279Z,1483637078.279 [Rowe_600LCM](INFO): Powering down
2017-01-05T17:24:38.357Z,1483637078.357 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:38.739Z,1483637078.739 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:39.131Z,1483637079.131 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:39.504Z,1483637079.504 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:39.505Z,1483637079.505 [CBIT](INFO): Clearing failed state for component Rowe_600LCM
2017-01-05T17:24:39.505Z,1483637079.505 [Rowe_600LCM] No Fault, FailCount= 1
2017-01-05T17:24:39.897Z,1483637079.897 [Rowe_600LCM](INFO): Initializing
2017-01-05T17:24:39.898Z,1483637079.898 [Rowe_600LCM](INFO): Checking LCM
2017-01-05T17:24:39.898Z,1483637079.898 [Rowe_600LCM](INFO): LCM OK
2017-01-05T17:24:39.898Z,1483637079.898 [Rowe_600LCM](INFO): Powering up
2017-01-05T17:24:39.958Z,1483637079.958 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:40.313Z,1483637080.313 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:40.740Z,1483637080.740 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:41.146Z,1483637081.146 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:41.532Z,1483637081.532 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:41.948Z,1483637081.948 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:42.316Z,1483637082.316 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:42.707Z,1483637082.707 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:43.114Z,1483637083.114 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:43.509Z,1483637083.509 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:43.977Z,1483637083.977 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:44.063Z,1483637084.063 [Rowe_600LCM](INFO): Stopping potential previous instance(s) of Rowe LCM interface
2017-01-05T17:24:44.130Z,1483637084.130 [Rowe_600LCM](INFO): Started Rowe LCM interface with command:nohup ./bin/roweadcp -ldir /mnt/mmc/LRAUV/Logs/latest/ -dev /dev/ttyB5 -b 38400 >& /dev/null &
2017-01-05T17:24:44.132Z,1483637084.132 [Rowe_600LCM](INFO): LCM subscribed to channel:Rowe_600LCM.adcp_dvl.bottom_track
2017-01-05T17:24:44.133Z,1483637084.133 [Rowe_600LCM](INFO): LCM subscribed to channel:Rowe_600LCM.adcp_dvl.vehicle_water_velocity
2017-01-05T17:24:44.369Z,1483637084.369 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:44.743Z,1483637084.743 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:45.177Z,1483637085.177 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:45.527Z,1483637085.527 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:45.913Z,1483637085.913 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:46.363Z,1483637086.363 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:46.716Z,1483637086.716 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:47.154Z,1483637087.154 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:47.569Z,1483637087.569 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:47.951Z,1483637087.951 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:48.336Z,1483637088.336 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:48.730Z,1483637088.730 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:49.124Z,1483637089.124 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:49.518Z,1483637089.518 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:49.938Z,1483637089.938 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:50.340Z,1483637090.340 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:50.740Z,1483637090.740 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:51.121Z,1483637091.121 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:51.504Z,1483637091.504 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:51.907Z,1483637091.907 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:52.329Z,1483637092.329 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:52.702Z,1483637092.702 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:53.143Z,1483637093.143 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:53.552Z,1483637093.552 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:53.950Z,1483637093.950 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:54.308Z,1483637094.308 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:54.709Z,1483637094.709 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:55.108Z,1483637095.108 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:55.508Z,1483637095.508 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:55.941Z,1483637095.941 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:56.351Z,1483637096.351 [BPC1](ERROR): Failed to parse bank B battery data
2017-01-05T17:24:56.351Z,1483637096.351 [BPC1] Data Fault, FailCount= 1
2017-01-05T17:24:56.351Z,1483637096.351 [BPC1](ERROR): Data Fault
2017-01-05T17:24:56.391Z,1483637096.391 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:56.392Z,1483637096.392 [CBIT](ERROR): Data Fault in component: BPC1
2017-01-05T17:24:56.729Z,1483637096.729 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:57.118Z,1483637097.118 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:57.516Z,1483637097.516 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:57.517Z,1483637097.517 [CBIT](INFO): Clearing failed state for component BPC1
2017-01-05T17:24:57.517Z,1483637097.517 [BPC1] No Fault, FailCount= 1
2017-01-05T17:24:57.972Z,1483637097.972 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:58.353Z,1483637098.353 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:58.723Z,1483637098.723 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:59.159Z,1483637099.159 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:59.530Z,1483637099.530 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:24:59.935Z,1483637099.935 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:00.314Z,1483637100.314 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:00.710Z,1483637100.710 [Startup:StartupSatComms:A](INFO): Timed out from 2017-01-05T17:24:00.3Z
2017-01-05T17:25:00.711Z,1483637100.711 [Startup:StartupSatComms:A] Stopped
2017-01-05T17:25:00.711Z,1483637100.711 [Startup:StartupSatComms:B] Running Loop=1
2017-01-05T17:25:00.730Z,1483637100.730 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:01.126Z,1483637101.126 [Startup:StartupSatComms:B](DEBUG): Initialize ReadDataComponent to sense platform_communications
2017-01-05T17:25:01.149Z,1483637101.149 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:01.540Z,1483637101.540 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:01.928Z,1483637101.928 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:02.343Z,1483637102.343 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:02.742Z,1483637102.742 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:03.130Z,1483637103.130 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:03.518Z,1483637103.518 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:03.915Z,1483637103.915 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:04.325Z,1483637104.325 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:04.748Z,1483637104.748 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:05.139Z,1483637105.139 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:05.518Z,1483637105.518 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:05.917Z,1483637105.917 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:06.300Z,1483637106.300 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:06.724Z,1483637106.724 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:07.176Z,1483637107.176 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:07.857Z,1483637107.857 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:09.995Z,1483637109.995 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:10.145Z,1483637110.145 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:10.451Z,1483637110.451 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:10.887Z,1483637110.887 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:11.253Z,1483637111.253 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:11.714Z,1483637111.714 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:12.090Z,1483637112.090 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:12.455Z,1483637112.455 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:12.859Z,1483637112.859 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:13.256Z,1483637113.256 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:13.656Z,1483637113.656 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:14.056Z,1483637114.056 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:14.457Z,1483637114.457 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:14.858Z,1483637114.858 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:15.255Z,1483637115.255 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:15.655Z,1483637115.655 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:16.070Z,1483637116.070 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:16.458Z,1483637116.458 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:16.856Z,1483637116.856 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:17.258Z,1483637117.258 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:17.658Z,1483637117.658 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:18.060Z,1483637118.060 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:18.460Z,1483637118.460 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:18.859Z,1483637118.859 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:19.256Z,1483637119.256 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:19.657Z,1483637119.657 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:20.057Z,1483637120.057 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:20.458Z,1483637120.458 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:20.908Z,1483637120.908 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:21.259Z,1483637121.259 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:21.708Z,1483637121.708 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:22.061Z,1483637122.061 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:22.498Z,1483637122.498 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:22.862Z,1483637122.862 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:23.294Z,1483637123.294 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:23.662Z,1483637123.662 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:24.096Z,1483637124.096 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:24.456Z,1483637124.456 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:24.860Z,1483637124.860 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:25.261Z,1483637125.261 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:25.658Z,1483637125.658 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:26.062Z,1483637126.062 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:26.413Z,1483637126.413 [NAL9602](INFO): SBD MO Status=2, MOMSN=44667, MT Status=2, MTMSN=0
2017-01-05T17:25:26.413Z,1483637126.413 [NAL9602](ERROR): Failed to initiate SBD session. Error code: 2
2017-01-05T17:25:26.471Z,1483637126.471 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:26.856Z,1483637126.856 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:27.267Z,1483637127.267 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:27.668Z,1483637127.668 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:28.068Z,1483637128.068 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:28.461Z,1483637128.461 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:28.864Z,1483637128.864 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:29.290Z,1483637129.290 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:29.656Z,1483637129.656 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:30.061Z,1483637130.061 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:30.458Z,1483637130.458 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:30.868Z,1483637130.868 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:31.452Z,1483637131.452 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:33.749Z,1483637133.749 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:33.865Z,1483637133.865 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:34.216Z,1483637134.216 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:34.652Z,1483637134.652 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:35.020Z,1483637135.020 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:35.453Z,1483637135.453 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:35.853Z,1483637135.853 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:36.218Z,1483637136.218 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:36.623Z,1483637136.623 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:37.015Z,1483637137.015 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:37.410Z,1483637137.410 [DeadReckonUsingMultipleVelocitySources](FAULT): Will not write estimated position: latitudeAccuracy_ = nan, longitudeAccuracy_ = nan, depthAccuracy_ = nan
2017-01-05T17:25:37.410Z,1483637137.410 [DeadReckonUsingMultipleVelocitySources] Software Fault, FailCount= 1
2017-01-05T17:25:37.410Z,1483637137.410 [DeadReckonUsingMultipleVelocitySources](ERROR): Software Fault
2017-01-05T17:25:37.412Z,1483637137.412 [DeadReckonUsingSpeedCalculator](FAULT): Will not write estimated position: latitudeAccuracy_ = nan, longitudeAccuracy_ = nan, depthAccuracy_ = nan
2017-01-05T17:25:37.412Z,1483637137.412 [DeadReckonUsingSpeedCalculator] Software Fault, FailCount= 1
2017-01-05T17:25:37.412Z,1483637137.412 [DeadReckonUsingSpeedCalculator](ERROR): Software Fault
2017-01-05T17:25:37.422Z,1483637137.422 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:37.423Z,1483637137.423 [CBIT](ERROR): Software Fault in component: DeadReckonUsingMultipleVelocitySources
2017-01-05T17:25:37.423Z,1483637137.423 [CBIT](ERROR): Software Fault in component: DeadReckonUsingSpeedCalculator
2017-01-05T17:25:37.826Z,1483637137.826 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:37.827Z,1483637137.827 [CBIT](INFO): Clearing failed state for component DeadReckonUsingMultipleVelocitySources
2017-01-05T17:25:37.831Z,1483637137.831 [DeadReckonUsingMultipleVelocitySources] No Fault, FailCount= 1
2017-01-05T17:25:37.832Z,1483637137.832 [CBIT](INFO): Clearing failed state for component DeadReckonUsingSpeedCalculator
2017-01-05T17:25:37.832Z,1483637137.832 [DeadReckonUsingSpeedCalculator] No Fault, FailCount= 1
2017-01-05T17:25:38.185Z,1483637138.185 [DeadReckonUsingMultipleVelocitySources](DEBUG): Initializing DeadReckonUsingMultipleVelocitySources component.
2017-01-05T17:25:38.186Z,1483637138.186 [DeadReckonUsingMultipleVelocitySources](INFO): Will consider orientation measurement stale after 120s.
2017-01-05T17:25:38.186Z,1483637138.186 [DeadReckonUsingMultipleVelocitySources](INFO): Will consider velocity measurement stale after 20s.
2017-01-05T17:25:38.186Z,1483637138.186 [DeadReckonUsingSpeedCalculator](DEBUG): Initializing DeadReckonUsingSpeedCalculator component.
2017-01-05T17:25:38.187Z,1483637138.187 [DeadReckonUsingSpeedCalculator](INFO): Will consider orientation measurement stale after 120s.
2017-01-05T17:25:38.187Z,1483637138.187 [DeadReckonUsingSpeedCalculator](INFO): Will consider velocity measurement stale after 20s.
2017-01-05T17:25:38.209Z,1483637138.209 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:38.594Z,1483637138.594 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 1.2 s old, using for 20.0 s.
2017-01-05T17:25:38.621Z,1483637138.621 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:38.995Z,1483637138.995 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 1.6 s old, using for 20.0 s.
2017-01-05T17:25:39.026Z,1483637139.026 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:39.387Z,1483637139.387 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 2.0 s old, using for 20.0 s.
2017-01-05T17:25:39.398Z,1483637139.398 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:39.788Z,1483637139.788 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 2.4 s old, using for 20.0 s.
2017-01-05T17:25:39.799Z,1483637139.799 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:40.189Z,1483637140.189 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 2.8 s old, using for 20.0 s.
2017-01-05T17:25:40.200Z,1483637140.200 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:40.589Z,1483637140.589 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 3.2 s old, using for 20.0 s.
2017-01-05T17:25:40.616Z,1483637140.616 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:40.988Z,1483637140.988 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 3.6 s old, using for 20.0 s.
2017-01-05T17:25:40.999Z,1483637140.999 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:41.395Z,1483637141.395 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 4.0 s old, using for 20.0 s.
2017-01-05T17:25:41.426Z,1483637141.426 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:41.427Z,1483637141.427 [CBIT](INFO): Clearing failed state for component Aanderaa_O2
2017-01-05T17:25:41.427Z,1483637141.427 [Aanderaa_O2] No Fault, FailCount= 3
2017-01-05T17:25:41.787Z,1483637141.787 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 4.4 s old, using for 20.0 s.
2017-01-05T17:25:41.797Z,1483637141.797 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:42.201Z,1483637142.201 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 4.8 s old, using for 20.0 s.
2017-01-05T17:25:42.228Z,1483637142.228 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:42.597Z,1483637142.597 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 5.2 s old, using for 20.0 s.
2017-01-05T17:25:42.624Z,1483637142.624 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:42.998Z,1483637142.998 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 5.6 s old, using for 20.0 s.
2017-01-05T17:25:43.025Z,1483637143.025 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:43.398Z,1483637143.398 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 6.0 s old, using for 20.0 s.
2017-01-05T17:25:43.429Z,1483637143.429 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:43.795Z,1483637143.795 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 6.4 s old, using for 20.0 s.
2017-01-05T17:25:43.806Z,1483637143.806 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:44.188Z,1483637144.188 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 6.8 s old, using for 20.0 s.
2017-01-05T17:25:44.199Z,1483637144.199 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:44.643Z,1483637144.643 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 7.2 s old, using for 20.0 s.
2017-01-05T17:25:44.670Z,1483637144.670 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:44.991Z,1483637144.991 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 7.6 s old, using for 20.0 s.
2017-01-05T17:25:45.002Z,1483637145.002 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:45.444Z,1483637145.444 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 8.0 s old, using for 20.0 s.
2017-01-05T17:25:45.463Z,1483637145.463 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:45.796Z,1483637145.796 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 8.4 s old, using for 20.0 s.
2017-01-05T17:25:45.807Z,1483637145.807 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:46.245Z,1483637146.245 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 8.8 s old, using for 20.0 s.
2017-01-05T17:25:46.256Z,1483637146.256 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:46.599Z,1483637146.599 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 9.2 s old, using for 20.0 s.
2017-01-05T17:25:46.610Z,1483637146.610 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:47.044Z,1483637147.044 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 9.6 s old, using for 20.0 s.
2017-01-05T17:25:47.055Z,1483637147.055 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:47.436Z,1483637147.436 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 10.0 s old, using for 20.0 s.
2017-01-05T17:25:47.447Z,1483637147.447 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:47.801Z,1483637147.801 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 10.4 s old, using for 20.0 s.
2017-01-05T17:25:47.832Z,1483637147.832 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:48.198Z,1483637148.198 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 10.8 s old, using for 20.0 s.
2017-01-05T17:25:48.209Z,1483637148.209 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:48.594Z,1483637148.594 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 11.2 s old, using for 20.0 s.
2017-01-05T17:25:48.605Z,1483637148.605 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:48.999Z,1483637148.999 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 11.6 s old, using for 20.0 s.
2017-01-05T17:25:49.010Z,1483637149.010 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:49.400Z,1483637149.400 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 12.0 s old, using for 20.0 s.
2017-01-05T17:25:49.411Z,1483637149.411 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:49.796Z,1483637149.796 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 12.4 s old, using for 20.0 s.
2017-01-05T17:25:49.807Z,1483637149.807 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:50.201Z,1483637150.201 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 12.8 s old, using for 20.0 s.
2017-01-05T17:25:50.228Z,1483637150.228 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:50.597Z,1483637150.597 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 13.2 s old, using for 20.0 s.
2017-01-05T17:25:50.608Z,1483637150.608 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:51.002Z,1483637151.002 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 13.6 s old, using for 20.0 s.
2017-01-05T17:25:51.029Z,1483637151.029 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:51.394Z,1483637151.394 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 14.0 s old, using for 20.0 s.
2017-01-05T17:25:51.405Z,1483637151.405 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:51.799Z,1483637151.799 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 14.4 s old, using for 20.0 s.
2017-01-05T17:25:51.810Z,1483637151.810 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:52.157Z,1483637152.157 [Aanderaa_O2](FAULT): Timed out starting
2017-01-05T17:25:52.157Z,1483637152.157 [Aanderaa_O2] Communications Fault, FailCount= 1
2017-01-05T17:25:52.157Z,1483637152.157 [Aanderaa_O2](ERROR): Communications Fault
2017-01-05T17:25:52.225Z,1483637152.225 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 14.8 s old, using for 20.0 s.
2017-01-05T17:25:52.236Z,1483637152.236 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:52.236Z,1483637152.236 [CBIT](ERROR): Communications Fault in component: Aanderaa_O2
2017-01-05T17:25:52.675Z,1483637152.675 [Aanderaa_O2](INFO): Powering down
2017-01-05T17:25:52.727Z,1483637152.727 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 15.3 s old, using for 20.0 s.
2017-01-05T17:25:52.752Z,1483637152.752 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:52.994Z,1483637152.994 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 15.6 s old, using for 20.0 s.
2017-01-05T17:25:53.005Z,1483637153.005 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:53.402Z,1483637153.402 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 16.0 s old, using for 20.0 s.
2017-01-05T17:25:53.413Z,1483637153.413 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:53.414Z,1483637153.414 [CBIT](INFO): Clearing failed state for component Aanderaa_O2
2017-01-05T17:25:53.414Z,1483637153.414 [Aanderaa_O2] No Fault, FailCount= 1
2017-01-05T17:25:53.795Z,1483637153.795 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 16.4 s old, using for 20.0 s.
2017-01-05T17:25:53.806Z,1483637153.806 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:54.200Z,1483637154.200 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 16.8 s old, using for 20.0 s.
2017-01-05T17:25:54.212Z,1483637154.212 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:54.579Z,1483637154.579 [NAL9602](IMPORTANT): SBD MO Status=1, MOMSN=44667, MT Status=1, MTMSN=1080
2017-01-05T17:25:54.634Z,1483637154.634 [NAL9602](INFO): Sent 18 bytes from file Logs/20170105T161706/Courier0032.lzma
2017-01-05T17:25:54.634Z,1483637154.634 [NAL9602](INFO): Packets left to send: 0
2017-01-05T17:25:54.636Z,1483637154.636 [NAL9602](DEBUG): Stored copy of sent data in Logs/20170105T161706/Courier0032.lzma.parts/0000.sbd
2017-01-05T17:25:54.636Z,1483637154.636 [NAL9602](DEBUG): Completed sending Logs/20170105T161706/Courier0032.lzma
2017-01-05T17:25:54.664Z,1483637154.664 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 17.3 s old, using for 20.0 s.
2017-01-05T17:25:54.703Z,1483637154.703 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:55.128Z,1483637155.128 [NAL9602](INFO): Received command:restart sys
2017-01-05T17:25:55.135Z,1483637155.135 [CommandLine](IMPORTANT): got command restart system
2017-01-05T17:25:55.155Z,1483637155.155 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 17.7 s old, using for 20.0 s.
2017-01-05T17:25:55.166Z,1483637155.166 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:55.416Z,1483637155.416 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 18.0 s old, using for 20.0 s.
2017-01-05T17:25:55.451Z,1483637155.451 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:55.814Z,1483637155.814 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 18.4 s old, using for 20.0 s.
2017-01-05T17:25:55.845Z,1483637155.845 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:56.307Z,1483637156.307 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 18.9 s old, using for 20.0 s.
2017-01-05T17:25:56.347Z,1483637156.347 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:56.620Z,1483637156.620 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 19.2 s old, using for 20.0 s.
2017-01-05T17:25:56.632Z,1483637156.632 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:57.051Z,1483637157.051 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 19.6 s old, using for 20.0 s.
2017-01-05T17:25:57.071Z,1483637157.071 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:57.401Z,1483637157.401 [DeadReckonUsingMultipleVelocitySources](DEBUG): Bottom track data is 20.0 s old, using for 20.0 s.
2017-01-05T17:25:57.425Z,1483637157.425 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:57.482Z,1483637157.482 [CommandLine ThreadHandler](INFO): Uninitializing protected caller thread.
2017-01-05T17:25:57.482Z,1483637157.482 [CommandLine ThreadHandler](INFO): Thread cancelled.
2017-01-05T17:25:57.662Z,1483637157.662 [Supervisor](DEBUG): Uninitializing supervisor and starting cleanup.  Bye!
2017-01-05T17:25:57.662Z,1483637157.662 [CommandLine ThreadHandler](INFO): Thread cancelled.
2017-01-05T17:25:57.663Z,1483637157.663 [CommandLine](INFO): Join timeout helper Thread ID is 901
2017-01-05T17:25:57.664Z,1483637157.664 [ComponentRegistry](INFO): Shutting down NavChartDb ThreadHandler
2017-01-05T17:25:57.664Z,1483637157.664 [NavChartDb ThreadHandler](INFO): Thread cancelled.
2017-01-05T17:25:57.664Z,1483637157.664 [NavChartDb](INFO): Join timeout helper Thread ID is 902
2017-01-05T17:25:57.832Z,1483637157.832 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:57.999Z,1483637157.999 [NavChartDb ThreadHandler](INFO): Uninitializing protected caller thread.
2017-01-05T17:25:57.999Z,1483637157.999 [NavChartDb ThreadHandler](INFO): Thread cancelled.
2017-01-05T17:25:58.015Z,1483637158.015 [ComponentRegistry](INFO): Shutting down Rowe_600LCM ThreadHandler
2017-01-05T17:25:58.015Z,1483637158.015 [Rowe_600LCM ThreadHandler](INFO): Thread cancelled.
2017-01-05T17:25:58.015Z,1483637158.015 [Rowe_600LCM](INFO): Join timeout helper Thread ID is 903
2017-01-05T17:25:58.237Z,1483637158.237 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:58.311Z,1483637158.311 [Rowe_600LCM ThreadHandler](INFO): Uninitializing protected caller thread.
2017-01-05T17:25:58.312Z,1483637158.312 [Rowe_600LCM](INFO): Powering down
2017-01-05T17:25:58.312Z,1483637158.312 [Rowe_600LCM ThreadHandler](INFO): Thread cancelled.
2017-01-05T17:25:58.315Z,1483637158.315 [ComponentRegistry](INFO): Shutting down Radio_Surface ThreadHandler
2017-01-05T17:25:58.315Z,1483637158.315 [Radio_Surface ThreadHandler](INFO): Thread cancelled.
2017-01-05T17:25:58.316Z,1483637158.316 [Radio_Surface](INFO): Join timeout helper Thread ID is 904
2017-01-05T17:25:58.604Z,1483637158.604 [Radio_Surface ThreadHandler](INFO): Uninitializing protected caller thread.
2017-01-05T17:25:58.604Z,1483637158.604 [Radio_Surface ThreadHandler](INFO): Thread cancelled.
2017-01-05T17:25:58.620Z,1483637158.620 [ComponentRegistry](INFO): Shutting down WetLabsBB2FL ThreadHandler
2017-01-05T17:25:58.620Z,1483637158.620 [WetLabsBB2FL ThreadHandler](INFO): Thread cancelled.
2017-01-05T17:25:58.620Z,1483637158.620 [WetLabsBB2FL](INFO): Join timeout helper Thread ID is 905
2017-01-05T17:25:58.632Z,1483637158.632 [WetLabsBB2FL ThreadHandler](INFO): Uninitializing protected caller thread.
2017-01-05T17:25:58.632Z,1483637158.632 [WetLabsBB2FL](INFO): Powering down
2017-01-05T17:25:58.633Z,1483637158.633 [WetLabsBB2FL ThreadHandler](INFO): Thread cancelled.
2017-01-05T17:25:58.641Z,1483637158.641 [ComponentRegistry](INFO): Shutting down CTD_NeilBrown ThreadHandler
2017-01-05T17:25:58.641Z,1483637158.641 [CTD_NeilBrown ThreadHandler](INFO): Thread cancelled.
2017-01-05T17:25:58.641Z,1483637158.641 [CTD_NeilBrown](INFO): Join timeout helper Thread ID is 906
2017-01-05T17:25:58.677Z,1483637158.677 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:58.968Z,1483637158.968 [CTD_NeilBrown ThreadHandler](INFO): Uninitializing protected caller thread.
2017-01-05T17:25:58.969Z,1483637158.969 [CTD_NeilBrown](INFO): Powering down
2017-01-05T17:25:58.969Z,1483637158.969 [CTD_NeilBrown ThreadHandler](INFO): Thread cancelled.
2017-01-05T17:25:58.973Z,1483637158.973 [ComponentRegistry](INFO): Shutting down logger ThreadHandler
2017-01-05T17:25:58.973Z,1483637158.973 [logger ThreadHandler](INFO): Thread cancelled.
2017-01-05T17:25:58.974Z,1483637158.974 [logger](INFO): Join timeout helper Thread ID is 907
2017-01-05T17:25:58.996Z,1483637158.996 [logger ThreadHandler](INFO): Uninitializing protected caller thread.
2017-01-05T17:25:58.997Z,1483637158.997 [logger ThreadHandler](INFO): Thread cancelled.
2017-01-05T17:25:59.013Z,1483637159.013 [ComponentRegistry](INFO): Shutting down CommandLine ThreadHandler
2017-01-05T17:25:59.013Z,1483637159.013 [CommandLine ThreadHandler](INFO): Thread cancelled.
2017-01-05T17:25:59.013Z,1483637159.013 [ComponentRegistry](INFO): Shutting down controlThread ThreadHandler
2017-01-05T17:25:59.013Z,1483637159.013 [controlThread ThreadHandler](INFO): Thread cancelled.
2017-01-05T17:25:59.014Z,1483637159.014 [controlThread](INFO): Join timeout helper Thread ID is 908
2017-01-05T17:25:59.053Z,1483637159.053 [CBIT](DEBUG): Strobing Watchdog.
2017-01-05T17:25:59.055Z,1483637159.055 [controlThread ThreadHandler](INFO): Uninitializing protected caller thread.
2017-01-05T17:25:59.055Z,1483637159.055 [controlThread](DEBUG): Uninitializing ControlThread
2017-01-05T17:25:59.173Z,1483637159.173 [Aanderaa_O2](INFO): Powering down
2017-01-05T17:25:59.176Z,1483637159.176 [NAL9602](INFO): Powering down
2017-01-05T17:25:59.177Z,1483637159.177 [PNI_TCM](INFO): Powering down
2017-01-05T17:25:59.266Z,1483637159.266 [DepthRateCalculator](DEBUG): Initializing DepthRateCalculator.
2017-01-05T17:25:59.269Z,1483637159.269 [Startup] Stopped
2017-01-05T17:25:59.270Z,1483637159.270 [Startup](DEBUG): Aggregate::uninitialize Startup
2017-01-05T17:25:59.270Z,1483637159.270 [Startup:A.GoToSurface] Stopped
2017-01-05T17:25:59.270Z,1483637159.270 [Startup:A.GoToSurface](DEBUG): Uninitialize GoToSurfaceComponent.
2017-01-05T17:25:59.270Z,1483637159.270 [Startup:StartupSatComms] Stopped
2017-01-05T17:25:59.270Z,1483637159.270 [Startup:StartupSatComms](DEBUG): Aggregate::uninitialize Startup:StartupSatComms
2017-01-05T17:25:59.270Z,1483637159.270 [Startup:StartupSatComms:B] Stopped
2017-01-05T17:25:59.271Z,1483637159.271 [VerticalControl](DEBUG): Uninitialize VerticalControlComponent.
2017-01-05T17:25:59.272Z,1483637159.272 [HorizontalControl](DEBUG): Uninitialize HorizontalControlComponent.
2017-01-05T17:25:59.272Z,1483637159.272 [SpeedControl](DEBUG): Uninitialize SpeedControlComponent.
2017-01-05T17:25:59.272Z,1483637159.272 [LoopControl](DEBUG): Uninitialize LoopControlComponent.
2017-01-05T17:25:59.273Z,1483637159.273 [BuoyancyServo](DEBUG): Uninitialize Buoyancy Servo.
2017-01-05T17:25:59.273Z,1483637159.273 [BuoyancyServo](INFO): Powering down
2017-01-05T17:25:59.285Z,1483637159.285 [ElevatorServo](DEBUG): Uninitialize Elevator Servo.
2017-01-05T17:25:59.285Z,1483637159.285 [ElevatorServo](INFO): Powering down
2017-01-05T17:25:59.286Z,1483637159.286 [MassServo](DEBUG): Uninitialize Mass Servo.
2017-01-05T17:25:59.286Z,1483637159.286 [MassServo](INFO): Powering down
2017-01-05T17:25:59.286Z,1483637159.286 [RudderServo](DEBUG): Uninitialize Rudder Servo.
2017-01-05T17:25:59.287Z,1483637159.287 [RudderServo](INFO): Powering down
2017-01-05T17:25:59.287Z,1483637159.287 [ThrusterServo](DEBUG): Uninitialize Thruster Servo.
2017-01-05T17:25:59.288Z,1483637159.288 [ThrusterServo](INFO): Powering down
2017-01-05T17:25:59.288Z,1483637159.288 [SBIT](DEBUG): Uninitialize SBIT Component.
2017-01-05T17:25:59.289Z,1483637159.289 [IBIT](DEBUG): Uninitialize IBIT Component.
2017-01-05T17:25:59.289Z,1483637159.289 [CBIT](DEBUG): Uninitialize CBIT Component.
2017-01-05T17:25:59.321Z,1483637159.321 [controlThread ThreadHandler](INFO): Thread cancelled.
2017-01-05T17:25:59.384Z,1483637159.384 [WetLabsBB2FL ThreadHandler](INFO): Thread cancelled.
2017-01-05T17:25:59.389Z,1483637159.389 [CTD_NeilBrown ThreadHandler](INFO): Thread cancelled.
2017-01-05T17:25:59.454Z,1483637159.454 [Rowe_600LCM ThreadHandler](INFO): Thread cancelled.
2017-01-05T17:25:59.486Z,1483637159.486 [Radio_Surface ThreadHandler](INFO): Thread cancelled.
2017-01-05T17:25:59.528Z,1483637159.528 [NavChartDb ThreadHandler](INFO): Thread cancelled.
2017-01-05T17:25:59.578Z,1483637159.578 [logger ThreadHandler](INFO): Thread cancelled.