2024-09-13T16:36:14.321Z,1726245374.321 [Supervisor](DEBUG): Initializing supervisor.
2024-09-13T16:36:14.325Z,1726245374.325 [SyncHandler](DEBUG): Created PCaller Thread at 404514E0
2024-09-13T16:36:14.326Z,1726245374.326 [SyncHandler](INFO): Protected caller Thread ID is 5134
2024-09-13T16:36:14.326Z,1726245374.326 [ComponentRegistry](DEBUG): Component "controlThread" handled in its own thread.
2024-09-13T16:36:14.327Z,1726245374.327 [controlThread ThreadHandler](DEBUG): Created PCaller Thread at 404814E0
2024-09-13T16:36:14.327Z,1726245374.327 [controlThread ThreadHandler](INFO): Protected caller Thread ID is 5135
2024-09-13T16:36:14.331Z,1726245374.331 [ComponentRegistry](DEBUG): SyncComponent "CycleStarter" handled in the control thread.
2024-09-13T16:36:14.348Z,1726245374.348 [ComponentRegistry](DEBUG): Component "CommandExec" handled in its own thread.
2024-09-13T16:36:14.349Z,1726245374.349 [CommandExec ThreadHandler](DEBUG): Created PCaller Thread at 404B14E0
2024-09-13T16:36:14.350Z,1726245374.350 [CommandExec ThreadHandler](INFO): Protected caller Thread ID is 5136
2024-09-13T16:36:14.354Z,1726245374.354 [ComponentRegistry](DEBUG): Component "CommandLine" handled in its own thread.
2024-09-13T16:36:14.355Z,1726245374.355 [CommandLine ThreadHandler](DEBUG): Created PCaller Thread at 404E14E0
2024-09-13T16:36:14.355Z,1726245374.355 [CommandLine ThreadHandler](INFO): Protected caller Thread ID is 5137
2024-09-13T16:36:14.357Z,1726245374.357 [ComponentRegistry](DEBUG): Component "logger" handled in its own thread.
2024-09-13T16:36:14.358Z,1726245374.358 [logger ThreadHandler](DEBUG): Created PCaller Thread at 405114E0
2024-09-13T16:36:14.358Z,1726245374.358 [logger ThreadHandler](INFO): Protected caller Thread ID is 5138
2024-09-13T16:36:14.362Z,1726245374.362 [ComponentRegistry](DEBUG): SyncComponent "LogSplitter" handled in the control thread.
2024-09-13T16:36:14.362Z,1726245374.362 [Supervisor](INFO): Looking for Config files in directory: Config/
2024-09-13T16:36:14.364Z,1726245374.364 [Supervisor](INFO): Opening Config file at: Config/Navigation.cfg
2024-09-13T16:36:14.640Z,1726245374.640 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Navigation
2024-09-13T16:36:14.640Z,1726245374.640 [Supervisor](INFO): Opening Config file at: Config/Guidance.cfg
2024-09-13T16:36:14.733Z,1726245374.733 [Supervisor](INFO): Opening Config file at: Config/Simulator.cfg
2024-09-13T16:36:15.281Z,1726245375.281 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Simulator
2024-09-13T16:36:15.281Z,1726245375.281 [Supervisor](INFO): Opening Config file at: Config/Control.cfg
2024-09-13T16:36:15.640Z,1726245375.640 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Control
2024-09-13T16:36:15.641Z,1726245375.641 [Supervisor](INFO): Opening Config file at: Config/secure.cfg
2024-09-13T16:36:15.748Z,1726245375.748 [ComponentRegistry](DEBUG): Loaded Config Component "Config/secure
2024-09-13T16:36:15.749Z,1726245375.749 [Supervisor](INFO): Opening Config file at: Config/Servo.cfg
2024-09-13T16:36:16.172Z,1726245376.172 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Servo
2024-09-13T16:36:16.173Z,1726245376.173 [Supervisor](INFO): Opening Config file at: Config/BIT.cfg
2024-09-13T16:36:16.401Z,1726245376.401 [ComponentRegistry](DEBUG): Loaded Config Component "Config/BIT
2024-09-13T16:36:16.402Z,1726245376.402 [Supervisor](INFO): Opening Config file at: Config/vehicle.cfg
2024-09-13T16:36:17.030Z,1726245377.030 [ComponentRegistry](DEBUG): Loaded Config Component "Config/vehicle
2024-09-13T16:36:17.031Z,1726245377.031 [Supervisor](INFO): Opening Config file at: Config/workSite.cfg
2024-09-13T16:36:17.178Z,1726245377.178 [ComponentRegistry](DEBUG): Loaded Config Component "Config/workSite
2024-09-13T16:36:17.179Z,1726245377.179 [Supervisor](INFO): Opening Config file at: Config/Sample.cfg
2024-09-13T16:36:17.270Z,1726245377.270 [Supervisor](INFO): Opening Config file at: Config/Sensor.cfg
2024-09-13T16:36:18.123Z,1726245378.123 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Sensor
2024-09-13T16:36:18.123Z,1726245378.123 [Supervisor](INFO): Opening Config file at: Config/Science.cfg
2024-09-13T16:36:18.522Z,1726245378.522 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Science
2024-09-13T16:36:18.523Z,1726245378.523 [Supervisor](INFO): Opening Config file at: Config/logger.cfg
2024-09-13T16:36:18.730Z,1726245378.730 [ComponentRegistry](DEBUG): Loaded Config Component "Config/logger
2024-09-13T16:36:18.731Z,1726245378.731 [Supervisor](INFO): Opening Config file at: Config/Estimation.cfg
2024-09-13T16:36:18.854Z,1726245378.854 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Estimation
2024-09-13T16:36:18.855Z,1726245378.855 [Supervisor](INFO): Opening Config file at: Config/Derivation.cfg
2024-09-13T16:36:19.096Z,1726245379.096 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Derivation
2024-09-13T16:36:19.096Z,1726245379.096 [Supervisor](INFO): Opening Config file at: Config/Dock.cfg
2024-09-13T16:36:19.415Z,1726245379.415 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Dock
2024-09-13T16:36:19.417Z,1726245379.417 [Supervisor](INFO): Looking for Config files in directory: Config/lrauv-daphne/
2024-09-13T16:36:19.418Z,1726245379.418 [Supervisor](INFO): Opening Config file at: Config/lrauv-daphne/Navigation.cfg
2024-09-13T16:36:19.614Z,1726245379.614 [Supervisor](INFO): Opening Config file at: Config/lrauv-daphne/Simulator.cfg
2024-09-13T16:36:19.752Z,1726245379.752 [Supervisor](INFO): Opening Config file at: Config/lrauv-daphne/Control.cfg
2024-09-13T16:36:19.937Z,1726245379.937 [Supervisor](INFO): Opening Config file at: Config/lrauv-daphne/secure.cfg
2024-09-13T16:36:20.037Z,1726245380.037 [Supervisor](INFO): Opening Config file at: Config/lrauv-daphne/Servo.cfg
2024-09-13T16:36:20.152Z,1726245380.152 [Supervisor](INFO): Opening Config file at: Config/lrauv-daphne/BIT.cfg
2024-09-13T16:36:20.257Z,1726245380.257 [Supervisor](INFO): Opening Config file at: Config/lrauv-daphne/vehicle.cfg
2024-09-13T16:36:20.385Z,1726245380.385 [Supervisor](INFO): Opening Config file at: Config/lrauv-daphne/Sensor.cfg
2024-09-13T16:36:20.551Z,1726245380.551 [Supervisor](INFO): Opening Config file at: Config/lrauv-daphne/Science.cfg
2024-09-13T16:36:20.712Z,1726245380.712 [Supervisor](INFO): Opening Config file at: Config/lrauv-daphne/logger.cfg
2024-09-13T16:36:20.834Z,1726245380.834 [Supervisor](INFO): Opening Config file at: Config/lrauv-daphne/Battery.cfg
2024-09-13T16:36:21.110Z,1726245381.110 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Battery
2024-09-13T16:36:21.111Z,1726245381.111 [Supervisor](INFO): Looking for Config files in directory: Config/lrauv-daphne/root/
2024-09-13T16:36:21.111Z,1726245381.111 [Supervisor](IMPORTANT): Reloading configuration overrides from Data/persisted.cfg
2024-09-13T16:36:21.124Z,1726245381.124 [Module Loader](DEBUG): Loading Module at Modules/Control.so
2024-09-13T16:36:21.176Z,1726245381.176 [VerticalControl](DEBUG): Construct VerticalControl.
2024-09-13T16:36:21.235Z,1726245381.235 [VerticalControl] Loaded
2024-09-13T16:36:21.235Z,1726245381.235 [ComponentRegistry](DEBUG): SyncComponent "VerticalControl" handled in the control thread.
2024-09-13T16:36:21.238Z,1726245381.238 [HorizontalControl](DEBUG): Construct HorizontalControl.
2024-09-13T16:36:21.284Z,1726245381.284 [HorizontalControl] Loaded
2024-09-13T16:36:21.284Z,1726245381.284 [ComponentRegistry](DEBUG): SyncComponent "HorizontalControl" handled in the control thread.
2024-09-13T16:36:21.286Z,1726245381.286 [SpeedControl](DEBUG): Construct SpeedControl.
2024-09-13T16:36:21.289Z,1726245381.289 [SpeedControl] Loaded
2024-09-13T16:36:21.290Z,1726245381.290 [ComponentRegistry](DEBUG): SyncComponent "SpeedControl" handled in the control thread.
2024-09-13T16:36:21.292Z,1726245381.292 [LoopControl](DEBUG): Construct LoopControl.
2024-09-13T16:36:21.293Z,1726245381.293 [LoopControl] Loaded
2024-09-13T16:36:21.293Z,1726245381.293 [ComponentRegistry](DEBUG): SyncComponent "LoopControl" handled in the control thread.
2024-09-13T16:36:21.293Z,1726245381.293 [Module Loader](DEBUG): Loaded Module: Control (Contains the Control components, such as Depth, Heading, and Speed Control)
2024-09-13T16:36:21.294Z,1726245381.294 [Module Loader](DEBUG): Loading Module at Modules/Sample.so
2024-09-13T16:36:21.304Z,1726245381.304 [Module Loader](DEBUG): Loaded Module: Sample (This is a Sample Module of Sample Components)
2024-09-13T16:36:21.304Z,1726245381.304 [Module Loader](DEBUG): Loading Module at Modules/Simulator.so
2024-09-13T16:36:21.469Z,1726245381.469 [Module Loader](DEBUG): Loaded Module: Simulator (This is the module containing the Simulator)
2024-09-13T16:36:21.469Z,1726245381.469 [Module Loader](DEBUG): Loading Module at Modules/Servo.so
2024-09-13T16:36:21.597Z,1726245381.597 [BuoyancyServo] Loaded
2024-09-13T16:36:21.597Z,1726245381.597 [ComponentRegistry](DEBUG): SyncComponent "BuoyancyServo" handled in the control thread.
2024-09-13T16:36:21.619Z,1726245381.619 [ElevatorServo] Loaded
2024-09-13T16:36:21.619Z,1726245381.619 [ComponentRegistry](DEBUG): SyncComponent "ElevatorServo" handled in the control thread.
2024-09-13T16:36:21.639Z,1726245381.639 [MassServo] Loaded
2024-09-13T16:36:21.640Z,1726245381.640 [ComponentRegistry](DEBUG): SyncComponent "MassServo" handled in the control thread.
2024-09-13T16:36:21.660Z,1726245381.660 [RudderServo] Loaded
2024-09-13T16:36:21.660Z,1726245381.660 [ComponentRegistry](DEBUG): SyncComponent "RudderServo" handled in the control thread.
2024-09-13T16:36:21.676Z,1726245381.676 [ThrusterHE] Loaded
2024-09-13T16:36:21.676Z,1726245381.676 [ComponentRegistry](DEBUG): SyncComponent "ThrusterHE" handled in the control thread.
2024-09-13T16:36:21.676Z,1726245381.676 [Module Loader](DEBUG): Loaded Module: Servo (This is the module containing motor controllers)
2024-09-13T16:36:21.677Z,1726245381.677 [Module Loader](DEBUG): Loading Module at Modules/Navigation.so
2024-09-13T16:36:21.785Z,1726245381.785 [DeadReckonUsingMultipleVelocitySources] Loaded
2024-09-13T16:36:21.785Z,1726245381.785 [ComponentRegistry](DEBUG): SyncComponent "DeadReckonUsingMultipleVelocitySources" handled in the control thread.
2024-09-13T16:36:21.798Z,1726245381.798 [NavChart] Loaded
2024-09-13T16:36:21.799Z,1726245381.799 [ComponentRegistry](DEBUG): SyncComponent "NavChart" handled in the control thread.
2024-09-13T16:36:21.804Z,1726245381.804 [UniversalFixResidualReporter] Loaded
2024-09-13T16:36:21.805Z,1726245381.805 [ComponentRegistry](DEBUG): SyncComponent "UniversalFixResidualReporter" handled in the control thread.
2024-09-13T16:36:21.805Z,1726245381.805 [Module Loader](DEBUG): Loaded Module: Navigation (Contains the base navigation components)
2024-09-13T16:36:21.806Z,1726245381.806 [Module Loader](DEBUG): Loading Module at Modules/Estimation.so
2024-09-13T16:36:21.873Z,1726245381.873 [Module Loader](DEBUG): Loaded Module: Estimation (Contains the base estimation components)
2024-09-13T16:36:21.873Z,1726245381.873 [Module Loader](DEBUG): Loading Module at Modules/Sensor.so
2024-09-13T16:36:22.318Z,1726245382.318 [AHRS_M2] Loaded
2024-09-13T16:36:22.318Z,1726245382.318 [ComponentRegistry](DEBUG): SyncComponent "AHRS_M2" handled in the control thread.
2024-09-13T16:36:23.133Z,1726245383.133 [BPC1] Loaded
2024-09-13T16:36:23.133Z,1726245383.133 [ComponentRegistry](DEBUG): SyncComponent "BPC1" handled in the control thread.
2024-09-13T16:36:23.221Z,1726245383.221 [DATMMP] Loaded
2024-09-13T16:36:23.221Z,1726245383.221 [ComponentRegistry](DEBUG): Component "DATMMP" handled in its own thread.
2024-09-13T16:36:23.222Z,1726245383.222 [DATMMP ThreadHandler](DEBUG): Created PCaller Thread at 4094C4E0
2024-09-13T16:36:23.222Z,1726245383.222 [DATMMP ThreadHandler](INFO): Protected caller Thread ID is 5221
2024-09-13T16:36:23.295Z,1726245383.295 [DataOverHttps] Loaded
2024-09-13T16:36:23.296Z,1726245383.296 [ComponentRegistry](DEBUG): Component "DataOverHttps" handled in its own thread.
2024-09-13T16:36:23.297Z,1726245383.297 [DataOverHttps ThreadHandler](DEBUG): Created PCaller Thread at 4097C4E0
2024-09-13T16:36:23.297Z,1726245383.297 [DataOverHttps ThreadHandler](INFO): Protected caller Thread ID is 5222
2024-09-13T16:36:23.319Z,1726245383.319 [Depth_Keller] Loaded
2024-09-13T16:36:23.320Z,1726245383.320 [ComponentRegistry](DEBUG): SyncComponent "Depth_Keller" handled in the control thread.
2024-09-13T16:36:23.383Z,1726245383.383 [NAL9602] Loaded
2024-09-13T16:36:23.383Z,1726245383.383 [ComponentRegistry](DEBUG): SyncComponent "NAL9602" handled in the control thread.
2024-09-13T16:36:23.413Z,1726245383.413 [Onboard] Loaded
2024-09-13T16:36:23.413Z,1726245383.413 [ComponentRegistry](DEBUG): Component "Onboard" handled in its own thread.
2024-09-13T16:36:23.414Z,1726245383.414 [Onboard ThreadHandler](DEBUG): Created PCaller Thread at 409AC4E0
2024-09-13T16:36:23.414Z,1726245383.414 [Onboard ThreadHandler](INFO): Protected caller Thread ID is 5223
2024-09-13T16:36:23.428Z,1726245383.428 [Power24vConverter] Loaded
2024-09-13T16:36:23.428Z,1726245383.428 [ComponentRegistry](DEBUG): SyncComponent "Power24vConverter" handled in the control thread.
2024-09-13T16:36:23.443Z,1726245383.443 [Radio_Surface] Loaded
2024-09-13T16:36:23.443Z,1726245383.443 [ComponentRegistry](DEBUG): Component "Radio_Surface" handled in its own thread.
2024-09-13T16:36:23.444Z,1726245383.444 [Radio_Surface ThreadHandler](DEBUG): Created PCaller Thread at 409DC4E0
2024-09-13T16:36:23.445Z,1726245383.445 [Radio_Surface ThreadHandler](INFO): Protected caller Thread ID is 5224
2024-09-13T16:36:23.446Z,1726245383.446 [Module Loader](DEBUG): Loaded Module: Sensor (Contains the sensor components)
2024-09-13T16:36:23.446Z,1726245383.446 [Module Loader](DEBUG): Loading Module at Modules/Derivation.so
2024-09-13T16:36:23.494Z,1726245383.494 [DepthRateCalculator] Loaded
2024-09-13T16:36:23.495Z,1726245383.495 [ComponentRegistry](DEBUG): SyncComponent "DepthRateCalculator" handled in the control thread.
2024-09-13T16:36:23.500Z,1726245383.500 [PitchRateCalculator] Loaded
2024-09-13T16:36:23.500Z,1726245383.500 [ComponentRegistry](DEBUG): SyncComponent "PitchRateCalculator" handled in the control thread.
2024-09-13T16:36:23.508Z,1726245383.508 [SpeedCalculator] Loaded
2024-09-13T16:36:23.509Z,1726245383.509 [ComponentRegistry](DEBUG): SyncComponent "SpeedCalculator" handled in the control thread.
2024-09-13T16:36:23.513Z,1726245383.513 [YawRateCalculator] Loaded
2024-09-13T16:36:23.513Z,1726245383.513 [ComponentRegistry](DEBUG): SyncComponent "YawRateCalculator" handled in the control thread.
2024-09-13T16:36:23.532Z,1726245383.532 [ElevatorOffsetCalculator] Loaded
2024-09-13T16:36:23.532Z,1726245383.532 [ComponentRegistry](DEBUG): SyncComponent "ElevatorOffsetCalculator" handled in the control thread.
2024-09-13T16:36:23.532Z,1726245383.532 [Module Loader](DEBUG): Loaded Module: Derivation (Contains the base derivation components)
2024-09-13T16:36:23.533Z,1726245383.533 [Module Loader](DEBUG): Loading Module at Modules/Science.so
2024-09-13T16:36:23.663Z,1726245383.663 [CANONSampler] Loaded
2024-09-13T16:36:23.663Z,1726245383.663 [ComponentRegistry](DEBUG): SyncComponent "CANONSampler" handled in the control thread.
2024-09-13T16:36:23.726Z,1726245383.726 [CTD_Seabird] Loaded
2024-09-13T16:36:23.726Z,1726245383.726 [ComponentRegistry](DEBUG): Component "CTD_Seabird" handled in its own thread.
2024-09-13T16:36:23.727Z,1726245383.727 [CTD_Seabird ThreadHandler](DEBUG): Created PCaller Thread at 40A984E0
2024-09-13T16:36:23.727Z,1726245383.727 [CTD_Seabird ThreadHandler](INFO): Protected caller Thread ID is 5225
2024-09-13T16:36:23.751Z,1726245383.751 [PAR_Licor] Loaded
2024-09-13T16:36:23.751Z,1726245383.751 [ComponentRegistry](DEBUG): SyncComponent "PAR_Licor" handled in the control thread.
2024-09-13T16:36:23.793Z,1726245383.793 [WetLabsBB2FL] Loaded
2024-09-13T16:36:23.793Z,1726245383.793 [ComponentRegistry](DEBUG): Component "WetLabsBB2FL" handled in its own thread.
2024-09-13T16:36:23.794Z,1726245383.794 [WetLabsBB2FL ThreadHandler](DEBUG): Created PCaller Thread at 40AC84E0
2024-09-13T16:36:23.794Z,1726245383.794 [WetLabsBB2FL ThreadHandler](INFO): Protected caller Thread ID is 5226
2024-09-13T16:36:23.795Z,1726245383.795 [Module Loader](DEBUG): Loaded Module: Science (Contains the science components)
2024-09-13T16:36:23.796Z,1726245383.796 [Module Loader](DEBUG): Loading Module at Modules/Trigger.so
2024-09-13T16:36:23.822Z,1726245383.822 [Module Loader](DEBUG): Loaded Module: Trigger (Contains triggers for use in missions)
2024-09-13T16:36:23.822Z,1726245383.822 [Module Loader](DEBUG): Loading Module at Modules/Guidance.so
2024-09-13T16:36:24.144Z,1726245384.144 [Module Loader](DEBUG): Loaded Module: Guidance (Contains behaviors and commands)
2024-09-13T16:36:24.145Z,1726245384.145 [Module Loader](DEBUG): Loading Module at Modules/BIT.so
2024-09-13T16:36:24.280Z,1726245384.280 [SBIT](DEBUG): Construct Startup Built In Test.
2024-09-13T16:36:24.289Z,1726245384.289 [SBIT] Loaded
2024-09-13T16:36:24.289Z,1726245384.289 [ComponentRegistry](DEBUG): SyncComponent "SBIT" handled in the control thread.
2024-09-13T16:36:24.292Z,1726245384.292 [IBIT](DEBUG): Construct Initiated Built In Test.
2024-09-13T16:36:24.305Z,1726245384.305 [IBIT] Loaded
2024-09-13T16:36:24.305Z,1726245384.305 [ComponentRegistry](DEBUG): SyncComponent "IBIT" handled in the control thread.
2024-09-13T16:36:24.311Z,1726245384.311 [CBIT](DEBUG): Construct Continuous Built In Test.
2024-09-13T16:36:24.414Z,1726245384.414 [CBIT] Loaded
2024-09-13T16:36:24.414Z,1726245384.414 [ComponentRegistry](DEBUG): SyncComponent "CBIT" handled in the control thread.
2024-09-13T16:36:24.414Z,1726245384.414 [Module Loader](DEBUG): Loaded Module: BIT (Contains the BuiltInTest components, such as C Built In Test)
2024-09-13T16:36:24.415Z,1726245384.415 [Module Loader](DEBUG): Loading Module at Modules/Dock.so
2024-09-13T16:36:24.696Z,1726245384.696 [Module Loader](DEBUG): Loaded Module: Dock (Contains behaviors and commands for docking)
2024-09-13T16:36:24.702Z,1726245384.702 [ComponentRegistry](DEBUG): SyncComponent "MissionManager" handled in the control thread.
2024-09-13T16:36:24.705Z,1726245384.705 [ComponentRegistry](DEBUG): SyncComponent "Reporter" handled in the control thread.
2024-09-13T16:36:24.716Z,1726245384.716 [ComponentRegistry](DEBUG): Component "NavChartDb" handled in its own thread.
2024-09-13T16:36:24.717Z,1726245384.717 [NavChartDb ThreadHandler](DEBUG): Created PCaller Thread at 40C224E0
2024-09-13T16:36:24.718Z,1726245384.718 [NavChartDb ThreadHandler](INFO): Protected caller Thread ID is 5227
2024-09-13T16:36:24.722Z,1726245384.722 [Supervisor](INFO): Main Thread ID is 5133
2024-09-13T16:36:24.723Z,1726245384.723 [Supervisor](DEBUG): Running supervisor.
2024-09-13T16:36:24.723Z,1726245384.723 [CommandExec ThreadHandler](INFO): Handler Thread ID is 5228
2024-09-13T16:36:24.724Z,1726245384.724 [CommandExec](INFO): Initializing the command executive.
2024-09-13T16:36:24.725Z,1726245384.725 [CommandLine ThreadHandler](INFO): Handler Thread ID is 5229
2024-09-13T16:36:24.727Z,1726245384.727 [controlThread ThreadHandler](INFO): Handler Thread ID is 5230
2024-09-13T16:36:24.728Z,1726245384.728 [controlThread](DEBUG): Initializing ControlThread
2024-09-13T16:36:24.729Z,1726245384.729 [VerticalControl](DEBUG): Initialize VerticalControlComponent.
2024-09-13T16:36:24.730Z,1726245384.730 [HorizontalControl](DEBUG): Initialize HorizontalControlComponent.
2024-09-13T16:36:24.731Z,1726245384.731 [SpeedControl](DEBUG): Initialize SpeedControlComponent.
2024-09-13T16:36:24.732Z,1726245384.732 [LoopControl](DEBUG): Initialize LoopControlComponent.
2024-09-13T16:36:24.733Z,1726245384.733 [NavChart](DEBUG): Initialize NavChart Navigation.
2024-09-13T16:36:24.734Z,1726245384.734 [UniversalFixResidualReporter](DEBUG): Initializing UniversalFixResidualReporter component.
2024-09-13T16:36:24.739Z,1726245384.739 [DepthRateCalculator](DEBUG): Initializing DepthRateCalculator.
2024-09-13T16:36:24.740Z,1726245384.740 [PitchRateCalculator](DEBUG): Initializing PitchRateCalculator.
2024-09-13T16:36:24.740Z,1726245384.740 [SpeedCalculator](DEBUG): Initializing SpeedCalculator.
2024-09-13T16:36:24.740Z,1726245384.740 [YawRateCalculator](DEBUG): Initializing YawRateCalculator.
2024-09-13T16:36:24.741Z,1726245384.741 [ElevatorOffsetCalculator](DEBUG): Initializing ElevatorOffsetCalculator.
2024-09-13T16:36:24.743Z,1726245384.743 [SBIT](INFO): Initialize SBIT Component.
2024-09-13T16:36:24.743Z,1726245384.743 [SBIT](IMPORTANT): git: 2024-09-05
2024-09-13T16:36:24.744Z,1726245384.744 [SBIT](INFO): git hash: dce0dc62070cf863068ea7da7140e449252762ed
2024-09-13T16:36:24.744Z,1726245384.744 [SBIT](IMPORTANT): Kernel Release: 2.6.27.8
2024-09-13T16:36:24.745Z,1726245384.745 [SBIT](INFO): Kernel Reporting Different Version From Configuration.
Kernel Expected: #2 PREEMPT Thu Jan 11 20:13:48 PST 2018
Kernel Reported: #1 PREEMPT Wed Mar 17 08:23:48 PDT 2021
2024-09-13T16:36:24.746Z,1726245384.746 [SBIT](INFO): Beginning SBIT in 99.000000 seconds.
2024-09-13T16:36:24.746Z,1726245384.746 [IBIT](INFO): Initialize IBIT Component.
2024-09-13T16:36:24.748Z,1726245384.748 [CBIT](DEBUG): Initialize CBIT Component.
2024-09-13T16:36:24.748Z,1726245384.748 [logger ThreadHandler](INFO): Handler Thread ID is 5231
2024-09-13T16:36:24.759Z,1726245384.759 [CBIT](DEBUG): Initialized mux pins.
2024-09-13T16:36:24.759Z,1726245384.759 [CBIT](DEBUG): Initializing the watchdog timer.
2024-09-13T16:36:24.779Z,1726245384.779 [DATMMP ThreadHandler](INFO): Handler Thread ID is 5232
2024-09-13T16:36:24.780Z,1726245384.780 [DATMMP](INFO): Start
2024-09-13T16:36:24.780Z,1726245384.780 [DATMMP](INFO): Powering up
2024-09-13T16:36:24.780Z,1726245384.780 [DATMMP](DEBUG): Initializing DATMMP.
2024-09-13T16:36:24.782Z,1726245384.782 [DataOverHttps ThreadHandler](INFO): Handler Thread ID is 5234
2024-09-13T16:36:24.783Z,1726245384.783 [CBIT](INFO): Last reboot was NOT due to watchdog timer.
2024-09-13T16:36:24.783Z,1726245384.783 [CBIT](DEBUG): Initializing heartbeat.
2024-09-13T16:36:24.785Z,1726245384.785 [DataOverHttps](DEBUG): dashIP=134.89.2.23 starts with a digit so assuming it is a numeric IP
2024-09-13T16:36:24.788Z,1726245384.788 [Radio_Surface ThreadHandler](INFO): Handler Thread ID is 5236
2024-09-13T16:36:24.789Z,1726245384.789 [CTD_Seabird ThreadHandler](INFO): Handler Thread ID is 5237
2024-09-13T16:36:24.791Z,1726245384.791 [CTD_Seabird](DEBUG): Initializing CTD_Seabird.
2024-09-13T16:36:24.795Z,1726245384.795 [WetLabsBB2FL ThreadHandler](INFO): Handler Thread ID is 5238
2024-09-13T16:36:24.798Z,1726245384.798 [NavChartDb ThreadHandler](INFO): Handler Thread ID is 5239
2024-09-13T16:36:24.801Z,1726245384.801 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US1WC07M.000
2024-09-13T16:36:24.801Z,1726245384.801 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US1WC07M.000
2024-09-13T16:36:24.801Z,1726245384.801 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US2WC11M.000
2024-09-13T16:36:24.802Z,1726245384.802 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US2WC11M.000
2024-09-13T16:36:24.802Z,1726245384.802 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US3CA52M.000
2024-09-13T16:36:24.802Z,1726245384.802 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US3CA52M.000
2024-09-13T16:36:24.802Z,1726245384.802 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US5CA50M.000
2024-09-13T16:36:24.802Z,1726245384.802 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US5CA50M.000
2024-09-13T16:36:24.835Z,1726245384.835 [Onboard ThreadHandler](INFO): Handler Thread ID is 5235
2024-09-13T16:36:24.855Z,1726245384.855 [CBIT](DEBUG): Deactivating GF circuits.
2024-09-13T16:36:24.855Z,1726245384.855 [CBIT](DEBUG): Deactivating emergency mode.
2024-09-13T16:36:24.879Z,1726245384.879 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:36:24.895Z,1726245384.895 [CBIT](DEBUG): Backplane powered.
2024-09-13T16:36:24.895Z,1726245384.895 [MissionManager](IMPORTANT): Using TethysL tl-to-tx parser
2024-09-13T16:36:24.896Z,1726245384.896 [MissionManager](INFO): Loading Mission from file: Missions/Startup.tl
2024-09-13T16:36:24.896Z,1726245384.896 [MissionManager](DEBUG): TethyslAPI: loading: Missions/Startup.tl
2024-09-13T16:36:24.897Z,1726245384.897 [MissionManager](DEBUG): TethyslAPI: mission file loaded: Missions/Startup.tl
2024-09-13T16:36:24.933Z,1726245384.933 [MissionManager](DEBUG): TethyslAPI: Missions/Startup.tl translated into:
2024-09-13T16:36:24.937Z,1726245384.937 [Startup:A.GoToSurface](DEBUG): Construct GoToSurface.
2024-09-13T16:36:25.001Z,1726245385.001 [MissionManager](DEBUG):
# Copyright (c) 2024 MBARI
# MBARI Proprietary Information. Confidential. All Rights Reserved
# Unauthorized copying or distribution of this file via any medium is strictly
# prohibited.
#
# WARNING - This file contains information whose export is restricted by the
# Export Administration Act of 1979 (Title 50, U.S.C., App. 2401 et seq.), as
# amended. Violations of these export laws are subject to severe civil and/or
# criminal penalties.
mission Startup {
behavior Guidance:GoToSurface {
run in progression
}
aggregate StartupSatComms {
run in sequence
readDatum {
timeout duration=P1M
Universal:latitude_fix
}
readDatum {
timeout duration=P1M
Universal:platform_communications
}
}
}
2024-09-13T16:36:25.002Z,1726245385.002 [MissionManager](INFO): Loading Mission from file: Missions/Default.tl
2024-09-13T16:36:25.002Z,1726245385.002 [MissionManager](DEBUG): TethyslAPI: loading: Missions/Default.tl
2024-09-13T16:36:25.015Z,1726245385.015 [MissionManager](DEBUG): TethyslAPI: mission file loaded: Missions/Default.tl
2024-09-13T16:36:25.031Z,1726245385.031 [DATMMP](INFO): Starting
2024-09-13T16:36:25.191Z,1726245385.191 [Radio_Surface](INFO): Powering up
2024-09-13T16:36:25.283Z,1726245385.283 [DATMMP](INFO): Starting
2024-09-13T16:36:25.381Z,1726245385.381 [MissionManager](DEBUG): TethyslAPI: Missions/Default.tl translated into:
0
13
Burn on
Dropped weight due to communications timeout.
5
Default mission has been running for
Restarting logs and Default mission.
restart logs
2024-09-13T16:36:25.403Z,1726245385.403 [MissionManager](INFO): DefineArg Default.ElapsedSinceDefaultStarted = 0.000000 min
2024-09-13T16:36:25.404Z,1726245385.404 [Default:A.Wait](DEBUG): Construct Wait.
2024-09-13T16:36:25.406Z,1726245385.406 [Default:B.GoToSurface](DEBUG): Construct GoToSurface.
2024-09-13T16:36:25.463Z,1726245385.463 [Default:CheckIn:Read_Iridium:A_Timeout:A.Execute](DEBUG): Construct Execute.
2024-09-13T16:36:25.465Z,1726245385.465 [Default:CheckIn:C.Wait](DEBUG): Construct Wait.
2024-09-13T16:36:25.483Z,1726245385.483 [Default:E.Execute](DEBUG): Construct Execute.
2024-09-13T16:36:25.486Z,1726245385.486 [MissionManager](DEBUG):
# Copyright (c) 2024 MBARI
# MBARI Proprietary Information. Confidential. All Rights Reserved
# Unauthorized copying or distribution of this file via any medium is strictly
# prohibited.
#
# WARNING - This file contains information whose export is restricted by the
# Export Administration Act of 1979 (Title 50, U.S.C., App. 2401 et seq.), as
# amended. Violations of these export laws are subject to severe civil and/or
# criminal penalties.
mission Default {
arguments {
ElapsedSinceDefaultStarted = 0 minute
}
behavior Guidance:Wait {
"""
Wait a moment to see if the scheduler starts a new mission before
starting to actually run Default.
"""
run in sequence
set duration = 13 second
}
behavior Guidance:GoToSurface {
run in progression
}
aggregate CheckIn {
run in sequence repeat=288
readDatum id="Read_GPS" {
timeout duration=P5M
Universal:time_fix
}
readDatum id="Read_Iridium" {
timeout duration=P4H {
behavior Guidance:Execute {
run in sequence
set command = "Burn on"
}
syslog critical "Dropped weight due to communications timeout."
}
Universal:platform_communications
}
behavior Guidance:Wait {
run in sequence
set duration = 5 minute
}
assign in sequence ElapsedSinceDefaultStarted = elapsed ( Universal:mission_started )
syslog important "Default mission has been running for " + ElapsedSinceDefaultStarted~minute
}
syslog important "Restarting logs and Default mission."
behavior Guidance:Execute {
run in sequence
set command = "restart logs"
}
}
2024-09-13T16:36:25.506Z,1726245385.506 [controlThread](DEBUG): Component order: CycleStarter,AHRS_M2,BPC1,Depth_Keller,NAL9602,Power24vConverter,CANONSampler,PAR_Licor,Depth_Keller,PAR_Licor,DepthRateCalculator,PitchRateCalculator,SpeedCalculator,YawRateCalculator,ElevatorOffsetCalculator,DeadReckonUsingMultipleVelocitySources,NavChart,UniversalFixResidualReporter,MissionManager,VerticalControl,HorizontalControl,SpeedControl,LoopControl,BuoyancyServo,ElevatorServo,MassServo,RudderServo,ThrusterHE,SBIT,IBIT,CBIT,Reporter,LogSplitter,
2024-09-13T16:36:25.513Z,1726245385.513 [AHRS_M2](DEBUG): Initializing AHRS_M2.
2024-09-13T16:36:25.535Z,1726245385.535 [DATMMP](INFO): Starting
2024-09-13T16:36:25.597Z,1726245385.597 [Power24vConverter](INFO): Powering up.
2024-09-13T16:36:25.598Z,1726245385.598 [CANONSampler](INFO): Powering down
2024-09-13T16:36:25.644Z,1726245385.644 [BuoyancyServo](DEBUG): Initializing EZServoServo.
2024-09-13T16:36:25.651Z,1726245385.651 [BuoyancyServo](DEBUG): Initializing BuoyancyServo.
2024-09-13T16:36:25.652Z,1726245385.652 [ElevatorServo](DEBUG): Initializing EZServoServo.
2024-09-13T16:36:25.660Z,1726245385.660 [ElevatorServo](DEBUG): Initializing ElevatorServo.
2024-09-13T16:36:25.660Z,1726245385.660 [MassServo](DEBUG): Initializing EZServoServo.
2024-09-13T16:36:25.667Z,1726245385.667 [MassServo](DEBUG): Initializing MassServo.
2024-09-13T16:36:25.668Z,1726245385.668 [RudderServo](DEBUG): Initializing EZServoServo.
2024-09-13T16:36:25.675Z,1726245385.675 [RudderServo](DEBUG): Initializing RudderServo.
2024-09-13T16:36:25.676Z,1726245385.676 [ThrusterHE](DEBUG): Initializing EZServoServo.
2024-09-13T16:36:25.683Z,1726245385.683 [ThrusterHE](DEBUG): Initializing ThrusterHE.
2024-09-13T16:36:25.787Z,1726245385.787 [DATMMP](INFO): Starting
2024-09-13T16:36:26.039Z,1726245386.039 [DATMMP](INFO): Starting
2024-09-13T16:36:26.291Z,1726245386.291 [DATMMP](INFO): Starting
2024-09-13T16:36:26.543Z,1726245386.543 [DATMMP](INFO): Starting
2024-09-13T16:36:26.796Z,1726245386.796 [DATMMP](INFO): Starting
2024-09-13T16:36:27.047Z,1726245387.047 [DATMMP](INFO): Starting
2024-09-13T16:36:27.299Z,1726245387.299 [DATMMP](INFO): Starting
2024-09-13T16:36:27.551Z,1726245387.551 [DATMMP](INFO): Starting
2024-09-13T16:36:27.803Z,1726245387.803 [DATMMP](INFO): Starting
2024-09-13T16:36:28.055Z,1726245388.055 [DATMMP](INFO): Starting
2024-09-13T16:36:28.307Z,1726245388.307 [DATMMP](INFO): Starting
2024-09-13T16:36:28.559Z,1726245388.559 [DATMMP](INFO): Starting
2024-09-13T16:36:28.811Z,1726245388.811 [DATMMP](INFO): Starting
2024-09-13T16:36:29.063Z,1726245389.063 [DATMMP](INFO): Starting
2024-09-13T16:36:29.315Z,1726245389.315 [DATMMP](INFO): Starting
2024-09-13T16:36:29.568Z,1726245389.568 [DATMMP](INFO): Starting
2024-09-13T16:36:29.819Z,1726245389.819 [DATMMP](INFO): Starting
2024-09-13T16:36:30.071Z,1726245390.071 [DATMMP](INFO): Starting
2024-09-13T16:36:30.095Z,1726245390.095 [WetLabsBB2FL] Communications Fault, FailCount= 1
2024-09-13T16:36:30.095Z,1726245390.095 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:36:30.171Z,1726245390.171 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:36:30.323Z,1726245390.323 [DATMMP](INFO): Starting
2024-09-13T16:36:30.575Z,1726245390.575 [DATMMP](INFO): Starting
2024-09-13T16:36:30.595Z,1726245390.595 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:36:30.827Z,1726245390.827 [DATMMP](INFO): Starting
2024-09-13T16:36:31.079Z,1726245391.079 [DATMMP](INFO): Starting
2024-09-13T16:36:31.331Z,1726245391.331 [DATMMP](INFO): Starting
2024-09-13T16:36:31.400Z,1726245391.400 [ThrusterHE](ERROR): Zero Speed Commanded.
2024-09-13T16:36:31.466Z,1726245391.466 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:36:31.466Z,1726245391.466 [WetLabsBB2FL] No Fault, FailCount= 1
2024-09-13T16:36:31.584Z,1726245391.584 [DATMMP](INFO): Starting
2024-09-13T16:36:31.819Z,1726245391.819 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:36:31.835Z,1726245391.835 [DATMMP](INFO): Starting
2024-09-13T16:36:32.087Z,1726245392.087 [DATMMP](INFO): Starting
2024-09-13T16:36:32.339Z,1726245392.339 [DATMMP](INFO): Starting
2024-09-13T16:36:32.591Z,1726245392.591 [DATMMP](INFO): Starting
2024-09-13T16:36:32.828Z,1726245392.828 [CTD_Seabird](ERROR): Device message queue exceeded the allowed limit.
2024-09-13T16:36:32.843Z,1726245392.843 [DATMMP](INFO): Starting
2024-09-13T16:36:33.095Z,1726245393.095 [DATMMP](INFO): Starting
2024-09-13T16:36:33.347Z,1726245393.347 [DATMMP](INFO): Starting
2024-09-13T16:36:33.599Z,1726245393.599 [DATMMP](INFO): Starting
2024-09-13T16:36:33.851Z,1726245393.851 [DATMMP](INFO): Starting
2024-09-13T16:36:34.103Z,1726245394.103 [DATMMP](INFO): Starting
2024-09-13T16:36:34.355Z,1726245394.355 [DATMMP](INFO): Starting
2024-09-13T16:36:34.607Z,1726245394.607 [DATMMP](INFO): Starting
2024-09-13T16:36:34.860Z,1726245394.860 [DATMMP](INFO): Starting
2024-09-13T16:36:35.111Z,1726245395.111 [DATMMP](INFO): Starting
2024-09-13T16:36:35.363Z,1726245395.363 [DATMMP](INFO): Starting
2024-09-13T16:36:35.616Z,1726245395.616 [DATMMP](INFO): Starting
2024-09-13T16:36:35.867Z,1726245395.867 [DATMMP](INFO): Starting
2024-09-13T16:36:36.119Z,1726245396.119 [DATMMP](INFO): Starting
2024-09-13T16:36:36.371Z,1726245396.371 [DATMMP](INFO): Starting
2024-09-13T16:36:36.371Z,1726245396.371 [DATMMP](INFO): DAT read:
2024-09-13T16:36:36.372Z,1726245396.372 [DATMMP](INFO): DAT read: Teledyne Benthos DAT-900 Series
2024-09-13T16:36:36.623Z,1726245396.623 [DATMMP](INFO): Starting
2024-09-13T16:36:36.875Z,1726245396.875 [DATMMP](INFO): Starting
2024-09-13T16:36:37.099Z,1726245397.099 [WetLabsBB2FL] Communications Fault, FailCount= 2
2024-09-13T16:36:37.099Z,1726245397.099 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:36:37.127Z,1726245397.127 [DATMMP](INFO): Starting
2024-09-13T16:36:37.298Z,1726245397.298 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:36:37.379Z,1726245397.379 [DATMMP](INFO): Starting
2024-09-13T16:36:37.599Z,1726245397.599 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:36:37.633Z,1726245397.633 [DataOverHttps](INFO): setting available, lastComms_.elapsed()=0.005173
2024-09-13T16:36:37.634Z,1726245397.634 [DATMMP](INFO): Starting
2024-09-13T16:36:37.887Z,1726245397.887 [DATMMP](INFO): Starting
2024-09-13T16:36:37.888Z,1726245397.888 [DATMMP](INFO): DAT read: MF Frequency Band
2024-09-13T16:36:37.889Z,1726245397.889 [DATMMP](INFO): DAT read: Directional Acoustic Transponder version 8.15.0
2024-09-13T16:36:37.889Z,1726245397.889 [DATMMP](INFO): DAT read: Aug 12 2000 22:27:03
2024-09-13T16:36:38.139Z,1726245398.139 [DATMMP](INFO): Starting
2024-09-13T16:36:38.391Z,1726245398.391 [DATMMP](INFO): Starting
2024-09-13T16:36:38.519Z,1726245398.519 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:36:38.519Z,1726245398.519 [WetLabsBB2FL] No Fault, FailCount= 2
2024-09-13T16:36:38.643Z,1726245398.643 [DATMMP](INFO): Starting
2024-09-13T16:36:38.812Z,1726245398.812 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:36:38.895Z,1726245398.895 [DATMMP](INFO): Starting
2024-09-13T16:36:38.896Z,1726245398.896 [DATMMP](INFO): DAT read: Features enabled [Bearing]
2024-09-13T16:36:38.897Z,1726245398.897 [DATMMP](INFO): DAT read: CONNECT 01200 bits/sec 1 of 4, Rate 1/2 CC
2024-09-13T16:36:38.897Z,1726245398.897 [DATMMP](INFO): commRate: 1200
2024-09-13T16:36:39.147Z,1726245399.147 [DATMMP](INFO): Starting
2024-09-13T16:36:39.399Z,1726245399.399 [DATMMP](INFO): Starting
2024-09-13T16:36:39.651Z,1726245399.651 [DATMMP](INFO): Starting
2024-09-13T16:36:39.903Z,1726245399.903 [DATMMP](INFO): Starting
2024-09-13T16:36:40.155Z,1726245400.155 [DATMMP](INFO): Starting
2024-09-13T16:36:40.407Z,1726245400.407 [DATMMP](INFO): Starting
2024-09-13T16:36:40.659Z,1726245400.659 [DATMMP](INFO): Starting
2024-09-13T16:36:40.911Z,1726245400.911 [DATMMP](INFO): Starting
2024-09-13T16:36:40.963Z,1726245400.963 [DATMMP](INFO): entering command mode
2024-09-13T16:36:41.163Z,1726245401.163 [DATMMP](INFO): Starting
2024-09-13T16:36:41.163Z,1726245401.163 [DATMMP](INFO): DAT read:
2024-09-13T16:36:41.164Z,1726245401.164 [DATMMP](INFO): DAT read: user:1>
2024-09-13T16:36:41.164Z,1726245401.164 [DATMMP](DEBUG): read user prompt 1: user:1>
2024-09-13T16:36:41.164Z,1726245401.164 [DATMMP](INFO): entering MMP mode
2024-09-13T16:36:41.415Z,1726245401.415 [DATMMP](INFO): Starting
2024-09-13T16:36:41.416Z,1726245401.416 [DATMMP](INFO): GSXN notify for xid: 0
2024-09-13T16:36:41.417Z,1726245401.417 [DATMMP](INFO): status rx: x1
2024-09-13T16:36:41.418Z,1726245401.418 [DATMMP](INFO): MMP status: 1: started
2024-09-13T16:36:41.418Z,1726245401.418 [DATMMP](INFO): Received message type: status
2024-09-13T16:36:41.418Z,1726245401.418 [DATMMP](INFO): Handled
2024-09-13T16:36:41.667Z,1726245401.667 [DATMMP](INFO): Starting
2024-09-13T16:36:41.668Z,1726245401.668 [DATMMP](INFO): Sent Tx Power Config 8
2024-09-13T16:36:41.668Z,1726245401.668 [DATMMP](INFO): Setting local address: 8
2024-09-13T16:36:41.670Z,1726245401.670 [DATMMP](INFO): Setting time to: 16:36:41 And date to:9/13/2024
2024-09-13T16:36:41.919Z,1726245401.919 [DATMMP](INFO): Starting
2024-09-13T16:36:41.919Z,1726245401.919 [DATMMP](INFO): GSXN notify for xid: 0
2024-09-13T16:36:41.920Z,1726245401.920 [DATMMP](INFO): mdmpower rx: x8 x0 x5 x0
2024-09-13T16:36:41.920Z,1726245401.920 [DATMMP](INFO): Received message type: mdmpower
2024-09-13T16:36:41.921Z,1726245401.921 [DATMMP](INFO): Handled
2024-09-13T16:36:42.171Z,1726245402.171 [DATMMP](INFO): Starting
2024-09-13T16:36:42.171Z,1726245402.171 [DATMMP](INFO): GSXN notify for xid: 10
2024-09-13T16:36:42.172Z,1726245402.172 [DATMMP](INFO): sreg_txpower rx: x8
2024-09-13T16:36:42.172Z,1726245402.172 [DATMMP](INFO): Received message type: sreg_txpower
2024-09-13T16:36:42.172Z,1726245402.172 [DATMMP](INFO): Match for : sreg_txpower
2024-09-13T16:36:42.172Z,1726245402.172 [DATMMP](INFO): ACK
2024-09-13T16:36:42.423Z,1726245402.423 [DATMMP](INFO): Starting
2024-09-13T16:36:42.423Z,1726245402.423 [DATMMP](INFO): GSXN notify for xid: 0
2024-09-13T16:36:42.424Z,1726245402.424 [DATMMP](INFO): mdmlocal rx: x8 x0 x0 x0
2024-09-13T16:36:42.424Z,1726245402.424 [DATMMP](INFO): Received message type: mdmlocal
2024-09-13T16:36:42.424Z,1726245402.424 [DATMMP](INFO): Handled
2024-09-13T16:36:42.675Z,1726245402.675 [DATMMP](INFO): Starting
2024-09-13T16:36:42.675Z,1726245402.675 [DATMMP](INFO): GSXN notify for xid: 11
2024-09-13T16:36:42.676Z,1726245402.676 [DATMMP](INFO): sreg_locaddr rx: x8
2024-09-13T16:36:42.676Z,1726245402.676 [DATMMP](INFO): Received message type: sreg_locaddr
2024-09-13T16:36:42.676Z,1726245402.676 [DATMMP](INFO): Match for : sreg_locaddr
2024-09-13T16:36:42.676Z,1726245402.676 [DATMMP](INFO): ACK
2024-09-13T16:36:42.927Z,1726245402.927 [DATMMP](INFO): Starting
2024-09-13T16:36:42.928Z,1726245402.928 [DATMMP](INFO): GSXN notify for xid: 12
2024-09-13T16:36:42.929Z,1726245402.929 [DATMMP](INFO): timedate rx: x0 x10 x24 x29 x8 xD x7C x0
2024-09-13T16:36:42.929Z,1726245402.929 [DATMMP](INFO): Received message type: timedate
2024-09-13T16:36:42.930Z,1726245402.930 [DATMMP](INFO): Match for : timedate
2024-09-13T16:36:42.930Z,1726245402.930 [DATMMP](INFO): ACK
2024-09-13T16:36:43.179Z,1726245403.179 [DATMMP](INFO): Starting
2024-09-13T16:36:43.179Z,1726245403.179 [DATMMP](INFO): GSXN notify for xid: 0
2024-09-13T16:36:43.180Z,1726245403.180 [DATMMP](INFO): sys_verb rx: x0 x0 x0 x0
2024-09-13T16:36:43.180Z,1726245403.180 [DATMMP](INFO): Received message type: sys_verb
2024-09-13T16:36:43.180Z,1726245403.180 [DATMMP](INFO): Handled
2024-09-13T16:36:43.431Z,1726245403.431 [DATMMP](INFO): Starting
2024-09-13T16:36:43.431Z,1726245403.431 [DATMMP](INFO): GSXN notify for xid: 13
2024-09-13T16:36:43.432Z,1726245403.432 [DATMMP](INFO): sreg_verbosity rx: x0
2024-09-13T16:36:43.432Z,1726245403.432 [DATMMP](INFO): Received message type: sreg_verbosity
2024-09-13T16:36:43.432Z,1726245403.432 [DATMMP](INFO): Match for : sreg_verbosity
2024-09-13T16:36:43.432Z,1726245403.432 [DATMMP](INFO): ACK
2024-09-13T16:36:43.683Z,1726245403.683 [DATMMP](INFO): Starting
2024-09-13T16:36:43.683Z,1726245403.683 [DATMMP](INFO): GSXN notify for xid: 14
2024-09-13T16:36:43.684Z,1726245403.684 [DATMMP](INFO): version rx: x2 x5
2024-09-13T16:36:43.684Z,1726245403.684 [DATMMP](INFO): DatMMPVersion: 2.5
2024-09-13T16:36:43.684Z,1726245403.684 [DATMMP](INFO): Received message type: version
2024-09-13T16:36:43.685Z,1726245403.685 [DATMMP](INFO): Match for : version
2024-09-13T16:36:43.685Z,1726245403.685 [DATMMP](INFO): ACK
2024-09-13T16:36:43.685Z,1726245403.685 [DATMMP](INFO): in MMP mode: config complete going to runnable
2024-09-13T16:36:44.104Z,1726245404.104 [WetLabsBB2FL] Communications Fault, FailCount= 3
2024-09-13T16:36:44.104Z,1726245404.104 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:36:44.180Z,1726245404.180 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:36:44.603Z,1726245404.603 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:36:45.783Z,1726245405.783 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:36:45.783Z,1726245405.783 [WetLabsBB2FL] No Fault, FailCount= 3
2024-09-13T16:36:45.816Z,1726245405.816 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:36:51.115Z,1726245411.115 [WetLabsBB2FL] Communications Fault, FailCount= 4
2024-09-13T16:36:51.115Z,1726245411.115 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:36:51.446Z,1726245411.446 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:36:51.615Z,1726245411.615 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:36:52.672Z,1726245412.672 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:36:52.672Z,1726245412.672 [WetLabsBB2FL] No Fault, FailCount= 4
2024-09-13T16:36:52.828Z,1726245412.828 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:36:53.409Z,1726245413.409 [NAL9602](INFO): Powering up NAL9602
2024-09-13T16:36:58.051Z,1726245418.051 [DATMMP](INFO): GSXN notify for xid: 0
2024-09-13T16:36:58.052Z,1726245418.052 [DATMMP](INFO): timesync rx: x0 x1 x1 x0
2024-09-13T16:36:58.053Z,1726245418.053 [DATMMP](INFO): Received message type: timesync
2024-09-13T16:36:58.053Z,1726245418.053 [DATMMP](INFO): Handled
2024-09-13T16:36:58.119Z,1726245418.119 [WetLabsBB2FL] Communications Fault, FailCount= 5
2024-09-13T16:36:58.119Z,1726245418.119 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:36:58.346Z,1726245418.346 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:36:58.346Z,1726245418.346 [CBIT](FAULT): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:36:58.619Z,1726245418.619 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:37:04.312Z,1726245424.312 [NAL9602](INFO): NAL9602 initialized
2024-09-13T16:37:08.159Z,1726245428.159 [DATMMP](INFO): GSXN notify for xid: 0
2024-09-13T16:37:08.160Z,1726245428.160 [DATMMP](INFO): timesync rx: x1 x0 x1 x0
2024-09-13T16:37:08.160Z,1726245428.160 [DATMMP](INFO): Received message type: timesync
2024-09-13T16:37:08.161Z,1726245428.161 [DATMMP](INFO): Handled
2024-09-13T16:37:11.252Z,1726245431.252 [CommandExec](IMPORTANT): got command strobe off
2024-09-13T16:37:11.252Z,1726245431.252 [CommandExec](IMPORTANT): Deactivating strobe
2024-09-13T16:37:28.559Z,1726245448.559 [BPC1](ERROR): BPC1B failed to parse battery data due to unrecognized msg size.
2024-09-13T16:37:41.072Z,1726245461.072 [BPC1](ERROR): BPC1B got IPBS message with 4 sticks (min is 7).
2024-09-13T16:37:52.384Z,1726245472.384 [BPC1](ERROR): BPC1B got IPBS message with 4 sticks (min is 7).
2024-09-13T16:38:04.100Z,1726245484.100 [BPC1](ERROR): BPC1B got IPBS message with 4 sticks (min is 7).
2024-09-13T16:38:04.536Z,1726245484.536 [SBIT](IMPORTANT): Beginning Startup BIT
2024-09-13T16:38:04.557Z,1726245484.557 [CBIT](IMPORTANT): Beginning ground fault scan
2024-09-13T16:38:15.520Z,1726245495.520 [CBIT](ERROR): Ground fault scan returned out of bounds value. Re-running scan.
2024-09-13T16:38:15.953Z,1726245495.953 [CBIT](IMPORTANT): Beginning ground fault scan
2024-09-13T16:38:16.220Z,1726245496.220 [BPC1](ERROR): BPC1B got IPBS message with 4 sticks (min is 7).
2024-09-13T16:38:26.821Z,1726245506.821 [CBIT](ERROR): Ground fault scan returned out of bounds value. Re-running scan.
2024-09-13T16:38:27.188Z,1726245507.188 [CBIT](IMPORTANT): Beginning ground fault scan
2024-09-13T16:38:27.935Z,1726245507.935 [BPC1](ERROR): BPC1B got IPBS message with 4 sticks (min is 7).
2024-09-13T16:38:38.064Z,1726245518.064 [CBIT](IMPORTANT): No ground fault detected
mA:
CHAN A0 (Batt): 0.025130
CHAN A1 (24V): 0.000669
CHAN A2 (12V): -0.002094
CHAN A3 (5V): -0.001663
CHAN B0 (3.3V): -0.000148
CHAN B1 (3.15aV): 0.000110
CHAN B2 (3.15bV): 0.000190
CHAN B3 (GND): 0.000029
OPEN: -0.000276
Full Scale: +/- 1 mA
2024-09-13T16:38:39.663Z,1726245519.663 [BPC1](ERROR): BPC1B got IPBS message with 4 sticks (min is 7).
2024-09-13T16:38:50.964Z,1726245530.964 [BPC1](ERROR): BPC1B got IPBS message with 4 sticks (min is 7).
2024-09-13T16:38:58.678Z,1726245538.678 [SBIT](IMPORTANT): SBIT PASSED
2024-09-13T16:38:58.678Z,1726245538.678 [SBIT](IMPORTANT): Listing configuration overrides from Data/persisted.cfg
2024-09-13T16:38:58.679Z,1726245538.679 [SBIT](IMPORTANT): BPC1.batteryMissingStickThreshold=20 count;
2024-09-13T16:38:58.679Z,1726245538.679 [SBIT](IMPORTANT): CANONSampler.loadAtStartup=1 bool;
2024-09-13T16:38:58.679Z,1726245538.679 [SBIT](IMPORTANT): CANONSampler.simulateHardware=0 bool;
2024-09-13T16:38:58.680Z,1726245538.680 [SBIT](IMPORTANT): DAT.loadAtStartup=0 bool;
2024-09-13T16:38:58.680Z,1726245538.680 [SBIT](IMPORTANT): DATMMP.loadAtStartup=1 bool;
2024-09-13T16:38:58.680Z,1726245538.680 [SBIT](IMPORTANT): DATMMP.simulateHardware=0 bool;
2024-09-13T16:38:58.680Z,1726245538.680 [SBIT](IMPORTANT): DATMMP.surfaceThreshold=2 meter;
2024-09-13T16:38:58.680Z,1726245538.680 [SBIT](IMPORTANT): DropWeight.loadAtStartup=0 bool;
2024-09-13T16:38:58.680Z,1726245538.680 [SBIT](IMPORTANT): ESPComponent.loadAtStartup=0 bool;
2024-09-13T16:38:58.680Z,1726245538.680 [SBIT](IMPORTANT): ESPComponent.sampleTimeout=5 minute;
2024-09-13T16:38:58.680Z,1726245538.680 [SBIT](IMPORTANT): Express linearApproximation DATMMP.acoustic_contact_range 15.000000 meter;
2024-09-13T16:38:58.680Z,1726245538.680 [SBIT](IMPORTANT): Express none _.predict_plankton_data_pct_dinos_sqerr;
2024-09-13T16:38:58.681Z,1726245538.681 [SBIT](IMPORTANT): Normal all WetLabsBB2FL.bin_median_mass_concentration_of_chlorophyll_in_sea_water;
2024-09-13T16:38:58.681Z,1726245538.681 [SBIT](IMPORTANT): VerticalControl.buoyancyNeutral=80 cubic_centimeter;
2024-09-13T16:38:58.681Z,1726245538.681 [SBIT](IMPORTANT): VerticalControl.massDefault=-20 millimeter;
2024-09-13T16:38:59.064Z,1726245539.064 [MissionManager](IMPORTANT): Started mission Startup
2024-09-13T16:38:59.065Z,1726245539.065 [Startup] Running Loop=1
2024-09-13T16:38:59.065Z,1726245539.065 [Startup](DEBUG): Aggregate::initialize Startup
2024-09-13T16:38:59.065Z,1726245539.065 [Startup:A.GoToSurface] Running Loop=1
2024-09-13T16:38:59.065Z,1726245539.065 [Startup:A.GoToSurface](DEBUG): Initialize GoToSurfaceComponent.
2024-09-13T16:38:59.065Z,1726245539.065 [Startup:A.GoToSurface](DEBUG): No depth rate setting specified. Using default value of nan m/s.
2024-09-13T16:38:59.066Z,1726245539.066 [Startup:A.GoToSurface](DEBUG): No pitch setting specified. Using default value of nan degrees.
2024-09-13T16:38:59.066Z,1726245539.066 [Startup:A.GoToSurface](DEBUG): No speed setting specified. Using default value of 1.000000 m/s.
2024-09-13T16:38:59.067Z,1726245539.067 [Startup:A.GoToSurface](DEBUG): No surface timeout specified. Using default value of 1000.000000 seconds.
2024-09-13T16:38:59.067Z,1726245539.067 [Startup:A.GoToSurface](DEBUG): No altitude timeout specified. Using default value of 600.000000 seconds.
2024-09-13T16:38:59.067Z,1726245539.067 [Startup:A.GoToSurface](INFO): Received pitch timeout configuration 60.000000 seconds.
2024-09-13T16:38:59.069Z,1726245539.069 [Startup:StartupSatComms] Running Loop=1
2024-09-13T16:38:59.069Z,1726245539.069 [Startup:StartupSatComms](DEBUG): Aggregate::initialize Startup:StartupSatComms
2024-09-13T16:38:59.069Z,1726245539.069 [Startup:StartupSatComms:A] Running Loop=1
2024-09-13T16:38:59.465Z,1726245539.465 [Startup:StartupSatComms:A](DEBUG): Initialize ReadDataComponent to sense latitude_fix
2024-09-13T16:39:24.932Z,1726245564.932 [DeadReckonUsingMultipleVelocitySources] Software Fault, FailCount= 1
2024-09-13T16:39:24.932Z,1726245564.932 [DeadReckonUsingMultipleVelocitySources](ERROR): Software Fault
2024-09-13T16:39:24.942Z,1726245564.942 [CBIT](ERROR): Software Fault in component: DeadReckonUsingMultipleVelocitySources
2024-09-13T16:39:25.347Z,1726245565.347 [CBIT](INFO): Clearing failed state for component DeadReckonUsingMultipleVelocitySources
2024-09-13T16:39:25.347Z,1726245565.347 [DeadReckonUsingMultipleVelocitySources] No Fault, FailCount= 1
2024-09-13T16:39:28.158Z,1726245568.158 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:39:28.158Z,1726245568.158 [WetLabsBB2FL] No Fault, FailCount= 5
2024-09-13T16:39:28.504Z,1726245568.504 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:39:33.795Z,1726245573.795 [WetLabsBB2FL] Communications Fault, FailCount= 1
2024-09-13T16:39:33.795Z,1726245573.795 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:39:33.853Z,1726245573.853 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:39:34.291Z,1726245574.291 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:39:35.429Z,1726245575.429 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:39:35.429Z,1726245575.429 [WetLabsBB2FL] No Fault, FailCount= 1
2024-09-13T16:39:35.504Z,1726245575.504 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:39:36.875Z,1726245576.875 [CommandExec](IMPORTANT): got command failComponent
2024-09-13T16:39:36.875Z,1726245576.875 [CommandExec](IMPORTANT): Failed components:
2024-09-13T16:39:36.876Z,1726245576.876 [CommandExec](IMPORTANT): No failed Components.
2024-09-13T16:39:40.799Z,1726245580.799 [WetLabsBB2FL] Communications Fault, FailCount= 2
2024-09-13T16:39:40.799Z,1726245580.799 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:39:41.093Z,1726245581.093 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:39:41.299Z,1726245581.299 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:39:42.297Z,1726245582.297 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:39:42.297Z,1726245582.297 [WetLabsBB2FL] No Fault, FailCount= 2
2024-09-13T16:39:42.513Z,1726245582.513 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:39:47.811Z,1726245587.811 [WetLabsBB2FL] Communications Fault, FailCount= 3
2024-09-13T16:39:47.811Z,1726245587.811 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:39:47.970Z,1726245587.970 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:39:48.311Z,1726245588.311 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:39:49.182Z,1726245589.182 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:39:49.182Z,1726245589.182 [WetLabsBB2FL] No Fault, FailCount= 3
2024-09-13T16:39:49.524Z,1726245589.524 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:39:50.507Z,1726245590.507 [CommandExec](IMPORTANT): got command failComponent
2024-09-13T16:39:50.507Z,1726245590.507 [CommandExec](IMPORTANT): Failed components:
2024-09-13T16:39:50.508Z,1726245590.508 [CommandExec](IMPORTANT): No failed Components.
2024-09-13T16:39:54.825Z,1726245594.825 [WetLabsBB2FL] Communications Fault, FailCount= 4
2024-09-13T16:39:54.825Z,1726245594.825 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:39:54.849Z,1726245594.849 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:39:55.323Z,1726245595.323 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:39:56.453Z,1726245596.453 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:39:56.453Z,1726245596.453 [WetLabsBB2FL] No Fault, FailCount= 4
2024-09-13T16:39:56.538Z,1726245596.538 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:39:59.258Z,1726245599.258 [Startup:StartupSatComms:A](INFO): Timed out from 2024-09-13T16:38:59.1Z
2024-09-13T16:39:59.258Z,1726245599.258 [Startup:StartupSatComms:A] Stopped
2024-09-13T16:39:59.258Z,1726245599.258 [Startup:StartupSatComms:B] Running Loop=1
2024-09-13T16:39:59.746Z,1726245599.746 [Startup:StartupSatComms:B](DEBUG): Initialize ReadDataComponent to sense platform_communications
2024-09-13T16:40:01.827Z,1726245601.827 [WetLabsBB2FL] Communications Fault, FailCount= 5
2024-09-13T16:40:01.827Z,1726245601.827 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:40:02.137Z,1726245602.137 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:40:02.138Z,1726245602.138 [CBIT](FAULT): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:40:02.327Z,1726245602.327 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:40:06.991Z,1726245606.991 [DataOverHttps](INFO): Sending 39 bytes from file Logs/20240912T182721/Courier0067.lzma
2024-09-13T16:40:07.993Z,1726245607.993 [DataOverHttps](INFO): Moved sent file to Logs/20240912T182721/Courier0067.lzma.bak
2024-09-13T16:40:07.993Z,1726245607.993 [DataOverHttps](INFO): SBD MOMSN=23177253
2024-09-13T16:40:28.802Z,1726245628.802 [DataOverHttps](INFO): Sending 151 bytes from file Logs/20240912T221652/Courier0000.lzma
2024-09-13T16:40:29.804Z,1726245629.804 [DataOverHttps](INFO): Moved sent file to Logs/20240912T221652/Courier0000.lzma.bak
2024-09-13T16:40:29.805Z,1726245629.805 [DataOverHttps](INFO): SBD MOMSN=23177257
2024-09-13T16:40:45.246Z,1726245645.246 [DataOverHttps](INFO): Sending 151 bytes from file Logs/20240913T163614/Courier0000.lzma
2024-09-13T16:40:46.249Z,1726245646.249 [DataOverHttps](INFO): Moved sent file to Logs/20240913T163614/Courier0000.lzma.bak
2024-09-13T16:40:46.249Z,1726245646.249 [DataOverHttps](INFO): SBD MOMSN=23177262
2024-09-13T16:40:59.526Z,1726245659.526 [Startup:StartupSatComms:B](INFO): Timed out from 2024-09-13T16:39:59.3Z
2024-09-13T16:40:59.526Z,1726245659.526 [Startup:StartupSatComms:B] Stopped
2024-09-13T16:40:59.526Z,1726245659.526 [Startup:StartupSatComms](INFO): Completed Startup:StartupSatComms
2024-09-13T16:40:59.526Z,1726245659.526 [Startup:StartupSatComms] Stopped
2024-09-13T16:40:59.526Z,1726245659.526 [Startup:StartupSatComms](DEBUG): Aggregate::uninitialize Startup:StartupSatComms
2024-09-13T16:40:59.532Z,1726245659.532 [Startup](INFO): Completed Startup
2024-09-13T16:40:59.532Z,1726245659.532 [MissionManager](INFO): Startup is completed.
2024-09-13T16:40:59.532Z,1726245659.532 [MissionManager](INFO): Uninitializing Mission Startup
2024-09-13T16:40:59.532Z,1726245659.532 [Startup] Stopped
2024-09-13T16:40:59.532Z,1726245659.532 [Startup](DEBUG): Aggregate::uninitialize Startup
2024-09-13T16:40:59.532Z,1726245659.532 [Startup:A.GoToSurface] Stopped
2024-09-13T16:40:59.532Z,1726245659.532 [Startup:A.GoToSurface](DEBUG): Uninitialize GoToSurfaceComponent.
2024-09-13T16:40:59.935Z,1726245659.935 [MissionManager](IMPORTANT): Started mission Default
2024-09-13T16:40:59.936Z,1726245659.936 [Default] Running Loop=1
2024-09-13T16:40:59.936Z,1726245659.936 [Default](DEBUG): Aggregate::initialize Default
2024-09-13T16:40:59.936Z,1726245659.936 [Default:B.GoToSurface] Running Loop=1
2024-09-13T16:40:59.936Z,1726245659.936 [Default:B.GoToSurface](DEBUG): Initialize GoToSurfaceComponent.
2024-09-13T16:40:59.936Z,1726245659.936 [Default:B.GoToSurface](DEBUG): No depth rate setting specified. Using default value of nan m/s.
2024-09-13T16:40:59.936Z,1726245659.936 [Default:B.GoToSurface](DEBUG): No pitch setting specified. Using default value of nan degrees.
2024-09-13T16:40:59.937Z,1726245659.937 [Default:B.GoToSurface](DEBUG): No speed setting specified. Using default value of 1.000000 m/s.
2024-09-13T16:40:59.937Z,1726245659.937 [Default:B.GoToSurface](DEBUG): No surface timeout specified. Using default value of 1000.000000 seconds.
2024-09-13T16:40:59.937Z,1726245659.937 [Default:B.GoToSurface](DEBUG): No altitude timeout specified. Using default value of 600.000000 seconds.
2024-09-13T16:40:59.938Z,1726245659.938 [Default:B.GoToSurface](INFO): Received pitch timeout configuration 60.000000 seconds.
2024-09-13T16:40:59.938Z,1726245659.938 [Default:A.Wait] Running Loop=1
2024-09-13T16:40:59.938Z,1726245659.938 [Default:A.Wait](DEBUG): Initialize Wait Component.
2024-09-13T16:41:01.870Z,1726245661.870 [DataOverHttps](INFO): Sending 141 bytes from file Logs/20240912T182721/Express0068.lzma
2024-09-13T16:41:02.873Z,1726245662.873 [DataOverHttps](INFO): Moved sent file to Logs/20240912T182721/Express0068.lzma.bak
2024-09-13T16:41:02.873Z,1726245662.873 [DataOverHttps](INFO): SBD MOMSN=23177265
2024-09-13T16:41:13.273Z,1726245673.273 [Default:A.Wait](INFO): Done Waiting.
2024-09-13T16:41:13.274Z,1726245673.274 [Default:A.Wait] Stopped
2024-09-13T16:41:13.274Z,1726245673.274 [Default:A.Wait](DEBUG): Uninitialize Wait Component.
2024-09-13T16:41:13.660Z,1726245673.660 [Default:CheckIn] Running Loop=1
2024-09-13T16:41:13.660Z,1726245673.660 [Default:CheckIn](DEBUG): Aggregate::initialize Default:CheckIn
2024-09-13T16:41:13.660Z,1726245673.660 [Default:CheckIn:Read_GPS] Running Loop=1
2024-09-13T16:41:14.057Z,1726245674.057 [Default:CheckIn:Read_GPS](DEBUG): Initialize ReadDataComponent to sense time_fix
2024-09-13T16:41:22.928Z,1726245682.928 [BPC1](ERROR): BPC1B got IPBS message with 4 sticks (min is 7).
2024-09-13T16:41:36.259Z,1726245696.259 [BPC1](ERROR): BPC1B got IPBS message with 4 sticks (min is 7).
2024-09-13T16:41:49.592Z,1726245709.592 [BPC1](ERROR): BPC1B got IPBS message with 4 sticks (min is 7).
2024-09-13T16:42:03.328Z,1726245723.328 [BPC1](ERROR): BPC1B got IPBS message with 4 sticks (min is 7).
2024-09-13T16:42:08.180Z,1726245728.180 [NAL9602](FAULT): MT Queue status failed to be acquired within timeout. Will not retry this session.
2024-09-13T16:42:17.467Z,1726245737.467 [BPC1](ERROR): BPC1B got IPBS message with 4 sticks (min is 7).
2024-09-13T16:42:25.966Z,1726245745.966 [DeadReckonUsingMultipleVelocitySources] Software Fault, FailCount= 2
2024-09-13T16:42:25.966Z,1726245745.966 [DeadReckonUsingMultipleVelocitySources](ERROR): Software Fault
2024-09-13T16:42:25.977Z,1726245745.977 [CBIT](ERROR): Software Fault in component: DeadReckonUsingMultipleVelocitySources
2024-09-13T16:42:26.440Z,1726245746.440 [CBIT](INFO): Clearing failed state for component DeadReckonUsingMultipleVelocitySources
2024-09-13T16:42:26.440Z,1726245746.440 [DeadReckonUsingMultipleVelocitySources] No Fault, FailCount= 2
2024-09-13T16:42:30.799Z,1726245750.799 [BPC1](ERROR): BPC1B got IPBS message with 4 sticks (min is 7).
2024-09-13T16:42:32.052Z,1726245752.052 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:42:32.052Z,1726245752.052 [WetLabsBB2FL] No Fault, FailCount= 5
2024-09-13T16:42:32.240Z,1726245752.240 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:42:37.543Z,1726245757.543 [WetLabsBB2FL] Communications Fault, FailCount= 1
2024-09-13T16:42:37.543Z,1726245757.543 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:42:37.733Z,1726245757.733 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:42:38.043Z,1726245758.043 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:42:38.935Z,1726245758.935 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:42:38.935Z,1726245758.935 [WetLabsBB2FL] No Fault, FailCount= 1
2024-09-13T16:42:39.268Z,1726245759.268 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:42:43.727Z,1726245763.727 [BPC1](ERROR): BPC1B got IPBS message with 4 sticks (min is 7).
2024-09-13T16:42:44.555Z,1726245764.555 [WetLabsBB2FL] Communications Fault, FailCount= 2
2024-09-13T16:42:44.555Z,1726245764.555 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:42:44.604Z,1726245764.604 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:42:45.055Z,1726245765.055 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:42:46.217Z,1726245766.217 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:42:46.217Z,1726245766.217 [WetLabsBB2FL] No Fault, FailCount= 2
2024-09-13T16:42:46.268Z,1726245766.268 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:42:51.563Z,1726245771.563 [WetLabsBB2FL] Communications Fault, FailCount= 3
2024-09-13T16:42:51.563Z,1726245771.563 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:42:51.854Z,1726245771.854 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:42:52.063Z,1726245772.063 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:42:53.142Z,1726245773.142 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:42:53.142Z,1726245773.142 [WetLabsBB2FL] No Fault, FailCount= 3
2024-09-13T16:42:53.276Z,1726245773.276 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:42:57.463Z,1726245777.463 [BPC1](ERROR): BPC1B got IPBS message with 4 sticks (min is 7).
2024-09-13T16:42:58.567Z,1726245778.567 [WetLabsBB2FL] Communications Fault, FailCount= 4
2024-09-13T16:42:58.567Z,1726245778.567 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:42:58.709Z,1726245778.709 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:42:59.067Z,1726245779.067 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:42:59.930Z,1726245779.930 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:42:59.930Z,1726245779.930 [WetLabsBB2FL] No Fault, FailCount= 4
2024-09-13T16:43:00.280Z,1726245780.280 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:43:05.587Z,1726245785.587 [WetLabsBB2FL] Communications Fault, FailCount= 5
2024-09-13T16:43:05.587Z,1726245785.587 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:43:05.998Z,1726245785.998 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:43:05.998Z,1726245785.998 [CBIT](FAULT): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:43:06.083Z,1726245786.083 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:43:11.604Z,1726245791.604 [BPC1](ERROR): BPC1B got IPBS message with 4 sticks (min is 7).
2024-09-13T16:43:24.936Z,1726245804.936 [BPC1](ERROR): BPC1B got IPBS message with 4 sticks (min is 7).
2024-09-13T16:43:37.864Z,1726245817.864 [BPC1](ERROR): BPC1B got IPBS message with 4 sticks (min is 7).
2024-09-13T16:43:45.951Z,1726245825.951 [BPC1](INFO): Calculating totals. Valid battery stick count: 42. Valid reserve battery stick count: 5.
2024-09-13T16:43:45.954Z,1726245825.954 [BPC1](INFO): Received data from all battery sticks.
2024-09-13T16:45:26.958Z,1726245926.958 [DeadReckonUsingMultipleVelocitySources] Software Fault, FailCount= 3
2024-09-13T16:45:26.958Z,1726245926.958 [DeadReckonUsingMultipleVelocitySources](ERROR): Software Fault
2024-09-13T16:45:26.969Z,1726245926.969 [CBIT](ERROR): Software Fault in component: DeadReckonUsingMultipleVelocitySources
2024-09-13T16:45:27.373Z,1726245927.373 [CBIT](INFO): Clearing failed state for component DeadReckonUsingMultipleVelocitySources
2024-09-13T16:45:27.373Z,1726245927.373 [DeadReckonUsingMultipleVelocitySources] No Fault, FailCount= 3
2024-09-13T16:45:35.895Z,1726245935.895 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:45:35.895Z,1726245935.895 [WetLabsBB2FL] No Fault, FailCount= 5
2024-09-13T16:45:35.968Z,1726245935.968 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:45:41.267Z,1726245941.267 [WetLabsBB2FL] Communications Fault, FailCount= 1
2024-09-13T16:45:41.267Z,1726245941.267 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:45:41.538Z,1726245941.538 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:45:41.767Z,1726245941.767 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:45:42.724Z,1726245942.724 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:45:42.724Z,1726245942.724 [WetLabsBB2FL] No Fault, FailCount= 1
2024-09-13T16:45:42.980Z,1726245942.980 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:45:48.271Z,1726245948.271 [WetLabsBB2FL] Communications Fault, FailCount= 2
2024-09-13T16:45:48.271Z,1726245948.271 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:45:48.393Z,1726245948.393 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:45:48.775Z,1726245948.775 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:45:49.618Z,1726245949.618 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:45:49.618Z,1726245949.618 [WetLabsBB2FL] No Fault, FailCount= 2
2024-09-13T16:45:49.988Z,1726245949.988 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:45:55.283Z,1726245955.283 [WetLabsBB2FL] Communications Fault, FailCount= 3
2024-09-13T16:45:55.283Z,1726245955.283 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:45:55.657Z,1726245955.657 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:45:55.783Z,1726245955.783 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:45:56.882Z,1726245956.882 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:45:56.882Z,1726245956.882 [WetLabsBB2FL] No Fault, FailCount= 3
2024-09-13T16:45:56.996Z,1726245956.996 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:46:02.295Z,1726245962.295 [WetLabsBB2FL] Communications Fault, FailCount= 4
2024-09-13T16:46:02.295Z,1726245962.295 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:46:02.551Z,1726245962.551 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:46:02.795Z,1726245962.795 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:46:03.753Z,1726245963.753 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:46:03.753Z,1726245963.753 [WetLabsBB2FL] No Fault, FailCount= 4
2024-09-13T16:46:04.008Z,1726245964.008 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:46:09.307Z,1726245969.307 [WetLabsBB2FL] Communications Fault, FailCount= 5
2024-09-13T16:46:09.307Z,1726245969.307 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:46:09.413Z,1726245969.413 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:46:09.413Z,1726245969.413 [CBIT](FAULT): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:46:09.807Z,1726245969.807 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:46:13.824Z,1726245973.824 [Default:CheckIn:Read_GPS](INFO): Timed out from 2024-09-13T16:41:13.7Z
2024-09-13T16:46:13.824Z,1726245973.824 [Default:CheckIn:Read_GPS] Stopped
2024-09-13T16:46:13.824Z,1726245973.824 [Default:CheckIn:Read_Iridium] Running Loop=1
2024-09-13T16:46:14.250Z,1726245974.250 [Default:CheckIn:Read_Iridium](DEBUG): Initialize ReadDataComponent to sense platform_communications
2024-09-13T16:46:21.422Z,1726245981.422 [DataOverHttps](INFO): Sending 168 bytes from file Logs/20240913T163614/Courier0004.lzma
2024-09-13T16:46:22.425Z,1726245982.425 [DataOverHttps](INFO): Moved sent file to Logs/20240913T163614/Courier0004.lzma.bak
2024-09-13T16:46:22.425Z,1726245982.425 [DataOverHttps](INFO): SBD MOMSN=23177275
2024-09-13T16:46:37.796Z,1726245997.796 [DataOverHttps](INFO): Sending 1123 bytes from file Logs/20240912T221652/Express0001.lzma
2024-09-13T16:46:38.796Z,1726245998.796 [DataOverHttps](INFO): Moved sent file to Logs/20240912T221652/Express0001.lzma.bak
2024-09-13T16:46:38.797Z,1726245998.797 [DataOverHttps](INFO): SBD MOMSN=23177277
2024-09-13T16:46:54.204Z,1726246014.204 [DataOverHttps](INFO): Sending 1115 bytes from file Logs/20240913T163614/Express0001.lzma
2024-09-13T16:46:55.205Z,1726246015.205 [DataOverHttps](INFO): Moved sent file to Logs/20240913T163614/Express0001.lzma.bak
2024-09-13T16:46:55.205Z,1726246015.205 [DataOverHttps](INFO): SBD MOMSN=23177316
2024-09-13T16:47:07.152Z,1726246027.152 [NAL9602](FAULT): GPS failed to acquire within timeout.
2024-09-13T16:47:07.152Z,1726246027.152 [NAL9602] Data Fault, FailCount= 1
2024-09-13T16:47:07.152Z,1726246027.152 [NAL9602](ERROR): Data Fault
2024-09-13T16:47:07.186Z,1726246027.186 [CBIT](ERROR): Data Fault in component: NAL9602
2024-09-13T16:47:07.556Z,1726246027.556 [NAL9602](INFO): Powering down
2024-09-13T16:47:08.417Z,1726246028.417 [CBIT](INFO): Clearing failed state for component NAL9602
2024-09-13T16:47:08.417Z,1726246028.417 [NAL9602] No Fault, FailCount= 1
2024-09-13T16:47:10.774Z,1726246030.774 [DataOverHttps](INFO): Sending 242 bytes from file Logs/20240913T163614/Express0005.lzma
2024-09-13T16:47:11.777Z,1726246031.777 [DataOverHttps](INFO): Moved sent file to Logs/20240913T163614/Express0005.lzma.bak
2024-09-13T16:47:11.777Z,1726246031.777 [DataOverHttps](INFO): SBD MOMSN=23177354
2024-09-13T16:47:13.632Z,1726246033.632 [Default:CheckIn:Read_Iridium] Stopped
2024-09-13T16:47:13.632Z,1726246033.632 [Default:CheckIn:C.Wait] Running Loop=1
2024-09-13T16:47:13.633Z,1726246033.633 [Default:CheckIn:C.Wait](DEBUG): Initialize Wait Component.
2024-09-13T16:47:37.856Z,1726246057.856 [NAL9602](INFO): Powering up NAL9602
2024-09-13T16:47:48.764Z,1726246068.764 [NAL9602](INFO): NAL9602 initialized
2024-09-13T16:48:27.984Z,1726246107.984 [DeadReckonUsingMultipleVelocitySources] Software Fault, FailCount= 4
2024-09-13T16:48:27.984Z,1726246107.984 [DeadReckonUsingMultipleVelocitySources](ERROR): Software Fault
2024-09-13T16:48:27.995Z,1726246107.995 [CBIT](ERROR): Software Fault in component: DeadReckonUsingMultipleVelocitySources
2024-09-13T16:48:28.405Z,1726246108.405 [CBIT](INFO): Clearing failed state for component DeadReckonUsingMultipleVelocitySources
2024-09-13T16:48:28.405Z,1726246108.405 [DeadReckonUsingMultipleVelocitySources] No Fault, FailCount= 4
2024-09-13T16:48:39.700Z,1726246119.700 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:48:39.700Z,1726246119.700 [WetLabsBB2FL] No Fault, FailCount= 5
2024-09-13T16:48:39.756Z,1726246119.756 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:48:45.047Z,1726246125.047 [WetLabsBB2FL] Communications Fault, FailCount= 1
2024-09-13T16:48:45.047Z,1726246125.047 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:48:45.340Z,1726246125.340 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:48:45.547Z,1726246125.547 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:48:46.583Z,1726246126.583 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:48:46.583Z,1726246126.583 [WetLabsBB2FL] No Fault, FailCount= 1
2024-09-13T16:48:46.760Z,1726246126.760 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:48:52.063Z,1726246132.063 [WetLabsBB2FL] Communications Fault, FailCount= 2
2024-09-13T16:48:52.063Z,1726246132.063 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:48:52.250Z,1726246132.250 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:48:52.563Z,1726246132.563 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:48:53.440Z,1726246133.440 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:48:53.440Z,1726246133.440 [WetLabsBB2FL] No Fault, FailCount= 2
2024-09-13T16:48:53.776Z,1726246133.776 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:48:59.067Z,1726246139.067 [WetLabsBB2FL] Communications Fault, FailCount= 3
2024-09-13T16:48:59.067Z,1726246139.067 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:48:59.082Z,1726246139.082 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:48:59.568Z,1726246139.568 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:49:00.697Z,1726246140.697 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:49:00.697Z,1726246140.697 [WetLabsBB2FL] No Fault, FailCount= 3
2024-09-13T16:49:00.780Z,1726246140.780 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:49:06.075Z,1726246146.075 [WetLabsBB2FL] Communications Fault, FailCount= 4
2024-09-13T16:49:06.075Z,1726246146.075 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:49:06.358Z,1726246146.358 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:49:06.575Z,1726246146.575 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:49:07.575Z,1726246147.575 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:49:07.575Z,1726246147.575 [WetLabsBB2FL] No Fault, FailCount= 4
2024-09-13T16:49:07.789Z,1726246147.789 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:49:13.091Z,1726246153.091 [WetLabsBB2FL] Communications Fault, FailCount= 5
2024-09-13T16:49:13.091Z,1726246153.091 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:49:13.228Z,1726246153.228 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:49:13.228Z,1726246153.228 [CBIT](FAULT): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:49:13.591Z,1726246153.591 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:51:28.965Z,1726246288.965 [DeadReckonUsingMultipleVelocitySources] Software Fault, FailCount= 5
2024-09-13T16:51:28.965Z,1726246288.965 [DeadReckonUsingMultipleVelocitySources](ERROR): Software Fault
2024-09-13T16:51:28.000Z,1726246289.000 [CBIT](ERROR): Software Fault in component: DeadReckonUsingMultipleVelocitySources
2024-09-13T16:51:29.404Z,1726246289.404 [CBIT](INFO): Clearing failed state for component DeadReckonUsingMultipleVelocitySources
2024-09-13T16:51:29.404Z,1726246289.404 [DeadReckonUsingMultipleVelocitySources] No Fault, FailCount= 5
2024-09-13T16:51:43.108Z,1726246303.108 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:51:43.108Z,1726246303.108 [WetLabsBB2FL] No Fault, FailCount= 5
2024-09-13T16:51:43.180Z,1726246303.180 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:51:48.471Z,1726246308.471 [WetLabsBB2FL] Communications Fault, FailCount= 1
2024-09-13T16:51:48.471Z,1726246308.471 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:51:48.777Z,1726246308.777 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:51:48.971Z,1726246308.971 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:51:50.043Z,1726246310.043 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:51:50.043Z,1726246310.043 [WetLabsBB2FL] No Fault, FailCount= 1
2024-09-13T16:51:50.188Z,1726246310.188 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:51:55.475Z,1726246315.475 [WetLabsBB2FL] Communications Fault, FailCount= 2
2024-09-13T16:51:55.475Z,1726246315.475 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:51:55.655Z,1726246315.655 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:51:55.975Z,1726246315.975 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:51:56.841Z,1726246316.841 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:51:56.841Z,1726246316.841 [WetLabsBB2FL] No Fault, FailCount= 2
2024-09-13T16:51:57.188Z,1726246317.188 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:52:02.483Z,1726246322.483 [WetLabsBB2FL] Communications Fault, FailCount= 3
2024-09-13T16:52:02.483Z,1726246322.483 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:52:02.531Z,1726246322.531 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:52:02.987Z,1726246322.987 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:52:04.126Z,1726246324.126 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:52:04.127Z,1726246324.127 [WetLabsBB2FL] No Fault, FailCount= 3
2024-09-13T16:52:04.200Z,1726246324.200 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:52:09.495Z,1726246329.495 [WetLabsBB2FL] Communications Fault, FailCount= 4
2024-09-13T16:52:09.495Z,1726246329.495 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:52:09.762Z,1726246329.762 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:52:09.995Z,1726246329.995 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:52:10.998Z,1726246330.998 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:52:10.998Z,1726246330.998 [WetLabsBB2FL] No Fault, FailCount= 4
2024-09-13T16:52:11.208Z,1726246331.208 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:52:14.203Z,1726246334.203 [Default:CheckIn:C.Wait](INFO): Done Waiting.
2024-09-13T16:52:14.203Z,1726246334.203 [Default:CheckIn:C.Wait] Stopped
2024-09-13T16:52:14.204Z,1726246334.204 [Default:CheckIn:C.Wait](DEBUG): Uninitialize Wait Component.
2024-09-13T16:52:14.204Z,1726246334.204 [Default:CheckIn:D] Running Loop=1
2024-09-13T16:52:14.621Z,1726246334.621 [Default:CheckIn:D] Stopped
2024-09-13T16:52:14.621Z,1726246334.621 [Default:CheckIn:E] Running Loop=1
2024-09-13T16:52:15.030Z,1726246335.030 [Default:CheckIn:E](IMPORTANT): Default mission has been running for 11.244756 min
2024-09-13T16:52:15.031Z,1726246335.031 [Default:CheckIn:E] Stopped
2024-09-13T16:52:15.031Z,1726246335.031 [Default:CheckIn](INFO): Completed Default:CheckIn
2024-09-13T16:52:15.031Z,1726246335.031 [Default:CheckIn] Stopped
2024-09-13T16:52:15.031Z,1726246335.031 [Default:CheckIn](DEBUG): Aggregate::uninitialize Default:CheckIn
2024-09-13T16:52:15.031Z,1726246335.031 [Default:CheckIn](INFO): Running loop #2
2024-09-13T16:52:15.031Z,1726246335.031 [Default:CheckIn] Running Loop=2
2024-09-13T16:52:15.031Z,1726246335.031 [Default:CheckIn](DEBUG): Aggregate::initialize Default:CheckIn
2024-09-13T16:52:15.031Z,1726246335.031 [Default:CheckIn:Read_GPS] Running Loop=1
2024-09-13T16:52:16.499Z,1726246336.499 [WetLabsBB2FL] Communications Fault, FailCount= 5
2024-09-13T16:52:16.499Z,1726246336.499 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:52:16.637Z,1726246336.637 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:52:16.637Z,1726246336.637 [CBIT](FAULT): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:52:16.999Z,1726246336.999 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:54:29.942Z,1726246469.942 [DeadReckonUsingMultipleVelocitySources] Software Fault, FailCount= 6
2024-09-13T16:54:29.942Z,1726246469.942 [DeadReckonUsingMultipleVelocitySources](ERROR): Software Fault
2024-09-13T16:54:29.954Z,1726246469.954 [CBIT](ERROR): Software Fault in component: DeadReckonUsingMultipleVelocitySources
2024-09-13T16:54:30.367Z,1726246470.367 [CBIT](INFO): Clearing failed state for component DeadReckonUsingMultipleVelocitySources
2024-09-13T16:54:30.367Z,1726246470.367 [DeadReckonUsingMultipleVelocitySources] No Fault, FailCount= 6
2024-09-13T16:54:46.526Z,1726246486.526 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:54:46.526Z,1726246486.526 [WetLabsBB2FL] No Fault, FailCount= 5
2024-09-13T16:54:46.884Z,1726246486.884 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:54:52.183Z,1726246492.183 [WetLabsBB2FL] Communications Fault, FailCount= 1
2024-09-13T16:54:52.183Z,1726246492.183 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:54:52.212Z,1726246492.212 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:54:52.679Z,1726246492.679 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:54:53.829Z,1726246493.829 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:54:53.830Z,1726246493.830 [WetLabsBB2FL] No Fault, FailCount= 1
2024-09-13T16:54:53.892Z,1726246493.892 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:54:59.207Z,1726246499.207 [WetLabsBB2FL] Communications Fault, FailCount= 2
2024-09-13T16:54:59.207Z,1726246499.207 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:54:59.450Z,1726246499.450 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:54:59.712Z,1726246499.712 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:55:00.685Z,1726246500.685 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:55:00.685Z,1726246500.685 [WetLabsBB2FL] No Fault, FailCount= 2
2024-09-13T16:55:00.925Z,1726246500.925 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:55:06.215Z,1726246506.215 [WetLabsBB2FL] Communications Fault, FailCount= 3
2024-09-13T16:55:06.215Z,1726246506.215 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:55:06.338Z,1726246506.338 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:55:06.715Z,1726246506.715 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:55:07.530Z,1726246507.530 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:55:07.530Z,1726246507.530 [WetLabsBB2FL] No Fault, FailCount= 3
2024-09-13T16:55:07.928Z,1726246507.928 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:55:13.227Z,1726246513.227 [WetLabsBB2FL] Communications Fault, FailCount= 4
2024-09-13T16:55:13.227Z,1726246513.227 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:55:13.606Z,1726246513.606 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:55:13.727Z,1726246513.727 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:55:14.819Z,1726246514.819 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:55:14.819Z,1726246514.819 [WetLabsBB2FL] No Fault, FailCount= 4
2024-09-13T16:55:14.940Z,1726246514.940 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:55:20.235Z,1726246520.235 [WetLabsBB2FL] Communications Fault, FailCount= 5
2024-09-13T16:55:20.235Z,1726246520.235 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:55:20.472Z,1726246520.472 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:55:20.473Z,1726246520.473 [CBIT](FAULT): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:55:20.735Z,1726246520.735 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:57:15.181Z,1726246635.181 [Default:CheckIn:Read_GPS](INFO): Timed out from 2024-09-13T16:52:15.0Z
2024-09-13T16:57:15.181Z,1726246635.181 [Default:CheckIn:Read_GPS] Stopped
2024-09-13T16:57:15.181Z,1726246635.181 [Default:CheckIn:Read_Iridium] Running Loop=1
2024-09-13T16:57:22.410Z,1726246642.410 [DataOverHttps](INFO): Sending 39 bytes from file Logs/20240913T163614/Courier0007.lzma
2024-09-13T16:57:23.413Z,1726246643.413 [DataOverHttps](INFO): Moved sent file to Logs/20240913T163614/Courier0007.lzma.bak
2024-09-13T16:57:23.413Z,1726246643.413 [DataOverHttps](INFO): SBD MOMSN=23177373
2024-09-13T16:57:30.940Z,1726246650.940 [DeadReckonUsingMultipleVelocitySources] Software Fault, FailCount= 7
2024-09-13T16:57:30.940Z,1726246650.940 [DeadReckonUsingMultipleVelocitySources](ERROR): Software Fault
2024-09-13T16:57:30.000Z,1726246651.000 [CBIT](ERROR): Software Fault in component: DeadReckonUsingMultipleVelocitySources
2024-09-13T16:57:31.378Z,1726246651.378 [CBIT](INFO): Clearing failed state for component DeadReckonUsingMultipleVelocitySources
2024-09-13T16:57:31.378Z,1726246651.378 [DeadReckonUsingMultipleVelocitySources] No Fault, FailCount= 7
2024-09-13T16:57:38.747Z,1726246658.747 [DataOverHttps](INFO): Sending 243 bytes from file Logs/20240913T163614/Express0008.lzma
2024-09-13T16:57:39.748Z,1726246659.748 [DataOverHttps](INFO): Moved sent file to Logs/20240913T163614/Express0008.lzma.bak
2024-09-13T16:57:39.749Z,1726246659.749 [DataOverHttps](INFO): SBD MOMSN=23177375
2024-09-13T16:57:41.441Z,1726246661.441 [Default:CheckIn:Read_Iridium] Stopped
2024-09-13T16:57:41.441Z,1726246661.441 [Default:CheckIn:C.Wait] Running Loop=1
2024-09-13T16:57:41.441Z,1726246661.441 [Default:CheckIn:C.Wait](DEBUG): Initialize Wait Component.
2024-09-13T16:57:50.340Z,1726246670.340 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:57:50.341Z,1726246670.341 [WetLabsBB2FL] No Fault, FailCount= 5
2024-09-13T16:57:50.620Z,1726246670.620 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:57:50.724Z,1726246670.724 [NAL9602](FAULT): GPS failed to acquire within timeout.
2024-09-13T16:57:50.724Z,1726246670.724 [NAL9602] Data Fault, FailCount= 2
2024-09-13T16:57:50.724Z,1726246670.724 [NAL9602](ERROR): Data Fault
2024-09-13T16:57:50.749Z,1726246670.749 [CBIT](ERROR): Data Fault in component: NAL9602
2024-09-13T16:57:51.134Z,1726246671.134 [NAL9602](INFO): Powering down
2024-09-13T16:57:51.957Z,1726246671.957 [CBIT](INFO): Clearing failed state for component NAL9602
2024-09-13T16:57:51.957Z,1726246671.957 [NAL9602] No Fault, FailCount= 2
2024-09-13T16:57:55.923Z,1726246675.923 [WetLabsBB2FL] Communications Fault, FailCount= 1
2024-09-13T16:57:55.923Z,1726246675.923 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:57:56.004Z,1726246676.004 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:57:56.423Z,1726246676.423 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:57:57.612Z,1726246677.612 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:57:57.612Z,1726246677.612 [WetLabsBB2FL] No Fault, FailCount= 1
2024-09-13T16:57:57.656Z,1726246677.656 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:58:02.951Z,1726246682.951 [WetLabsBB2FL] Communications Fault, FailCount= 2
2024-09-13T16:58:02.951Z,1726246682.951 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:58:03.278Z,1726246683.278 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:58:03.451Z,1726246683.451 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:58:04.479Z,1726246684.479 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:58:04.480Z,1726246684.480 [WetLabsBB2FL] No Fault, FailCount= 2
2024-09-13T16:58:04.664Z,1726246684.664 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:58:09.959Z,1726246689.959 [WetLabsBB2FL] Communications Fault, FailCount= 3
2024-09-13T16:58:09.959Z,1726246689.959 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:58:10.141Z,1726246690.141 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:58:10.459Z,1726246690.459 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:58:11.346Z,1726246691.346 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:58:11.346Z,1726246691.346 [WetLabsBB2FL] No Fault, FailCount= 3
2024-09-13T16:58:11.672Z,1726246691.672 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:58:16.963Z,1726246696.963 [WetLabsBB2FL] Communications Fault, FailCount= 4
2024-09-13T16:58:16.963Z,1726246696.963 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:58:17.042Z,1726246697.042 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:58:17.463Z,1726246697.463 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:58:18.622Z,1726246698.622 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T16:58:18.622Z,1726246698.622 [WetLabsBB2FL] No Fault, FailCount= 4
2024-09-13T16:58:18.676Z,1726246698.676 [WetLabsBB2FL](INFO): Powering up
2024-09-13T16:58:21.432Z,1726246701.432 [NAL9602](INFO): Powering up NAL9602
2024-09-13T16:58:23.967Z,1726246703.967 [WetLabsBB2FL] Communications Fault, FailCount= 5
2024-09-13T16:58:23.967Z,1726246703.967 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T16:58:24.280Z,1726246704.280 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:58:24.280Z,1726246704.280 [CBIT](FAULT): Communications Fault in component: WetLabsBB2FL
2024-09-13T16:58:24.467Z,1726246704.467 [WetLabsBB2FL](INFO): Powering down
2024-09-13T16:58:32.340Z,1726246712.340 [NAL9602](INFO): NAL9602 initialized
2024-09-13T17:00:31.934Z,1726246831.934 [DeadReckonUsingMultipleVelocitySources] Software Fault, FailCount= 8
2024-09-13T17:00:31.934Z,1726246831.934 [DeadReckonUsingMultipleVelocitySources](ERROR): Software Fault
2024-09-13T17:00:31.946Z,1726246831.946 [CBIT](ERROR): Software Fault in component: DeadReckonUsingMultipleVelocitySources
2024-09-13T17:00:32.362Z,1726246832.362 [CBIT](INFO): Clearing failed state for component DeadReckonUsingMultipleVelocitySources
2024-09-13T17:00:32.362Z,1726246832.362 [DeadReckonUsingMultipleVelocitySources] No Fault, FailCount= 8
2024-09-13T17:00:54.180Z,1726246854.180 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T17:00:54.180Z,1726246854.180 [WetLabsBB2FL] No Fault, FailCount= 5
2024-09-13T17:00:54.352Z,1726246854.352 [WetLabsBB2FL](INFO): Powering up
2024-09-13T17:00:59.647Z,1726246859.647 [WetLabsBB2FL] Communications Fault, FailCount= 1
2024-09-13T17:00:59.647Z,1726246859.647 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T17:00:59.814Z,1726246859.814 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T17:01:00.147Z,1726246860.147 [WetLabsBB2FL](INFO): Powering down
2024-09-13T17:01:01.084Z,1726246861.084 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T17:01:01.084Z,1726246861.084 [WetLabsBB2FL] No Fault, FailCount= 1
2024-09-13T17:01:01.360Z,1726246861.360 [WetLabsBB2FL](INFO): Powering up
2024-09-13T17:01:06.651Z,1726246866.651 [WetLabsBB2FL] Communications Fault, FailCount= 2
2024-09-13T17:01:06.651Z,1726246866.651 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T17:01:06.693Z,1726246866.693 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T17:01:07.147Z,1726246867.147 [WetLabsBB2FL](INFO): Powering down
2024-09-13T17:01:08.305Z,1726246868.305 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T17:01:08.305Z,1726246868.305 [WetLabsBB2FL] No Fault, FailCount= 2
2024-09-13T17:01:08.376Z,1726246868.376 [WetLabsBB2FL](INFO): Powering up
2024-09-13T17:01:13.667Z,1726246873.667 [WetLabsBB2FL] Communications Fault, FailCount= 3
2024-09-13T17:01:13.667Z,1726246873.667 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T17:01:13.987Z,1726246873.987 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T17:01:14.167Z,1726246874.167 [WetLabsBB2FL](INFO): Powering down
2024-09-13T17:01:15.179Z,1726246875.179 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T17:01:15.179Z,1726246875.179 [WetLabsBB2FL] No Fault, FailCount= 3
2024-09-13T17:01:15.380Z,1726246875.380 [WetLabsBB2FL](INFO): Powering up
2024-09-13T17:01:20.679Z,1726246880.679 [WetLabsBB2FL] Communications Fault, FailCount= 4
2024-09-13T17:01:20.679Z,1726246880.679 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T17:01:20.840Z,1726246880.840 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T17:01:21.179Z,1726246881.179 [WetLabsBB2FL](INFO): Powering down
2024-09-13T17:01:22.066Z,1726246882.066 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T17:01:22.066Z,1726246882.066 [WetLabsBB2FL] No Fault, FailCount= 4
2024-09-13T17:01:22.392Z,1726246882.392 [WetLabsBB2FL](INFO): Powering up
2024-09-13T17:01:27.683Z,1726246887.683 [WetLabsBB2FL] Communications Fault, FailCount= 5
2024-09-13T17:01:27.683Z,1726246887.683 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T17:01:27.715Z,1726246887.715 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T17:01:27.716Z,1726246887.716 [CBIT](FAULT): Communications Fault in component: WetLabsBB2FL
2024-09-13T17:01:28.183Z,1726246888.183 [WetLabsBB2FL](INFO): Powering down
2024-09-13T17:02:42.041Z,1726246962.041 [Default:CheckIn:C.Wait](INFO): Done Waiting.
2024-09-13T17:02:42.041Z,1726246962.041 [Default:CheckIn:C.Wait] Stopped
2024-09-13T17:02:42.041Z,1726246962.041 [Default:CheckIn:C.Wait](DEBUG): Uninitialize Wait Component.
2024-09-13T17:02:42.041Z,1726246962.041 [Default:CheckIn:D] Running Loop=1
2024-09-13T17:02:42.445Z,1726246962.445 [Default:CheckIn:D] Stopped
2024-09-13T17:02:42.445Z,1726246962.445 [Default:CheckIn:E] Running Loop=1
2024-09-13T17:02:42.856Z,1726246962.856 [Default:CheckIn:E](IMPORTANT): Default mission has been running for 21.708488 min
2024-09-13T17:02:42.856Z,1726246962.856 [Default:CheckIn:E] Stopped
2024-09-13T17:02:42.856Z,1726246962.856 [Default:CheckIn](INFO): Completed Default:CheckIn
2024-09-13T17:02:42.856Z,1726246962.856 [Default:CheckIn] Stopped
2024-09-13T17:02:42.857Z,1726246962.857 [Default:CheckIn](DEBUG): Aggregate::uninitialize Default:CheckIn
2024-09-13T17:02:42.857Z,1726246962.857 [Default:CheckIn](INFO): Running loop #3
2024-09-13T17:02:42.857Z,1726246962.857 [Default:CheckIn] Running Loop=3
2024-09-13T17:02:42.857Z,1726246962.857 [Default:CheckIn](DEBUG): Aggregate::initialize Default:CheckIn
2024-09-13T17:02:42.857Z,1726246962.857 [Default:CheckIn:Read_GPS] Running Loop=1
2024-09-13T17:03:32.926Z,1726247012.926 [DeadReckonUsingMultipleVelocitySources] Software Fault, FailCount= 9
2024-09-13T17:03:32.926Z,1726247012.926 [DeadReckonUsingMultipleVelocitySources](ERROR): Software Fault
2024-09-13T17:03:32.936Z,1726247012.936 [CBIT](ERROR): Software Fault in component: DeadReckonUsingMultipleVelocitySources
2024-09-13T17:03:33.344Z,1726247013.344 [CBIT](INFO): Clearing failed state for component DeadReckonUsingMultipleVelocitySources
2024-09-13T17:03:33.344Z,1726247013.344 [DeadReckonUsingMultipleVelocitySources] No Fault, FailCount= 9
2024-09-13T17:03:57.984Z,1726247037.984 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T17:03:57.985Z,1726247037.985 [WetLabsBB2FL] No Fault, FailCount= 5
2024-09-13T17:03:58.068Z,1726247038.068 [WetLabsBB2FL](INFO): Powering up
2024-09-13T17:04:03.359Z,1726247043.359 [WetLabsBB2FL] Communications Fault, FailCount= 1
2024-09-13T17:04:03.359Z,1726247043.359 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T17:04:03.651Z,1726247043.651 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T17:04:03.859Z,1726247043.859 [WetLabsBB2FL](INFO): Powering down
2024-09-13T17:04:04.891Z,1726247044.891 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T17:04:04.891Z,1726247044.891 [WetLabsBB2FL] No Fault, FailCount= 1
2024-09-13T17:04:05.073Z,1726247045.073 [WetLabsBB2FL](INFO): Powering up
2024-09-13T17:04:10.363Z,1726247050.363 [WetLabsBB2FL] Communications Fault, FailCount= 2
2024-09-13T17:04:10.363Z,1726247050.363 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T17:04:10.516Z,1726247050.516 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T17:04:10.863Z,1726247050.863 [WetLabsBB2FL](INFO): Powering down
2024-09-13T17:04:11.734Z,1726247051.734 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T17:04:11.734Z,1726247051.734 [WetLabsBB2FL] No Fault, FailCount= 2
2024-09-13T17:04:12.076Z,1726247052.076 [WetLabsBB2FL](INFO): Powering up
2024-09-13T17:04:17.371Z,1726247057.371 [WetLabsBB2FL] Communications Fault, FailCount= 3
2024-09-13T17:04:17.371Z,1726247057.371 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T17:04:17.412Z,1726247057.412 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T17:04:17.875Z,1726247057.875 [WetLabsBB2FL](INFO): Powering down
2024-09-13T17:04:19.026Z,1726247059.026 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T17:04:19.026Z,1726247059.026 [WetLabsBB2FL] No Fault, FailCount= 3
2024-09-13T17:04:19.088Z,1726247059.088 [WetLabsBB2FL](INFO): Powering up
2024-09-13T17:04:24.379Z,1726247064.379 [WetLabsBB2FL] Communications Fault, FailCount= 4
2024-09-13T17:04:24.379Z,1726247064.379 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T17:04:24.650Z,1726247064.650 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T17:04:24.879Z,1726247064.879 [WetLabsBB2FL](INFO): Powering down
2024-09-13T17:04:25.890Z,1726247065.890 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
2024-09-13T17:04:25.890Z,1726247065.890 [WetLabsBB2FL] No Fault, FailCount= 4
2024-09-13T17:04:26.092Z,1726247066.092 [WetLabsBB2FL](INFO): Powering up
2024-09-13T17:04:31.391Z,1726247071.391 [WetLabsBB2FL] Communications Fault, FailCount= 5
2024-09-13T17:04:31.391Z,1726247071.391 [WetLabsBB2FL](ERROR): Communications Fault
2024-09-13T17:04:31.519Z,1726247071.519 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
2024-09-13T17:04:31.519Z,1726247071.519 [CBIT](FAULT): Communications Fault in component: WetLabsBB2FL
2024-09-13T17:04:31.903Z,1726247071.903 [WetLabsBB2FL](INFO): Powering down
2024-09-13T17:06:33.912Z,1726247193.912 [DeadReckonUsingMultipleVelocitySources] Software Fault, FailCount= 10
2024-09-13T17:06:33.912Z,1726247193.912 [DeadReckonUsingMultipleVelocitySources](ERROR): Software Fault
2024-09-13T17:06:33.922Z,1726247193.922 [CBIT](ERROR): Software Fault in component: DeadReckonUsingMultipleVelocitySources
2024-09-13T17:06:34.333Z,1726247194.333 [CBIT](INFO): Clearing failed state for component DeadReckonUsingMultipleVelocitySources
2024-09-13T17:06:34.333Z,1726247194.333 [DeadReckonUsingMultipleVelocitySources] No Fault, FailCount= 10
2024-09-13T17:06:39.516Z,1726247199.516 [CommandExec](IMPORTANT): got command restart system
2024-09-13T17:06:41.571Z,1726247201.571 [Supervisor](INFO): Stop Mission called by Supervisor::terminate
2024-09-13T17:06:41.571Z,1726247201.571 [CommandExec ThreadHandler](INFO): Uninitializing protected caller thread.
2024-09-13T17:06:41.571Z,1726247201.571 [CommandExec](INFO): Uninitializing the command executive.
2024-09-13T17:06:41.571Z,1726247201.571 [CommandExec](INFO): Uninitializing the command scheduler.
2024-09-13T17:06:41.572Z,1726247201.572 [CommandExec ThreadHandler](INFO): Thread cancelled.
2024-09-13T17:06:41.581Z,1726247201.581 [Supervisor](DEBUG): Uninitializing supervisor and starting cleanup. Bye!
2024-09-13T17:06:41.581Z,1726247201.581 [ComponentRegistry](INFO): Shutting down NavChartDb ThreadHandler
2024-09-13T17:06:41.581Z,1726247201.581 [NavChartDb ThreadHandler](INFO): Thread cancelled.
2024-09-13T17:06:41.582Z,1726247201.582 [NavChartDb](INFO): Join timeout helper Thread ID is 5335
2024-09-13T17:06:41.715Z,1726247201.715 [NavChartDb ThreadHandler](INFO): Uninitializing protected caller thread.
2024-09-13T17:06:41.715Z,1726247201.715 [NavChartDb ThreadHandler](INFO): Thread cancelled.
2024-09-13T17:06:41.727Z,1726247201.727 [ComponentRegistry](INFO): Shutting down WetLabsBB2FL ThreadHandler
2024-09-13T17:06:41.727Z,1726247201.727 [WetLabsBB2FL ThreadHandler](INFO): Thread cancelled.
2024-09-13T17:06:41.727Z,1726247201.727 [WetLabsBB2FL](INFO): Join timeout helper Thread ID is 5336
2024-09-13T17:06:42.079Z,1726247202.079 [WetLabsBB2FL ThreadHandler](INFO): Uninitializing protected caller thread.
2024-09-13T17:06:42.079Z,1726247202.079 [WetLabsBB2FL](INFO): Powering down
2024-09-13T17:06:42.080Z,1726247202.080 [WetLabsBB2FL ThreadHandler](INFO): Thread cancelled.
2024-09-13T17:06:42.083Z,1726247202.083 [ComponentRegistry](INFO): Shutting down CTD_Seabird ThreadHandler
2024-09-13T17:06:42.083Z,1726247202.083 [CTD_Seabird ThreadHandler](INFO): Thread cancelled.
2024-09-13T17:06:42.083Z,1726247202.083 [CTD_Seabird](INFO): Join timeout helper Thread ID is 5337
2024-09-13T17:06:42.463Z,1726247202.463 [CTD_Seabird](INFO): Powering down
2024-09-13T17:06:42.475Z,1726247202.475 [CTD_Seabi