2025-04-08T18:22:27.969Z,1744136547.969 [Supervisor](DEBUG): Initializing supervisor.
2025-04-08T18:22:27.974Z,1744136547.974 [SyncHandler](DEBUG): Created PCaller Thread at 404514E0
2025-04-08T18:22:27.975Z,1744136547.975 [SyncHandler](INFO): Protected caller Thread ID is 3138
2025-04-08T18:22:27.975Z,1744136547.975 [ComponentRegistry](DEBUG): Component "controlThread" handled in its own thread.
2025-04-08T18:22:27.977Z,1744136547.977 [controlThread ThreadHandler](DEBUG): Created PCaller Thread at 404814E0
2025-04-08T18:22:27.977Z,1744136547.977 [controlThread ThreadHandler](INFO): Protected caller Thread ID is 3139
2025-04-08T18:22:27.982Z,1744136547.982 [ComponentRegistry](DEBUG): SyncComponent "CycleStarter" handled in the control thread.
2025-04-08T18:22:28.001Z,1744136548.001 [ComponentRegistry](DEBUG): Component "CommandExec" handled in its own thread.
2025-04-08T18:22:28.002Z,1744136548.002 [CommandExec ThreadHandler](DEBUG): Created PCaller Thread at 404B14E0
2025-04-08T18:22:28.003Z,1744136548.003 [CommandExec ThreadHandler](INFO): Protected caller Thread ID is 3140
2025-04-08T18:22:28.007Z,1744136548.007 [ComponentRegistry](DEBUG): Component "CommandLine" handled in its own thread.
2025-04-08T18:22:28.008Z,1744136548.008 [CommandLine ThreadHandler](DEBUG): Created PCaller Thread at 404E14E0
2025-04-08T18:22:28.008Z,1744136548.008 [CommandLine ThreadHandler](INFO): Protected caller Thread ID is 3141
2025-04-08T18:22:28.011Z,1744136548.011 [ComponentRegistry](DEBUG): Component "logger" handled in its own thread.
2025-04-08T18:22:28.012Z,1744136548.012 [logger ThreadHandler](DEBUG): Created PCaller Thread at 405114E0
2025-04-08T18:22:28.012Z,1744136548.012 [logger ThreadHandler](INFO): Protected caller Thread ID is 3142
2025-04-08T18:22:28.016Z,1744136548.016 [ComponentRegistry](DEBUG): SyncComponent "LogSplitter" handled in the control thread.
2025-04-08T18:22:28.016Z,1744136548.016 [Supervisor](INFO): Looking for Config files in directory: Config/
2025-04-08T18:22:28.018Z,1744136548.018 [Supervisor](INFO): Opening Config file at: Config/Science.cfg
2025-04-08T18:22:28.366Z,1744136548.366 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Science
2025-04-08T18:22:28.366Z,1744136548.366 [Supervisor](INFO): Opening Config file at: Config/Navigation.cfg
2025-04-08T18:22:28.644Z,1744136548.644 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Navigation
2025-04-08T18:22:28.645Z,1744136548.645 [Supervisor](INFO): Opening Config file at: Config/vehicle.cfg
2025-04-08T18:22:29.151Z,1744136549.151 [ComponentRegistry](DEBUG): Loaded Config Component "Config/vehicle
2025-04-08T18:22:29.151Z,1744136549.151 [Supervisor](INFO): Opening Config file at: Config/Dock.cfg
2025-04-08T18:22:29.395Z,1744136549.395 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Dock
2025-04-08T18:22:29.395Z,1744136549.395 [Supervisor](INFO): Opening Config file at: Config/BIT.cfg
2025-04-08T18:22:29.631Z,1744136549.631 [ComponentRegistry](DEBUG): Loaded Config Component "Config/BIT
2025-04-08T18:22:29.631Z,1744136549.631 [Supervisor](INFO): Opening Config file at: Config/Sensor.cfg
2025-04-08T18:22:30.483Z,1744136550.483 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Sensor
2025-04-08T18:22:30.484Z,1744136550.484 [Supervisor](INFO): Opening Config file at: Config/Control.cfg
2025-04-08T18:22:31.011Z,1744136551.011 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Control
2025-04-08T18:22:31.011Z,1744136551.011 [Supervisor](INFO): Opening Config file at: Config/Estimation.cfg
2025-04-08T18:22:31.135Z,1744136551.135 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Estimation
2025-04-08T18:22:31.136Z,1744136551.136 [Supervisor](INFO): Opening Config file at: Config/Sample.cfg
2025-04-08T18:22:31.226Z,1744136551.226 [Supervisor](INFO): Opening Config file at: Config/logger.cfg
2025-04-08T18:22:31.422Z,1744136551.422 [ComponentRegistry](DEBUG): Loaded Config Component "Config/logger
2025-04-08T18:22:31.422Z,1744136551.422 [Supervisor](INFO): Opening Config file at: Config/secure.cfg
2025-04-08T18:22:31.531Z,1744136551.531 [ComponentRegistry](DEBUG): Loaded Config Component "Config/secure
2025-04-08T18:22:31.531Z,1744136551.531 [Supervisor](INFO): Opening Config file at: Config/Derivation.cfg
2025-04-08T18:22:31.764Z,1744136551.764 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Derivation
2025-04-08T18:22:31.765Z,1744136551.765 [Supervisor](INFO): Opening Config file at: Config/workSite.cfg
2025-04-08T18:22:31.914Z,1744136551.914 [ComponentRegistry](DEBUG): Loaded Config Component "Config/workSite
2025-04-08T18:22:31.914Z,1744136551.914 [Supervisor](INFO): Opening Config file at: Config/Guidance.cfg
2025-04-08T18:22:32.007Z,1744136552.007 [Supervisor](INFO): Opening Config file at: Config/Servo.cfg
2025-04-08T18:22:32.447Z,1744136552.447 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Servo
2025-04-08T18:22:32.448Z,1744136552.448 [Supervisor](INFO): Opening Config file at: Config/Simulator.cfg
2025-04-08T18:22:33.021Z,1744136553.021 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Simulator
2025-04-08T18:22:33.023Z,1744136553.023 [Supervisor](INFO): Looking for Config files in directory: Config/lrauv-opah/
2025-04-08T18:22:33.024Z,1744136553.024 [Supervisor](INFO): Opening Config file at: Config/lrauv-opah/Science.cfg
2025-04-08T18:22:33.171Z,1744136553.171 [Supervisor](INFO): Opening Config file at: Config/lrauv-opah/Battery.cfg
2025-04-08T18:22:33.448Z,1744136553.448 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Battery
2025-04-08T18:22:33.449Z,1744136553.449 [Supervisor](INFO): Opening Config file at: Config/lrauv-opah/Navigation.cfg
2025-04-08T18:22:33.563Z,1744136553.563 [Supervisor](INFO): Opening Config file at: Config/lrauv-opah/vehicle.cfg
2025-04-08T18:22:33.670Z,1744136553.670 [Supervisor](INFO): Opening Config file at: Config/lrauv-opah/BIT.cfg
2025-04-08T18:22:33.791Z,1744136553.791 [Supervisor](INFO): Opening Config file at: Config/lrauv-opah/Sensor.cfg
2025-04-08T18:22:33.934Z,1744136553.934 [Supervisor](INFO): Opening Config file at: Config/lrauv-opah/Control.cfg
2025-04-08T18:22:34.039Z,1744136554.039 [Supervisor](INFO): Opening Config file at: Config/lrauv-opah/logger.cfg
2025-04-08T18:22:34.159Z,1744136554.159 [Supervisor](INFO): Opening Config file at: Config/lrauv-opah/secure.cfg
2025-04-08T18:22:34.254Z,1744136554.254 [Supervisor](INFO): Opening Config file at: Config/lrauv-opah/Servo.cfg
2025-04-08T18:22:34.367Z,1744136554.367 [Supervisor](INFO): Opening Config file at: Config/lrauv-opah/Simulator.cfg
2025-04-08T18:22:34.466Z,1744136554.466 [Supervisor](INFO): Looking for Config files in directory: Config/lrauv-opah/root/
2025-04-08T18:22:34.466Z,1744136554.466 [Supervisor](IMPORTANT): Reloading configuration overrides from Data/persisted.cfg
2025-04-08T18:22:34.473Z,1744136554.473 [Module Loader](DEBUG): Loading Module at Modules/Sample.so
2025-04-08T18:22:34.483Z,1744136554.483 [Module Loader](DEBUG): Loaded Module: Sample (This is a Sample Module of Sample Components)
2025-04-08T18:22:34.484Z,1744136554.484 [Module Loader](DEBUG): Loading Module at Modules/Navigation.so
2025-04-08T18:22:34.597Z,1744136554.597 [DeadReckonUsingMultipleVelocitySources] Loaded
2025-04-08T18:22:34.597Z,1744136554.597 [ComponentRegistry](DEBUG): SyncComponent "DeadReckonUsingMultipleVelocitySources" handled in the control thread.
2025-04-08T18:22:34.637Z,1744136554.637 [DeadReckonWithRespectToSeafloor] Loaded
2025-04-08T18:22:34.637Z,1744136554.637 [ComponentRegistry](DEBUG): SyncComponent "DeadReckonWithRespectToSeafloor" handled in the control thread.
2025-04-08T18:22:34.650Z,1744136554.650 [NavChart] Loaded
2025-04-08T18:22:34.651Z,1744136554.651 [ComponentRegistry](DEBUG): SyncComponent "NavChart" handled in the control thread.
2025-04-08T18:22:34.656Z,1744136554.656 [UniversalFixResidualReporter] Loaded
2025-04-08T18:22:34.657Z,1744136554.657 [ComponentRegistry](DEBUG): SyncComponent "UniversalFixResidualReporter" handled in the control thread.
2025-04-08T18:22:34.657Z,1744136554.657 [Module Loader](DEBUG): Loaded Module: Navigation (Contains the base navigation components)
2025-04-08T18:22:34.658Z,1744136554.658 [Module Loader](DEBUG): Loading Module at Modules/Sensor.so
2025-04-08T18:22:35.136Z,1744136555.136 [AHRS_M2] Loaded
2025-04-08T18:22:35.136Z,1744136555.136 [ComponentRegistry](DEBUG): SyncComponent "AHRS_M2" handled in the control thread.
2025-04-08T18:22:35.201Z,1744136555.201 [BackseatComponent](INFO): Found secondary power supply at: /dev/loadC3
2025-04-08T18:22:35.201Z,1744136555.201 [BackseatComponent] Loaded
2025-04-08T18:22:35.201Z,1744136555.201 [ComponentRegistry](DEBUG): Component "BackseatComponent" handled in its own thread.
2025-04-08T18:22:35.203Z,1744136555.203 [BackseatComponent ThreadHandler](DEBUG): Created PCaller Thread at 4085D4E0
2025-04-08T18:22:35.203Z,1744136555.203 [BackseatComponent ThreadHandler](INFO): Protected caller Thread ID is 3224
2025-04-08T18:22:35.206Z,1744136555.206 [LcmUniversalReporter] Loaded
2025-04-08T18:22:35.206Z,1744136555.206 [ComponentRegistry](DEBUG): SyncComponent "LcmUniversalReporter" handled in the control thread.
2025-04-08T18:22:35.999Z,1744136555.999 [BPC1] Loaded
2025-04-08T18:22:35.999Z,1744136555.999 [ComponentRegistry](DEBUG): SyncComponent "BPC1" handled in the control thread.
2025-04-08T18:22:36.165Z,1744136556.165 [DataOverHttps] Loaded
2025-04-08T18:22:36.165Z,1744136556.165 [ComponentRegistry](DEBUG): Component "DataOverHttps" handled in its own thread.
2025-04-08T18:22:36.166Z,1744136556.166 [DataOverHttps ThreadHandler](DEBUG): Created PCaller Thread at 4088D4E0
2025-04-08T18:22:36.166Z,1744136556.166 [DataOverHttps ThreadHandler](INFO): Protected caller Thread ID is 3225
2025-04-08T18:22:36.241Z,1744136556.241 [NAL9602] Loaded
2025-04-08T18:22:36.241Z,1744136556.241 [ComponentRegistry](DEBUG): SyncComponent "NAL9602" handled in the control thread.
2025-04-08T18:22:36.271Z,1744136556.271 [Onboard] Loaded
2025-04-08T18:22:36.271Z,1744136556.271 [ComponentRegistry](DEBUG): Component "Onboard" handled in its own thread.
2025-04-08T18:22:36.272Z,1744136556.272 [Onboard ThreadHandler](DEBUG): Created PCaller Thread at 408BD4E0
2025-04-08T18:22:36.273Z,1744136556.273 [Onboard ThreadHandler](INFO): Protected caller Thread ID is 3226
2025-04-08T18:22:36.321Z,1744136556.321 [Power24vConverter] Loaded
2025-04-08T18:22:36.321Z,1744136556.321 [ComponentRegistry](DEBUG): SyncComponent "Power24vConverter" handled in the control thread.
2025-04-08T18:22:36.433Z,1744136556.433 [Radio_Surface] Loaded
2025-04-08T18:22:36.433Z,1744136556.433 [ComponentRegistry](DEBUG): Component "Radio_Surface" handled in its own thread.
2025-04-08T18:22:36.434Z,1744136556.434 [Radio_Surface ThreadHandler](DEBUG): Created PCaller Thread at 408ED4E0
2025-04-08T18:22:36.434Z,1744136556.434 [Radio_Surface ThreadHandler](INFO): Protected caller Thread ID is 3227
2025-04-08T18:22:36.435Z,1744136556.435 [Module Loader](DEBUG): Loaded Module: Sensor (Contains the sensor components)
2025-04-08T18:22:36.436Z,1744136556.436 [Module Loader](DEBUG): Loading Module at Modules/Derivation.so
2025-04-08T18:22:36.594Z,1744136556.594 [DepthRateCalculator] Loaded
2025-04-08T18:22:36.594Z,1744136556.594 [ComponentRegistry](DEBUG): SyncComponent "DepthRateCalculator" handled in the control thread.
2025-04-08T18:22:36.599Z,1744136556.599 [PitchRateCalculator] Loaded
2025-04-08T18:22:36.600Z,1744136556.600 [ComponentRegistry](DEBUG): SyncComponent "PitchRateCalculator" handled in the control thread.
2025-04-08T18:22:36.677Z,1744136556.677 [SpeedCalculator] Loaded
2025-04-08T18:22:36.677Z,1744136556.677 [ComponentRegistry](DEBUG): SyncComponent "SpeedCalculator" handled in the control thread.
2025-04-08T18:22:36.682Z,1744136556.682 [YawRateCalculator] Loaded
2025-04-08T18:22:36.682Z,1744136556.682 [ComponentRegistry](DEBUG): SyncComponent "YawRateCalculator" handled in the control thread.
2025-04-08T18:22:36.703Z,1744136556.703 [ElevatorOffsetCalculator] Loaded
2025-04-08T18:22:36.704Z,1744136556.704 [ComponentRegistry](DEBUG): SyncComponent "ElevatorOffsetCalculator" handled in the control thread.
2025-04-08T18:22:36.704Z,1744136556.704 [Module Loader](DEBUG): Loaded Module: Derivation (Contains the base derivation components)
2025-04-08T18:22:36.705Z,1744136556.705 [Module Loader](DEBUG): Loading Module at Modules/Estimation.so
2025-04-08T18:22:36.802Z,1744136556.802 [Module Loader](DEBUG): Loaded Module: Estimation (Contains the base estimation components)
2025-04-08T18:22:36.803Z,1744136556.803 [Module Loader](DEBUG): Loading Module at Modules/Servo.so
2025-04-08T18:22:37.085Z,1744136557.085 [BuoyancyServo] Loaded
2025-04-08T18:22:37.085Z,1744136557.085 [ComponentRegistry](DEBUG): SyncComponent "BuoyancyServo" handled in the control thread.
2025-04-08T18:22:37.109Z,1744136557.109 [ElevatorServo] Loaded
2025-04-08T18:22:37.109Z,1744136557.109 [ComponentRegistry](DEBUG): SyncComponent "ElevatorServo" handled in the control thread.
2025-04-08T18:22:37.132Z,1744136557.132 [MassServo] Loaded
2025-04-08T18:22:37.133Z,1744136557.133 [ComponentRegistry](DEBUG): SyncComponent "MassServo" handled in the control thread.
2025-04-08T18:22:37.155Z,1744136557.155 [RudderServo] Loaded
2025-04-08T18:22:37.155Z,1744136557.155 [ComponentRegistry](DEBUG): SyncComponent "RudderServo" handled in the control thread.
2025-04-08T18:22:37.173Z,1744136557.173 [ThrusterHE] Loaded
2025-04-08T18:22:37.173Z,1744136557.173 [ComponentRegistry](DEBUG): SyncComponent "ThrusterHE" handled in the control thread.
2025-04-08T18:22:37.174Z,1744136557.174 [Module Loader](DEBUG): Loaded Module: Servo (This is the module containing motor controllers)
2025-04-08T18:22:37.174Z,1744136557.174 [Module Loader](DEBUG): Loading Module at Modules/Science.so
2025-04-08T18:22:37.306Z,1744136557.306 [Aanderaa_O2] Loaded
2025-04-08T18:22:37.306Z,1744136557.306 [ComponentRegistry](DEBUG): SyncComponent "Aanderaa_O2" handled in the control thread.
2025-04-08T18:22:37.367Z,1744136557.367 [CTD_Seabird] Loaded
2025-04-08T18:22:37.368Z,1744136557.368 [ComponentRegistry](DEBUG): Component "CTD_Seabird" handled in its own thread.
2025-04-08T18:22:37.369Z,1744136557.369 [CTD_Seabird ThreadHandler](DEBUG): Created PCaller Thread at 40A1E4E0
2025-04-08T18:22:37.369Z,1744136557.369 [CTD_Seabird ThreadHandler](INFO): Protected caller Thread ID is 3228
2025-04-08T18:22:37.404Z,1744136557.404 [ESPComponent] Loaded
2025-04-08T18:22:37.405Z,1744136557.405 [ComponentRegistry](DEBUG): SyncComponent "ESPComponent" handled in the control thread.
2025-04-08T18:22:37.405Z,1744136557.405 [Module Loader](DEBUG): Loaded Module: Science (Contains the science components)
2025-04-08T18:22:37.406Z,1744136557.406 [Module Loader](DEBUG): Loading Module at Modules/Dock.so
2025-04-08T18:22:37.537Z,1744136557.537 [Module Loader](DEBUG): Loaded Module: Dock (Contains behaviors and commands for docking)
2025-04-08T18:22:37.538Z,1744136557.538 [Module Loader](DEBUG): Loading Module at Modules/Simulator.so
2025-04-08T18:22:37.717Z,1744136557.717 [Module Loader](DEBUG): Loaded Module: Simulator (This is the module containing the Simulator)
2025-04-08T18:22:37.717Z,1744136557.717 [Module Loader](DEBUG): Loading Module at Modules/Guidance.so
2025-04-08T18:22:38.060Z,1744136558.060 [Module Loader](DEBUG): Loaded Module: Guidance (Contains behaviors and commands)
2025-04-08T18:22:38.061Z,1744136558.061 [Module Loader](DEBUG): Loading Module at Modules/Control.so
2025-04-08T18:22:38.114Z,1744136558.114 [VerticalControl](DEBUG): Construct VerticalControl.
2025-04-08T18:22:38.166Z,1744136558.166 [VerticalControl] Loaded
2025-04-08T18:22:38.167Z,1744136558.167 [ComponentRegistry](DEBUG): SyncComponent "VerticalControl" handled in the control thread.
2025-04-08T18:22:38.170Z,1744136558.170 [HorizontalControl](DEBUG): Construct HorizontalControl.
2025-04-08T18:22:38.216Z,1744136558.216 [HorizontalControl] Loaded
2025-04-08T18:22:38.216Z,1744136558.216 [ComponentRegistry](DEBUG): SyncComponent "HorizontalControl" handled in the control thread.
2025-04-08T18:22:38.219Z,1744136558.219 [SpeedControl](DEBUG): Construct SpeedControl.
2025-04-08T18:22:38.221Z,1744136558.221 [SpeedControl] Loaded
2025-04-08T18:22:38.221Z,1744136558.221 [ComponentRegistry](DEBUG): SyncComponent "SpeedControl" handled in the control thread.
2025-04-08T18:22:38.224Z,1744136558.224 [LoopControl](DEBUG): Construct LoopControl.
2025-04-08T18:22:38.224Z,1744136558.224 [LoopControl] Loaded
2025-04-08T18:22:38.224Z,1744136558.224 [ComponentRegistry](DEBUG): SyncComponent "LoopControl" handled in the control thread.
2025-04-08T18:22:38.225Z,1744136558.225 [Module Loader](DEBUG): Loaded Module: Control (Contains the Control components, such as Depth, Heading, and Speed Control)
2025-04-08T18:22:38.225Z,1744136558.225 [Module Loader](DEBUG): Loading Module at Modules/BIT.so
2025-04-08T18:22:38.383Z,1744136558.383 [SBIT](DEBUG): Construct Startup Built In Test.
2025-04-08T18:22:38.392Z,1744136558.392 [SBIT] Loaded
2025-04-08T18:22:38.392Z,1744136558.392 [ComponentRegistry](DEBUG): SyncComponent "SBIT" handled in the control thread.
2025-04-08T18:22:38.395Z,1744136558.395 [IBIT](DEBUG): Construct Initiated Built In Test.
2025-04-08T18:22:38.408Z,1744136558.408 [IBIT] Loaded
2025-04-08T18:22:38.408Z,1744136558.408 [ComponentRegistry](DEBUG): SyncComponent "IBIT" handled in the control thread.
2025-04-08T18:22:38.413Z,1744136558.413 [CBIT](DEBUG): Construct Continuous Built In Test.
2025-04-08T18:22:38.492Z,1744136558.492 [CBIT] Loaded
2025-04-08T18:22:38.492Z,1744136558.492 [ComponentRegistry](DEBUG): SyncComponent "CBIT" handled in the control thread.
2025-04-08T18:22:38.524Z,1744136558.524 [GFScanner] Loaded
2025-04-08T18:22:38.524Z,1744136558.524 [ComponentRegistry](DEBUG): SyncComponent "GFScanner" handled in the control thread.
2025-04-08T18:22:38.524Z,1744136558.524 [Module Loader](DEBUG): Loaded Module: BIT (Contains the BuiltInTest components, such as C Built In Test)
2025-04-08T18:22:38.525Z,1744136558.525 [Module Loader](DEBUG): Loading Module at Modules/Trigger.so
2025-04-08T18:22:38.554Z,1744136558.554 [Module Loader](DEBUG): Loaded Module: Trigger (Contains triggers for use in missions)
2025-04-08T18:22:38.560Z,1744136558.560 [ComponentRegistry](DEBUG): SyncComponent "MissionManager" handled in the control thread.
2025-04-08T18:22:38.563Z,1744136558.563 [ComponentRegistry](DEBUG): SyncComponent "Reporter" handled in the control thread.
2025-04-08T18:22:38.574Z,1744136558.574 [ComponentRegistry](DEBUG): Component "NavChartDb" handled in its own thread.
2025-04-08T18:22:38.575Z,1744136558.575 [NavChartDb ThreadHandler](DEBUG): Created PCaller Thread at 40C054E0
2025-04-08T18:22:38.576Z,1744136558.576 [NavChartDb ThreadHandler](INFO): Protected caller Thread ID is 3229
2025-04-08T18:22:38.580Z,1744136558.580 [Supervisor](INFO): Main Thread ID is 2979
2025-04-08T18:22:38.580Z,1744136558.580 [Supervisor](DEBUG): Running supervisor.
2025-04-08T18:22:38.581Z,1744136558.581 [CommandExec ThreadHandler](INFO): Handler Thread ID is 3230
2025-04-08T18:22:38.581Z,1744136558.581 [CommandExec](INFO): Initializing the command executive.
2025-04-08T18:22:38.583Z,1744136558.583 [CommandLine ThreadHandler](INFO): Handler Thread ID is 3231
2025-04-08T18:22:38.585Z,1744136558.585 [controlThread ThreadHandler](INFO): Handler Thread ID is 3232
2025-04-08T18:22:38.586Z,1744136558.586 [controlThread](DEBUG): Initializing ControlThread
2025-04-08T18:22:38.587Z,1744136558.587 [NavChart](DEBUG): Initialize NavChart Navigation.
2025-04-08T18:22:38.588Z,1744136558.588 [UniversalFixResidualReporter](DEBUG): Initializing UniversalFixResidualReporter component.
2025-04-08T18:22:38.589Z,1744136558.589 [DepthRateCalculator](DEBUG): Initializing DepthRateCalculator.
2025-04-08T18:22:38.590Z,1744136558.590 [PitchRateCalculator](DEBUG): Initializing PitchRateCalculator.
2025-04-08T18:22:38.590Z,1744136558.590 [SpeedCalculator](DEBUG): Initializing SpeedCalculator.
2025-04-08T18:22:38.590Z,1744136558.590 [YawRateCalculator](DEBUG): Initializing YawRateCalculator.
2025-04-08T18:22:38.591Z,1744136558.591 [ElevatorOffsetCalculator](DEBUG): Initializing ElevatorOffsetCalculator.
2025-04-08T18:22:38.593Z,1744136558.593 [VerticalControl](DEBUG): Initialize VerticalControlComponent.
2025-04-08T18:22:38.594Z,1744136558.594 [HorizontalControl](DEBUG): Initialize HorizontalControlComponent.
2025-04-08T18:22:38.595Z,1744136558.595 [SpeedControl](DEBUG): Initialize SpeedControlComponent.
2025-04-08T18:22:38.596Z,1744136558.596 [LoopControl](DEBUG): Initialize LoopControlComponent.
2025-04-08T18:22:38.596Z,1744136558.596 [SBIT](INFO): Initialize SBIT Component.
2025-04-08T18:22:38.597Z,1744136558.597 [SBIT](IMPORTANT): git: 2025-03-31
2025-04-08T18:22:38.597Z,1744136558.597 [SBIT](INFO): git hash: fa5a0d22cc02557daa9f4ab77c7f518dfe223d1b
2025-04-08T18:22:38.597Z,1744136558.597 [SBIT](IMPORTANT): Kernel Release: 2.6.27.8
2025-04-08T18:22:38.598Z,1744136558.598 [SBIT](INFO): Kernel Reporting Different Version From Configuration.
Kernel Expected: #2 PREEMPT Thu Jan 11 20:13:48 PST 2018
Kernel Reported: #1 PREEMPT Mon Nov 27 01:04:18 PST 2023
2025-04-08T18:22:38.599Z,1744136558.599 [SBIT](INFO): Beginning SBIT in 39.000000 seconds.
2025-04-08T18:22:38.600Z,1744136558.600 [IBIT](INFO): Initialize IBIT Component.
2025-04-08T18:22:38.601Z,1744136558.601 [CBIT](DEBUG): Initialize CBIT Component.
2025-04-08T18:22:38.602Z,1744136558.602 [logger ThreadHandler](INFO): Handler Thread ID is 3233
2025-04-08T18:22:38.612Z,1744136558.612 [CBIT](DEBUG): Initialized mux pins.
2025-04-08T18:22:38.612Z,1744136558.612 [CBIT](DEBUG): Initializing the watchdog timer.
2025-04-08T18:22:38.621Z,1744136558.621 [BackseatComponent ThreadHandler](INFO): Handler Thread ID is 3234
2025-04-08T18:22:38.636Z,1744136558.636 [CBIT](INFO): Last reboot was NOT due to watchdog timer.
2025-04-08T18:22:38.637Z,1744136558.637 [CBIT](DEBUG): Initializing heartbeat.
2025-04-08T18:22:38.637Z,1744136558.637 [DataOverHttps ThreadHandler](INFO): Handler Thread ID is 3235
2025-04-08T18:22:38.639Z,1744136558.639 [DataOverHttps](DEBUG): dashIP=134.89.2.23 starts with a digit so assuming it is a numeric IP
2025-04-08T18:22:38.653Z,1744136558.653 [Onboard ThreadHandler](INFO): Handler Thread ID is 3236
2025-04-08T18:22:38.670Z,1744136558.670 [Radio_Surface ThreadHandler](INFO): Handler Thread ID is 3237
2025-04-08T18:22:38.697Z,1744136558.697 [CTD_Seabird ThreadHandler](INFO): Handler Thread ID is 3238
2025-04-08T18:22:38.697Z,1744136558.697 [CTD_Seabird](DEBUG): Initializing CTD_Seabird.
2025-04-08T18:22:38.702Z,1744136558.702 [NavChartDb ThreadHandler](INFO): Handler Thread ID is 3240
2025-04-08T18:22:38.704Z,1744136558.704 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US1WC07M.000
2025-04-08T18:22:38.704Z,1744136558.704 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US1WC07M.000
2025-04-08T18:22:38.705Z,1744136558.705 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US2WC11M.000
2025-04-08T18:22:38.705Z,1744136558.705 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US2WC11M.000
2025-04-08T18:22:38.705Z,1744136558.705 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US3CA52M.000
2025-04-08T18:22:38.705Z,1744136558.705 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US3CA52M.000
2025-04-08T18:22:38.705Z,1744136558.705 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US5CA50M.000
2025-04-08T18:22:38.705Z,1744136558.705 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US5CA50M.000
2025-04-08T18:22:38.708Z,1744136558.708 [CBIT](DEBUG): Deactivating emergency mode.
2025-04-08T18:22:38.748Z,1744136558.748 [CBIT](DEBUG): Backplane powered.
2025-04-08T18:22:38.749Z,1744136558.749 [GFScanner](DEBUG): Initializing GFScanner
2025-04-08T18:22:38.749Z,1744136558.749 [MissionManager](IMPORTANT): Using TethysL tl-to-tx parser
2025-04-08T18:22:38.750Z,1744136558.750 [MissionManager](INFO): Loading Mission from file: Missions/Startup.tl
2025-04-08T18:22:38.750Z,1744136558.750 [MissionManager](DEBUG): TethyslAPI: loading: Missions/Startup.tl
2025-04-08T18:22:38.751Z,1744136558.751 [MissionManager](DEBUG): TethyslAPI: mission file loaded: Missions/Startup.tl
2025-04-08T18:22:38.784Z,1744136558.784 [MissionManager](DEBUG): TethyslAPI: Missions/Startup.tl translated into:
<?xml version="1.0" encoding="UTF-8" ?>
<!--generated by tl2xml-->
<Mission Id="Startup">
    <Guidance:GoToSurface>
        <Progression />
    </Guidance:GoToSurface>
    <Aggregate Id="StartupSatComms">
        <Sequence />
        <ReadDatum>
            <Timeout Duration="P1M" />
            <Universal:latitude_fix />
        </ReadDatum>
        <ReadDatum>
            <Timeout Duration="P1M" />
            <Universal:platform_communications />
        </ReadDatum>
    </Aggregate>
</Mission>

2025-04-08T18:22:38.800Z,1744136558.800 [Startup:A.GoToSurface](DEBUG): Construct GoToSurface.
2025-04-08T18:22:38.853Z,1744136558.853 [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
    }
  }
}


2025-04-08T18:22:38.854Z,1744136558.854 [MissionManager](INFO): Loading Mission from file: Missions/Default.tl
2025-04-08T18:22:38.854Z,1744136558.854 [MissionManager](DEBUG): TethyslAPI: loading: Missions/Default.tl
2025-04-08T18:22:38.855Z,1744136558.855 [MissionManager](DEBUG): TethyslAPI: mission file loaded: Missions/Default.tl
2025-04-08T18:22:39.076Z,1744136559.076 [Radio_Surface](INFO): Powering up
2025-04-08T18:22:39.139Z,1744136559.139 [MissionManager](DEBUG): TethyslAPI: Missions/Default.tl translated into:
<?xml version="1.0" encoding="UTF-8" ?>
<!--generated by tl2xml-->
<Mission Id="Default">
    <DefineArg Name="ElapsedSinceDefaultStarted">
        <Units:minute />
        <Value>0</Value>
    </DefineArg>
    <Guidance:Wait>
        <Sequence />
        <Setting>
            <Guidance:Wait.duration />
            <Units:second />
            <Value>13</Value>
        </Setting>
    </Guidance:Wait>
    <Guidance:GoToSurface>
        <Progression />
    </Guidance:GoToSurface>
    <Aggregate Id="CheckIn">
        <Sequence Repeat="288" />
        <ReadDatum Id="Read_GPS">
            <Timeout Duration="P5M" />
            <Universal:time_fix />
        </ReadDatum>
        <ReadDatum Id="Read_Iridium">
            <Timeout Duration="P4H">
                <Guidance:Execute>
                    <Sequence />
                    <Setting>
                        <Guidance:Execute.command />
                        <String>Burn on</String>
                    </Setting>
                </Guidance:Execute>
                <Syslog Severity="Critical">Dropped weight due to communications timeout.</Syslog>
            </Timeout>
            <Universal:platform_communications />
        </ReadDatum>
        <Guidance:Wait>
            <Sequence />
            <Setting>
                <Guidance:Wait.duration />
                <Units:minute />
                <Value>5</Value>
            </Setting>
        </Guidance:Wait>
        <Assign>
            <Sequence />
            <Arg Name="ElapsedSinceDefaultStarted" />
            <Elapsed>
                <Universal:mission_started />
            </Elapsed>
        </Assign>
        <Syslog Severity="Important">
            Default mission has been running for 
            <Arg Name="ElapsedSinceDefaultStarted" />
            <Units:minute />
        </Syslog>
    </Aggregate>
    <Syslog Severity="Important">Restarting logs and Default mission.</Syslog>
    <Guidance:Execute>
        <Sequence />
        <Setting>
            <Guidance:Execute.command />
            <String>restart logs</String>
        </Setting>
    </Guidance:Execute>
</Mission>

2025-04-08T18:22:39.166Z,1744136559.166 [MissionManager](INFO): DefineArg Default.ElapsedSinceDefaultStarted = 0.000000 min
2025-04-08T18:22:39.167Z,1744136559.167 [Default:A.Wait](DEBUG): Construct Wait.
2025-04-08T18:22:39.178Z,1744136559.178 [Default:B.GoToSurface](DEBUG): Construct GoToSurface.
2025-04-08T18:22:39.223Z,1744136559.223 [Default:CheckIn:Read_Iridium:A_Timeout:A.Execute](DEBUG): Construct Execute.
2025-04-08T18:22:39.225Z,1744136559.225 [Default:CheckIn:C.Wait](DEBUG): Construct Wait.
2025-04-08T18:22:39.243Z,1744136559.243 [Default:E.Execute](DEBUG): Construct Execute.
2025-04-08T18:22:39.246Z,1744136559.246 [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"
  }
}


2025-04-08T18:22:39.260Z,1744136559.260 [controlThread](DEBUG): Component order: CycleStarter,AHRS_M2,BPC1,NAL9602,Power24vConverter,Aanderaa_O2,ESPComponent,DepthRateCalculator,PitchRateCalculator,SpeedCalculator,YawRateCalculator,ElevatorOffsetCalculator,DeadReckonUsingMultipleVelocitySources,DeadReckonWithRespectToSeafloor,NavChart,UniversalFixResidualReporter,MissionManager,VerticalControl,HorizontalControl,SpeedControl,LoopControl,BuoyancyServo,ElevatorServo,MassServo,RudderServo,ThrusterHE,SBIT,IBIT,CBIT,GFScanner,LcmUniversalReporter,Reporter,LogSplitter,
2025-04-08T18:22:39.272Z,1744136559.272 [AHRS_M2](DEBUG): Initializing AHRS_M2.
2025-04-08T18:22:39.321Z,1744136559.321 [Power24vConverter](INFO): Powering up.
2025-04-08T18:22:39.329Z,1744136559.329 [DepthRateCalculator](ERROR): Depth measurement is not active
2025-04-08T18:22:39.345Z,1744136559.345 [BuoyancyServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:22:39.353Z,1744136559.353 [BuoyancyServo](DEBUG): Initializing BuoyancyServo.
2025-04-08T18:22:39.354Z,1744136559.354 [ElevatorServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:22:39.361Z,1744136559.361 [ElevatorServo](DEBUG): Initializing ElevatorServo.
2025-04-08T18:22:39.361Z,1744136559.361 [MassServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:22:39.369Z,1744136559.369 [MassServo](DEBUG): Initializing MassServo.
2025-04-08T18:22:39.369Z,1744136559.369 [RudderServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:22:39.377Z,1744136559.377 [RudderServo](DEBUG): Initializing RudderServo.
2025-04-08T18:22:39.377Z,1744136559.377 [ThrusterHE](DEBUG): Initializing EZServoServo.
2025-04-08T18:22:39.384Z,1744136559.384 [ThrusterHE](DEBUG): Initializing ThrusterHE.
2025-04-08T18:22:39.713Z,1744136559.713 [DepthRateCalculator](ERROR): Depth measurement is not active
2025-04-08T18:22:40.076Z,1744136560.076 [DepthRateCalculator](ERROR): Depth measurement is not active
2025-04-08T18:22:40.480Z,1744136560.480 [DepthRateCalculator](ERROR): Depth measurement is not active
2025-04-08T18:22:40.812Z,1744136560.812 [BuoyancyServo](ERROR): Buoyancy initialization uart error serial timeout
2025-04-08T18:22:40.812Z,1744136560.812 [BuoyancyServo](FAULT): Buoyancy failed to initialize
2025-04-08T18:22:40.812Z,1744136560.812 [BuoyancyServo] Communications Fault, FailCount= 1
2025-04-08T18:22:40.813Z,1744136560.813 [BuoyancyServo](ERROR): Communications Fault
2025-04-08T18:22:41.124Z,1744136561.124 [ElevatorServo](ERROR): Elevator initialization uart error I:serial timeout
2025-04-08T18:22:41.124Z,1744136561.124 [ElevatorServo](FAULT): Elevator failed to initialize
2025-04-08T18:22:41.124Z,1744136561.124 [ElevatorServo] Communications Fault, FailCount= 1
2025-04-08T18:22:41.125Z,1744136561.125 [ElevatorServo](ERROR): Communications Fault
2025-04-08T18:22:41.460Z,1744136561.460 [RudderServo](ERROR): Rudder initialization uart error serial timeout
2025-04-08T18:22:41.460Z,1744136561.460 [RudderServo](FAULT): Rudder failed to initialize
2025-04-08T18:22:41.460Z,1744136561.460 [RudderServo] Communications Fault, FailCount= 1
2025-04-08T18:22:41.460Z,1744136561.460 [RudderServo](ERROR): Communications Fault
2025-04-08T18:22:41.466Z,1744136561.466 [CBIT](ERROR): Communications Fault in component: BuoyancyServo
2025-04-08T18:22:41.467Z,1744136561.467 [CBIT](ERROR): Communications Fault in component: ElevatorServo
2025-04-08T18:22:41.469Z,1744136561.469 [CBIT](ERROR): Communications Fault in component: RudderServo
2025-04-08T18:22:41.490Z,1744136561.490 [DepthRateCalculator](ERROR): Depth measurement is not active
2025-04-08T18:22:41.536Z,1744136561.536 [ElevatorServo](DEBUG): Uninitialize Elevator Servo.
2025-04-08T18:22:41.536Z,1744136561.536 [ElevatorServo](INFO): Powering down
2025-04-08T18:22:41.538Z,1744136561.538 [RudderServo](DEBUG): Uninitialize Rudder Servo.
2025-04-08T18:22:41.538Z,1744136561.538 [RudderServo](INFO): Powering down
2025-04-08T18:22:41.883Z,1744136561.883 [DepthRateCalculator](ERROR): Depth measurement is not active
2025-04-08T18:22:42.288Z,1744136562.288 [DepthRateCalculator](ERROR): Depth measurement is not active
2025-04-08T18:22:42.295Z,1744136562.295 [ElevatorServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:22:42.413Z,1744136562.413 [ElevatorServo](DEBUG): Initializing ElevatorServo.
2025-04-08T18:22:42.415Z,1744136562.415 [RudderServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:22:42.534Z,1744136562.534 [RudderServo](DEBUG): Initializing RudderServo.
2025-04-08T18:22:42.538Z,1744136562.538 [CBIT](INFO): Clearing failed state for component ElevatorServo
2025-04-08T18:22:42.538Z,1744136562.538 [ElevatorServo] No Fault, FailCount= 1
2025-04-08T18:22:42.538Z,1744136562.538 [CBIT](INFO): Clearing failed state for component RudderServo
2025-04-08T18:22:42.538Z,1744136562.538 [RudderServo] No Fault, FailCount= 1
2025-04-08T18:22:42.692Z,1744136562.692 [AHRS_M2](DEBUG): boresightMatrix m[ decimal 0 0 2 2 f0.0 f0.0 f-1.0 f0.0 f-1.0 f0.0 f-1.0 f0.0 f0.0 ]m set drop

2025-04-08T18:22:42.694Z,1744136562.694 [DepthRateCalculator](ERROR): Depth measurement is not active
2025-04-08T18:22:42.956Z,1744136562.956 [MassServo](FAULT): Mass initialization uart error:serial timeout
2025-04-08T18:22:42.956Z,1744136562.956 [MassServo] Communications Fault, FailCount= 1
2025-04-08T18:22:42.956Z,1744136562.956 [MassServo](ERROR): Communications Fault
2025-04-08T18:22:42.960Z,1744136562.960 [CBIT](ERROR): Communications Fault in component: MassServo
2025-04-08T18:22:43.095Z,1744136563.095 [AHRS_M2](DEBUG): chan0Format 2 set drop

2025-04-08T18:22:43.096Z,1744136563.096 [DepthRateCalculator](ERROR): Depth measurement is not active
2025-04-08T18:22:43.103Z,1744136563.103 [MassServo](DEBUG): Uninitialize Mass Servo.
2025-04-08T18:22:43.103Z,1744136563.103 [MassServo](INFO): Powering down
2025-04-08T18:22:43.499Z,1744136563.499 [AHRS_M2](DEBUG): chan0Trigger 5 set drop

2025-04-08T18:22:43.500Z,1744136563.500 [DepthRateCalculator](ERROR): Depth measurement is not active
2025-04-08T18:22:43.820Z,1744136563.820 [ElevatorServo](ERROR): Elevator initialization uart error I:serial timeout
2025-04-08T18:22:43.820Z,1744136563.820 [ElevatorServo](FAULT): Elevator failed to initialize
2025-04-08T18:22:43.820Z,1744136563.820 [ElevatorServo] Communications Fault, FailCount= 2
2025-04-08T18:22:43.820Z,1744136563.820 [ElevatorServo](ERROR): Communications Fault
2025-04-08T18:22:43.883Z,1744136563.883 [CBIT](INFO): Clearing failed state for component BuoyancyServo
2025-04-08T18:22:43.884Z,1744136563.884 [BuoyancyServo] No Fault, FailCount= 1
2025-04-08T18:22:43.886Z,1744136563.886 [CBIT](ERROR): Communications Fault in component: ElevatorServo
2025-04-08T18:22:43.902Z,1744136563.902 [AHRS_M2](DEBUG): chan0Enables array[ 0 15 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 ]array set drop

2025-04-08T18:22:43.903Z,1744136563.903 [AHRS_M2](DEBUG): chan0EnableBit pitch dvid@ set drop

2025-04-08T18:22:43.909Z,1744136563.909 [DepthRateCalculator](ERROR): Depth measurement is not active
2025-04-08T18:22:43.916Z,1744136563.916 [ElevatorServo](DEBUG): Uninitialize Elevator Servo.
2025-04-08T18:22:43.916Z,1744136563.916 [ElevatorServo](INFO): Powering down
2025-04-08T18:22:43.926Z,1744136563.926 [MassServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:22:44.045Z,1744136564.045 [MassServo](DEBUG): Initializing MassServo.
2025-04-08T18:22:44.052Z,1744136564.052 [CBIT](INFO): Clearing failed state for component MassServo
2025-04-08T18:22:44.052Z,1744136564.052 [MassServo] No Fault, FailCount= 1
2025-04-08T18:22:44.307Z,1744136564.307 [AHRS_M2](DEBUG): chan0EnableBit roll dvid@ set drop

2025-04-08T18:22:44.309Z,1744136564.309 [DepthRateCalculator](ERROR): Depth measurement is not active
2025-04-08T18:22:44.711Z,1744136564.711 [AHRS_M2](DEBUG): chan0EnableBit yaw dvid@ set drop

2025-04-08T18:22:44.713Z,1744136564.713 [DepthRateCalculator](ERROR): Depth measurement is not active
2025-04-08T18:22:44.720Z,1744136564.720 [ElevatorServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:22:44.837Z,1744136564.837 [ElevatorServo](DEBUG): Initializing ElevatorServo.
2025-04-08T18:22:44.839Z,1744136564.839 [ThrusterHE](ERROR): Zero Speed Commanded.
2025-04-08T18:22:44.904Z,1744136564.904 [CBIT](INFO): Clearing failed state for component ElevatorServo
2025-04-08T18:22:44.904Z,1744136564.904 [ElevatorServo] No Fault, FailCount= 2
2025-04-08T18:22:45.115Z,1744136565.115 [AHRS_M2](DEBUG): chan0EnableBit magp dvid@ set drop

2025-04-08T18:22:45.116Z,1744136565.116 [DepthRateCalculator](ERROR): Depth measurement is not active
2025-04-08T18:22:45.519Z,1744136565.519 [AHRS_M2](DEBUG): chan0EnableBit accelp dvid@ set drop

2025-04-08T18:22:45.520Z,1744136565.520 [DepthRateCalculator](ERROR): Depth measurement is not active
2025-04-08T18:22:45.528Z,1744136565.528 [BuoyancyServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:22:45.649Z,1744136565.649 [BuoyancyServo](DEBUG): Initializing BuoyancyServo.
2025-04-08T18:22:45.923Z,1744136565.923 [AHRS_M2](DEBUG): chan0EnableBit gyrop dvid@ set drop

2025-04-08T18:22:45.924Z,1744136565.924 [DepthRateCalculator](ERROR): Depth measurement is not active
2025-04-08T18:22:46.327Z,1744136566.327 [AHRS_M2](DEBUG): chan0EnableBit yawErrEst dvid@ set drop

2025-04-08T18:22:46.329Z,1744136566.329 [DepthRateCalculator](ERROR): Depth measurement is not active
2025-04-08T18:22:46.731Z,1744136566.731 [AHRS_M2](DEBUG): chan0EnableBit temperature dvid@ set drop

2025-04-08T18:22:47.135Z,1744136567.135 [AHRS_M2](DEBUG): chan0EnableBit magBufferActiveIndex dvid@ set drop

2025-04-08T18:22:47.539Z,1744136567.539 [AHRS_M2](DEBUG): chan0TriggerDivisor 40 set drop

2025-04-08T18:22:49.189Z,1744136569.189 [BuoyancyServo](FAULT): Reading outside of valid range:11120.000000

2025-04-08T18:22:49.189Z,1744136569.189 [BuoyancyServo](FAULT): Buoyancy engine reporting null position
2025-04-08T18:22:49.189Z,1744136569.189 [BuoyancyServo] Hardware Fault, FailCount= 2
2025-04-08T18:22:49.189Z,1744136569.189 [BuoyancyServo](ERROR): Hardware Fault
2025-04-08T18:22:49.220Z,1744136569.220 [CBIT](ERROR): Hardware Fault in component: BuoyancyServo
2025-04-08T18:22:49.560Z,1744136569.560 [Aanderaa_O2](FAULT): Failed to initialize within timeout.
2025-04-08T18:22:49.560Z,1744136569.560 [Aanderaa_O2] Communications Fault, FailCount= 1
2025-04-08T18:22:49.560Z,1744136569.560 [Aanderaa_O2](ERROR): Communications Fault
2025-04-08T18:22:49.600Z,1744136569.600 [CBIT](ERROR): Communications Fault in component: Aanderaa_O2
2025-04-08T18:22:50.084Z,1744136570.084 [Aanderaa_O2](INFO): Powering down
2025-04-08T18:22:50.809Z,1744136570.809 [CBIT](INFO): Clearing failed state for component Aanderaa_O2
2025-04-08T18:22:50.809Z,1744136570.809 [Aanderaa_O2] No Fault, FailCount= 1
2025-04-08T18:22:51.184Z,1744136571.184 [BuoyancyServo](DEBUG): Uninitialize Buoyancy Servo.
2025-04-08T18:22:51.185Z,1744136571.185 [BuoyancyServo](INFO): Powering down
2025-04-08T18:22:52.024Z,1744136572.024 [CBIT](INFO): Clearing failed state for component BuoyancyServo
2025-04-08T18:22:52.024Z,1744136572.024 [BuoyancyServo] No Fault, FailCount= 2
2025-04-08T18:22:52.395Z,1744136572.395 [BuoyancyServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:22:52.397Z,1744136572.397 [BuoyancyServo](DEBUG): Initializing BuoyancyServo.
2025-04-08T18:22:52.700Z,1744136572.700 [MassServo](ERROR): isCommunicating uart error serial timeout
2025-04-08T18:22:52.701Z,1744136572.701 [MassServo](FAULT): Invalid EZ Servo response:""
2025-04-08T18:22:52.701Z,1744136572.701 [MassServo] Communications Fault, FailCount= 2
2025-04-08T18:22:52.701Z,1744136572.701 [MassServo](ERROR): Communications Fault
2025-04-08T18:22:52.701Z,1744136572.701 [MassServo](FAULT): Mass Shifter error waiting for homing. Uart error: serial timeout
2025-04-08T18:22:52.701Z,1744136572.701 [MassServo] Hardware Fault, FailCount= 2
2025-04-08T18:22:52.701Z,1744136572.701 [MassServo](ERROR): Hardware Fault
2025-04-08T18:22:52.713Z,1744136572.713 [MassServo](FAULT): Invalid EZ Servo response:"5\r"
2025-04-08T18:22:52.713Z,1744136572.713 [MassServo] Communications Fault, FailCount= 2
2025-04-08T18:22:52.713Z,1744136572.713 [MassServo](ERROR): Communications Fault
2025-04-08T18:22:52.717Z,1744136572.717 [CBIT](ERROR): Communications Fault in component: MassServo
2025-04-08T18:22:52.757Z,1744136572.757 [CTD_Seabird](ERROR): Failed to parse device response: .53
2025-04-08T18:22:52.800Z,1744136572.800 [MassServo](DEBUG): Uninitialize Mass Servo.
2025-04-08T18:22:52.800Z,1744136572.800 [MassServo](INFO): Powering down
2025-04-08T18:22:53.517Z,1744136573.517 [BuoyancyServo](ERROR): Buoyancy initialization uart error serial timeout
2025-04-08T18:22:53.517Z,1744136573.517 [BuoyancyServo](FAULT): Buoyancy failed to initialize
2025-04-08T18:22:53.517Z,1744136573.517 [BuoyancyServo] Communications Fault, FailCount= 3
2025-04-08T18:22:53.517Z,1744136573.517 [BuoyancyServo](ERROR): Communications Fault
2025-04-08T18:22:53.522Z,1744136573.522 [CBIT](ERROR): Communications Fault in component: BuoyancyServo
2025-04-08T18:22:53.616Z,1744136573.616 [MassServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:22:53.737Z,1744136573.737 [MassServo](DEBUG): Initializing MassServo.
2025-04-08T18:22:53.741Z,1744136573.741 [CBIT](INFO): Clearing failed state for component MassServo
2025-04-08T18:22:53.742Z,1744136573.742 [MassServo] No Fault, FailCount= 2
2025-04-08T18:22:53.761Z,1744136573.761 [CTD_Seabird](ERROR): Failed to parse device response: .63
2025-04-08T18:22:55.633Z,1744136575.633 [CBIT](INFO): Clearing failed state for component BuoyancyServo
2025-04-08T18:22:55.633Z,1744136575.633 [BuoyancyServo] No Fault, FailCount= 3
2025-04-08T18:22:56.030Z,1744136576.030 [BuoyancyServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:22:56.145Z,1744136576.145 [BuoyancyServo](DEBUG): Initializing BuoyancyServo.
2025-04-08T18:22:56.688Z,1744136576.688 [MassServo](FAULT): Mass initialization uart error:serial timeout
2025-04-08T18:22:56.688Z,1744136576.688 [MassServo] Communications Fault, FailCount= 3
2025-04-08T18:22:56.688Z,1744136576.688 [MassServo](ERROR): Communications Fault
2025-04-08T18:22:56.692Z,1744136576.692 [CBIT](ERROR): Communications Fault in component: MassServo
2025-04-08T18:22:56.773Z,1744136576.773 [CTD_Seabird](ERROR): Failed to parse device response: .49
2025-04-08T18:22:56.832Z,1744136576.832 [Power24vConverter](FAULT): LCB fault:  Current Limiter Activated.
2025-04-08T18:22:56.832Z,1744136576.832 [Power24vConverter] Hardware Fault, FailCount= 1
2025-04-08T18:22:56.832Z,1744136576.832 [Power24vConverter](ERROR): Hardware Fault
2025-04-08T18:22:56.832Z,1744136576.832 [Power24vConverter](INFO): Powering down.
2025-04-08T18:22:56.833Z,1744136576.833 [Power24vConverter](FAULT): 24V Power is reporting not powering/powered.
2025-04-08T18:22:56.842Z,1744136576.842 [MassServo](DEBUG): Uninitialize Mass Servo.
2025-04-08T18:22:56.842Z,1744136576.842 [MassServo](INFO): Powering down
2025-04-08T18:22:56.846Z,1744136576.846 [CBIT](ERROR): Hardware Fault in component: Power24vConverter
2025-04-08T18:22:57.235Z,1744136577.235 [Power24vConverter](INFO): Powering down.
2025-04-08T18:22:57.568Z,1744136577.568 [BuoyancyServo](ERROR): Buoyancy initialization uart error serial timeout
2025-04-08T18:22:57.568Z,1744136577.568 [BuoyancyServo](FAULT): Buoyancy failed to initialize
2025-04-08T18:22:57.568Z,1744136577.568 [BuoyancyServo] Communications Fault, FailCount= 4
2025-04-08T18:22:57.568Z,1744136577.568 [BuoyancyServo](ERROR): Communications Fault
2025-04-08T18:22:57.573Z,1744136577.573 [CBIT](ERROR): Communications Fault in component: BuoyancyServo
2025-04-08T18:22:57.638Z,1744136577.638 [AHRS_M2](FAULT): Failed to acquire valid data within timeout.
2025-04-08T18:22:57.639Z,1744136577.639 [AHRS_M2] Data Fault, FailCount= 1
2025-04-08T18:22:57.639Z,1744136577.639 [AHRS_M2](ERROR): Data Fault
2025-04-08T18:22:57.640Z,1744136577.640 [Power24vConverter](FAULT):  LCB fault:  Current Limiter Activated.
2025-04-08T18:22:57.649Z,1744136577.649 [MassServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:22:57.765Z,1744136577.765 [MassServo](DEBUG): Initializing MassServo.
2025-04-08T18:22:57.770Z,1744136577.770 [CBIT](ERROR): Data Fault in component: AHRS_M2
2025-04-08T18:22:57.770Z,1744136577.770 [CBIT](CRITICAL): Data Fault in component: AHRS_M2
2025-04-08T18:22:57.770Z,1744136577.770 [CBIT](INFO): Clearing failed state for component MassServo
2025-04-08T18:22:57.770Z,1744136577.770 [MassServo] No Fault, FailCount= 3
2025-04-08T18:22:57.777Z,1744136577.777 [CTD_Seabird](ERROR): Failed to parse device response: .93
2025-04-08T18:22:58.043Z,1744136578.043 [Power24vConverter](INFO): Powering down.
2025-04-08T18:22:58.067Z,1744136578.067 [CommandExec](FAULT): Scheduling is paused
2025-04-08T18:22:58.067Z,1744136578.067 [CBIT](INFO): Critical error at 20250408T182257
2025-04-08T18:22:58.067Z,1744136578.067 [Supervisor](INFO): Stop Mission called by CBIT::checkCriticals
2025-04-08T18:22:58.447Z,1744136578.447 [Power24vConverter](FAULT):  LCB fault:  Current Limiter Activated.
2025-04-08T18:22:58.851Z,1744136578.851 [Power24vConverter](INFO): Powering down.
2025-04-08T18:22:59.674Z,1744136579.674 [CBIT](INFO): Clearing failed state for component Power24vConverter
2025-04-08T18:22:59.674Z,1744136579.674 [Power24vConverter] No Fault, FailCount= 1
2025-04-08T18:22:59.674Z,1744136579.674 [CBIT](INFO): Clearing failed state for component BuoyancyServo
2025-04-08T18:22:59.674Z,1744136579.674 [BuoyancyServo] No Fault, FailCount= 4
2025-04-08T18:22:59.786Z,1744136579.786 [CTD_Seabird](ERROR): Failed to parse device response: 0,0.00008,2992.78
2025-04-08T18:23:00.062Z,1744136580.062 [Power24vConverter](INFO): Powering up.
2025-04-08T18:23:00.071Z,1744136580.071 [BuoyancyServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:23:00.185Z,1744136580.185 [BuoyancyServo](DEBUG): Initializing BuoyancyServo.
2025-04-08T18:23:00.488Z,1744136580.488 [MassServo](FAULT): Mass shifter EEPROM initialization uart error serial timeout
2025-04-08T18:23:00.488Z,1744136580.488 [MassServo] Communications Fault, FailCount= 4
2025-04-08T18:23:00.488Z,1744136580.488 [MassServo](ERROR): Communications Fault
2025-04-08T18:23:00.509Z,1744136580.509 [CBIT](ERROR): Communications Fault in component: MassServo
2025-04-08T18:23:00.526Z,1744136580.526 [MassServo](DEBUG): Uninitialize Mass Servo.
2025-04-08T18:23:00.526Z,1744136580.526 [MassServo](INFO): Powering down
2025-04-08T18:23:01.323Z,1744136581.323 [Aanderaa_O2](FAULT): Failed to initialize within timeout.
2025-04-08T18:23:01.323Z,1744136581.323 [Aanderaa_O2] Communications Fault, FailCount= 2
2025-04-08T18:23:01.323Z,1744136581.323 [Aanderaa_O2](ERROR): Communications Fault
2025-04-08T18:23:01.664Z,1744136581.664 [BuoyancyServo](ERROR): Buoyancy initialization uart error serial timeout
2025-04-08T18:23:01.664Z,1744136581.664 [BuoyancyServo](FAULT): Buoyancy failed to initialize
2025-04-08T18:23:01.664Z,1744136581.664 [BuoyancyServo] Communications Fault, FailCount= 5
2025-04-08T18:23:01.664Z,1744136581.664 [BuoyancyServo](ERROR): Communications Fault
2025-04-08T18:23:01.666Z,1744136581.666 [MassServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:23:01.785Z,1744136581.785 [MassServo](DEBUG): Initializing MassServo.
2025-04-08T18:23:01.790Z,1744136581.790 [CBIT](ERROR): Communications Fault in component: BuoyancyServo
2025-04-08T18:23:01.790Z,1744136581.790 [CBIT](INFO): Clearing failed state for component MassServo
2025-04-08T18:23:01.790Z,1744136581.790 [MassServo] No Fault, FailCount= 4
2025-04-08T18:23:01.791Z,1744136581.791 [CBIT](ERROR): Communications Fault in component: Aanderaa_O2
2025-04-08T18:23:01.793Z,1744136581.793 [CTD_Seabird](ERROR): Failed to parse device response: 
2025-04-08T18:23:05.809Z,1744136585.809 [CTD_Seabird](FAULT): Failed to acquire real or simulated CTD data within timeout.
2025-04-08T18:23:05.809Z,1744136585.809 [CTD_Seabird] Communications Fault, FailCount= 1
2025-04-08T18:23:05.809Z,1744136585.809 [CTD_Seabird](ERROR): Communications Fault
2025-04-08T18:23:06.213Z,1744136586.213 [CTD_Seabird](INFO): Powering down
2025-04-08T18:23:31.924Z,1744136611.924 [Aanderaa_O2](INFO): Powering down
2025-04-08T18:23:31.982Z,1744136611.982 [CBIT](ERROR): Communications Fault in component: CTD_Seabird
2025-04-08T18:23:31.982Z,1744136611.982 [CBIT](INFO): Clearing failed state for component CTD_Seabird
2025-04-08T18:23:31.982Z,1744136611.982 [CTD_Seabird] No Fault, FailCount= 1
2025-04-08T18:23:32.010Z,1744136612.010 [NAL9602](INFO): Powering up NAL9602
2025-04-08T18:23:32.020Z,1744136612.020 [SBIT](IMPORTANT): Beginning Startup BIT
2025-04-08T18:23:32.197Z,1744136612.197 [CTD_Seabird](DEBUG): Initializing CTD_Seabird.
2025-04-08T18:23:32.554Z,1744136612.554 [CBIT](INFO): Clearing failed state for component Aanderaa_O2
2025-04-08T18:23:32.554Z,1744136612.554 [Aanderaa_O2] No Fault, FailCount= 2
2025-04-08T18:23:33.536Z,1744136613.536 [ElevatorServo](ERROR): getPosition uart error serial timeout
2025-04-08T18:23:33.536Z,1744136613.536 [ElevatorServo](FAULT): Elevator uart error - getPosition.serial timeout
2025-04-08T18:23:33.536Z,1744136613.536 [ElevatorServo] Communications Fault, FailCount= 3
2025-04-08T18:23:33.536Z,1744136613.536 [ElevatorServo](ERROR): Communications Fault
2025-04-08T18:23:33.542Z,1744136613.542 [CBIT](ERROR): Communications Fault in component: ElevatorServo
2025-04-08T18:23:33.543Z,1744136613.543 [CBIT](CRITICAL): Communications Fault in component: ElevatorServo
2025-04-08T18:23:33.621Z,1744136613.621 [ElevatorServo](DEBUG): Uninitialize Elevator Servo.
2025-04-08T18:23:33.622Z,1744136613.622 [ElevatorServo](INFO): Powering down
2025-04-08T18:23:33.884Z,1744136613.884 [MassServo](FAULT): Mass initialization uart error:serial timeout
2025-04-08T18:23:33.884Z,1744136613.884 [MassServo] Communications Fault, FailCount= 5
2025-04-08T18:23:33.884Z,1744136613.884 [MassServo](ERROR): Communications Fault
2025-04-08T18:23:34.192Z,1744136614.192 [RudderServo](ERROR): getPosition uart error serial timeout
2025-04-08T18:23:34.192Z,1744136614.192 [RudderServo](FAULT): Rudder uart error - getPosition..serial timeout
2025-04-08T18:23:34.192Z,1744136614.192 [RudderServo] Communications Fault, FailCount= 2
2025-04-08T18:23:34.192Z,1744136614.192 [RudderServo](ERROR): Communications Fault
2025-04-08T18:23:34.195Z,1744136614.195 [CBIT](INFO): Critical error at 20250408T182333
2025-04-08T18:23:34.198Z,1744136614.198 [CBIT](ERROR): Communications Fault in component: MassServo
2025-04-08T18:23:34.198Z,1744136614.198 [CBIT](CRITICAL): Communications Fault in component: MassServo
2025-04-08T18:23:34.198Z,1744136614.198 [CBIT](ERROR): Communications Fault in component: RudderServo
2025-04-08T18:23:34.219Z,1744136614.219 [MassServo](DEBUG): Uninitialize Mass Servo.
2025-04-08T18:23:34.220Z,1744136614.220 [MassServo](INFO): Powering down
2025-04-08T18:23:34.224Z,1744136614.224 [RudderServo](DEBUG): Uninitialize Rudder Servo.
2025-04-08T18:23:34.224Z,1744136614.224 [RudderServo](INFO): Powering down
2025-04-08T18:23:34.227Z,1744136614.227 [CBIT](INFO): Critical error at 20250408T182334
2025-04-08T18:23:34.257Z,1744136614.257 [CBIT](INFO): Clearing failed state for component BuoyancyServo
2025-04-08T18:23:34.257Z,1744136614.257 [BuoyancyServo] No Fault, FailCount= 5
2025-04-08T18:23:34.615Z,1744136614.615 [ElevatorServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:23:34.729Z,1744136614.729 [ElevatorServo](DEBUG): Initializing ElevatorServo.
2025-04-08T18:23:35.021Z,1744136615.021 [MassServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:23:35.141Z,1744136615.141 [MassServo](DEBUG): Initializing MassServo.
2025-04-08T18:23:35.142Z,1744136615.142 [RudderServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:23:35.261Z,1744136615.261 [RudderServo](DEBUG): Initializing RudderServo.
2025-04-08T18:23:35.266Z,1744136615.266 [CBIT](INFO): Clearing failed state for component RudderServo
2025-04-08T18:23:35.266Z,1744136615.266 [RudderServo] No Fault, FailCount= 2
2025-04-08T18:23:36.231Z,1744136616.231 [BuoyancyServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:23:36.349Z,1744136616.349 [BuoyancyServo](DEBUG): Initializing BuoyancyServo.
2025-04-08T18:23:36.656Z,1744136616.656 [RudderServo](ERROR): Rudder initialization uart error serial timeout
2025-04-08T18:23:36.656Z,1744136616.656 [RudderServo](FAULT): Rudder failed to initialize
2025-04-08T18:23:36.656Z,1744136616.656 [RudderServo] Communications Fault, FailCount= 3
2025-04-08T18:23:36.656Z,1744136616.656 [RudderServo](ERROR): Communications Fault
2025-04-08T18:23:36.661Z,1744136616.661 [CBIT](ERROR): Communications Fault in component: RudderServo
2025-04-08T18:23:36.662Z,1744136616.662 [CBIT](CRITICAL): Communications Fault in component: RudderServo
2025-04-08T18:23:36.695Z,1744136616.695 [RudderServo](DEBUG): Uninitialize Rudder Servo.
2025-04-08T18:23:36.695Z,1744136616.695 [RudderServo](INFO): Powering down
2025-04-08T18:23:36.698Z,1744136616.698 [CBIT](INFO): Critical error at 20250408T182336
2025-04-08T18:23:37.808Z,1744136617.808 [BuoyancyServo](ERROR): Buoyancy initialization uart error serial timeout
2025-04-08T18:23:37.808Z,1744136617.808 [BuoyancyServo](FAULT): Buoyancy failed to initialize
2025-04-08T18:23:37.808Z,1744136617.808 [BuoyancyServo] Communications Fault, FailCount= 6
2025-04-08T18:23:37.808Z,1744136617.808 [BuoyancyServo](ERROR): Communications Fault
2025-04-08T18:23:37.809Z,1744136617.809 [RudderServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:23:37.929Z,1744136617.929 [RudderServo](DEBUG): Initializing RudderServo.
2025-04-08T18:23:37.934Z,1744136617.934 [CBIT](ERROR): Communications Fault in component: BuoyancyServo
2025-04-08T18:23:39.225Z,1744136619.225 [CTD_Seabird](ERROR): Failed to parse device response: .20
2025-04-08T18:23:40.017Z,1744136620.017 [CBIT](INFO): Clearing failed state for component BuoyancyServo
2025-04-08T18:23:40.017Z,1744136620.017 [BuoyancyServo] No Fault, FailCount= 6
2025-04-08T18:23:40.229Z,1744136620.229 [CTD_Seabird](ERROR): Failed to parse device response: 
2025-04-08T18:23:41.994Z,1744136621.994 [BuoyancyServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:23:42.113Z,1744136622.113 [BuoyancyServo](DEBUG): Initializing BuoyancyServo.
2025-04-08T18:23:42.805Z,1744136622.805 [Aanderaa_O2](FAULT): Failed to initialize within timeout.
2025-04-08T18:23:42.805Z,1744136622.805 [Aanderaa_O2] Communications Fault, FailCount= 3
2025-04-08T18:23:42.805Z,1744136622.805 [Aanderaa_O2](ERROR): Communications Fault
2025-04-08T18:23:42.838Z,1744136622.838 [CBIT](ERROR): Communications Fault in component: Aanderaa_O2
2025-04-08T18:23:42.839Z,1744136622.839 [CBIT](FAULT): Communications Fault in component: Aanderaa_O2
2025-04-08T18:23:43.196Z,1744136623.196 [NAL9602](INFO): NAL9602 initialized
2025-04-08T18:23:45.248Z,1744136625.248 [CTD_Seabird](FAULT): Failed to initialize within timeout.
2025-04-08T18:23:45.249Z,1744136625.249 [CTD_Seabird] Communications Fault, FailCount= 2
2025-04-08T18:23:45.249Z,1744136625.249 [CTD_Seabird](ERROR): Communications Fault
2025-04-08T18:23:45.652Z,1744136625.652 [CTD_Seabird](INFO): Powering down
2025-04-08T18:24:06.392Z,1744136646.392 [Radio_Surface](INFO): Powering down
2025-04-08T18:24:12.008Z,1744136652.008 [DataOverHttps](INFO): Radio surface powered OFF, will not connect.
2025-04-08T18:24:13.316Z,1744136653.316 [Aanderaa_O2](INFO): Powering down
2025-04-08T18:24:13.402Z,1744136653.402 [SBIT](ERROR): Could not read elevatorAngleReader_.
2025-04-08T18:24:13.402Z,1744136653.402 [SBIT](ERROR): Could not read rudderAngleReader_.
2025-04-08T18:24:13.402Z,1744136653.402 [SBIT](ERROR): Could not read massPosReader_.
2025-04-08T18:24:13.406Z,1744136653.406 [CBIT](ERROR): Communications Fault in component: CTD_Seabird
2025-04-08T18:24:13.407Z,1744136653.407 [CBIT](INFO): Clearing failed state for component CTD_Seabird
2025-04-08T18:24:13.407Z,1744136653.407 [CTD_Seabird] No Fault, FailCount= 2
2025-04-08T18:24:13.660Z,1744136653.660 [CTD_Seabird](DEBUG): Initializing CTD_Seabird.
2025-04-08T18:24:13.819Z,1744136653.819 [BPC1](ERROR): BPC1A got IPBS message with 6 sticks (min is 7).
2025-04-08T18:24:13.820Z,1744136653.820 [BPC1](ERROR): BPC1A: No match for serial number 00B0 in BPC1A's battery stick inventory (sticks 1-31 in onboard configuration file).
2025-04-08T18:24:13.822Z,1744136653.822 [BPC1](ERROR): BPC1A: No match for serial number 00BD in BPC1A's battery stick inventory (sticks 1-31 in onboard configuration file).
2025-04-08T18:24:13.823Z,1744136653.823 [BPC1](ERROR): BPC1A: No match for serial number 00D5 in BPC1A's battery stick inventory (sticks 1-31 in onboard configuration file).
2025-04-08T18:24:13.824Z,1744136653.824 [BPC1](ERROR): BPC1A: No match for serial number 0142 in BPC1A's battery stick inventory (sticks 1-31 in onboard configuration file).
2025-04-08T18:24:13.826Z,1744136653.826 [BPC1](ERROR): BPC1A: No match for serial number 0155 in BPC1A's battery stick inventory (sticks 1-31 in onboard configuration file).
2025-04-08T18:24:13.827Z,1744136653.827 [BPC1](ERROR): BPC1A: No match for serial number 00F2 in BPC1A's battery stick inventory (sticks 1-31 in onboard configuration file).
2025-04-08T18:24:13.827Z,1744136653.827 [BPC1](ERROR): BPC1B got IPBS message with 6 sticks (min is 7).
2025-04-08T18:24:13.828Z,1744136653.828 [BPC1](ERROR): BPC1B: No match for serial number 011B in BPC1B's battery stick inventory (sticks 32-62 in onboard configuration file).
2025-04-08T18:24:13.830Z,1744136653.830 [BPC1](ERROR): BPC1B: No match for serial number 0130 in BPC1B's battery stick inventory (sticks 32-62 in onboard configuration file).
2025-04-08T18:24:13.831Z,1744136653.831 [BPC1](ERROR): BPC1B: No match for serial number 0115 in BPC1B's battery stick inventory (sticks 32-62 in onboard configuration file).
2025-04-08T18:24:13.832Z,1744136653.832 [BPC1](ERROR): BPC1B: No match for serial number 0131 in BPC1B's battery stick inventory (sticks 32-62 in onboard configuration file).
2025-04-08T18:24:13.833Z,1744136653.833 [BPC1](ERROR): BPC1B: No match for serial number 00DE in BPC1B's battery stick inventory (sticks 32-62 in onboard configuration file).
2025-04-08T18:24:13.834Z,1744136653.834 [BPC1](ERROR): BPC1B: No match for serial number 00D9 in BPC1B's battery stick inventory (sticks 32-62 in onboard configuration file).
2025-04-08T18:24:13.834Z,1744136653.834 [BPC1](FAULT): Failed to parse data from all battery packs.
2025-04-08T18:24:13.834Z,1744136653.834 [BPC1] Data Fault, FailCount= 1
2025-04-08T18:24:13.834Z,1744136653.834 [BPC1](ERROR): Data Fault
2025-04-08T18:24:13.879Z,1744136653.879 [CBIT](ERROR): Data Fault in component: BPC1
2025-04-08T18:24:15.877Z,1744136655.877 [BuoyancyServo](FAULT): Reading outside of valid range:11120.000000

2025-04-08T18:24:15.877Z,1744136655.877 [BuoyancyServo](FAULT): Buoyancy engine reporting null position
2025-04-08T18:24:15.877Z,1744136655.877 [BuoyancyServo] Hardware Fault, FailCount= 7
2025-04-08T18:24:15.877Z,1744136655.877 [BuoyancyServo](ERROR): Hardware Fault
2025-04-08T18:24:15.881Z,1744136655.881 [CBIT](ERROR): Hardware Fault in component: BuoyancyServo
2025-04-08T18:24:17.871Z,1744136657.871 [BuoyancyServo](DEBUG): Uninitialize Buoyancy Servo.
2025-04-08T18:24:17.871Z,1744136657.871 [BuoyancyServo](INFO): Powering down
2025-04-08T18:24:18.680Z,1744136658.680 [CBIT](INFO): Clearing failed state for component BuoyancyServo
2025-04-08T18:24:18.680Z,1744136658.680 [BuoyancyServo] No Fault, FailCount= 7
2025-04-08T18:24:19.081Z,1744136659.081 [BuoyancyServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:24:19.082Z,1744136659.082 [BuoyancyServo](DEBUG): Initializing BuoyancyServo.
2025-04-08T18:24:22.148Z,1744136662.148 [Radio_Surface](INFO): Powering up
2025-04-08T18:24:22.353Z,1744136662.353 [BuoyancyServo](FAULT): Reading outside of valid range:11119.000000

2025-04-08T18:24:22.353Z,1744136662.353 [BuoyancyServo](FAULT): Buoyancy engine reporting null position
2025-04-08T18:24:22.353Z,1744136662.353 [BuoyancyServo] Hardware Fault, FailCount= 8
2025-04-08T18:24:22.353Z,1744136662.353 [BuoyancyServo](ERROR): Hardware Fault
2025-04-08T18:24:22.371Z,1744136662.371 [CBIT](ERROR): Hardware Fault in component: BuoyancyServo
2025-04-08T18:24:24.331Z,1744136664.331 [BuoyancyServo](DEBUG): Uninitialize Buoyancy Servo.
2025-04-08T18:24:24.332Z,1744136664.332 [BuoyancyServo](INFO): Powering down
2025-04-08T18:24:25.144Z,1744136665.144 [CBIT](INFO): Clearing failed state for component BuoyancyServo
2025-04-08T18:24:25.144Z,1744136665.144 [BuoyancyServo] No Fault, FailCount= 8
2025-04-08T18:24:25.545Z,1744136665.545 [BuoyancyServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:24:25.546Z,1744136665.546 [BuoyancyServo](DEBUG): Initializing BuoyancyServo.
2025-04-08T18:24:28.073Z,1744136668.073 [DataOverHttps](INFO): Radio surface powered ON.
2025-04-08T18:24:28.809Z,1744136668.809 [BuoyancyServo](FAULT): Reading outside of valid range:11119.000000

2025-04-08T18:24:28.809Z,1744136668.809 [BuoyancyServo](FAULT): Buoyancy engine reporting null position
2025-04-08T18:24:28.809Z,1744136668.809 [BuoyancyServo] Hardware Fault, FailCount= 9
2025-04-08T18:24:28.809Z,1744136668.809 [BuoyancyServo](ERROR): Hardware Fault
2025-04-08T18:24:28.813Z,1744136668.813 [CBIT](ERROR): Hardware Fault in component: BuoyancyServo
2025-04-08T18:24:30.796Z,1744136670.796 [BuoyancyServo](DEBUG): Uninitialize Buoyancy Servo.
2025-04-08T18:24:30.796Z,1744136670.796 [BuoyancyServo](INFO): Powering down
2025-04-08T18:24:31.621Z,1744136671.621 [CBIT](INFO): Clearing failed state for component BuoyancyServo
2025-04-08T18:24:31.621Z,1744136671.621 [BuoyancyServo] No Fault, FailCount= 9
2025-04-08T18:24:32.021Z,1744136672.021 [BuoyancyServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:24:32.022Z,1744136672.022 [BuoyancyServo](DEBUG): Initializing BuoyancyServo.
2025-04-08T18:24:35.269Z,1744136675.269 [BuoyancyServo](FAULT): Reading outside of valid range:11120.000000

2025-04-08T18:24:35.269Z,1744136675.269 [BuoyancyServo](FAULT): Buoyancy engine reporting null position
2025-04-08T18:24:35.269Z,1744136675.269 [BuoyancyServo] Hardware Fault, FailCount= 10
2025-04-08T18:24:35.269Z,1744136675.269 [BuoyancyServo](ERROR): Hardware Fault
2025-04-08T18:24:35.274Z,1744136675.274 [CBIT](ERROR): Hardware Fault in component: BuoyancyServo
2025-04-08T18:24:35.274Z,1744136675.274 [CBIT](CRITICAL): Hardware Fault in component: BuoyancyServo
2025-04-08T18:24:35.648Z,1744136675.648 [CBIT](INFO): Critical error at 20250408T182435
2025-04-08T18:24:37.273Z,1744136677.273 [BuoyancyServo](DEBUG): Uninitialize Buoyancy Servo.
2025-04-08T18:24:37.273Z,1744136677.273 [BuoyancyServo](INFO): Powering down
2025-04-08T18:24:38.873Z,1744136678.873 [DeadReckonUsingMultipleVelocitySources](FAULT): Unable to read the rotation from vehicle frame to navigation frame for more than 120 seconds.
2025-04-08T18:24:38.874Z,1744136678.874 [DeadReckonUsingMultipleVelocitySources] Software Fault, FailCount= 1
2025-04-08T18:24:38.874Z,1744136678.874 [DeadReckonUsingMultipleVelocitySources](ERROR): Software Fault
2025-04-08T18:24:38.876Z,1744136678.876 [DeadReckonWithRespectToSeafloor](FAULT): Unable to read the rotation from vehicle frame to navigation frame for more than 120 seconds.
2025-04-08T18:24:38.876Z,1744136678.876 [DeadReckonWithRespectToSeafloor] Software Fault, FailCount= 1
2025-04-08T18:24:38.876Z,1744136678.876 [DeadReckonWithRespectToSeafloor](ERROR): Software Fault
2025-04-08T18:24:38.886Z,1744136678.886 [CBIT](ERROR): Software Fault in component: DeadReckonUsingMultipleVelocitySources
2025-04-08T18:24:38.886Z,1744136678.886 [CBIT](ERROR): Software Fault in component: DeadReckonWithRespectToSeafloor
2025-04-08T18:24:39.283Z,1744136679.283 [CBIT](INFO): Clearing failed state for component DeadReckonUsingMultipleVelocitySources
2025-04-08T18:24:39.283Z,1744136679.283 [DeadReckonUsingMultipleVelocitySources] No Fault, FailCount= 1
2025-04-08T18:24:39.284Z,1744136679.284 [CBIT](INFO): Clearing failed state for component DeadReckonWithRespectToSeafloor
2025-04-08T18:24:39.284Z,1744136679.284 [DeadReckonWithRespectToSeafloor] No Fault, FailCount= 1
2025-04-08T18:24:39.689Z,1744136679.689 [SBIT](ERROR): Could not read elevatorAngleReader_.
2025-04-08T18:24:39.689Z,1744136679.689 [SBIT](ERROR): Could not read rudderAngleReader_.
2025-04-08T18:24:39.689Z,1744136679.689 [SBIT](ERROR): Could not read massPosReader_.
2025-04-08T18:24:39.689Z,1744136679.689 [SBIT](FAULT): Control surface position failure.
2025-04-08T18:24:53.433Z,1744136693.433 [SBIT](ERROR): Could not read elevatorAngleReader_.
2025-04-08T18:24:53.433Z,1744136693.433 [SBIT](ERROR): Could not read rudderAngleReader_.
2025-04-08T18:24:53.433Z,1744136693.433 [SBIT](ERROR): Could not read massPosReader_.
2025-04-08T18:24:53.433Z,1744136693.433 [SBIT](FAULT): Control surface position failure.
2025-04-08T18:24:53.844Z,1744136693.844 [SBIT](CRITICAL): SBIT FAILED
2025-04-08T18:24:53.844Z,1744136693.844 [SBIT](IMPORTANT): Listing configuration overrides from Data/persisted.cfg
2025-04-08T18:24:53.845Z,1744136693.845 [SBIT](IMPORTANT): AHRS_M2.simulateHardware=1 bool;

2025-04-08T18:24:53.845Z,1744136693.845 [SBIT](IMPORTANT): DAT.loadAtStartup=0 bool;

2025-04-08T18:24:53.845Z,1744136693.845 [SBIT](IMPORTANT): DepthKeller33X.loadAtStartup=0 bool;

2025-04-08T18:24:53.846Z,1744136693.846 [SBIT](IMPORTANT): DepthKeller33X.simulateHardware=1 bool;

2025-04-08T18:24:53.846Z,1744136693.846 [SBIT](IMPORTANT): DropWeight.loadAtStartup=0 bool;

2025-04-08T18:24:53.846Z,1744136693.846 [SBIT](IMPORTANT): WetLabsBB2FL.loadAtStartup=0 bool;

2025-04-08T18:24:53.848Z,1744136693.848 [CBIT](INFO): Critical error at 20250408T182453
2025-04-08T18:24:54.223Z,1744136694.223 [MissionManager](IMPORTANT): Started mission Startup
2025-04-08T18:24:54.223Z,1744136694.223 [Startup] Running Loop=1
2025-04-08T18:24:54.223Z,1744136694.223 [Startup](DEBUG): Aggregate::initialize Startup
2025-04-08T18:24:54.224Z,1744136694.224 [Startup:A.GoToSurface] Running Loop=1
2025-04-08T18:24:54.224Z,1744136694.224 [Startup:A.GoToSurface](DEBUG): Initialize GoToSurfaceComponent.
2025-04-08T18:24:54.224Z,1744136694.224 [Startup:A.GoToSurface](DEBUG): No depth rate setting specified. Using default value of nan m/s.
2025-04-08T18:24:54.225Z,1744136694.225 [Startup:A.GoToSurface](DEBUG): No pitch setting specified. Using default value of nan degrees.
2025-04-08T18:24:54.225Z,1744136694.225 [Startup:A.GoToSurface](DEBUG): No speed setting specified. Using default value of 1.000000 m/s.
2025-04-08T18:24:54.225Z,1744136694.225 [Startup:A.GoToSurface](DEBUG): No surface timeout specified. Using default value of 1000.000000 seconds.
2025-04-08T18:24:54.226Z,1744136694.226 [Startup:A.GoToSurface](DEBUG): No altitude timeout specified. Using default value of 600.000000 seconds.
2025-04-08T18:24:54.226Z,1744136694.226 [Startup:A.GoToSurface](INFO): Received pitch timeout configuration 60.000000 seconds.
2025-04-08T18:24:54.228Z,1744136694.228 [Startup:StartupSatComms] Running Loop=1
2025-04-08T18:24:54.228Z,1744136694.228 [Startup:StartupSatComms](DEBUG): Aggregate::initialize Startup:StartupSatComms
2025-04-08T18:24:54.228Z,1744136694.228 [Startup:StartupSatComms:A] Running Loop=1
2025-04-08T18:24:54.628Z,1744136694.628 [Startup:StartupSatComms:A](DEBUG): Initialize ReadDataComponent to sense latitude_fix
2025-04-08T18:25:54.422Z,1744136754.422 [Startup:StartupSatComms:A](INFO): Timed out from 2025-04-08T18:24:54.2Z
2025-04-08T18:25:54.422Z,1744136754.422 [Startup:StartupSatComms:A] Stopped
2025-04-08T18:25:54.422Z,1744136754.422 [Startup:StartupSatComms:B] Running Loop=1
2025-04-08T18:25:54.824Z,1744136754.824 [Startup:StartupSatComms:B](DEBUG): Initialize ReadDataComponent to sense platform_communications
2025-04-08T18:26:13.014Z,1744136773.014 [CBIT](INFO): Clearing failed state for component Aanderaa_O2
2025-04-08T18:26:13.014Z,1744136773.014 [Aanderaa_O2] No Fault, FailCount= 3
2025-04-08T18:26:15.828Z,1744136775.828 [Power24vConverter](FAULT): LCB fault:  Current Limiter Activated.
2025-04-08T18:26:15.828Z,1744136775.828 [Power24vConverter] Hardware Fault, FailCount= 1
2025-04-08T18:26:15.828Z,1744136775.828 [Power24vConverter](ERROR): Hardware Fault
2025-04-08T18:26:15.829Z,1744136775.829 [Power24vConverter](INFO): Powering down.
2025-04-08T18:26:15.829Z,1744136775.829 [Power24vConverter](FAULT): 24V Power is reporting not powering/powered.
2025-04-08T18:26:15.842Z,1744136775.842 [CBIT](ERROR): Hardware Fault in component: Power24vConverter
2025-04-08T18:26:16.231Z,1744136776.231 [Power24vConverter](INFO): Powering down.
2025-04-08T18:26:16.650Z,1744136776.650 [Power24vConverter](FAULT):  LCB fault:  Current Limiter Activated.
2025-04-08T18:26:17.053Z,1744136777.053 [Power24vConverter](INFO): Powering down.
2025-04-08T18:26:17.457Z,1744136777.457 [Power24vConverter](FAULT):  LCB fault:  Current Limiter Activated.
2025-04-08T18:26:17.861Z,1744136777.861 [Power24vConverter](INFO): Powering down.
2025-04-08T18:26:18.251Z,1744136778.251 [Power24vConverter](FAULT):  LCB fault:  Current Limiter Activated.
2025-04-08T18:26:18.655Z,1744136778.655 [Power24vConverter](INFO): Powering down.
2025-04-08T18:26:19.059Z,1744136779.059 [Power24vConverter](FAULT):  LCB fault:  Current Limiter Activated.
2025-04-08T18:26:19.463Z,1744136779.463 [Power24vConverter](INFO): Powering down.
2025-04-08T18:26:19.868Z,1744136779.868 [Power24vConverter](FAULT):  LCB fault:  Current Limiter Activated.
2025-04-08T18:26:20.185Z,1744136780.185 [CTD_Seabird](FAULT): Failed to acquire real or simulated CTD data within timeout.
2025-04-08T18:26:20.185Z,1744136780.185 [CTD_Seabird] Communications Fault, FailCount= 1
2025-04-08T18:26:20.185Z,1744136780.185 [CTD_Seabird](ERROR): Communications Fault
2025-04-08T18:26:20.271Z,1744136780.271 [Power24vConverter](INFO): Powering down.
2025-04-08T18:26:20.285Z,1744136780.285 [CBIT](ERROR): Communications Fault in component: CTD_Seabird
2025-04-08T18:26:20.589Z,1744136780.589 [CTD_Seabird](INFO): Powering down
2025-04-08T18:26:20.675Z,1744136780.675 [Power24vConverter](FAULT):  LCB fault:  Current Limiter Activated.
2025-04-08T18:26:21.082Z,1744136781.082 [Power24vConverter](INFO): Powering down.
2025-04-08T18:26:21.483Z,1744136781.483 [Power24vConverter](FAULT):  LCB fault:  Current Limiter Activated.
2025-04-08T18:26:21.900Z,1744136781.900 [Power24vConverter](INFO): Powering down.
2025-04-08T18:26:21.926Z,1744136781.926 [CBIT](INFO): Clearing failed state for component CTD_Seabird
2025-04-08T18:26:21.926Z,1744136781.926 [CTD_Seabird] No Fault, FailCount= 1
2025-04-08T18:26:21.936Z,1744136781.936 [CTD_Seabird](DEBUG): Initializing CTD_Seabird.
2025-04-08T18:26:22.305Z,1744136782.305 [Power24vConverter](FAULT):  LCB fault:  Current Limiter Activated.
2025-04-08T18:26:22.708Z,1744136782.708 [Power24vConverter](INFO): Powering down.
2025-04-08T18:26:23.114Z,1744136783.114 [Power24vConverter](FAULT):  LCB fault:  Current Limiter Activated.
2025-04-08T18:26:23.504Z,1744136783.504 [Power24vConverter](INFO): Powering down.
2025-04-08T18:26:23.505Z,1744136783.505 [Aanderaa_O2](FAULT): Failed to initialize within timeout.
2025-04-08T18:26:23.506Z,1744136783.506 [Aanderaa_O2] Communications Fault, FailCount= 1
2025-04-08T18:26:23.506Z,1744136783.506 [Aanderaa_O2](ERROR): Communications Fault
2025-04-08T18:26:23.519Z,1744136783.519 [CBIT](ERROR): Communications Fault in component: Aanderaa_O2
2025-04-08T18:26:23.907Z,1744136783.907 [Power24vConverter](FAULT):  LCB fault:  Current Limiter Activated.
2025-04-08T18:26:34.988Z,1744136794.988 [CTD_Seabird](FAULT): Failed to initialize within timeout.
2025-04-08T18:26:34.988Z,1744136794.988 [CTD_Seabird] Communications Fault, FailCount= 2
2025-04-08T18:26:34.988Z,1744136794.988 [CTD_Seabird](ERROR): Communications Fault
2025-04-08T18:26:35.392Z,1744136795.392 [CTD_Seabird](INFO): Powering down
2025-04-08T18:26:39.270Z,1744136799.270 [DataOverHttps](INFO): setting available, lastComms_.elapsed()=0.004533
2025-04-08T18:26:45.965Z,1744136805.965 [DataOverHttps](INFO): Sending 92 bytes from file Logs/20250404T231657/Courier0043.lzma
2025-04-08T18:26:46.966Z,1744136806.966 [DataOverHttps](INFO): Moved sent file to Logs/20250404T231657/Courier0043.lzma.bak
2025-04-08T18:26:46.966Z,1744136806.966 [DataOverHttps](INFO): SBD MOMSN=24577323
2025-04-08T18:26:54.028Z,1744136814.028 [Aanderaa_O2](INFO): Powering down
2025-04-08T18:26:54.032Z,1744136814.032 [DeadReckonUsingMultipleVelocitySources](FAULT): Unable to read the rotation from vehicle frame to navigation frame for more than 120 seconds.
2025-04-08T18:26:54.032Z,1744136814.032 [DeadReckonUsingMultipleVelocitySources] Software Fault, FailCount= 2
2025-04-08T18:26:54.032Z,1744136814.032 [DeadReckonUsingMultipleVelocitySources](ERROR): Software Fault
2025-04-08T18:26:54.034Z,1744136814.034 [DeadReckonWithRespectToSeafloor](FAULT): Unable to read the rotation from vehicle frame to navigation frame for more than 120 seconds.
2025-04-08T18:26:54.034Z,1744136814.034 [DeadReckonWithRespectToSeafloor] Software Fault, FailCount= 2
2025-04-08T18:26:54.034Z,1744136814.034 [DeadReckonWithRespectToSeafloor](ERROR): Software Fault
2025-04-08T18:26:54.043Z,1744136814.043 [CBIT](ERROR): Software Fault in component: DeadReckonUsingMultipleVelocitySources
2025-04-08T18:26:54.044Z,1744136814.044 [CBIT](ERROR): Software Fault in component: DeadReckonWithRespectToSeafloor
2025-04-08T18:26:54.044Z,1744136814.044 [CBIT](INFO): Clearing failed state for component BuoyancyServo
2025-04-08T18:26:54.044Z,1744136814.044 [BuoyancyServo] No Fault, FailCount= 10
2025-04-08T18:26:54.045Z,1744136814.045 [CBIT](ERROR): Communications Fault in component: CTD_Seabird
2025-04-08T18:26:54.045Z,1744136814.045 [CBIT](INFO): Clearing failed state for component CTD_Seabird
2025-04-08T18:26:54.045Z,1744136814.045 [CTD_Seabird] No Fault, FailCount= 2
2025-04-08T18:26:54.076Z,1744136814.076 [Power24vConverter](INFO): Powering down.
2025-04-08T18:26:54.091Z,1744136814.091 [BuoyancyServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:26:54.097Z,1744136814.097 [BuoyancyServo](DEBUG): Initializing BuoyancyServo.
2025-04-08T18:26:54.109Z,1744136814.109 [CTD_Seabird](DEBUG): Initializing CTD_Seabird.
2025-04-08T18:26:54.111Z,1744136814.111 [CBIT](INFO): Clearing failed state for component DeadReckonUsingMultipleVelocitySources
2025-04-08T18:26:54.111Z,1744136814.111 [DeadReckonUsingMultipleVelocitySources] No Fault, FailCount= 2
2025-04-08T18:26:54.111Z,1744136814.111 [CBIT](INFO): Clearing failed state for component DeadReckonWithRespectToSeafloor
2025-04-08T18:26:54.112Z,1744136814.112 [DeadReckonWithRespectToSeafloor] No Fault, FailCount= 2
2025-04-08T18:26:54.473Z,1744136814.473 [Startup:StartupSatComms:B](INFO): Timed out from 2025-04-08T18:25:54.4Z
2025-04-08T18:26:54.473Z,1744136814.473 [Startup:StartupSatComms:B] Stopped
2025-04-08T18:26:54.473Z,1744136814.473 [Startup:StartupSatComms](INFO): Completed Startup:StartupSatComms
2025-04-08T18:26:54.473Z,1744136814.473 [Startup:StartupSatComms] Stopped
2025-04-08T18:26:54.473Z,1744136814.473 [Startup:StartupSatComms](DEBUG): Aggregate::uninitialize Startup:StartupSatComms
2025-04-08T18:26:54.474Z,1744136814.474 [Startup](INFO): Completed Startup
2025-04-08T18:26:54.474Z,1744136814.474 [MissionManager](INFO): Startup is completed.
2025-04-08T18:26:54.474Z,1744136814.474 [MissionManager](INFO): Uninitializing Mission Startup
2025-04-08T18:26:54.474Z,1744136814.474 [Startup] Stopped
2025-04-08T18:26:54.475Z,1744136814.475 [Startup](DEBUG): Aggregate::uninitialize Startup
2025-04-08T18:26:54.475Z,1744136814.475 [Startup:A.GoToSurface] Stopped
2025-04-08T18:26:54.475Z,1744136814.475 [Startup:A.GoToSurface](DEBUG): Uninitialize GoToSurfaceComponent.
2025-04-08T18:26:54.496Z,1744136814.496 [CBIT](INFO): Clearing failed state for component Aanderaa_O2
2025-04-08T18:26:54.496Z,1744136814.496 [Aanderaa_O2] No Fault, FailCount= 1
2025-04-08T18:26:54.878Z,1744136814.878 [MissionManager](IMPORTANT): Started mission Default
2025-04-08T18:26:54.878Z,1744136814.878 [Default] Running Loop=1
2025-04-08T18:26:54.878Z,1744136814.878 [Default](DEBUG): Aggregate::initialize Default
2025-04-08T18:26:54.878Z,1744136814.878 [Default:B.GoToSurface] Running Loop=1
2025-04-08T18:26:54.879Z,1744136814.879 [Default:B.GoToSurface](DEBUG): Initialize GoToSurfaceComponent.
2025-04-08T18:26:54.879Z,1744136814.879 [Default:B.GoToSurface](DEBUG): No depth rate setting specified. Using default value of nan m/s.
2025-04-08T18:26:54.879Z,1744136814.879 [Default:B.GoToSurface](DEBUG): No pitch setting specified. Using default value of nan degrees.
2025-04-08T18:26:54.879Z,1744136814.879 [Default:B.GoToSurface](DEBUG): No speed setting specified. Using default value of 1.000000 m/s.
2025-04-08T18:26:54.880Z,1744136814.880 [Default:B.GoToSurface](DEBUG): No surface timeout specified. Using default value of 1000.000000 seconds.
2025-04-08T18:26:54.880Z,1744136814.880 [Default:B.GoToSurface](DEBUG): No altitude timeout specified. Using default value of 600.000000 seconds.
2025-04-08T18:26:54.881Z,1744136814.881 [Default:B.GoToSurface](INFO): Received pitch timeout configuration 60.000000 seconds.
2025-04-08T18:26:54.881Z,1744136814.881 [Default:A.Wait] Running Loop=1
2025-04-08T18:26:54.881Z,1744136814.881 [Default:A.Wait](DEBUG): Initialize Wait Component.
2025-04-08T18:26:54.890Z,1744136814.890 [CBIT](INFO): Clearing failed state for component Power24vConverter
2025-04-08T18:26:54.890Z,1744136814.890 [Power24vConverter] No Fault, FailCount= 1
2025-04-08T18:26:55.276Z,1744136815.276 [Power24vConverter](INFO): Powering up.
2025-04-08T18:26:55.616Z,1744136815.616 [BuoyancyServo](ERROR): Buoyancy initialization uart error serial timeout
2025-04-08T18:26:55.616Z,1744136815.616 [BuoyancyServo](FAULT): Buoyancy failed to initialize
2025-04-08T18:26:55.616Z,1744136815.616 [BuoyancyServo] Communications Fault, FailCount= 1
2025-04-08T18:26:55.616Z,1744136815.616 [BuoyancyServo](ERROR): Communications Fault
2025-04-08T18:26:55.620Z,1744136815.620 [CBIT](ERROR): Communications Fault in component: BuoyancyServo
2025-04-08T18:26:57.744Z,1744136817.744 [CBIT](INFO): Clearing failed state for component BuoyancyServo
2025-04-08T18:26:57.744Z,1744136817.744 [BuoyancyServo] No Fault, FailCount= 1
2025-04-08T18:26:59.733Z,1744136819.733 [BuoyancyServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:26:59.849Z,1744136819.849 [BuoyancyServo](DEBUG): Initializing BuoyancyServo.
2025-04-08T18:27:01.137Z,1744136821.137 [CTD_Seabird](ERROR): Failed to parse device response: 50
2025-04-08T18:27:01.260Z,1744136821.260 [BuoyancyServo](ERROR): Buoyancy initialization uart error serial timeout
2025-04-08T18:27:01.260Z,1744136821.260 [BuoyancyServo](FAULT): Buoyancy failed to initialize
2025-04-08T18:27:01.260Z,1744136821.260 [BuoyancyServo] Communications Fault, FailCount= 2
2025-04-08T18:27:01.260Z,1744136821.260 [BuoyancyServo](ERROR): Communications Fault
2025-04-08T18:27:01.264Z,1744136821.264 [CBIT](ERROR): Communications Fault in component: BuoyancyServo
2025-04-08T18:27:01.709Z,1744136821.709 [DataOverHttps](INFO): Sending 91 bytes from file Logs/20250404T231657/Courier0046.lzma
2025-04-08T18:27:02.710Z,1744136822.710 [DataOverHttps](INFO): Moved sent file to Logs/20250404T231657/Courier0046.lzma.bak
2025-04-08T18:27:02.710Z,1744136822.710 [DataOverHttps](INFO): SBD MOMSN=24577326
2025-04-08T18:27:03.369Z,1744136823.369 [CBIT](INFO): Clearing failed state for component BuoyancyServo
2025-04-08T18:27:03.369Z,1744136823.369 [BuoyancyServo] No Fault, FailCount= 2
2025-04-08T18:27:04.149Z,1744136824.149 [CTD_Seabird](ERROR): Failed to parse device response: 
2025-04-08T18:27:04.979Z,1744136824.979 [Aanderaa_O2](FAULT): Failed to initialize within timeout.
2025-04-08T18:27:04.979Z,1744136824.979 [Aanderaa_O2] Communications Fault, FailCount= 2
2025-04-08T18:27:04.979Z,1744136824.979 [Aanderaa_O2](ERROR): Communications Fault
2025-04-08T18:27:04.993Z,1744136824.993 [CBIT](ERROR): Communications Fault in component: Aanderaa_O2
2025-04-08T18:27:07.161Z,1744136827.161 [CTD_Seabird](FAULT): Failed to initialize within timeout.
2025-04-08T18:27:07.161Z,1744136827.161 [CTD_Seabird] Communications Fault, FailCount= 3
2025-04-08T18:27:07.162Z,1744136827.162 [CTD_Seabird](ERROR): Communications Fault
2025-04-08T18:27:07.564Z,1744136827.564 [CTD_Seabird](INFO): Powering down
2025-04-08T18:27:35.500Z,1744136855.500 [Aanderaa_O2](INFO): Powering down
2025-04-08T18:27:35.514Z,1744136855.514 [Default:A.Wait](INFO): Done Waiting.
2025-04-08T18:27:35.514Z,1744136855.514 [Default:A.Wait] Stopped
2025-04-08T18:27:35.515Z,1744136855.515 [Default:A.Wait](DEBUG): Uninitialize Wait Component.
2025-04-08T18:27:35.519Z,1744136855.519 [BuoyancyServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:27:35.633Z,1744136855.633 [BuoyancyServo](DEBUG): Initializing BuoyancyServo.
2025-04-08T18:27:35.638Z,1744136855.638 [CBIT](ERROR): Communications Fault in component: CTD_Seabird
2025-04-08T18:27:35.638Z,1744136855.638 [CBIT](FAULT): Communications Fault in component: CTD_Seabird
2025-04-08T18:27:36.075Z,1744136856.075 [CBIT](INFO): Clearing failed state for component Aanderaa_O2
2025-04-08T18:27:36.075Z,1744136856.075 [Aanderaa_O2] No Fault, FailCount= 2
2025-04-08T18:27:38.380Z,1744136858.380 [BuoyancyServo](FAULT): Buoyancy initialization uart error:serial timeout
2025-04-08T18:27:38.380Z,1744136858.380 [BuoyancyServo] Communications Fault, FailCount= 3
2025-04-08T18:27:38.380Z,1744136858.380 [BuoyancyServo](ERROR): Communications Fault
2025-04-08T18:27:38.385Z,1744136858.385 [CBIT](ERROR): Communications Fault in component: BuoyancyServo
2025-04-08T18:27:40.529Z,1744136860.529 [CBIT](INFO): Clearing failed state for component BuoyancyServo
2025-04-08T18:27:40.529Z,1744136860.529 [BuoyancyServo] No Fault, FailCount= 3
2025-04-08T18:27:42.521Z,1744136862.522 [BuoyancyServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:27:42.637Z,1744136862.637 [BuoyancyServo](DEBUG): Initializing BuoyancyServo.
2025-04-08T18:27:44.036Z,1744136864.036 [BuoyancyServo](FAULT): Buoyancy initialization uart error:serial timeout
2025-04-08T18:27:44.036Z,1744136864.036 [BuoyancyServo] Communications Fault, FailCount= 4
2025-04-08T18:27:44.036Z,1744136864.036 [BuoyancyServo](ERROR): Communications Fault
2025-04-08T18:27:44.041Z,1744136864.041 [CBIT](ERROR): Communications Fault in component: BuoyancyServo
2025-04-08T18:27:46.182Z,1744136866.182 [CBIT](INFO): Clearing failed state for component BuoyancyServo
2025-04-08T18:27:46.182Z,1744136866.182 [BuoyancyServo] No Fault, FailCount= 4
2025-04-08T18:27:46.565Z,1744136866.565 [Aanderaa_O2](FAULT): Failed to initialize within timeout.
2025-04-08T18:27:46.565Z,1744136866.565 [Aanderaa_O2] Communications Fault, FailCount= 3
2025-04-08T18:27:46.565Z,1744136866.565 [Aanderaa_O2](ERROR): Communications Fault
2025-04-08T18:27:46.579Z,1744136866.579 [CBIT](ERROR): Communications Fault in component: Aanderaa_O2
2025-04-08T18:27:46.579Z,1744136866.579 [CBIT](FAULT): Communications Fault in component: Aanderaa_O2
2025-04-08T18:28:17.088Z,1744136897.088 [Aanderaa_O2](INFO): Powering down
2025-04-08T18:28:17.156Z,1744136897.156 [BuoyancyServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:28:17.277Z,1744136897.277 [BuoyancyServo](DEBUG): Initializing BuoyancyServo.
2025-04-08T18:28:19.165Z,1744136899.165 [BuoyancyServo](FAULT): Reading outside of valid range:11105.000000

2025-04-08T18:28:19.165Z,1744136899.165 [BuoyancyServo](FAULT): Buoyancy engine reporting null position
2025-04-08T18:28:19.165Z,1744136899.165 [BuoyancyServo] Hardware Fault, FailCount= 5
2025-04-08T18:28:19.165Z,1744136899.165 [BuoyancyServo](ERROR): Hardware Fault
2025-04-08T18:28:19.176Z,1744136899.176 [CBIT](ERROR): Hardware Fault in component: BuoyancyServo
2025-04-08T18:28:21.158Z,1744136901.158 [BuoyancyServo](DEBUG): Uninitialize Buoyancy Servo.
2025-04-08T18:28:21.158Z,1744136901.158 [BuoyancyServo](INFO): Powering down
2025-04-08T18:28:21.968Z,1744136901.968 [CBIT](INFO): Clearing failed state for component BuoyancyServo
2025-04-08T18:28:21.968Z,1744136901.968 [BuoyancyServo] No Fault, FailCount= 5
2025-04-08T18:28:22.381Z,1744136902.381 [BuoyancyServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:28:22.382Z,1744136902.382 [BuoyancyServo](DEBUG): Initializing BuoyancyServo.
2025-04-08T18:28:25.629Z,1744136905.629 [BuoyancyServo](FAULT): Reading outside of valid range:11109.000000

2025-04-08T18:28:25.629Z,1744136905.629 [BuoyancyServo](FAULT): Buoyancy engine reporting null position
2025-04-08T18:28:25.629Z,1744136905.629 [BuoyancyServo] Hardware Fault, FailCount= 6
2025-04-08T18:28:25.629Z,1744136905.629 [BuoyancyServo](ERROR): Hardware Fault
2025-04-08T18:28:25.645Z,1744136905.645 [CBIT](ERROR): Hardware Fault in component: BuoyancyServo
2025-04-08T18:28:27.633Z,1744136907.633 [BuoyancyServo](DEBUG): Uninitialize Buoyancy Servo.
2025-04-08T18:28:27.633Z,1744136907.633 [BuoyancyServo](INFO): Powering down
2025-04-08T18:28:28.445Z,1744136908.445 [CBIT](INFO): Clearing failed state for component BuoyancyServo
2025-04-08T18:28:28.445Z,1744136908.445 [BuoyancyServo] No Fault, FailCount= 6
2025-04-08T18:28:28.845Z,1744136908.845 [BuoyancyServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:28:28.853Z,1744136908.853 [BuoyancyServo](DEBUG): Initializing BuoyancyServo.
2025-04-08T18:28:32.497Z,1744136912.497 [BuoyancyServo](FAULT): Reading outside of valid range:11105.000000

2025-04-08T18:28:32.497Z,1744136912.497 [BuoyancyServo](FAULT): Buoyancy engine reporting null position
2025-04-08T18:28:32.497Z,1744136912.497 [BuoyancyServo] Hardware Fault, FailCount= 7
2025-04-08T18:28:32.497Z,1744136912.497 [BuoyancyServo](ERROR): Hardware Fault
2025-04-08T18:28:32.501Z,1744136912.501 [CBIT](ERROR): Hardware Fault in component: BuoyancyServo
2025-04-08T18:28:34.102Z,1744136914.102 [CBIT](INFO): Clearing failed state for component MassServo
2025-04-08T18:28:34.102Z,1744136914.102 [MassServo] No Fault, FailCount= 5
2025-04-08T18:28:34.489Z,1744136914.489 [BuoyancyServo](DEBUG): Uninitialize Buoyancy Servo.
2025-04-08T18:28:34.489Z,1744136914.489 [BuoyancyServo](INFO): Powering down
2025-04-08T18:28:35.301Z,1744136915.301 [CBIT](INFO): Clearing failed state for component BuoyancyServo
2025-04-08T18:28:35.301Z,1744136915.301 [BuoyancyServo] No Fault, FailCount= 7
2025-04-08T18:28:35.703Z,1744136915.703 [BuoyancyServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:28:35.704Z,1744136915.704 [BuoyancyServo](DEBUG): Initializing BuoyancyServo.
2025-04-08T18:28:38.989Z,1744136918.989 [BuoyancyServo](FAULT): Reading outside of valid range:11119.000000

2025-04-08T18:28:38.990Z,1744136918.990 [BuoyancyServo](FAULT): Buoyancy engine reporting null position
2025-04-08T18:28:38.990Z,1744136918.990 [BuoyancyServo] Hardware Fault, FailCount= 8
2025-04-08T18:28:38.990Z,1744136918.990 [BuoyancyServo](ERROR): Hardware Fault
2025-04-08T18:28:39.021Z,1744136919.021 [CBIT](ERROR): Hardware Fault in component: BuoyancyServo
2025-04-08T18:28:40.952Z,1744136920.952 [BuoyancyServo](DEBUG): Uninitialize Buoyancy Servo.
2025-04-08T18:28:40.952Z,1744136920.952 [BuoyancyServo](INFO): Powering down
2025-04-08T18:28:41.801Z,1744136921.801 [CBIT](INFO): Clearing failed state for component BuoyancyServo
2025-04-08T18:28:41.801Z,1744136921.801 [BuoyancyServo] No Fault, FailCount= 8
2025-04-08T18:28:42.166Z,1744136922.166 [BuoyancyServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:28:42.167Z,1744136922.167 [BuoyancyServo](DEBUG): Initializing BuoyancyServo.
2025-04-08T18:28:45.425Z,1744136925.425 [BuoyancyServo](FAULT): Reading outside of valid range:11119.000000

2025-04-08T18:28:45.425Z,1744136925.425 [BuoyancyServo](FAULT): Buoyancy engine reporting null position
2025-04-08T18:28:45.425Z,1744136925.425 [BuoyancyServo] Hardware Fault, FailCount= 9
2025-04-08T18:28:45.425Z,1744136925.425 [BuoyancyServo](ERROR): Hardware Fault
2025-04-08T18:28:45.453Z,1744136925.453 [CBIT](ERROR): Hardware Fault in component: BuoyancyServo
2025-04-08T18:28:47.416Z,1744136927.416 [BuoyancyServo](DEBUG): Uninitialize Buoyancy Servo.
2025-04-08T18:28:47.416Z,1744136927.416 [BuoyancyServo](INFO): Powering down
2025-04-08T18:28:48.265Z,1744136928.265 [CBIT](INFO): Clearing failed state for component BuoyancyServo
2025-04-08T18:28:48.265Z,1744136928.265 [BuoyancyServo] No Fault, FailCount= 9
2025-04-08T18:28:48.641Z,1744136928.641 [BuoyancyServo](DEBUG): Initializing EZServoServo.
2025-04-08T18:28:48.642Z,1744136928.642 [BuoyancyServo](DEBUG): Initializing BuoyancyServo.
2025-04-08T18:28:51.130Z,1744136931.130 [MassServo](INFO): Failure count cleared after critical for MassServo
2025-04-08T18:28:51.893Z,1744136931.893 [BuoyancyServo](FAULT): Reading outside of valid range:11115.000000

2025-04-08T18:28:51.893Z,1744136931.893 [BuoyancyServo](FAULT): Buoyancy engine reporting null position
2025-04-08T18:28:51.893Z,1744136931.893 [BuoyancyServo] Hardware Fault, FailCount= 10
2025-04-08T18:28:51.893Z,1744136931.893 [BuoyancyServo](ERROR): Hardware Fault
2025-04-08T18:28:51.928Z,1744136931.928 [CBIT](ERROR): Hardware Fault in component: BuoyancyServo
2025-04-08T18:28:51.929Z,1744136931.929 [CBIT](CRITICAL): Hardware Fault in component: BuoyancyServo
2025-04-08T18:28:52.290Z,1744136932.290 [CBIT](INFO): Critical error at 20250408T182851
2025-04-08T18:28:53.893Z,1744136933.893 [BuoyancyServo](DEBUG): Uninitialize Buoyancy Servo.
2025-04-08T18:28:53.893Z,1744136933.894 [BuoyancyServo](INFO): Powering down
2025-04-08T18:28:54.695Z,1744136934.695 [DeadReckonUsingMultipleVelocitySources](FAULT): Unable to read the rotation from vehicle frame to navigation frame for more than 120 seconds.
2025-04-08T18:28:54.695Z,1744136934.695 [DeadReckonUsingMultipleVelocitySources] Software Fault, FailCount= 3
2025-04-08T18:28:54.695Z,1744136934.695 [DeadReckonUsingMultipleVelocitySources](ERROR): Software Fault
2025-04-08T18:28:54.697Z,1744136934.697 [DeadReckonWithRespectToSeafloor](FAULT): Unable to read the rotation from vehicle frame to navigation frame for more than 120 seconds.
2025-04-08T18:28:54.697Z,1744136934.697 [DeadReckonWithRespectToSeafloor] Software Fault, FailCount= 3
2025-04-08T18:28:54.697Z,1744136934.697 [DeadReckonWithRespectToSeafloor](ERROR): Software Fault
2025-04-08T18:28:54.732Z,1744136934.732 [CBIT](ERROR): Software Fault in component: DeadReckonUsingMultipleVelocitySources
2025-04-08T18:28:54.733Z,1744136934.733 [CBIT](ERROR): Software Fault in component: DeadReckonWithRespectToSeafloor
2025-04-08T18:28:55.137Z,1744136935.137 [CBIT](INFO): Clearing failed state for component DeadReckonUsingMultipleVelocitySources
2025-04-08T18:28:55.137Z,1744136935.137 [DeadReckonUsingMultipleVelocitySources] No Fault, FailCount= 3
2025-04-08T18:28:55.137Z,1744136935.137 [CBIT](INFO): Clearing failed state for component DeadReckonWithRespectToSeafloor
2025-04-08T18:28:55.137Z,1744136935.137 [DeadReckonWithRespectToSeafloor] No Fault, FailCount= 3
2025-04-08T18:29:05.860Z,1744136945.860 [CommandExec](IMPORTA