2024-06-25T21:22:53.499Z,1719350573.499 [Supervisor](DEBUG): Initializing supervisor.
2024-06-25T21:22:53.504Z,1719350573.504 [SyncHandler](DEBUG): Created PCaller Thread at 404514E0
2024-06-25T21:22:53.505Z,1719350573.505 [SyncHandler](INFO): Protected caller Thread ID is 3262
2024-06-25T21:22:53.505Z,1719350573.505 [ComponentRegistry](DEBUG): Component "controlThread" handled in its own thread.
2024-06-25T21:22:53.506Z,1719350573.506 [controlThread ThreadHandler](DEBUG): Created PCaller Thread at 404814E0
2024-06-25T21:22:53.507Z,1719350573.507 [controlThread ThreadHandler](INFO): Protected caller Thread ID is 3263
2024-06-25T21:22:53.511Z,1719350573.511 [ComponentRegistry](DEBUG): SyncComponent "CycleStarter" handled in the control thread.
2024-06-25T21:22:53.530Z,1719350573.530 [ComponentRegistry](DEBUG): Component "CommandExec" handled in its own thread.
2024-06-25T21:22:53.531Z,1719350573.531 [CommandExec ThreadHandler](DEBUG): Created PCaller Thread at 404B14E0
2024-06-25T21:22:53.531Z,1719350573.531 [CommandExec ThreadHandler](INFO): Protected caller Thread ID is 3264
2024-06-25T21:22:53.535Z,1719350573.535 [ComponentRegistry](DEBUG): Component "CommandLine" handled in its own thread.
2024-06-25T21:22:53.538Z,1719350573.538 [CommandLine ThreadHandler](DEBUG): Created PCaller Thread at 404E14E0
2024-06-25T21:22:53.562Z,1719350573.562 [CommandLine ThreadHandler](INFO): Protected caller Thread ID is 3265
2024-06-25T21:22:53.564Z,1719350573.564 [ComponentRegistry](DEBUG): Component "logger" handled in its own thread.
2024-06-25T21:22:53.565Z,1719350573.565 [logger ThreadHandler](DEBUG): Created PCaller Thread at 405114E0
2024-06-25T21:22:53.565Z,1719350573.565 [logger ThreadHandler](INFO): Protected caller Thread ID is 3266
2024-06-25T21:22:53.569Z,1719350573.569 [ComponentRegistry](DEBUG): SyncComponent "LogSplitter" handled in the control thread.
2024-06-25T21:22:53.570Z,1719350573.570 [Supervisor](INFO): Looking for Config files in directory: Config/
2024-06-25T21:22:53.587Z,1719350573.587 [Supervisor](INFO): Opening Config file at: Config/vehicle.cfg
2024-06-25T21:22:55.428Z,1719350575.428 [ComponentRegistry](DEBUG): Loaded Config Component "Config/vehicle
2024-06-25T21:22:55.428Z,1719350575.428 [Supervisor](INFO): Opening Config file at: Config/Derivation.cfg
2024-06-25T21:22:55.918Z,1719350575.918 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Derivation
2024-06-25T21:22:55.919Z,1719350575.919 [Supervisor](INFO): Opening Config file at: Config/Guidance.cfg
2024-06-25T21:22:56.173Z,1719350576.173 [Supervisor](INFO): Opening Config file at: Config/Dock.cfg
2024-06-25T21:22:56.891Z,1719350576.891 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Dock
2024-06-25T21:22:56.892Z,1719350576.892 [Supervisor](INFO): Opening Config file at: Config/Sample.cfg
2024-06-25T21:22:57.141Z,1719350577.141 [Supervisor](INFO): Opening Config file at: Config/secure.cfg
2024-06-25T21:22:57.255Z,1719350577.255 [ComponentRegistry](DEBUG): Loaded Config Component "Config/secure
2024-06-25T21:22:57.256Z,1719350577.256 [Supervisor](INFO): Opening Config file at: Config/Science.cfg
2024-06-25T21:22:57.649Z,1719350577.649 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Science
2024-06-25T21:22:57.649Z,1719350577.649 [Supervisor](INFO): Opening Config file at: Config/workSite.cfg
2024-06-25T21:22:57.803Z,1719350577.803 [ComponentRegistry](DEBUG): Loaded Config Component "Config/workSite
2024-06-25T21:22:57.804Z,1719350577.804 [Supervisor](INFO): Opening Config file at: Config/Simulator.cfg
2024-06-25T21:22:58.413Z,1719350578.413 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Simulator
2024-06-25T21:22:58.413Z,1719350578.413 [Supervisor](INFO): Opening Config file at: Config/logger.cfg
2024-06-25T21:22:58.638Z,1719350578.638 [ComponentRegistry](DEBUG): Loaded Config Component "Config/logger
2024-06-25T21:22:58.639Z,1719350578.639 [Supervisor](INFO): Opening Config file at: Config/Servo.cfg
2024-06-25T21:22:59.106Z,1719350579.106 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Servo
2024-06-25T21:22:59.107Z,1719350579.107 [Supervisor](INFO): Opening Config file at: Config/Navigation.cfg
2024-06-25T21:22:59.441Z,1719350579.441 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Navigation
2024-06-25T21:22:59.441Z,1719350579.441 [Supervisor](INFO): Opening Config file at: Config/Estimation.cfg
2024-06-25T21:22:59.570Z,1719350579.570 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Estimation
2024-06-25T21:22:59.571Z,1719350579.571 [Supervisor](INFO): Opening Config file at: Config/Sensor.cfg
2024-06-25T21:23:00.508Z,1719350580.508 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Sensor
2024-06-25T21:23:00.509Z,1719350580.509 [Supervisor](INFO): Opening Config file at: Config/Control.cfg
2024-06-25T21:23:00.912Z,1719350580.912 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Control
2024-06-25T21:23:00.912Z,1719350580.912 [Supervisor](INFO): Opening Config file at: Config/BIT.cfg
2024-06-25T21:23:01.176Z,1719350581.176 [ComponentRegistry](DEBUG): Loaded Config Component "Config/BIT
2024-06-25T21:23:01.178Z,1719350581.178 [Supervisor](INFO): Looking for Config files in directory: Config/lrauv-triton/
2024-06-25T21:23:01.179Z,1719350581.179 [Supervisor](INFO): Opening Config file at: Config/lrauv-triton/vehicle.cfg
2024-06-25T21:23:01.320Z,1719350581.320 [Supervisor](INFO): Opening Config file at: Config/lrauv-triton/secure.cfg
2024-06-25T21:23:01.420Z,1719350581.420 [Supervisor](INFO): Opening Config file at: Config/lrauv-triton/Science.cfg
2024-06-25T21:23:01.582Z,1719350581.582 [Supervisor](INFO): Opening Config file at: Config/lrauv-triton/Simulator.cfg
2024-06-25T21:23:01.684Z,1719350581.684 [Supervisor](INFO): Opening Config file at: Config/lrauv-triton/Battery.cfg
2024-06-25T21:23:02.004Z,1719350582.004 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Battery
2024-06-25T21:23:02.005Z,1719350582.005 [Supervisor](INFO): Opening Config file at: Config/lrauv-triton/logger.cfg
2024-06-25T21:23:02.162Z,1719350582.162 [Supervisor](INFO): Opening Config file at: Config/lrauv-triton/Servo.cfg
2024-06-25T21:23:02.482Z,1719350582.482 [Supervisor](INFO): Opening Config file at: Config/lrauv-triton/Navigation.cfg
2024-06-25T21:23:02.741Z,1719350582.741 [Supervisor](INFO): Opening Config file at: Config/lrauv-triton/Sensor.cfg
2024-06-25T21:23:02.987Z,1719350582.987 [Supervisor](INFO): Opening Config file at: Config/lrauv-triton/Control.cfg
2024-06-25T21:23:03.104Z,1719350583.104 [Supervisor](INFO): Opening Config file at: Config/lrauv-triton/BIT.cfg
2024-06-25T21:23:03.208Z,1719350583.208 [Supervisor](INFO): Looking for Config files in directory: Config/lrauv-triton/root/
2024-06-25T21:23:03.208Z,1719350583.208 [Supervisor](IMPORTANT): Reloading configuration overrides from Data/persisted.cfg
2024-06-25T21:23:03.213Z,1719350583.213 [Module Loader](DEBUG): Loading Module at Modules/Sample.so
2024-06-25T21:23:03.224Z,1719350583.224 [Module Loader](DEBUG): Loaded Module: Sample (This is a Sample Module of Sample Components)
2024-06-25T21:23:03.224Z,1719350583.224 [Module Loader](DEBUG): Loading Module at Modules/Dock.so
2024-06-25T21:23:03.335Z,1719350583.335 [Module Loader](DEBUG): Loaded Module: Dock (Contains behaviors and commands for docking)
2024-06-25T21:23:03.336Z,1719350583.336 [Module Loader](DEBUG): Loading Module at Modules/Control.so
2024-06-25T21:23:03.388Z,1719350583.388 [VerticalControl](DEBUG): Construct VerticalControl.
2024-06-25T21:23:03.450Z,1719350583.450 [VerticalControl] Loaded
2024-06-25T21:23:03.450Z,1719350583.450 [ComponentRegistry](DEBUG): SyncComponent "VerticalControl" handled in the control thread.
2024-06-25T21:23:03.453Z,1719350583.453 [HorizontalControl](DEBUG): Construct HorizontalControl.
2024-06-25T21:23:03.501Z,1719350583.501 [HorizontalControl] Loaded
2024-06-25T21:23:03.501Z,1719350583.501 [ComponentRegistry](DEBUG): SyncComponent "HorizontalControl" handled in the control thread.
2024-06-25T21:23:03.504Z,1719350583.504 [SpeedControl](DEBUG): Construct SpeedControl.
2024-06-25T21:23:03.507Z,1719350583.507 [SpeedControl] Loaded
2024-06-25T21:23:03.507Z,1719350583.507 [ComponentRegistry](DEBUG): SyncComponent "SpeedControl" handled in the control thread.
2024-06-25T21:23:03.510Z,1719350583.510 [LoopControl](DEBUG): Construct LoopControl.
2024-06-25T21:23:03.510Z,1719350583.510 [LoopControl] Loaded
2024-06-25T21:23:03.511Z,1719350583.511 [ComponentRegistry](DEBUG): SyncComponent "LoopControl" handled in the control thread.
2024-06-25T21:23:03.511Z,1719350583.511 [Module Loader](DEBUG): Loaded Module: Control (Contains the Control components, such as Depth, Heading, and Speed Control)
2024-06-25T21:23:03.512Z,1719350583.512 [Module Loader](DEBUG): Loading Module at Modules/Servo.so
2024-06-25T21:23:03.670Z,1719350583.670 [BuoyancyServo] Loaded
2024-06-25T21:23:03.670Z,1719350583.670 [ComponentRegistry](DEBUG): SyncComponent "BuoyancyServo" handled in the control thread.
2024-06-25T21:23:03.692Z,1719350583.692 [ElevatorServo] Loaded
2024-06-25T21:23:03.693Z,1719350583.693 [ComponentRegistry](DEBUG): SyncComponent "ElevatorServo" handled in the control thread.
2024-06-25T21:23:03.714Z,1719350583.714 [MassServo] Loaded
2024-06-25T21:23:03.714Z,1719350583.714 [ComponentRegistry](DEBUG): SyncComponent "MassServo" handled in the control thread.
2024-06-25T21:23:03.735Z,1719350583.735 [RudderServo] Loaded
2024-06-25T21:23:03.735Z,1719350583.735 [ComponentRegistry](DEBUG): SyncComponent "RudderServo" handled in the control thread.
2024-06-25T21:23:03.752Z,1719350583.752 [ThrusterHE] Loaded
2024-06-25T21:23:03.752Z,1719350583.752 [ComponentRegistry](DEBUG): SyncComponent "ThrusterHE" handled in the control thread.
2024-06-25T21:23:03.753Z,1719350583.753 [Module Loader](DEBUG): Loaded Module: Servo (This is the module containing motor controllers)
2024-06-25T21:23:03.753Z,1719350583.753 [Module Loader](DEBUG): Loading Module at Modules/Derivation.so
2024-06-25T21:23:03.805Z,1719350583.805 [DepthRateCalculator] Loaded
2024-06-25T21:23:03.805Z,1719350583.805 [ComponentRegistry](DEBUG): SyncComponent "DepthRateCalculator" handled in the control thread.
2024-06-25T21:23:03.810Z,1719350583.810 [PitchRateCalculator] Loaded
2024-06-25T21:23:03.810Z,1719350583.810 [ComponentRegistry](DEBUG): SyncComponent "PitchRateCalculator" handled in the control thread.
2024-06-25T21:23:03.820Z,1719350583.820 [SpeedCalculator] Loaded
2024-06-25T21:23:03.820Z,1719350583.820 [ComponentRegistry](DEBUG): SyncComponent "SpeedCalculator" handled in the control thread.
2024-06-25T21:23:03.825Z,1719350583.825 [YawRateCalculator] Loaded
2024-06-25T21:23:03.825Z,1719350583.825 [ComponentRegistry](DEBUG): SyncComponent "YawRateCalculator" handled in the control thread.
2024-06-25T21:23:03.844Z,1719350583.844 [ElevatorOffsetCalculator] Loaded
2024-06-25T21:23:03.844Z,1719350583.844 [ComponentRegistry](DEBUG): SyncComponent "ElevatorOffsetCalculator" handled in the control thread.
2024-06-25T21:23:03.845Z,1719350583.845 [Module Loader](DEBUG): Loaded Module: Derivation (Contains the base derivation components)
2024-06-25T21:23:03.845Z,1719350583.845 [Module Loader](DEBUG): Loading Module at Modules/Navigation.so
2024-06-25T21:23:03.957Z,1719350583.957 [DeadReckonUsingMultipleVelocitySources] Loaded
2024-06-25T21:23:03.958Z,1719350583.958 [ComponentRegistry](DEBUG): SyncComponent "DeadReckonUsingMultipleVelocitySources" handled in the control thread.
2024-06-25T21:23:03.972Z,1719350583.972 [NavChart] Loaded
2024-06-25T21:23:03.972Z,1719350583.972 [ComponentRegistry](DEBUG): SyncComponent "NavChart" handled in the control thread.
2024-06-25T21:23:03.978Z,1719350583.978 [UniversalFixResidualReporter] Loaded
2024-06-25T21:23:03.978Z,1719350583.978 [ComponentRegistry](DEBUG): SyncComponent "UniversalFixResidualReporter" handled in the control thread.
2024-06-25T21:23:03.978Z,1719350583.978 [Module Loader](DEBUG): Loaded Module: Navigation (Contains the base navigation components)
2024-06-25T21:23:03.979Z,1719350583.979 [Module Loader](DEBUG): Loading Module at Modules/Sensor.so
2024-06-25T21:23:04.397Z,1719350584.397 [BackseatComponent] Loaded
2024-06-25T21:23:04.398Z,1719350584.398 [ComponentRegistry](DEBUG): Component "BackseatComponent" handled in its own thread.
2024-06-25T21:23:04.399Z,1719350584.399 [BackseatComponent ThreadHandler](DEBUG): Created PCaller Thread at 4090B4E0
2024-06-25T21:23:04.399Z,1719350584.399 [BackseatComponent ThreadHandler](INFO): Protected caller Thread ID is 3348
2024-06-25T21:23:04.402Z,1719350584.402 [LcmUniversalReporter] Loaded
2024-06-25T21:23:04.403Z,1719350584.403 [ComponentRegistry](DEBUG): SyncComponent "LcmUniversalReporter" handled in the control thread.
2024-06-25T21:23:04.409Z,1719350584.409 [BioacousticsDataBridge] Loaded
2024-06-25T21:23:04.409Z,1719350584.409 [ComponentRegistry](DEBUG): SyncComponent "BioacousticsDataBridge" handled in the control thread.
2024-06-25T21:23:05.249Z,1719350585.249 [BPC1] Loaded
2024-06-25T21:23:05.250Z,1719350585.250 [ComponentRegistry](DEBUG): SyncComponent "BPC1" handled in the control thread.
2024-06-25T21:23:05.320Z,1719350585.320 [DataOverHttps] Loaded
2024-06-25T21:23:05.320Z,1719350585.320 [ComponentRegistry](DEBUG): Component "DataOverHttps" handled in its own thread.
2024-06-25T21:23:05.321Z,1719350585.321 [DataOverHttps ThreadHandler](DEBUG): Created PCaller Thread at 4093B4E0
2024-06-25T21:23:05.322Z,1719350585.322 [DataOverHttps ThreadHandler](INFO): Protected caller Thread ID is 3349
2024-06-25T21:23:05.345Z,1719350585.345 [Depth_Keller] Loaded
2024-06-25T21:23:05.345Z,1719350585.345 [ComponentRegistry](DEBUG): SyncComponent "Depth_Keller" handled in the control thread.
2024-06-25T21:23:05.351Z,1719350585.351 [DropWeight] Loaded
2024-06-25T21:23:05.351Z,1719350585.351 [ComponentRegistry](DEBUG): SyncComponent "DropWeight" handled in the control thread.
2024-06-25T21:23:05.417Z,1719350585.417 [NAL9602] Loaded
2024-06-25T21:23:05.417Z,1719350585.417 [ComponentRegistry](DEBUG): SyncComponent "NAL9602" handled in the control thread.
2024-06-25T21:23:05.448Z,1719350585.448 [Onboard] Loaded
2024-06-25T21:23:05.448Z,1719350585.448 [ComponentRegistry](DEBUG): Component "Onboard" handled in its own thread.
2024-06-25T21:23:05.449Z,1719350585.449 [Onboard ThreadHandler](DEBUG): Created PCaller Thread at 4096B4E0
2024-06-25T21:23:05.449Z,1719350585.449 [Onboard ThreadHandler](INFO): Protected caller Thread ID is 3350
2024-06-25T21:23:05.464Z,1719350585.464 [Power24vConverter] Loaded
2024-06-25T21:23:05.464Z,1719350585.464 [ComponentRegistry](DEBUG): SyncComponent "Power24vConverter" handled in the control thread.
2024-06-25T21:23:05.480Z,1719350585.480 [Radio_Surface] Loaded
2024-06-25T21:23:05.480Z,1719350585.480 [ComponentRegistry](DEBUG): Component "Radio_Surface" handled in its own thread.
2024-06-25T21:23:05.481Z,1719350585.481 [Radio_Surface ThreadHandler](DEBUG): Created PCaller Thread at 4099B4E0
2024-06-25T21:23:05.481Z,1719350585.481 [Radio_Surface ThreadHandler](INFO): Protected caller Thread ID is 3351
2024-06-25T21:23:05.497Z,1719350585.497 [Sonardyne_Nano] Loaded
2024-06-25T21:23:05.497Z,1719350585.497 [ComponentRegistry](DEBUG): SyncComponent "Sonardyne_Nano" handled in the control thread.
2024-06-25T21:23:05.498Z,1719350585.498 [Module Loader](DEBUG): Loaded Module: Sensor (Contains the sensor components)
2024-06-25T21:23:05.498Z,1719350585.498 [Module Loader](DEBUG): Loading Module at Modules/Estimation.so
2024-06-25T21:23:05.555Z,1719350585.555 [Module Loader](DEBUG): Loaded Module: Estimation (Contains the base estimation components)
2024-06-25T21:23:05.556Z,1719350585.556 [Module Loader](DEBUG): Loading Module at Modules/Simulator.so
2024-06-25T21:23:05.726Z,1719350585.726 [Module Loader](DEBUG): Loaded Module: Simulator (This is the module containing the Simulator)
2024-06-25T21:23:05.726Z,1719350585.726 [Module Loader](DEBUG): Loading Module at Modules/Trigger.so
2024-06-25T21:23:05.753Z,1719350585.753 [Module Loader](DEBUG): Loaded Module: Trigger (Contains triggers for use in missions)
2024-06-25T21:23:05.753Z,1719350585.753 [Module Loader](DEBUG): Loading Module at Modules/Science.so
2024-06-25T21:23:05.927Z,1719350585.927 [CTD_Seabird] Loaded
2024-06-25T21:23:05.928Z,1719350585.928 [ComponentRegistry](DEBUG): Component "CTD_Seabird" handled in its own thread.
2024-06-25T21:23:05.929Z,1719350585.929 [CTD_Seabird ThreadHandler](DEBUG): Created PCaller Thread at 40ADB4E0
2024-06-25T21:23:05.929Z,1719350585.929 [CTD_Seabird ThreadHandler](INFO): Protected caller Thread ID is 3352
2024-06-25T21:23:05.952Z,1719350585.952 [PAR_Licor] Loaded
2024-06-25T21:23:05.952Z,1719350585.952 [ComponentRegistry](DEBUG): SyncComponent "PAR_Licor" handled in the control thread.
2024-06-25T21:23:05.998Z,1719350585.998 [WetLabsBB2FL] Loaded
2024-06-25T21:23:05.999Z,1719350585.999 [ComponentRegistry](DEBUG): Component "WetLabsBB2FL" handled in its own thread.
2024-06-25T21:23:05.000Z,1719350586.000 [WetLabsBB2FL ThreadHandler](DEBUG): Created PCaller Thread at 40B0B4E0
2024-06-25T21:23:05.000Z,1719350586.000 [WetLabsBB2FL ThreadHandler](INFO): Protected caller Thread ID is 3353
2024-06-25T21:23:06.001Z,1719350586.001 [Module Loader](DEBUG): Loaded Module: Science (Contains the science components)
2024-06-25T21:23:06.001Z,1719350586.001 [Module Loader](DEBUG): Loading Module at Modules/Guidance.so
2024-06-25T21:23:06.339Z,1719350586.339 [Module Loader](DEBUG): Loaded Module: Guidance (Contains behaviors and commands)
2024-06-25T21:23:06.339Z,1719350586.339 [Module Loader](DEBUG): Loading Module at Modules/BIT.so
2024-06-25T21:23:06.477Z,1719350586.477 [SBIT](DEBUG): Construct Startup Built In Test.
2024-06-25T21:23:06.487Z,1719350586.487 [SBIT] Loaded
2024-06-25T21:23:06.487Z,1719350586.487 [ComponentRegistry](DEBUG): SyncComponent "SBIT" handled in the control thread.
2024-06-25T21:23:06.490Z,1719350586.490 [IBIT](DEBUG): Construct Initiated Built In Test.
2024-06-25T21:23:06.504Z,1719350586.504 [IBIT] Loaded
2024-06-25T21:23:06.504Z,1719350586.504 [ComponentRegistry](DEBUG): SyncComponent "IBIT" handled in the control thread.
2024-06-25T21:23:06.510Z,1719350586.510 [CBIT](DEBUG): Construct Continuous Built In Test.
2024-06-25T21:23:06.617Z,1719350586.617 [CBIT] Loaded
2024-06-25T21:23:06.618Z,1719350586.618 [ComponentRegistry](DEBUG): SyncComponent "CBIT" handled in the control thread.
2024-06-25T21:23:06.618Z,1719350586.618 [Module Loader](DEBUG): Loaded Module: BIT (Contains the BuiltInTest components, such as C Built In Test)
2024-06-25T21:23:06.625Z,1719350586.625 [ComponentRegistry](DEBUG): SyncComponent "MissionManager" handled in the control thread.
2024-06-25T21:23:06.627Z,1719350586.627 [ComponentRegistry](DEBUG): SyncComponent "Reporter" handled in the control thread.
2024-06-25T21:23:06.639Z,1719350586.639 [ComponentRegistry](DEBUG): Component "NavChartDb" handled in its own thread.
2024-06-25T21:23:06.640Z,1719350586.640 [NavChartDb ThreadHandler](DEBUG): Created PCaller Thread at 40C074E0
2024-06-25T21:23:06.641Z,1719350586.641 [NavChartDb ThreadHandler](INFO): Protected caller Thread ID is 3354
2024-06-25T21:23:06.645Z,1719350586.645 [Supervisor](INFO): Main Thread ID is 2996
2024-06-25T21:23:06.645Z,1719350586.645 [Supervisor](DEBUG): Running supervisor.
2024-06-25T21:23:06.646Z,1719350586.646 [CommandExec ThreadHandler](INFO): Handler Thread ID is 3355
2024-06-25T21:23:06.647Z,1719350586.647 [CommandExec](INFO): Initializing the command executive.
2024-06-25T21:23:06.648Z,1719350586.648 [CommandLine ThreadHandler](INFO): Handler Thread ID is 3356
2024-06-25T21:23:06.650Z,1719350586.650 [controlThread ThreadHandler](INFO): Handler Thread ID is 3357
2024-06-25T21:23:06.651Z,1719350586.651 [controlThread](DEBUG): Initializing ControlThread
2024-06-25T21:23:06.651Z,1719350586.651 [VerticalControl](DEBUG): Initialize VerticalControlComponent.
2024-06-25T21:23:06.653Z,1719350586.653 [HorizontalControl](DEBUG): Initialize HorizontalControlComponent.
2024-06-25T21:23:06.654Z,1719350586.654 [SpeedControl](DEBUG): Initialize SpeedControlComponent.
2024-06-25T21:23:06.654Z,1719350586.654 [LoopControl](DEBUG): Initialize LoopControlComponent.
2024-06-25T21:23:06.656Z,1719350586.656 [DepthRateCalculator](DEBUG): Initializing DepthRateCalculator.
2024-06-25T21:23:06.656Z,1719350586.656 [PitchRateCalculator](DEBUG): Initializing PitchRateCalculator.
2024-06-25T21:23:06.656Z,1719350586.656 [SpeedCalculator](DEBUG): Initializing SpeedCalculator.
2024-06-25T21:23:06.657Z,1719350586.657 [YawRateCalculator](DEBUG): Initializing YawRateCalculator.
2024-06-25T21:23:06.657Z,1719350586.657 [ElevatorOffsetCalculator](DEBUG): Initializing ElevatorOffsetCalculator.
2024-06-25T21:23:06.658Z,1719350586.658 [NavChart](DEBUG): Initialize NavChart Navigation.
2024-06-25T21:23:06.658Z,1719350586.658 [UniversalFixResidualReporter](DEBUG): Initializing UniversalFixResidualReporter component.
2024-06-25T21:23:06.666Z,1719350586.666 [SBIT](INFO): Initialize SBIT Component.
2024-06-25T21:23:06.667Z,1719350586.667 [SBIT](IMPORTANT): git: 2024-06-04
2024-06-25T21:23:06.667Z,1719350586.667 [SBIT](INFO): git hash: 665aaa51948338ae26aa7901209e8336b196d4d1
2024-06-25T21:23:06.667Z,1719350586.667 [SBIT](IMPORTANT): Kernel Release: 2.6.27.8
2024-06-25T21:23:06.668Z,1719350586.668 [SBIT](INFO): Kernel Reporting Different Version From Configuration.
Kernel Expected: #1 PREEMPT Tue Dec 18 21:19:28 PST 2018
Kernel Reported: #1 PREEMPT Wed Mar 17 08:23:48 PDT 2021
2024-06-25T21:23:06.669Z,1719350586.669 [SBIT](INFO): Beginning SBIT in 20.000000 seconds.
2024-06-25T21:23:06.670Z,1719350586.670 [IBIT](INFO): Initialize IBIT Component.
2024-06-25T21:23:06.671Z,1719350586.671 [CBIT](DEBUG): Initialize CBIT Component.
2024-06-25T21:23:06.672Z,1719350586.672 [logger ThreadHandler](INFO): Handler Thread ID is 3358
2024-06-25T21:23:06.682Z,1719350586.682 [CBIT](DEBUG): Initialized mux pins.
2024-06-25T21:23:06.682Z,1719350586.682 [CBIT](DEBUG): Initializing the watchdog timer.
2024-06-25T21:23:06.691Z,1719350586.691 [BackseatComponent ThreadHandler](INFO): Handler Thread ID is 3359
2024-06-25T21:23:06.702Z,1719350586.702 [DataOverHttps ThreadHandler](INFO): Handler Thread ID is 3360
2024-06-25T21:23:06.704Z,1719350586.704 [DataOverHttps](DEBUG): dashIP=134.89.2.23 starts with a digit so assuming it is a numeric IP
2024-06-25T21:23:06.706Z,1719350586.706 [CBIT](CRITICAL): LAST REBOOT DUE TO WATCHDOG TIMER RESET.
2024-06-25T21:23:06.707Z,1719350586.707 [CBIT](DEBUG): Initializing heartbeat.
2024-06-25T21:23:06.715Z,1719350586.715 [Onboard ThreadHandler](INFO): Handler Thread ID is 3361
2024-06-25T21:23:06.732Z,1719350586.732 [Radio_Surface ThreadHandler](INFO): Handler Thread ID is 3362
2024-06-25T21:23:06.755Z,1719350586.755 [CTD_Seabird ThreadHandler](INFO): Handler Thread ID is 3363
2024-06-25T21:23:06.755Z,1719350586.755 [CTD_Seabird](DEBUG): Initializing CTD_Seabird.
2024-06-25T21:23:06.760Z,1719350586.760 [WetLabsBB2FL ThreadHandler](INFO): Handler Thread ID is 3365
2024-06-25T21:23:06.763Z,1719350586.763 [WetLabsBB2FL](INFO): Powering up
2024-06-25T21:23:06.764Z,1719350586.764 [NavChartDb ThreadHandler](INFO): Handler Thread ID is 3367
2024-06-25T21:23:06.766Z,1719350586.766 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US1WC07M.000
2024-06-25T21:23:06.766Z,1719350586.766 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US1WC07M.000
2024-06-25T21:23:06.766Z,1719350586.766 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US2WC11M.000
2024-06-25T21:23:06.767Z,1719350586.767 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US2WC11M.000
2024-06-25T21:23:06.767Z,1719350586.767 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US3CA52M.000
2024-06-25T21:23:06.767Z,1719350586.767 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US3CA52M.000
2024-06-25T21:23:06.767Z,1719350586.767 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US5CA50M.000
2024-06-25T21:23:06.767Z,1719350586.767 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US5CA50M.000
2024-06-25T21:23:06.778Z,1719350586.778 [CBIT](DEBUG): Deactivating GF circuits.
2024-06-25T21:23:06.778Z,1719350586.778 [CBIT](DEBUG): Deactivating emergency mode.
2024-06-25T21:23:06.818Z,1719350586.818 [CBIT](DEBUG): Backplane powered.
2024-06-25T21:23:06.819Z,1719350586.819 [MissionManager](IMPORTANT): Using TethysL tl-to-tx parser
2024-06-25T21:23:06.820Z,1719350586.820 [MissionManager](INFO): Loading Mission from file: Missions/Startup.tl
2024-06-25T21:23:06.820Z,1719350586.820 [MissionManager](DEBUG): TethyslAPI: loading: Missions/Startup.tl
2024-06-25T21:23:06.821Z,1719350586.821 [MissionManager](DEBUG): TethyslAPI: mission file loaded: Missions/Startup.tl
2024-06-25T21:23:06.856Z,1719350586.856 [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>

2024-06-25T21:23:06.860Z,1719350586.860 [Startup:A.GoToSurface](DEBUG): Construct GoToSurface.
2024-06-25T21:23:06.912Z,1719350586.912 [MissionManager](DEBUG): 
#   Copyright (c) 2024 MBARI
#   MBARI Proprietary Information. Confidential. All Rights Reserved
#   Unauthorized copying or distribution of this file via any medium is strictly
#   prohibited.
#
#   WARNING - This file contains information whose export is restricted by the
#   Export Administration Act of 1979 (Title 50, U.S.C., App. 2401 et seq.), as
#   amended. Violations of these export laws are subject to severe civil and/or
#   criminal penalties.

mission Startup {
  behavior Guidance:GoToSurface {
    run in progression
  }

  aggregate StartupSatComms {
    run in sequence

    readDatum {
      timeout duration=P1M

      Universal:latitude_fix
    }

    readDatum {
      timeout duration=P1M

      Universal:platform_communications
    }
  }
}


2024-06-25T21:23:06.913Z,1719350586.913 [MissionManager](INFO): Loading Mission from file: Missions/Default.tl
2024-06-25T21:23:06.913Z,1719350586.913 [MissionManager](DEBUG): TethyslAPI: loading: Missions/Default.tl
2024-06-25T21:23:06.914Z,1719350586.914 [MissionManager](DEBUG): TethyslAPI: mission file loaded: Missions/Default.tl
2024-06-25T21:23:07.138Z,1719350587.138 [Radio_Surface](INFO): Powering up
2024-06-25T21:23:07.385Z,1719350587.385 [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>

2024-06-25T21:23:07.407Z,1719350587.407 [MissionManager](INFO): DefineArg Default.ElapsedSinceDefaultStarted = 0.000000 min
2024-06-25T21:23:07.408Z,1719350587.408 [Default:A.Wait](DEBUG): Construct Wait.
2024-06-25T21:23:07.411Z,1719350587.411 [Default:B.GoToSurface](DEBUG): Construct GoToSurface.
2024-06-25T21:23:07.484Z,1719350587.484 [Default:CheckIn:Read_Iridium:A_Timeout:A.Execute](DEBUG): Construct Execute.
2024-06-25T21:23:07.507Z,1719350587.507 [Default:CheckIn:C.Wait](DEBUG): Construct Wait.
2024-06-25T21:23:07.525Z,1719350587.525 [Default:E.Execute](DEBUG): Construct Execute.
2024-06-25T21:23:07.675Z,1719350587.675 [MissionManager](DEBUG): 
#   Copyright (c) 2024 MBARI
#   MBARI Proprietary Information. Confidential. All Rights Reserved
#   Unauthorized copying or distribution of this file via any medium is strictly
#   prohibited.
#
#   WARNING - This file contains information whose export is restricted by the
#   Export Administration Act of 1979 (Title 50, U.S.C., App. 2401 et seq.), as
#   amended. Violations of these export laws are subject to severe civil and/or
#   criminal penalties.

mission Default {
  arguments {
    ElapsedSinceDefaultStarted = 0 minute
  }

  behavior Guidance:Wait {
    """
    Wait a moment to see if the scheduler starts a new mission before
    starting to actually run Default.
    """

    run in sequence

    set duration = 13 second
  }

  behavior Guidance:GoToSurface {
    run in progression
  }

  aggregate CheckIn {
    run in sequence repeat=288

    readDatum id="Read_GPS" {
      timeout duration=P5M

      Universal:time_fix
    }

    readDatum id="Read_Iridium" {
      timeout duration=P4H {
        behavior Guidance:Execute {
          run in sequence

          set command = "Burn on"
        }

        syslog critical "Dropped weight due to communications timeout."
      }

      Universal:platform_communications
    }

    behavior Guidance:Wait {
      run in sequence

      set duration = 5 minute
    }

    assign in sequence ElapsedSinceDefaultStarted = elapsed ( Universal:mission_started )

    syslog important "Default mission has been running for " + ElapsedSinceDefaultStarted~minute
  }

  syslog important "Restarting logs and Default mission."

  behavior Guidance:Execute {
    run in sequence

    set command = "restart logs"
  }
}


2024-06-25T21:23:07.679Z,1719350587.679 [controlThread](DEBUG): Component order: CycleStarter,BioacousticsDataBridge,BPC1,Depth_Keller,DropWeight,NAL9602,Power24vConverter,Sonardyne_Nano,PAR_Licor,Depth_Keller,PAR_Licor,DepthRateCalculator,PitchRateCalculator,SpeedCalculator,YawRateCalculator,ElevatorOffsetCalculator,DeadReckonUsingMultipleVelocitySources,NavChart,UniversalFixResidualReporter,MissionManager,VerticalControl,HorizontalControl,SpeedControl,LoopControl,BuoyancyServo,ElevatorServo,MassServo,RudderServo,ThrusterHE,SBIT,IBIT,CBIT,LcmUniversalReporter,Reporter,LogSplitter,
2024-06-25T21:23:07.721Z,1719350587.721 [Power24vConverter](INFO): Powering up.
2024-06-25T21:23:07.721Z,1719350587.721 [Sonardyne_Nano](INFO): Initializing.
2024-06-25T21:23:07.776Z,1719350587.776 [BuoyancyServo](DEBUG): Initializing EZServoServo.
2024-06-25T21:23:07.782Z,1719350587.782 [BuoyancyServo](DEBUG): Initializing BuoyancyServo.
2024-06-25T21:23:07.783Z,1719350587.783 [ElevatorServo](DEBUG): Initializing EZServoServo.
2024-06-25T21:23:07.791Z,1719350587.791 [ElevatorServo](DEBUG): Initializing ElevatorServo.
2024-06-25T21:23:07.792Z,1719350587.792 [MassServo](DEBUG): Initializing EZServoServo.
2024-06-25T21:23:07.798Z,1719350587.798 [MassServo](DEBUG): Initializing MassServo.
2024-06-25T21:23:07.799Z,1719350587.799 [RudderServo](DEBUG): Initializing EZServoServo.
2024-06-25T21:23:07.806Z,1719350587.806 [RudderServo](DEBUG): Initializing RudderServo.
2024-06-25T21:23:07.807Z,1719350587.807 [ThrusterHE](DEBUG): Initializing EZServoServo.
2024-06-25T21:23:07.814Z,1719350587.814 [ThrusterHE](DEBUG): Initializing ThrusterHE.
2024-06-25T21:23:07.816Z,1719350587.816 [CommandExec](FAULT): Scheduling is paused
2024-06-25T21:23:07.817Z,1719350587.817 [CBIT](INFO): Critical error at 20240625T212306
2024-06-25T21:23:07.817Z,1719350587.817 [Supervisor](INFO): Stop Mission called by CBIT::checkCriticals
2024-06-25T21:23:08.135Z,1719350588.135 [DropWeight](CRITICAL): DROP WEIGHT MISSING.

2024-06-25T21:23:08.135Z,1719350588.135 [DropWeight] Hardware Fault, FailCount= 1
2024-06-25T21:23:08.135Z,1719350588.135 [DropWeight](ERROR): Hardware Fault
2024-06-25T21:23:08.173Z,1719350588.173 [CBIT](INFO): Critical error at 20240625T212308
2024-06-25T21:23:08.184Z,1719350588.184 [CBIT](ERROR): Hardware Fault in component: DropWeight
2024-06-25T21:23:08.184Z,1719350588.184 [CBIT](CRITICAL): Hardware Fault in component: DropWeight
2024-06-25T21:23:08.519Z,1719350588.519 [CBIT](INFO): Critical error at 20240625T212308
2024-06-25T21:23:08.870Z,1719350588.870 [WetLabsBB2FL](INFO): Powering down
2024-06-25T21:23:13.492Z,1719350593.492 [ThrusterHE](ERROR): Zero Speed Commanded.
2024-06-25T21:23:13.786Z,1719350593.786 [CTD_Seabird](ERROR): Device message queue exceeded the allowed limit.
2024-06-25T21:23:17.015Z,1719350597.015 [CBIT](CRITICAL): Environmental Failure. Press:14.874997 PSI. Humidity:46%. Temp:23 C. ABORTING MISSION
2024-06-25T21:23:17.404Z,1719350597.404 [CBIT](INFO): Critical error at 20240625T212317
2024-06-25T21:23:27.115Z,1719350607.115 [SBIT](IMPORTANT): Beginning Startup BIT
2024-06-25T21:23:27.139Z,1719350607.139 [CBIT](IMPORTANT): Beginning ground fault scan
2024-06-25T21:23:35.563Z,1719350615.563 [NAL9602](INFO): Powering up NAL9602
2024-06-25T21:23:38.015Z,1719350618.015 [CBIT](IMPORTANT): No ground fault detected
mA:
CHAN A0 (Batt): 0.017919
CHAN A1 (24V): -0.007104
CHAN A2 (12V): -0.004840
CHAN A3 (5V): -0.002778
CHAN B0 (3.3V): -0.000751
CHAN B1 (3.15aV): -0.001297
CHAN B2 (3.15bV): -0.000985
CHAN B3 (GND): 0.000220
OPEN: 0.003372
Full Scale: +/- 1 mA
2024-06-25T21:23:46.476Z,1719350626.476 [NAL9602](INFO): NAL9602 initialized
2024-06-25T21:24:21.280Z,1719350661.280 [SBIT](IMPORTANT): SBIT PASSED
2024-06-25T21:24:21.280Z,1719350661.280 [SBIT](IMPORTANT): Listing configuration overrides from Data/persisted.cfg
2024-06-25T21:24:21.281Z,1719350661.281 [SBIT](IMPORTANT): AHRS_M2.loadAtStartup=0 bool;

2024-06-25T21:24:21.281Z,1719350661.281 [SBIT](IMPORTANT): BPC1.batteryMissingStickThreshold=6 count;

2024-06-25T21:24:21.281Z,1719350661.281 [SBIT](IMPORTANT): DAT.loadAtStartup=0 bool;

2024-06-25T21:24:21.672Z,1719350661.672 [MissionManager](IMPORTANT): Started mission Startup
2024-06-25T21:24:21.673Z,1719350661.673 [Startup] Running Loop=1
2024-06-25T21:24:21.673Z,1719350661.673 [Startup](DEBUG): Aggregate::initialize Startup
2024-06-25T21:24:21.673Z,1719350661.673 [Startup:A.GoToSurface] Running Loop=1
2024-06-25T21:24:21.673Z,1719350661.673 [Startup:A.GoToSurface](DEBUG): Initialize GoToSurfaceComponent.
2024-06-25T21:24:21.673Z,1719350661.673 [Startup:A.GoToSurface](DEBUG): No depth rate setting specified. Using default value of nan m/s.
2024-06-25T21:24:21.674Z,1719350661.674 [Startup:A.GoToSurface](DEBUG): No pitch setting specified. Using default value of nan degrees.
2024-06-25T21:24:21.674Z,1719350661.674 [Startup:A.GoToSurface](DEBUG): No speed setting specified. Using default value of 1.000000 m/s.
2024-06-25T21:24:21.675Z,1719350661.675 [Startup:A.GoToSurface](DEBUG): No surface timeout specified. Using default value of 1000.000000 seconds.
2024-06-25T21:24:21.675Z,1719350661.675 [Startup:A.GoToSurface](DEBUG): No altitude timeout specified. Using default value of 600.000000 seconds.
2024-06-25T21:24:21.675Z,1719350661.675 [Startup:A.GoToSurface](INFO): Received pitch timeout configuration 60.000000 seconds.
2024-06-25T21:24:21.677Z,1719350661.677 [Startup:StartupSatComms] Running Loop=1
2024-06-25T21:24:21.677Z,1719350661.677 [Startup:StartupSatComms](DEBUG): Aggregate::initialize Startup:StartupSatComms
2024-06-25T21:24:21.677Z,1719350661.677 [Startup:StartupSatComms:A] Running Loop=1
2024-06-25T21:24:22.087Z,1719350662.087 [Startup:StartupSatComms:A](DEBUG): Initialize ReadDataComponent to sense latitude_fix
2024-06-25T21:24:47.529Z,1719350687.529 [BPC1](ERROR): BPC1A failed to parse battery data due to unrecognized msg size.
2024-06-25T21:25:06.885Z,1719350706.885 [DeadReckonUsingMultipleVelocitySources](FAULT): Unable to read the rotation from vehicle frame to navigation frame for more than 120 seconds.
2024-06-25T21:25:06.885Z,1719350706.885 [DeadReckonUsingMultipleVelocitySources] Software Fault, FailCount= 1
2024-06-25T21:25:06.885Z,1719350706.885 [DeadReckonUsingMultipleVelocitySources](ERROR): Software Fault
2024-06-25T21:25:06.897Z,1719350706.897 [CBIT](ERROR): Software Fault in component: DeadReckonUsingMultipleVelocitySources
2024-06-25T21:25:07.294Z,1719350707.294 [CBIT](INFO): Clearing failed state for component DeadReckonUsingMultipleVelocitySources
2024-06-25T21:25:07.295Z,1719350707.295 [DeadReckonUsingMultipleVelocitySources] No Fault, FailCount= 1
2024-06-25T21:25:21.830Z,1719350721.830 [Startup:StartupSatComms:A](INFO): Timed out from 2024-06-25T21:24:21.7Z
2024-06-25T21:25:21.830Z,1719350721.830 [Startup:StartupSatComms:A] Stopped
2024-06-25T21:25:21.830Z,1719350721.830 [Startup:StartupSatComms:B] Running Loop=1
2024-06-25T21:25:22.232Z,1719350722.232 [Startup:StartupSatComms:B](DEBUG): Initialize ReadDataComponent to sense platform_communications
2024-06-25T21:25:34.421Z,1719350734.421 [DataOverHttps](INFO): setting available, lastComms_.elapsed()=0.005038
2024-06-25T21:25:42.017Z,1719350742.017 [BPC1](ERROR): BPC1A: No match for serial number 1717 in BPC1A's battery stick inventory (sticks 1-31 in onboard configuration file).
2024-06-25T21:25:43.791Z,1719350743.791 [DataOverHttps](INFO): Sending 169 bytes from file Logs/20240625T183528/Courier0004.lzma
2024-06-25T21:25:44.792Z,1719350744.792 [DataOverHttps](INFO): Moved sent file to Logs/20240625T183528/Courier0004.lzma.bak
2024-06-25T21:25:44.792Z,1719350744.792 [DataOverHttps](INFO): SBD MOMSN=21274105
2024-06-25T21:25:56.628Z,1719350756.628 [BPC1](ERROR): BPC1B failed to parse battery data due to unrecognized msg size.
2024-06-25T21:26:01.094Z,1719350761.094 [DataOverHttps](INFO): Sending 285 bytes from file Logs/20240625T183528/Courier0007.lzma
2024-06-25T21:26:02.084Z,1719350762.084 [DataOverHttps](INFO): Moved sent file to Logs/20240625T183528/Courier0007.lzma.bak
2024-06-25T21:26:02.084Z,1719350762.084 [DataOverHttps](INFO): SBD MOMSN=21274107
2024-06-25T21:26:19.728Z,1719350779.728 [DataOverHttps](INFO): Sending 492 bytes from file Logs/20240625T191026/Courier0000.lzma
2024-06-25T21:26:20.728Z,1719350780.728 [DataOverHttps](INFO): Moved sent file to Logs/20240625T191026/Courier0000.lzma.bak
2024-06-25T21:26:20.728Z,1719350780.728 [DataOverHttps](INFO): SBD MOMSN=21274112
2024-06-25T21:26:22.059Z,1719350782.059 [Startup:StartupSatComms:B](INFO): Timed out from 2024-06-25T21:25:21.8Z
2024-06-25T21:26:22.059Z,1719350782.059 [Startup:StartupSatComms:B] Stopped
2024-06-25T21:26:22.059Z,1719350782.059 [Startup:StartupSatComms](INFO): Completed Startup:StartupSatComms
2024-06-25T21:26:22.059Z,1719350782.059 [Startup:StartupSatComms] Stopped
2024-06-25T21:26:22.060Z,1719350782.060 [Startup:StartupSatComms](DEBUG): Aggregate::uninitialize Startup:StartupSatComms
2024-06-25T21:26:22.060Z,1719350782.060 [Startup](INFO): Completed Startup
2024-06-25T21:26:22.061Z,1719350782.061 [MissionManager](INFO): Startup is completed.
2024-06-25T21:26:22.061Z,1719350782.061 [MissionManager](INFO): Uninitializing Mission Startup
2024-06-25T21:26:22.061Z,1719350782.061 [Startup] Stopped
2024-06-25T21:26:22.061Z,1719350782.061 [Startup](DEBUG): Aggregate::uninitialize Startup
2024-06-25T21:26:22.061Z,1719350782.061 [Startup:A.GoToSurface] Stopped
2024-06-25T21:26:22.061Z,1719350782.061 [Startup:A.GoToSurface](DEBUG): Uninitialize GoToSurfaceComponent.
2024-06-25T21:26:22.446Z,1719350782.446 [MissionManager](IMPORTANT): Started mission Default
2024-06-25T21:26:22.446Z,1719350782.446 [Default] Running Loop=1
2024-06-25T21:26:22.446Z,1719350782.446 [Default](DEBUG): Aggregate::initialize Default
2024-06-25T21:26:22.447Z,1719350782.447 [Default:B.GoToSurface] Running Loop=1
2024-06-25T21:26:22.447Z,1719350782.447 [Default:B.GoToSurface](DEBUG): Initialize GoToSurfaceComponent.
2024-06-25T21:26:22.447Z,1719350782.447 [Default:B.GoToSurface](DEBUG): No depth rate setting specified. Using default value of nan m/s.
2024-06-25T21:26:22.447Z,1719350782.447 [Default:B.GoToSurface](DEBUG): No pitch setting specified. Using default value of nan degrees.
2024-06-25T21:26:22.447Z,1719350782.447 [Default:B.GoToSurface](DEBUG): No speed setting specified. Using default value of 1.000000 m/s.
2024-06-25T21:26:22.448Z,1719350782.448 [Default:B.GoToSurface](DEBUG): No surface timeout specified. Using default value of 1000.000000 seconds.
2024-06-25T21:26:22.448Z,1719350782.448 [Default:B.GoToSurface](DEBUG): No altitude timeout specified. Using default value of 600.000000 seconds.
2024-06-25T21:26:22.448Z,1719350782.448 [Default:B.GoToSurface](INFO): Received pitch timeout configuration 60.000000 seconds.
2024-06-25T21:26:22.449Z,1719350782.449 [Default:A.Wait] Running Loop=1
2024-06-25T21:26:22.449Z,1719350782.449 [Default:A.Wait](DEBUG): Initialize Wait Component.
2024-06-25T21:26:35.768Z,1719350795.768 [Default:A.Wait](INFO): Done Waiting.
2024-06-25T21:26:35.768Z,1719350795.768 [Default:A.Wait] Stopped
2024-06-25T21:26:35.768Z,1719350795.768 [Default:A.Wait](DEBUG): Uninitialize Wait Component.
2024-06-25T21:26:36.164Z,1719350796.164 [Default:CheckIn] Running Loop=1
2024-06-25T21:26:36.164Z,1719350796.164 [Default:CheckIn](DEBUG): Aggregate::initialize Default:CheckIn
2024-06-25T21:26:36.164Z,1719350796.164 [Default:CheckIn:Read_GPS] Running Loop=1
2024-06-25T21:26:36.625Z,1719350796.625 [Default:CheckIn:Read_GPS](DEBUG): Initialize ReadDataComponent to sense time_fix
2024-06-25T21:27:00.303Z,1719350820.303 [CommandExec](IMPORTANT): got command quit
2024-06-25T21:27:01.306Z,1719350821.306 [CommandExec ThreadHandler](INFO): Uninitializing protected caller thread.
2024-06-25T21:27:01.306Z,1719350821.306 [CommandExec](INFO): Uninitializing the command executive.
2024-06-25T21:27:01.307Z,1719350821.307 [CommandExec](INFO): Uninitializing the command scheduler.
2024-06-25T21:27:01.307Z,1719350821.307 [CommandExec ThreadHandler](INFO): Thread cancelled.
2024-06-25T21:27:01.446Z,1719350821.446 [Supervisor](DEBUG): Uninitializing supervisor and starting cleanup.  Bye!
2024-06-25T21:27:01.446Z,1719350821.446 [ComponentRegistry](INFO): Shutting down NavChartDb ThreadHandler
2024-06-25T21:27:01.446Z,1719350821.446 [NavChartDb ThreadHandler](INFO): Thread cancelled.
2024-06-25T21:27:01.447Z,1719350821.447 [NavChartDb](INFO): Join timeout helper Thread ID is 3385
2024-06-25T21:27:01.766Z,1719350821.766 [NavChartDb ThreadHandler](INFO): Uninitializing protected caller thread.
2024-06-25T21:27:01.766Z,1719350821.766 [NavChartDb ThreadHandler](INFO): Thread cancelled.
2024-06-25T21:27:01.778Z,1719350821.778 [ComponentRegistry](INFO): Shutting down WetLabsBB2FL ThreadHandler
2024-06-25T21:27:01.778Z,1719350821.778 [WetLabsBB2FL ThreadHandler](INFO): Thread cancelled.
2024-06-25T21:27:01.779Z,1719350821.779 [WetLabsBB2FL](INFO): Join timeout helper Thread ID is 3386
2024-06-25T21:27:02.243Z,1719350822.243 [WetLabsBB2FL ThreadHandler](INFO): Uninitializing protected caller thread.
2024-06-25T21:27:02.243Z,1719350822.243 [WetLabsBB2FL](INFO): Powering down
2024-06-25T21:27:02.244Z,1719350822.244 [WetLabsBB2FL ThreadHandler](INFO): Thread cancelled.
2024-06-25T21:27:02.250Z,1719350822.250 [ComponentRegistry](INFO): Shutting down CTD_Seabird ThreadHandler
2024-06-25T21:27:02.250Z,1719350822.250 [CTD_Seabird ThreadHandler](INFO): Thread cancelled.
2024-06-25T21:27:02.251Z,1719350822.251 [CTD_Seabird](INFO): Join timeout helper Thread ID is 3387
2024-06-25T21:27:02.718Z,1719350822.718 [CTD_Seabird](INFO): Powering down
2024-06-25T21:27:02.730Z,1719350822.730 [CTD_Seabird ThreadHandler](INFO): Uninitializing protected caller thread.
2024-06-25T21:27:02.730Z,1719350822.730 [CTD_Seabird](INFO): Powering down
2024-06-25T21:27:02.742Z,1719350822.742 [CTD_Seabird ThreadHandler](INFO): Thread cancelled.
2024-06-25T21:27:02.746Z,1719350822.746 [ComponentRegistry](INFO): Shutting down Radio_Surface ThreadHandler
2024-06-25T21:27:02.746Z,1719350822.746 [Radio_Surface ThreadHandler](INFO): Thread cancelled.
2024-06-25T21:27:02.747Z,1719350822.747 [Radio_Surface](INFO): Join timeout helper Thread ID is 3388
2024-06-25T21:27:03.074Z,1719350823.074 [Radio_Surface](INFO): Powering down
2024-06-25T21:27:03.075Z,1719350823.075 [Radio_Surface ThreadHandler](INFO): Uninitializing protected caller thread.
2024-06-25T21:27:03.075Z,1719350823.075 [Radio_Surface ThreadHandler](INFO): Thread cancelled.
2024-06-25T21:27:03.086Z,1719350823.086 [ComponentRegistry](INFO): Shutting down Onboard ThreadHandler
2024-06-25T21:27:03.086Z,1719350823.086 [Onboard ThreadHandler](INFO): Thread cancelled.
2024-06-25T21:27:03.087Z,1719350823.087 [Onboard](INFO): Join timeout helper Thread ID is 3389
2024-06-25T21:27:03.336Z,1719350823.336 [BPC1](ERROR): BPC1A failed to parse battery data due to unrecognized msg size.
2024-06-25T21:27:06.448Z,1719350826.448 [BPC1](ERROR): BPC1B got IPBS message with 6 sticks (min is 7).
2024-06-25T21:27:06.933Z,1719350826.933 [Onboard ThreadHandler](INFO): Uninitializing protected caller thread.
2024-06-25T21:27:06.933Z,1719350826.933 [Onboard ThreadHandler](INFO): Thread cancelled.
2024-06-25T21:27:06.951Z,1719350826.951 [ComponentRegistry](INFO): Shutting down DataOverHttps ThreadHandler
2024-06-25T21:27:06.951Z,1719350826.951 [DataOverHttps ThreadHandler](INFO): Thread cancelled.
2024-06-25T21:27:06.951Z,1719350826.951 [DataOverHttps](INFO): Join timeout helper Thread ID is 3390
2024-06-25T21:27:07.786Z,1719350827.786 [DataOverHttps ThreadHandler](INFO): Uninitializing protected caller thread.
2024-06-25T21:27:07.789Z,1719350827.789 [DataOverHttps ThreadHandler](INFO): Thread cancelled.
2024-06-25T21:27:07.795Z,1719350827.795 [ComponentRegistry](INFO): Shutting down BackseatComponent ThreadHandler
2024-06-25T21:27:07.795Z,1719350827.795 [BackseatComponent ThreadHandler](INFO): Thread cancelled.
2024-06-25T21:27:07.795Z,1719350827.795 [BackseatComponent](INFO): Join timeout helper Thread ID is 3391
2024-06-25T21:27:07.802Z,1719350827.802 [BackseatComponent ThreadHandler](INFO): Uninitializing protected caller thread.
2024-06-25T21:27:07.803Z,1719350827.803 [BackseatComponent ThreadHandler](INFO): Thread cancelled.
2024-06-25T21:27:07.823Z,1719350827.823 [ComponentRegistry](INFO): Shutting down logger ThreadHandler
2024-06-25T21:27:07.823Z,1719350827.823 [logger ThreadHandler](INFO): Thread cancelled.
2024-06-25T21:27:07.823Z,1719350827.823 [logger](INFO): Join timeout helper Thread ID is 3392
2024-06-25T21:27:07.852Z,1719350827.852 [logger ThreadHandler](INFO): Uninitializing protected caller thread.
2024-06-25T21:27:07.852Z,1719350827.852 [logger ThreadHandler](INFO): Thread cancelled.
2024-06-25T21:27:07.855Z,1719350827.855 [ComponentRegistry](INFO): Shutting down CommandLine ThreadHandler
2024-06-25T21:27:07.855Z,1719350827.855 [CommandLine ThreadHandler](INFO): Thread cancelled.
2024-06-25T21:27:07.855Z,1719350827.855 [CommandLine](INFO): Join timeout helper Thread ID is 3393
2024-06-25T21:27:07.902Z,1719350827.902 [CommandLine ThreadHandler](INFO): Uninitializing protected caller thread.
2024-06-25T21:27:07.902Z,1719350827.902 [CommandLine ThreadHandler](INFO): Thread cancelled.
2024-06-25T21:27:07.915Z,1719350827.915 [ComponentRegistry](INFO): Shutting down CommandExec ThreadHandler
2024-06-25T21:27:07.915Z,1719350827.915 [CommandExec ThreadHandler](INFO): Thread cancelled.
2024-06-25T21:27:07.915Z,1719350827.915 [CommandExec](INFO): Join timeout helper Thread ID is 3394
2024-06-25T21:27:07.916Z,1719350827.916 [ComponentRegistry](INFO): Shutting down controlThread ThreadHandler
2024-06-25T21:27:07.916Z,1719350827.916 [controlThread ThreadHandler](INFO): Thread cancelled.
2024-06-25T21:27:07.917Z,1719350827.917 [controlThread](INFO): Join timeout helper Thread ID is 3395
2024-06-25T21:27:08.058Z,1719350828.058 [controlThread ThreadHandler](INFO): Uninitializing protected caller thread.
2024-06-25T21:27:08.058Z,1719350828.058 [controlThread](DEBUG): Uninitializing ControlThread
2024-06-25T21:27:08.060Z,1719350828.060 [NAL9602](INFO): Powering down
2024-06-25T21:27:08.061Z,1719350828.061 [Sonardyne_Nano](INFO): Powering down
2024-06-25T21:27:08.183Z,1719350828.183 [DepthRateCalculator](DEBUG): Uninitializing DepthRateCalculator.
2024-06-25T21:27:08.184Z,1719350828.184 [ElevatorOffsetCalculator](DEBUG): Uninitializing ElevatorOffsetCalculator.
2024-06-25T21:27:08.184Z,1719350828.184 [NavChart](DEBUG): Uninitialize NavChart Navigation.
2024-06-25T21:27:08.185Z,1719350828.185 [MissionManager](INFO): Uninitializing Mission Default
2024-06-25T21:27:08.185Z,1719350828.185 [Default] Stopped
2024-06-25T21:27:08.185Z,1719350828.185 [Default](DEBUG): Aggregate::uninitialize Default
2024-06-25T21:27:08.185Z,1719350828.185 [Default:B.GoToSurface] Stopped
2024-06-25T21:27:08.185Z,1719350828.185 [Default:B.GoToSurface](DEBUG): Uninitialize GoToSurfaceComponent.
2024-06-25T21:27:08.185Z,1719350828.185 [Default:CheckIn] Stopped
2024-06-25T21:27:08.185Z,1719350828.185 [Default:CheckIn](DEBUG): Aggregate::uninitialize Default:CheckIn
2024-06-25T21:27:08.185Z,1719350828.185 [Default:CheckIn:Read_GPS] Stopped
2024-06-25T21:27:08.188Z,1719350828.188 [VerticalControl](DEBUG): Uninitialize VerticalControlComponent.
2024-06-25T21:27:08.188Z,1719350828.188 [HorizontalControl](DEBUG): Uninitialize HorizontalControlComponent.
2024-06-25T21:27:08.188Z,1719350828.188 [SpeedControl](DEBUG): Uninitialize SpeedControlComponent.
2024-06-25T21:27:08.189Z,1719350828.189 [LoopControl](DEBUG): Uninitialize LoopControlComponent.
2024-06-25T21:27:08.189Z,1719350828.189 [BuoyancyServo](DEBUG): Uninitialize Buoyancy Servo.
2024-06-25T21:27:08.189Z,1719350828.189 [BuoyancyServo](INFO): Powering down
2024-06-25T21:27:08.202Z,1719350828.202 [ElevatorServo](DEBUG): Uninitialize Elevator Servo.
2024-06-25T21:27:08.202Z,1719350828.202 [ElevatorServo](INFO): Powering down
2024-06-25T21:27:08.203Z,1719350828.203 [MassServo](DEBUG): Uninitialize Mass Servo.
2024-06-25T21:27:08.203Z,1719350828.203 [MassServo](INFO): Powering down
2024-06-25T21:27:08.204Z,1719350828.204 [RudderServo](DEBUG): Uninitialize Rudder Servo.
2024-06-25T21:27:08.204Z,1719350828.204 [RudderServo](INFO): Powering down
2024-06-25T21:27:08.205Z,1719350828.205 [ThrusterHE](DEBUG): Uninitialize Thruster Servo.
2024-06-25T21:27:08.205Z,1719350828.205 [ThrusterHE](INFO): Powering down
2024-06-25T21:27:08.206Z,1719350828.206 [SBIT](DEBUG): Uninitialize SBIT Component.
2024-06-25T21:27:08.206Z,1719350828.206 [IBIT](DEBUG): Uninitialize IBIT Component.
2024-06-25T21:27:08.207Z,1719350828.207 [CBIT](DEBUG): Uninitialize CBIT Component.
2024-06-25T21:27:08.207Z,1719350828.207 [CBIT](DEBUG): Powering off loads.
2024-06-25T21:27:08.218Z,1719350828.218 [CBIT](DEBUG): Disabling WDT.
2024-06-25T21:27:08.230Z,1719350828.230 [CBIT](DEBUG): Opening all GF detection circuits.
2024-06-25T21:27:08.231Z,1719350828.231 [controlThread ThreadHandler](INFO): Thread cancelled.
2024-06-25T21:27:08.277Z,1719350828.277 [Radio_Surface ThreadHandler](INFO): Thread cancelled.
2024-06-25T21:27:08.280Z,1719350828.280 [Onboard ThreadHandler](INFO): Thread cancelled.
2024-06-25T21:27:08.286Z,1719350828.286 [DataOverHttps ThreadHandler](INFO): Thread cancelled.
2024-06-25T21:27:08.330Z,1719350828.330 [BackseatComponent ThreadHandler](INFO): Thread cancelled.
2024-06-25T21:27:08.367Z,1719350828.367 [WetLabsBB2FL ThreadHandler](INFO): Thread cancelled.
2024-06-25T21:27:08.371Z,1719350828.371 [CTD_Seabird ThreadHandler](INFO): Thread cancelled.
2024-06-25T21:27:08.405Z,1719350828.405 [NavChartDb ThreadHandler](INFO): Thread cancelled.
2024-06-25T21:27:08.470Z,1719350828.470 [logger ThreadHandler](INFO): Thread cancelled.