2023-09-08T12:36:40.154Z,1694176600.154 [Supervisor](DEBUG): Initializing supervisor.
2023-09-08T12:36:40.159Z,1694176600.159 [SyncHandler](DEBUG): Created PCaller Thread at 404514E0
2023-09-08T12:36:40.159Z,1694176600.159 [SyncHandler](INFO): Protected caller Thread ID is 1534
2023-09-08T12:36:40.160Z,1694176600.160 [ComponentRegistry](DEBUG): Component "controlThread" handled in its own thread.
2023-09-08T12:36:40.161Z,1694176600.161 [controlThread ThreadHandler](DEBUG): Created PCaller Thread at 404814E0
2023-09-08T12:36:40.161Z,1694176600.161 [controlThread ThreadHandler](INFO): Protected caller Thread ID is 1535
2023-09-08T12:36:40.165Z,1694176600.165 [ComponentRegistry](DEBUG): SyncComponent "CycleStarter" handled in the control thread.
2023-09-08T12:36:40.193Z,1694176600.193 [ComponentRegistry](DEBUG): Component "CommandExec" handled in its own thread.
2023-09-08T12:36:40.200Z,1694176600.200 [CommandExec ThreadHandler](DEBUG): Created PCaller Thread at 404B14E0
2023-09-08T12:36:40.200Z,1694176600.200 [CommandExec ThreadHandler](INFO): Protected caller Thread ID is 1536
2023-09-08T12:36:40.205Z,1694176600.205 [ComponentRegistry](DEBUG): Component "CommandLine" handled in its own thread.
2023-09-08T12:36:40.206Z,1694176600.206 [CommandLine ThreadHandler](DEBUG): Created PCaller Thread at 404E14E0
2023-09-08T12:36:40.206Z,1694176600.206 [CommandLine ThreadHandler](INFO): Protected caller Thread ID is 1537
2023-09-08T12:36:40.208Z,1694176600.208 [ComponentRegistry](DEBUG): Component "logger" handled in its own thread.
2023-09-08T12:36:40.209Z,1694176600.209 [logger ThreadHandler](DEBUG): Created PCaller Thread at 405114E0
2023-09-08T12:36:40.210Z,1694176600.210 [logger ThreadHandler](INFO): Protected caller Thread ID is 1538
2023-09-08T12:36:40.213Z,1694176600.213 [ComponentRegistry](DEBUG): SyncComponent "LogSplitter" handled in the control thread.
2023-09-08T12:36:40.214Z,1694176600.214 [Supervisor](INFO): Looking for Config files in directory: Config/
2023-09-08T12:36:40.215Z,1694176600.215 [Supervisor](INFO): Opening Config file at: Config/secure.cfg
2023-09-08T12:36:40.375Z,1694176600.375 [ComponentRegistry](DEBUG): Loaded Config Component "Config/secure
2023-09-08T12:36:40.375Z,1694176600.375 [Supervisor](INFO): Opening Config file at: Config/Dock.cfg
2023-09-08T12:36:40.730Z,1694176600.730 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Dock
2023-09-08T12:36:40.731Z,1694176600.731 [Supervisor](INFO): Opening Config file at: Config/Navigation.cfg
2023-09-08T12:36:41.187Z,1694176601.187 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Navigation
2023-09-08T12:36:41.187Z,1694176601.187 [Supervisor](INFO): Opening Config file at: Config/Estimation.cfg
2023-09-08T12:36:41.367Z,1694176601.367 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Estimation
2023-09-08T12:36:41.367Z,1694176601.367 [Supervisor](INFO): Opening Config file at: Config/Sensor.cfg
2023-09-08T12:36:42.455Z,1694176602.455 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Sensor
2023-09-08T12:36:42.456Z,1694176602.456 [Supervisor](INFO): Opening Config file at: Config/vehicle.cfg
2023-09-08T12:36:43.193Z,1694176603.193 [ComponentRegistry](DEBUG): Loaded Config Component "Config/vehicle
2023-09-08T12:36:43.194Z,1694176603.194 [Supervisor](INFO): Opening Config file at: Config/Simulator.cfg
2023-09-08T12:36:43.724Z,1694176603.724 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Simulator
2023-09-08T12:36:43.725Z,1694176603.725 [Supervisor](INFO): Opening Config file at: Config/Servo.cfg
2023-09-08T12:36:44.167Z,1694176604.167 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Servo
2023-09-08T12:36:44.168Z,1694176604.168 [Supervisor](INFO): Opening Config file at: Config/Control.cfg
2023-09-08T12:36:44.543Z,1694176604.543 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Control
2023-09-08T12:36:44.544Z,1694176604.544 [Supervisor](INFO): Opening Config file at: Config/Science.cfg
2023-09-08T12:36:44.942Z,1694176604.942 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Science
2023-09-08T12:36:44.943Z,1694176604.943 [Supervisor](INFO): Opening Config file at: Config/Derivation.cfg
2023-09-08T12:36:45.180Z,1694176605.180 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Derivation
2023-09-08T12:36:45.180Z,1694176605.180 [Supervisor](INFO): Opening Config file at: Config/workSite.cfg
2023-09-08T12:36:45.327Z,1694176605.327 [ComponentRegistry](DEBUG): Loaded Config Component "Config/workSite
2023-09-08T12:36:45.327Z,1694176605.327 [Supervisor](INFO): Opening Config file at: Config/Guidance.cfg
2023-09-08T12:36:45.411Z,1694176605.411 [Supervisor](INFO): Opening Config file at: Config/Sample.cfg
2023-09-08T12:36:45.492Z,1694176605.492 [Supervisor](INFO): Opening Config file at: Config/logger.cfg
2023-09-08T12:36:45.697Z,1694176605.697 [ComponentRegistry](DEBUG): Loaded Config Component "Config/logger
2023-09-08T12:36:45.698Z,1694176605.698 [Supervisor](INFO): Opening Config file at: Config/BIT.cfg
2023-09-08T12:36:45.946Z,1694176605.946 [ComponentRegistry](DEBUG): Loaded Config Component "Config/BIT
2023-09-08T12:36:45.948Z,1694176605.948 [Supervisor](INFO): Looking for Config files in directory: Config/lrauv-makai/
2023-09-08T12:36:45.949Z,1694176605.949 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/secure.cfg
2023-09-08T12:36:46.035Z,1694176606.035 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/Battery.cfg
2023-09-08T12:36:46.308Z,1694176606.308 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Battery
2023-09-08T12:36:46.309Z,1694176606.309 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/Navigation.cfg
2023-09-08T12:36:46.422Z,1694176606.422 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/Sensor.cfg
2023-09-08T12:36:46.594Z,1694176606.594 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/vehicle.cfg
2023-09-08T12:36:46.702Z,1694176606.702 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/Simulator.cfg
2023-09-08T12:36:46.821Z,1694176606.821 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/Servo.cfg
2023-09-08T12:36:46.938Z,1694176606.938 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/Control.cfg
2023-09-08T12:36:47.048Z,1694176607.048 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/Science.cfg
2023-09-08T12:36:47.223Z,1694176607.223 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/Derivation.cfg
2023-09-08T12:36:47.323Z,1694176607.323 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/logger.cfg
2023-09-08T12:36:47.424Z,1694176607.424 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/BIT.cfg
2023-09-08T12:36:47.531Z,1694176607.531 [Supervisor](INFO): Looking for Config files in directory: Config/lrauv-makai/root/
2023-09-08T12:36:47.531Z,1694176607.531 [Supervisor](IMPORTANT): Reading configuration overrides from Data/persisted.cfg
2023-09-08T12:36:47.555Z,1694176607.555 [Module Loader](DEBUG): Loading Module at Modules/Simulator.so
2023-09-08T12:36:47.710Z,1694176607.710 [Module Loader](DEBUG): Loaded Module: Simulator (This is the module containing the Simulator)
2023-09-08T12:36:47.711Z,1694176607.711 [Module Loader](DEBUG): Loading Module at Modules/Servo.so
2023-09-08T12:36:47.869Z,1694176607.869 [BuoyancyServo] Loaded
2023-09-08T12:36:47.870Z,1694176607.870 [ComponentRegistry](DEBUG): SyncComponent "BuoyancyServo" handled in the control thread.
2023-09-08T12:36:47.891Z,1694176607.891 [ElevatorServo] Loaded
2023-09-08T12:36:47.892Z,1694176607.892 [ComponentRegistry](DEBUG): SyncComponent "ElevatorServo" handled in the control thread.
2023-09-08T12:36:47.912Z,1694176607.912 [MassServo] Loaded
2023-09-08T12:36:47.913Z,1694176607.913 [ComponentRegistry](DEBUG): SyncComponent "MassServo" handled in the control thread.
2023-09-08T12:36:47.933Z,1694176607.933 [RudderServo] Loaded
2023-09-08T12:36:47.933Z,1694176607.933 [ComponentRegistry](DEBUG): SyncComponent "RudderServo" handled in the control thread.
2023-09-08T12:36:47.950Z,1694176607.950 [ThrusterHE] Loaded
2023-09-08T12:36:47.950Z,1694176607.950 [ComponentRegistry](DEBUG): SyncComponent "ThrusterHE" handled in the control thread.
2023-09-08T12:36:47.950Z,1694176607.950 [Module Loader](DEBUG): Loaded Module: Servo (This is the module containing motor controllers)
2023-09-08T12:36:47.951Z,1694176607.951 [Module Loader](DEBUG): Loading Module at Modules/BIT.so
2023-09-08T12:36:48.096Z,1694176608.096 [SBIT](DEBUG): Construct Startup Built In Test.
2023-09-08T12:36:48.111Z,1694176608.111 [SBIT] Loaded
2023-09-08T12:36:48.112Z,1694176608.112 [ComponentRegistry](DEBUG): SyncComponent "SBIT" handled in the control thread.
2023-09-08T12:36:48.114Z,1694176608.114 [IBIT](DEBUG): Construct Initiated Built In Test.
2023-09-08T12:36:48.136Z,1694176608.136 [IBIT] Loaded
2023-09-08T12:36:48.136Z,1694176608.136 [ComponentRegistry](DEBUG): SyncComponent "IBIT" handled in the control thread.
2023-09-08T12:36:48.142Z,1694176608.142 [CBIT](DEBUG): Construct Continuous Built In Test.
2023-09-08T12:36:48.366Z,1694176608.366 [CBIT] Loaded
2023-09-08T12:36:48.366Z,1694176608.366 [ComponentRegistry](DEBUG): SyncComponent "CBIT" handled in the control thread.
2023-09-08T12:36:48.366Z,1694176608.366 [Module Loader](DEBUG): Loaded Module: BIT (Contains the BuiltInTest components, such as C Built In Test)
2023-09-08T12:36:48.367Z,1694176608.367 [Module Loader](DEBUG): Loading Module at Modules/Science.so
2023-09-08T12:36:48.646Z,1694176608.646 [CTD_Seabird] Loaded
2023-09-08T12:36:48.647Z,1694176608.647 [ComponentRegistry](DEBUG): Component "CTD_Seabird" handled in its own thread.
2023-09-08T12:36:48.648Z,1694176608.648 [CTD_Seabird ThreadHandler](DEBUG): Created PCaller Thread at 406674E0
2023-09-08T12:36:48.648Z,1694176608.648 [CTD_Seabird ThreadHandler](INFO): Protected caller Thread ID is 1623
2023-09-08T12:36:48.682Z,1694176608.682 [ESPComponent] Loaded
2023-09-08T12:36:48.683Z,1694176608.683 [ComponentRegistry](DEBUG): SyncComponent "ESPComponent" handled in the control thread.
2023-09-08T12:36:48.731Z,1694176608.731 [PAR_Licor] Loaded
2023-09-08T12:36:48.731Z,1694176608.731 [ComponentRegistry](DEBUG): SyncComponent "PAR_Licor" handled in the control thread.
2023-09-08T12:36:48.822Z,1694176608.822 [WetLabsBB2FL] Loaded
2023-09-08T12:36:48.822Z,1694176608.822 [ComponentRegistry](DEBUG): Component "WetLabsBB2FL" handled in its own thread.
2023-09-08T12:36:48.823Z,1694176608.823 [WetLabsBB2FL ThreadHandler](DEBUG): Created PCaller Thread at 406974E0
2023-09-08T12:36:48.824Z,1694176608.824 [WetLabsBB2FL ThreadHandler](INFO): Protected caller Thread ID is 1624
2023-09-08T12:36:48.824Z,1694176608.824 [Module Loader](DEBUG): Loaded Module: Science (Contains the science components)
2023-09-08T12:36:48.825Z,1694176608.825 [Module Loader](DEBUG): Loading Module at Modules/Derivation.so
2023-09-08T12:36:48.916Z,1694176608.916 [DepthRateCalculator] Loaded
2023-09-08T12:36:48.916Z,1694176608.916 [ComponentRegistry](DEBUG): SyncComponent "DepthRateCalculator" handled in the control thread.
2023-09-08T12:36:48.922Z,1694176608.922 [PitchRateCalculator] Loaded
2023-09-08T12:36:48.922Z,1694176608.922 [ComponentRegistry](DEBUG): SyncComponent "PitchRateCalculator" handled in the control thread.
2023-09-08T12:36:48.932Z,1694176608.932 [SpeedCalculator] Loaded
2023-09-08T12:36:48.933Z,1694176608.933 [ComponentRegistry](DEBUG): SyncComponent "SpeedCalculator" handled in the control thread.
2023-09-08T12:36:48.937Z,1694176608.937 [YawRateCalculator] Loaded
2023-09-08T12:36:48.938Z,1694176608.938 [ComponentRegistry](DEBUG): SyncComponent "YawRateCalculator" handled in the control thread.
2023-09-08T12:36:48.958Z,1694176608.958 [ElevatorOffsetCalculator] Loaded
2023-09-08T12:36:48.958Z,1694176608.958 [ComponentRegistry](DEBUG): SyncComponent "ElevatorOffsetCalculator" handled in the control thread.
2023-09-08T12:36:48.975Z,1694176608.975 [ShortestDistanceToPolygonSidesCalculator] Loaded
2023-09-08T12:36:48.976Z,1694176608.976 [ComponentRegistry](DEBUG): SyncComponent "ShortestDistanceToPolygonSidesCalculator" handled in the control thread.
2023-09-08T12:36:48.976Z,1694176608.976 [Module Loader](DEBUG): Loaded Module: Derivation (Contains the base derivation components)
2023-09-08T12:36:48.977Z,1694176608.977 [Module Loader](DEBUG): Loading Module at Modules/Dock.so
2023-09-08T12:36:49.085Z,1694176609.085 [Module Loader](DEBUG): Loaded Module: Dock (Contains behaviors and commands for docking)
2023-09-08T12:36:49.085Z,1694176609.085 [Module Loader](DEBUG): Loading Module at Modules/Trigger.so
2023-09-08T12:36:49.112Z,1694176609.112 [Module Loader](DEBUG): Loaded Module: Trigger (Contains triggers for use in missions)
2023-09-08T12:36:49.113Z,1694176609.113 [Module Loader](DEBUG): Loading Module at Modules/Navigation.so
2023-09-08T12:36:49.222Z,1694176609.222 [DeadReckonUsingSpeedCalculator] Loaded
2023-09-08T12:36:49.223Z,1694176609.223 [ComponentRegistry](DEBUG): SyncComponent "DeadReckonUsingSpeedCalculator" handled in the control thread.
2023-09-08T12:36:49.237Z,1694176609.237 [NavChart] Loaded
2023-09-08T12:36:49.237Z,1694176609.237 [ComponentRegistry](DEBUG): SyncComponent "NavChart" handled in the control thread.
2023-09-08T12:36:49.243Z,1694176609.243 [UniversalFixResidualReporter] Loaded
2023-09-08T12:36:49.243Z,1694176609.243 [ComponentRegistry](DEBUG): SyncComponent "UniversalFixResidualReporter" handled in the control thread.
2023-09-08T12:36:49.244Z,1694176609.244 [Module Loader](DEBUG): Loaded Module: Navigation (Contains the base navigation components)
2023-09-08T12:36:49.244Z,1694176609.244 [Module Loader](DEBUG): Loading Module at Modules/Sensor.so
2023-09-08T12:36:49.678Z,1694176609.678 [AHRS_M2] Loaded
2023-09-08T12:36:49.678Z,1694176609.678 [ComponentRegistry](DEBUG): SyncComponent "AHRS_M2" handled in the control thread.
2023-09-08T12:36:49.713Z,1694176609.713 [BackseatComponent] Loaded
2023-09-08T12:36:49.714Z,1694176609.714 [ComponentRegistry](DEBUG): Component "BackseatComponent" handled in its own thread.
2023-09-08T12:36:49.715Z,1694176609.715 [BackseatComponent ThreadHandler](DEBUG): Created PCaller Thread at 40A2F4E0
2023-09-08T12:36:49.715Z,1694176609.715 [BackseatComponent ThreadHandler](INFO): Protected caller Thread ID is 1625
2023-09-08T12:36:49.718Z,1694176609.718 [LcmUniversalReporter] Loaded
2023-09-08T12:36:49.718Z,1694176609.718 [ComponentRegistry](DEBUG): SyncComponent "LcmUniversalReporter" handled in the control thread.
2023-09-08T12:36:50.465Z,1694176610.465 [BPC1] Loaded
2023-09-08T12:36:50.466Z,1694176610.466 [ComponentRegistry](DEBUG): SyncComponent "BPC1" handled in the control thread.
2023-09-08T12:36:50.540Z,1694176610.540 [DataOverHttps] Loaded
2023-09-08T12:36:50.540Z,1694176610.540 [ComponentRegistry](DEBUG): Component "DataOverHttps" handled in its own thread.
2023-09-08T12:36:50.541Z,1694176610.541 [DataOverHttps ThreadHandler](DEBUG): Created PCaller Thread at 40A5F4E0
2023-09-08T12:36:50.542Z,1694176610.542 [DataOverHttps ThreadHandler](INFO): Protected caller Thread ID is 1626
2023-09-08T12:36:50.563Z,1694176610.563 [Depth_Keller] Loaded
2023-09-08T12:36:50.563Z,1694176610.563 [ComponentRegistry](DEBUG): SyncComponent "Depth_Keller" handled in the control thread.
2023-09-08T12:36:50.568Z,1694176610.568 [DropWeight] Loaded
2023-09-08T12:36:50.569Z,1694176610.569 [ComponentRegistry](DEBUG): SyncComponent "DropWeight" handled in the control thread.
2023-09-08T12:36:50.609Z,1694176610.609 [DVL_micro] Loaded
2023-09-08T12:36:50.609Z,1694176610.609 [ComponentRegistry](DEBUG): SyncComponent "DVL_micro" handled in the control thread.
2023-09-08T12:36:50.671Z,1694176610.671 [NAL9602] Loaded
2023-09-08T12:36:50.671Z,1694176610.671 [ComponentRegistry](DEBUG): SyncComponent "NAL9602" handled in the control thread.
2023-09-08T12:36:50.698Z,1694176610.698 [Onboard] Loaded
2023-09-08T12:36:50.698Z,1694176610.698 [ComponentRegistry](DEBUG): Component "Onboard" handled in its own thread.
2023-09-08T12:36:50.699Z,1694176610.699 [Onboard ThreadHandler](DEBUG): Created PCaller Thread at 40A8F4E0
2023-09-08T12:36:50.699Z,1694176610.699 [Onboard ThreadHandler](INFO): Protected caller Thread ID is 1627
2023-09-08T12:36:50.712Z,1694176610.712 [Power24vConverter] Loaded
2023-09-08T12:36:50.712Z,1694176610.712 [ComponentRegistry](DEBUG): SyncComponent "Power24vConverter" handled in the control thread.
2023-09-08T12:36:50.726Z,1694176610.726 [Radio_Surface] Loaded
2023-09-08T12:36:50.726Z,1694176610.726 [ComponentRegistry](DEBUG): Component "Radio_Surface" handled in its own thread.
2023-09-08T12:36:50.727Z,1694176610.727 [Radio_Surface ThreadHandler](DEBUG): Created PCaller Thread at 40ABF4E0
2023-09-08T12:36:50.727Z,1694176610.727 [Radio_Surface ThreadHandler](INFO): Protected caller Thread ID is 1628
2023-09-08T12:36:50.742Z,1694176610.742 [Sonardyne_Nano] Loaded
2023-09-08T12:36:50.742Z,1694176610.742 [ComponentRegistry](DEBUG): SyncComponent "Sonardyne_Nano" handled in the control thread.
2023-09-08T12:36:50.743Z,1694176610.743 [Module Loader](DEBUG): Loaded Module: Sensor (Contains the sensor components)
2023-09-08T12:36:50.743Z,1694176610.743 [Module Loader](DEBUG): Loading Module at Modules/Estimation.so
2023-09-08T12:36:50.800Z,1694176610.800 [Module Loader](DEBUG): Loaded Module: Estimation (Contains the base estimation components)
2023-09-08T12:36:50.801Z,1694176610.801 [Module Loader](DEBUG): Loading Module at Modules/Control.so
2023-09-08T12:36:50.852Z,1694176610.852 [VerticalControl](DEBUG): Construct VerticalControl.
2023-09-08T12:36:50.904Z,1694176610.904 [VerticalControl] Loaded
2023-09-08T12:36:50.905Z,1694176610.905 [ComponentRegistry](DEBUG): SyncComponent "VerticalControl" handled in the control thread.
2023-09-08T12:36:50.908Z,1694176610.908 [HorizontalControl](DEBUG): Construct HorizontalControl.
2023-09-08T12:36:50.946Z,1694176610.946 [HorizontalControl] Loaded
2023-09-08T12:36:50.946Z,1694176610.946 [ComponentRegistry](DEBUG): SyncComponent "HorizontalControl" handled in the control thread.
2023-09-08T12:36:50.949Z,1694176610.949 [SpeedControl](DEBUG): Construct SpeedControl.
2023-09-08T12:36:50.950Z,1694176610.950 [SpeedControl] Loaded
2023-09-08T12:36:50.951Z,1694176610.951 [ComponentRegistry](DEBUG): SyncComponent "SpeedControl" handled in the control thread.
2023-09-08T12:36:50.954Z,1694176610.954 [LoopControl](DEBUG): Construct LoopControl.
2023-09-08T12:36:50.954Z,1694176610.954 [LoopControl] Loaded
2023-09-08T12:36:50.955Z,1694176610.955 [ComponentRegistry](DEBUG): SyncComponent "LoopControl" handled in the control thread.
2023-09-08T12:36:50.955Z,1694176610.955 [Module Loader](DEBUG): Loaded Module: Control (Contains the Control components, such as Depth, Heading, and Speed Control)
2023-09-08T12:36:50.955Z,1694176610.955 [Module Loader](DEBUG): Loading Module at Modules/Sample.so
2023-09-08T12:36:50.966Z,1694176610.966 [Module Loader](DEBUG): Loaded Module: Sample (This is a Sample Module of Sample Components)
2023-09-08T12:36:50.966Z,1694176610.966 [Module Loader](DEBUG): Loading Module at Modules/Guidance.so
2023-09-08T12:36:51.279Z,1694176611.279 [Module Loader](DEBUG): Loaded Module: Guidance (Contains behaviors and commands)
2023-09-08T12:36:51.286Z,1694176611.286 [ComponentRegistry](DEBUG): SyncComponent "MissionManager" handled in the control thread.
2023-09-08T12:36:51.289Z,1694176611.289 [ComponentRegistry](DEBUG): SyncComponent "Reporter" handled in the control thread.
2023-09-08T12:36:51.300Z,1694176611.300 [ComponentRegistry](DEBUG): Component "NavChartDb" handled in its own thread.
2023-09-08T12:36:51.301Z,1694176611.301 [NavChartDb ThreadHandler](DEBUG): Created PCaller Thread at 40BCB4E0
2023-09-08T12:36:51.302Z,1694176611.302 [NavChartDb ThreadHandler](INFO): Protected caller Thread ID is 1629
2023-09-08T12:36:51.307Z,1694176611.307 [Supervisor](INFO): Main Thread ID is 822
2023-09-08T12:36:51.307Z,1694176611.307 [Supervisor](DEBUG): Running supervisor.
2023-09-08T12:36:51.307Z,1694176611.307 [CommandExec ThreadHandler](INFO): Handler Thread ID is 1630
2023-09-08T12:36:51.308Z,1694176611.308 [CommandExec](INFO): Initializing the command executive.
2023-09-08T12:36:51.309Z,1694176611.309 [CommandLine ThreadHandler](INFO): Handler Thread ID is 1631
2023-09-08T12:36:51.313Z,1694176611.313 [controlThread ThreadHandler](INFO): Handler Thread ID is 1632
2023-09-08T12:36:51.313Z,1694176611.313 [controlThread](DEBUG): Initializing ControlThread
2023-09-08T12:36:51.315Z,1694176611.315 [SBIT](INFO): Initialize SBIT Component.
2023-09-08T12:36:51.315Z,1694176611.315 [SBIT](IMPORTANT): git: 2023-09-07
2023-09-08T12:36:51.316Z,1694176611.316 [SBIT](INFO): git hash: de73b65bba9e058a7fe4bf2bc7b950ee8b764c06
2023-09-08T12:36:51.316Z,1694176611.316 [SBIT](IMPORTANT): Kernel Release: 2.6.27.8
2023-09-08T12:36:51.318Z,1694176611.318 [SBIT](INFO): Kernel Reporting Different Version From Configuration.
Kernel Expected: #2 PREEMPT Thu Jan 11 20:13:48 PST 2018
Kernel Reported: #1 PREEMPT Wed Mar 17 08:23:48 PDT 2021
2023-09-08T12:36:51.319Z,1694176611.319 [SBIT](INFO): Beginning SBIT in 55.000000 seconds.
2023-09-08T12:36:51.319Z,1694176611.319 [IBIT](INFO): Initialize IBIT Component.
2023-09-08T12:36:51.320Z,1694176611.320 [CBIT](DEBUG): Initialize CBIT Component.
2023-09-08T12:36:51.321Z,1694176611.321 [logger ThreadHandler](INFO): Handler Thread ID is 1633
2023-09-08T12:36:51.332Z,1694176611.332 [CBIT](DEBUG): Initialized mux pins.
2023-09-08T12:36:51.332Z,1694176611.332 [CBIT](DEBUG): Initializing the watchdog timer.
2023-09-08T12:36:51.340Z,1694176611.340 [CTD_Seabird ThreadHandler](INFO): Handler Thread ID is 1634
2023-09-08T12:36:51.341Z,1694176611.341 [CTD_Seabird](DEBUG): Initializing CTD_Seabird.
2023-09-08T12:36:51.345Z,1694176611.345 [WetLabsBB2FL ThreadHandler](INFO): Handler Thread ID is 1636
2023-09-08T12:36:51.348Z,1694176611.348 [WetLabsBB2FL](INFO): Powering up
2023-09-08T12:36:51.350Z,1694176611.350 [BackseatComponent ThreadHandler](INFO): Handler Thread ID is 1638
2023-09-08T12:36:51.356Z,1694176611.356 [CBIT](INFO): Last reboot was NOT due to watchdog timer.
2023-09-08T12:36:51.356Z,1694176611.356 [CBIT](DEBUG): Initializing heartbeat.
2023-09-08T12:36:51.357Z,1694176611.357 [DataOverHttps ThreadHandler](INFO): Handler Thread ID is 1639
2023-09-08T12:36:51.358Z,1694176611.358 [DataOverHttps](DEBUG): dashIP=134.89.2.23 starts with a digit so assuming it is a numeric IP
2023-09-08T12:36:51.368Z,1694176611.368 [Onboard ThreadHandler](INFO): Handler Thread ID is 1640
2023-09-08T12:36:51.385Z,1694176611.385 [Radio_Surface ThreadHandler](INFO): Handler Thread ID is 1641
2023-09-08T12:36:51.405Z,1694176611.405 [NavChartDb ThreadHandler](INFO): Handler Thread ID is 1642
2023-09-08T12:36:51.408Z,1694176611.408 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US2MI01M.000
2023-09-08T12:36:51.409Z,1694176611.409 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US2MI01M.000
2023-09-08T12:36:51.409Z,1694176611.409 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US2MI80M.000
2023-09-08T12:36:51.409Z,1694176611.409 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US2MI80M.000
2023-09-08T12:36:51.409Z,1694176611.409 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US4MI57M.000
2023-09-08T12:36:51.409Z,1694176611.409 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US4MI57M.000
2023-09-08T12:36:51.410Z,1694176611.410 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US4MI56M.000
2023-09-08T12:36:51.410Z,1694176611.410 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US4MI56M.000
2023-09-08T12:36:51.410Z,1694176611.410 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US4MI90M.000
2023-09-08T12:36:51.410Z,1694176611.410 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US4MI90M.000
2023-09-08T12:36:51.410Z,1694176611.410 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US4MI89M.000
2023-09-08T12:36:51.410Z,1694176611.410 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US4MI89M.000
2023-09-08T12:36:51.411Z,1694176611.411 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US4WI03M.000
2023-09-08T12:36:51.411Z,1694176611.411 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US4WI03M.000
2023-09-08T12:36:51.411Z,1694176611.411 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US4WI06M.000
2023-09-08T12:36:51.411Z,1694176611.411 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US4WI06M.000
2023-09-08T12:36:51.411Z,1694176611.411 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US4OH01M.000
2023-09-08T12:36:51.411Z,1694176611.411 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US4OH01M.000
2023-09-08T12:36:51.411Z,1694176611.411 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US4OH04M.000
2023-09-08T12:36:51.412Z,1694176611.412 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US4OH04M.000
2023-09-08T12:36:51.413Z,1694176611.413 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US4OH02M.000
2023-09-08T12:36:51.413Z,1694176611.413 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US4OH02M.000
2023-09-08T12:36:51.413Z,1694176611.413 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US4PA20M.000
2023-09-08T12:36:51.413Z,1694176611.413 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US4PA20M.000
2023-09-08T12:36:51.413Z,1694176611.413 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US4PA21M.000
2023-09-08T12:36:51.413Z,1694176611.413 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US4PA21M.000
2023-09-08T12:36:51.428Z,1694176611.428 [CBIT](DEBUG): Deactivating GF circuits.
2023-09-08T12:36:51.428Z,1694176611.428 [CBIT](DEBUG): Deactivating emergency mode.
2023-09-08T12:36:51.468Z,1694176611.468 [CBIT](DEBUG): Backplane powered.
2023-09-08T12:36:51.472Z,1694176611.472 [DepthRateCalculator](DEBUG): Initializing DepthRateCalculator.
2023-09-08T12:36:51.473Z,1694176611.473 [PitchRateCalculator](DEBUG): Initializing PitchRateCalculator.
2023-09-08T12:36:51.473Z,1694176611.473 [SpeedCalculator](DEBUG): Initializing SpeedCalculator.
2023-09-08T12:36:51.473Z,1694176611.473 [YawRateCalculator](DEBUG): Initializing YawRateCalculator.
2023-09-08T12:36:51.474Z,1694176611.474 [ElevatorOffsetCalculator](DEBUG): Initializing ElevatorOffsetCalculator.
2023-09-08T12:36:51.474Z,1694176611.474 [ShortestDistanceToPolygonSidesCalculator](DEBUG): Initializing.
2023-09-08T12:36:51.475Z,1694176611.475 [DeadReckonUsingSpeedCalculator](DEBUG): Initializing DeadReckonUsingSpeedCalculator component.
2023-09-08T12:36:51.476Z,1694176611.476 [NavChart](DEBUG): Initialize NavChart Navigation.
2023-09-08T12:36:51.476Z,1694176611.476 [UniversalFixResidualReporter](DEBUG): Initializing UniversalFixResidualReporter component.
2023-09-08T12:36:51.482Z,1694176611.482 [VerticalControl](DEBUG): Initialize VerticalControlComponent.
2023-09-08T12:36:51.488Z,1694176611.488 [HorizontalControl](DEBUG): Initialize HorizontalControlComponent.
2023-09-08T12:36:51.489Z,1694176611.489 [SpeedControl](DEBUG): Initialize SpeedControlComponent.
2023-09-08T12:36:51.489Z,1694176611.489 [LoopControl](DEBUG): Initialize LoopControlComponent.
2023-09-08T12:36:51.490Z,1694176611.490 [MissionManager](INFO): Loading Mission from file: Missions/Startup.xml
2023-09-08T12:36:51.527Z,1694176611.527 [Startup:A.GoToSurface](DEBUG): Construct GoToSurface.
2023-09-08T12:36:51.563Z,1694176611.563 [MissionManager](DEBUG): 
<?xml version="1.0" encoding="UTF-8"?>
<Mission xmlns="Tethys"
       xmlns:Control="Tethys/Control"
       xmlns:Guidance="Tethys/Guidance" 
       xmlns:Units="Tethys/Units"
       xmlns:Universal="Tethys/Universal"
       xmlns:xsi="http://www.w3.org/2001/XMLSchema-instance"
       xsi:schemaLocation="Tethys http://okeanids.mbari.org/tethys/Xml/Tethys.xsd
                           Tethys/Control http://okeanids.mbari.org/tethys/Xml/Control.xsd
                           Tethys/Guidance http://okeanids.mbari.org/tethys/Xml/Guidance.xsd
                           Tethys/Units http://okeanids.mbari.org/tethys/Xml/Units.xsd
                           Tethys/Universal http://okeanids.mbari.org/tethys/Xml/Universal.xsd"
       Id="Startup">

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

    <Aggregate Id="StartupSatComms">

        <Sequence/>

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

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

    </Aggregate>

</Mission>


2023-09-08T12:36:51.580Z,1694176611.580 [MissionManager](INFO): Loading Mission from file: Missions/Default.xml
2023-09-08T12:36:51.654Z,1694176611.654 [MissionManager](INFO): DefineArg Default.ElapsedSinceDefaultStarted = 0.000000 min
2023-09-08T12:36:51.655Z,1694176611.655 [Default:A.Wait](DEBUG): Construct Wait.
2023-09-08T12:36:51.657Z,1694176611.657 [Default:B.GoToSurface](DEBUG): Construct GoToSurface.
2023-09-08T12:36:51.705Z,1694176611.705 [Default:CheckIn:Read_Iridium:A_Timeout:A.Execute](DEBUG): Construct Execute.
2023-09-08T12:36:51.707Z,1694176611.707 [Default:CheckIn:C.Wait](DEBUG): Construct Wait.
2023-09-08T12:36:51.726Z,1694176611.726 [Default:E.Execute](DEBUG): Construct Execute.
2023-09-08T12:36:51.729Z,1694176611.729 [MissionManager](DEBUG): 
<?xml version="1.0" encoding="UTF-8"?>
<Mission xmlns:xsi="http://www.w3.org/2001/XMLSchema-instance"
         xmlns="Tethys"
         xmlns:Units="Tethys/Units"
         xmlns:Guidance="Tethys/Guidance"
         xmlns:Universal="Tethys/Universal"
         xsi:schemaLocation="Tethys http://okeanids.mbari.org/tethys/Xml/Tethys.xsd
                             Tethys/Units http://okeanids.mbari.org/tethys/Xml/Units.xsd
                             Tethys/Guidance http://okeanids.mbari.org/tethys/Xml/Guidance.xsd
                             Tethys/Universal http://okeanids.mbari.org/tethys/Xml/Universal.xsd"
         Id="Default">

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

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

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

    <Aggregate Id="CheckIn">

        <Sequence Repeat="288"/>

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

        <ReadDatum Id="Read_Iridium">
            <Timeout Duration="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>


2023-09-08T12:36:51.748Z,1694176611.748 [controlThread](DEBUG): Component order: CycleStarter,ESPComponent,PAR_Licor,AHRS_M2,BPC1,Depth_Keller,DropWeight,DVL_micro,NAL9602,Power24vConverter,Sonardyne_Nano,PAR_Licor,Depth_Keller,DepthRateCalculator,PitchRateCalculator,SpeedCalculator,YawRateCalculator,ElevatorOffsetCalculator,ShortestDistanceToPolygonSidesCalculator,DeadReckonUsingSpeedCalculator,NavChart,UniversalFixResidualReporter,MissionManager,VerticalControl,HorizontalControl,SpeedControl,LoopControl,BuoyancyServo,ElevatorServo,MassServo,RudderServo,ThrusterHE,SBIT,IBIT,CBIT,LcmUniversalReporter,Reporter,LogSplitter,
2023-09-08T12:36:51.773Z,1694176611.773 [AHRS_M2](DEBUG): Initializing AHRS_M2.
2023-09-08T12:36:51.808Z,1694176611.808 [Radio_Surface](INFO): Powering up
2023-09-08T12:36:51.849Z,1694176611.849 [Depth_Keller](ERROR): Pressure or depth reading out of range: 1895.894409 decibar, 0.000000 m
2023-09-08T12:36:51.857Z,1694176611.857 [Power24vConverter](INFO): Powering up.
2023-09-08T12:36:51.858Z,1694176611.858 [Sonardyne_Nano](INFO): Initializing.
2023-09-08T12:36:51.884Z,1694176611.884 [DepthRateCalculator](ERROR): Depth measurement is not active
2023-09-08T12:36:51.910Z,1694176611.910 [BuoyancyServo](DEBUG): Initializing EZServoServo.
2023-09-08T12:36:51.924Z,1694176611.924 [BuoyancyServo](DEBUG): Initializing BuoyancyServo.
2023-09-08T12:36:51.925Z,1694176611.925 [ElevatorServo](DEBUG): Initializing EZServoServo.
2023-09-08T12:36:51.933Z,1694176611.933 [ElevatorServo](DEBUG): Initializing ElevatorServo.
2023-09-08T12:36:51.933Z,1694176611.933 [MassServo](DEBUG): Initializing EZServoServo.
2023-09-08T12:36:51.940Z,1694176611.940 [MassServo](DEBUG): Initializing MassServo.
2023-09-08T12:36:51.941Z,1694176611.941 [RudderServo](DEBUG): Initializing EZServoServo.
2023-09-08T12:36:51.948Z,1694176611.948 [RudderServo](DEBUG): Initializing RudderServo.
2023-09-08T12:36:51.949Z,1694176611.949 [ThrusterHE](DEBUG): Initializing EZServoServo.
2023-09-08T12:36:51.956Z,1694176611.956 [ThrusterHE](DEBUG): Initializing ThrusterHE.
2023-09-08T12:36:52.308Z,1694176612.308 [DVL_micro](INFO): Powering down
2023-09-08T12:36:53.456Z,1694176613.456 [WetLabsBB2FL](INFO): Powering down
2023-09-08T12:36:54.187Z,1694176614.187 [Sonardyne_Nano](ERROR): Failed to get valid response or reached max queue size, flushing UART
2023-09-08T12:36:55.425Z,1694176615.425 [Sonardyne_Nano](IMPORTANT): Found beacon with acoustic ID 2213
2023-09-08T12:36:57.517Z,1694176617.517 [ThrusterHE](ERROR): Zero Speed Commanded.
2023-09-08T12:37:20.854Z,1694176640.854 [NAL9602](INFO): Powering up NAL9602
2023-09-08T12:37:31.768Z,1694176651.768 [NAL9602](INFO): NAL9602 initialized
2023-09-08T12:37:47.136Z,1694176667.136 [SBIT](IMPORTANT): Beginning Startup BIT
2023-09-08T12:37:47.140Z,1694176667.140 [CBIT](IMPORTANT): Beginning ground fault scan
2023-09-08T12:37:54.793Z,1694176674.793 [NAL9602](INFO): SBD MO Status=0, MOMSN=8962, MT Status=0, MTMSN=0
2023-09-08T12:37:54.793Z,1694176674.793 [NAL9602](INFO): No messages in MT queue
2023-09-08T12:37:56.005Z,1694176676.005 [NAL9602](DEBUG): Parsing RMC sentence: $GPRMC,123752.00,A,4145.52940,N,08116.65645,W,0.039,0.00,080923,,,A*72
2023-09-08T12:37:56.009Z,1694176676.009 [NAL9602](INFO): GPS fix at 20230908T123752: (41.758823, -81.277608)
2023-09-08T12:37:58.105Z,1694176678.105 [CBIT](IMPORTANT): No ground fault detected
mA:
CHAN A0 (Batt): -0.006670
CHAN A1 (24V): 0.001421
CHAN A2 (12V): -0.006277
CHAN A3 (5V): -0.003072
CHAN B0 (3.3V): -0.001679
CHAN B1 (3.15aV): -0.000956
CHAN B2 (3.15bV): -0.000678
CHAN B3 (GND): -0.000130
OPEN: 0.000354
Full Scale: +/- 1 mA
2023-09-08T12:38:28.328Z,1694176708.328 [NAL9602](INFO): Not Powering down - fast GPS
2023-09-08T12:38:41.273Z,1694176721.273 [SBIT](IMPORTANT): SBIT PASSED
2023-09-08T12:38:41.274Z,1694176721.274 [SBIT](IMPORTANT): Listing configuration overrides from Data/persisted.cfg
2023-09-08T12:38:41.275Z,1694176721.275 [SBIT](IMPORTANT): DAT.loadAtStartup=0 bool;

2023-09-08T12:38:41.275Z,1694176721.275 [SBIT](IMPORTANT): DVL_micro.loadAtStartup=1 bool;

2023-09-08T12:38:41.275Z,1694176721.275 [SBIT](IMPORTANT): DeadReckonUsingMultipleVelocitySources.loadAtStartup=0 bool;

2023-09-08T12:38:41.275Z,1694176721.275 [SBIT](IMPORTANT): DeadReckonUsingSpeedCalculator.loadAtStartup=1 bool;

2023-09-08T12:38:41.275Z,1694176721.275 [SBIT](IMPORTANT): Depth_Keller.offset=-0.35 decibar;

2023-09-08T12:38:41.275Z,1694176721.275 [SBIT](IMPORTANT): DropWeight.loadAtStartup=1 bool;

2023-09-08T12:38:41.275Z,1694176721.275 [SBIT](IMPORTANT): ESPComponent.filterCompleteTimeout=135 minute;

2023-09-08T12:38:41.275Z,1694176721.275 [SBIT](IMPORTANT): ESPComponent.sampleTimeout=3 minute;

2023-09-08T12:38:41.276Z,1694176721.276 [SBIT](IMPORTANT): ESPComponent.simulateHardware=0 bool;

2023-09-08T12:38:41.276Z,1694176721.276 [SBIT](IMPORTANT): ElevatorServo.offsetAngle=1 degree;

2023-09-08T12:38:41.276Z,1694176721.276 [SBIT](IMPORTANT): Express linearApproximation CTD_Seabird.bin_mean_sea_water_temperature 5.000000 celsius;

2023-09-08T12:38:41.276Z,1694176721.276 [SBIT](IMPORTANT): Express none CTD_Seabird.bin_median_sea_water_salinity;

2023-09-08T12:38:41.276Z,1694176721.276 [SBIT](IMPORTANT): Express none WetLabsBB2FL.bin_mean_mass_concentration_of_chlorophyll_in_sea_water;

2023-09-08T12:38:41.276Z,1694176721.276 [SBIT](IMPORTANT): Express linearApproximation WetLabsSeaOWL_UV_A.mass_concentration_of_petroleum_hydrocarbons_in_sea_water 1.000000 kilogram_per_cubic_meter;

2023-09-08T12:38:41.277Z,1694176721.277 [SBIT](IMPORTANT): Express linearApproximation height_above_sea_floor 50.000000 meter;

2023-09-08T12:38:41.277Z,1694176721.277 [SBIT](IMPORTANT): InternalEnvSim.loadAtStartup=0 bool;

2023-09-08T12:38:41.277Z,1694176721.277 [SBIT](IMPORTANT): ShortestDistanceToPolygonSidesCalculator.loadAtStartup=1 bool;

2023-09-08T12:38:41.277Z,1694176721.277 [SBIT](IMPORTANT): Sonardyne_Nano.loadAtStartup=1 bool;

2023-09-08T12:38:41.277Z,1694176721.277 [SBIT](IMPORTANT): StratificationFrontDetector.loadAtStartup=0 bool;

2023-09-08T12:38:41.277Z,1694176721.277 [SBIT](IMPORTANT): StratificationFrontDetector.threshold_VTHI=0.05 celsius;

2023-09-08T12:38:41.277Z,1694176721.277 [SBIT](IMPORTANT): StratificationFrontDetector.verbosity=1 count;

2023-09-08T12:38:41.277Z,1694176721.277 [SBIT](IMPORTANT): VerticalControl.buoyancyNeutral=193.25 cubic_centimeter;

2023-09-08T12:38:41.278Z,1694176721.278 [SBIT](IMPORTANT): VerticalControl.massDefault=8.91 millimeter;

2023-09-08T12:38:41.278Z,1694176721.278 [SBIT](IMPORTANT): VerticalHomogeneityIndexCalculator.depth3=20 meter;

2023-09-08T12:38:41.278Z,1694176721.278 [SBIT](IMPORTANT): VerticalHomogeneityIndexCalculator.depth4=30 meter;

2023-09-08T12:38:41.278Z,1694176721.278 [SBIT](IMPORTANT): VerticalHomogeneityIndexCalculator.loadAtStartup=0 bool;

2023-09-08T12:38:41.278Z,1694176721.278 [SBIT](IMPORTANT): WetLabsSeaOWL_UV_A.loadAtStartup=0 bool;

2023-09-08T12:38:41.679Z,1694176721.679 [MissionManager](IMPORTANT): Started mission Startup
2023-09-08T12:38:41.680Z,1694176721.680 [Startup] Running Loop=1
2023-09-08T12:38:41.680Z,1694176721.680 [Startup](DEBUG): Aggregate::initialize Startup
2023-09-08T12:38:41.680Z,1694176721.680 [Startup:A.GoToSurface] Running Loop=1
2023-09-08T12:38:41.680Z,1694176721.680 [Startup:A.GoToSurface](DEBUG): Initialize GoToSurfaceComponent.
2023-09-08T12:38:41.680Z,1694176721.680 [Startup:A.GoToSurface](DEBUG): No depth rate setting specified. Using default value of nan m/s.
2023-09-08T12:38:41.681Z,1694176721.681 [Startup:A.GoToSurface](DEBUG): No pitch setting specified. Using default value of nan degrees.
2023-09-08T12:38:41.681Z,1694176721.681 [Startup:A.GoToSurface](DEBUG): No speed setting specified. Using default value of 1.000000 m/s.
2023-09-08T12:38:41.682Z,1694176721.682 [Startup:A.GoToSurface](DEBUG): No surface timeout specified. Using default value of 1000.000000 seconds.
2023-09-08T12:38:41.682Z,1694176721.682 [Startup:A.GoToSurface](INFO): Received pitch timeout configuration 60.000000 seconds.
2023-09-08T12:38:41.683Z,1694176721.683 [Startup:StartupSatComms] Running Loop=1
2023-09-08T12:38:41.683Z,1694176721.683 [Startup:StartupSatComms](DEBUG): Aggregate::initialize Startup:StartupSatComms
2023-09-08T12:38:41.683Z,1694176721.683 [Startup:StartupSatComms:A] Running Loop=1
2023-09-08T12:38:42.071Z,1694176722.071 [Startup:StartupSatComms:A](DEBUG): Initialize ReadDataComponent to sense latitude_fix
2023-09-08T12:38:43.682Z,1694176723.682 [NAL9602](DEBUG): Parsing RMC sentence: $GPRMC,123842.00,A,4145.52994,N,08116.65615,W,0.078,0.00,080923,,,A*75
2023-09-08T12:38:43.685Z,1694176723.685 [NAL9602](INFO): GPS fix at 20230908T123842: (41.758832, -81.277603)
2023-09-08T12:38:43.695Z,1694176723.695 [Startup:StartupSatComms:A] Stopped
2023-09-08T12:38:43.695Z,1694176723.695 [Startup:StartupSatComms:B] Running Loop=1
2023-09-08T12:38:44.110Z,1694176724.110 [Startup:StartupSatComms:B](DEBUG): Initialize ReadDataComponent to sense platform_communications
2023-09-08T12:39:01.635Z,1694176741.635 [NAL9602](INFO): SBD MO Status=1, MOMSN=8963, MT Status=0, MTMSN=0
2023-09-08T12:39:01.696Z,1694176741.696 [NAL9602](INFO): Sent 40 bytes from file Logs/20230908T113054/Courier0046.lzma
2023-09-08T12:39:01.696Z,1694176741.696 [NAL9602](INFO): Packets left to send: 0
2023-09-08T12:39:10.694Z,1694176750.694 [NAL9602](INFO): SBD MO Status=1, MOMSN=8964, MT Status=0, MTMSN=0
2023-09-08T12:39:10.752Z,1694176750.752 [NAL9602](INFO): Sent 271 bytes from file Logs/20230908T123640/Courier0000.lzma
2023-09-08T12:39:10.752Z,1694176750.752 [NAL9602](INFO): Packets left to send: 0
2023-09-08T12:39:19.198Z,1694176759.198 [NAL9602](INFO): SBD MO Status=1, MOMSN=8965, MT Status=0, MTMSN=0
2023-09-08T12:39:19.260Z,1694176759.260 [NAL9602](INFO): Sent 111 bytes from file Logs/20230908T113054/Express0047.lzma
2023-09-08T12:39:19.261Z,1694176759.261 [NAL9602](INFO): Packets left to send: 0
2023-09-08T12:39:27.815Z,1694176767.815 [NAL9602](INFO): SBD MO Status=1, MOMSN=8966, MT Status=0, MTMSN=0
2023-09-08T12:39:27.876Z,1694176767.876 [NAL9602](INFO): Sent 332 bytes from file Logs/20230908T123640/Express0001.lzma
2023-09-08T12:39:27.876Z,1694176767.876 [NAL9602](INFO): Packets left to send: 3
2023-09-08T12:39:36.860Z,1694176776.860 [NAL9602](INFO): SBD MO Status=1, MOMSN=8967, MT Status=0, MTMSN=0
2023-09-08T12:39:36.920Z,1694176776.920 [NAL9602](INFO): Sent 332 bytes from file Logs/20230908T123640/Express0001.lzma
2023-09-08T12:39:36.920Z,1694176776.920 [NAL9602](INFO): Packets left to send: 2
2023-09-08T12:39:43.743Z,1694176783.743 [Startup:StartupSatComms:B](INFO): Timed out from 2023-09-08T12:38:43.7Z
2023-09-08T12:39:43.743Z,1694176783.743 [Startup:StartupSatComms:B] Stopped
2023-09-08T12:39:43.743Z,1694176783.743 [Startup:StartupSatComms](INFO): Completed Startup:StartupSatComms
2023-09-08T12:39:43.743Z,1694176783.743 [Startup:StartupSatComms] Stopped
2023-09-08T12:39:43.743Z,1694176783.743 [Startup:StartupSatComms](DEBUG): Aggregate::uninitialize Startup:StartupSatComms
2023-09-08T12:39:43.744Z,1694176783.744 [Startup](INFO): Completed Startup
2023-09-08T12:39:43.744Z,1694176783.744 [MissionManager](INFO): Startup is completed.
2023-09-08T12:39:43.744Z,1694176783.744 [MissionManager](INFO): Uninitializing Mission Startup
2023-09-08T12:39:43.745Z,1694176783.745 [Startup] Stopped
2023-09-08T12:39:43.745Z,1694176783.745 [Startup](DEBUG): Aggregate::uninitialize Startup
2023-09-08T12:39:43.745Z,1694176783.745 [Startup:A.GoToSurface] Stopped
2023-09-08T12:39:43.745Z,1694176783.745 [Startup:A.GoToSurface](DEBUG): Uninitialize GoToSurfaceComponent.
2023-09-08T12:39:44.211Z,1694176784.211 [MissionManager](IMPORTANT): Started mission Default
2023-09-08T12:39:44.217Z,1694176784.217 [Default] Running Loop=1
2023-09-08T12:39:44.217Z,1694176784.217 [Default](DEBUG): Aggregate::initialize Default
2023-09-08T12:39:44.217Z,1694176784.217 [Default:B.GoToSurface] Running Loop=1
2023-09-08T12:39:44.217Z,1694176784.217 [Default:B.GoToSurface](DEBUG): Initialize GoToSurfaceComponent.
2023-09-08T12:39:44.218Z,1694176784.218 [Default:B.GoToSurface](DEBUG): No depth rate setting specified. Using default value of nan m/s.
2023-09-08T12:39:44.218Z,1694176784.218 [Default:B.GoToSurface](DEBUG): No pitch setting specified. Using default value of nan degrees.
2023-09-08T12:39:44.219Z,1694176784.219 [Default:B.GoToSurface](DEBUG): No speed setting specified. Using default value of 1.000000 m/s.
2023-09-08T12:39:44.219Z,1694176784.219 [Default:B.GoToSurface](DEBUG): No surface timeout specified. Using default value of 1000.000000 seconds.
2023-09-08T12:39:44.219Z,1694176784.219 [Default:B.GoToSurface](INFO): Received pitch timeout configuration 60.000000 seconds.
2023-09-08T12:39:44.220Z,1694176784.220 [Default:A.Wait] Running Loop=1
2023-09-08T12:39:44.220Z,1694176784.220 [Default:A.Wait](DEBUG): Initialize Wait Component.
2023-09-08T12:39:44.704Z,1694176784.704 [DVL_micro](INFO): Powering down
2023-09-08T12:39:44.953Z,1694176784.953 [NAL9602](INFO): SBD MO Status=1, MOMSN=8968, MT Status=0, MTMSN=0
2023-09-08T12:39:45.000Z,1694176785.000 [NAL9602](INFO): Sent 332 bytes from file Logs/20230908T123640/Express0001.lzma
2023-09-08T12:39:45.000Z,1694176785.000 [NAL9602](INFO): Packets left to send: 1
2023-09-08T12:39:57.229Z,1694176797.229 [Default:A.Wait](INFO): Done Waiting.
2023-09-08T12:39:57.229Z,1694176797.229 [Default:A.Wait] Stopped
2023-09-08T12:39:57.229Z,1694176797.229 [Default:A.Wait](DEBUG): Uninitialize Wait Component.
2023-09-08T12:39:57.645Z,1694176797.645 [Default:CheckIn] Running Loop=1
2023-09-08T12:39:57.645Z,1694176797.645 [Default:CheckIn](DEBUG): Aggregate::initialize Default:CheckIn
2023-09-08T12:39:57.645Z,1694176797.645 [Default:CheckIn:Read_GPS] Running Loop=1
2023-09-08T12:39:58.034Z,1694176798.034 [Default:CheckIn:Read_GPS](DEBUG): Initialize ReadDataComponent to sense time_fix
2023-09-08T12:39:59.646Z,1694176799.646 [NAL9602](DEBUG): Parsing RMC sentence: $GPRMC,123958.00,A,4145.53032,N,08116.65375,W,0.019,0.00,080923,,,A*7F
2023-09-08T12:39:59.648Z,1694176799.648 [NAL9602](INFO): GPS fix at 20230908T123958: (41.758839, -81.277563)
2023-09-08T12:39:59.658Z,1694176799.658 [Default:CheckIn:Read_GPS] Stopped
2023-09-08T12:39:59.658Z,1694176799.658 [Default:CheckIn:Read_Iridium] Running Loop=1
2023-09-08T12:40:00.100Z,1694176800.100 [Default:CheckIn:Read_Iridium](DEBUG): Initialize ReadDataComponent to sense platform_communications
2023-09-08T12:40:18.734Z,1694176818.734 [NAL9602](INFO): SBD MO Status=1, MOMSN=8969, MT Status=0, MTMSN=0
2023-09-08T12:40:18.788Z,1694176818.788 [NAL9602](INFO): Sent 76 bytes from file Logs/20230908T123640/Courier0004.lzma
2023-09-08T12:40:18.788Z,1694176818.788 [NAL9602](INFO): Packets left to send: 0
2023-09-08T12:40:26.326Z,1694176826.326 [DataOverHttps](INFO): setting available, lastComms_.elapsed()=0.004368
2023-09-08T12:40:28.111Z,1694176828.111 [NAL9602](INFO): SBD MO Status=1, MOMSN=8970, MT Status=0, MTMSN=0
2023-09-08T12:40:28.157Z,1694176828.157 [NAL9602](INFO): Sent 282 bytes from file Logs/20230908T123640/Express0001.lzma
2023-09-08T12:40:28.158Z,1694176828.158 [NAL9602](INFO): Packets left to send: 0
2023-09-08T12:40:28.211Z,1694176828.211 [Default:CheckIn:Read_Iridium] Stopped
2023-09-08T12:40:28.211Z,1694176828.211 [Default:CheckIn:C.Wait] Running Loop=1
2023-09-08T12:40:28.216Z,1694176828.216 [Default:CheckIn:C.Wait](DEBUG): Initialize Wait Component.
2023-09-08T12:40:39.067Z,1694176839.067 [DataOverHttps](INFO): Sending 228 bytes from file Logs/20230908T123640/Express0005.lzma
2023-09-08T12:40:40.070Z,1694176840.070 [DataOverHttps](INFO): Moved sent file to Logs/20230908T123640/Express0005.lzma.bak
2023-09-08T12:40:40.070Z,1694176840.070 [DataOverHttps](INFO): SBD MOMSN=18630771
2023-09-08T12:40:58.829Z,1694176858.829 [NAL9602](INFO): Not Powering down - fast GPS
2023-09-08T12:44:29.870Z,1694177069.870 [BPC1](INFO): Calculating totals. Valid battery stick count: 56. Valid reserve battery stick count: 6.
2023-09-08T12:44:29.874Z,1694177069.874 [BPC1](INFO): Received data from all battery sticks.
2023-09-08T12:45:28.898Z,1694177128.898 [Default:CheckIn:C.Wait](INFO): Done Waiting.
2023-09-08T12:45:28.898Z,1694177128.898 [Default:CheckIn:C.Wait] Stopped
2023-09-08T12:45:28.898Z,1694177128.898 [Default:CheckIn:C.Wait](DEBUG): Uninitialize Wait Component.
2023-09-08T12:45:28.898Z,1694177128.898 [Default:CheckIn:D] Running Loop=1
2023-09-08T12:45:29.305Z,1694177129.305 [Default:CheckIn:D] Stopped
2023-09-08T12:45:29.305Z,1694177129.305 [Default:CheckIn:E] Running Loop=1
2023-09-08T12:45:29.709Z,1694177129.709 [Default:CheckIn:E](IMPORTANT): Default mission has been running for 5.751557 min 
2023-09-08T12:45:29.709Z,1694177129.709 [Default:CheckIn:E] Stopped
2023-09-08T12:45:29.709Z,1694177129.709 [Default:CheckIn](INFO): Completed Default:CheckIn
2023-09-08T12:45:29.709Z,1694177129.709 [Default:CheckIn] Stopped
2023-09-08T12:45:29.709Z,1694177129.709 [Default:CheckIn](DEBUG): Aggregate::uninitialize Default:CheckIn
2023-09-08T12:45:29.709Z,1694177129.709 [Default:CheckIn](INFO): Running loop #2
2023-09-08T12:45:29.710Z,1694177129.710 [Default:CheckIn] Running Loop=2
2023-09-08T12:45:29.710Z,1694177129.710 [Default:CheckIn](DEBUG): Aggregate::initialize Default:CheckIn
2023-09-08T12:45:29.710Z,1694177129.710 [Default:CheckIn:Read_GPS] Running Loop=1
2023-09-08T12:45:31.743Z,1694177131.743 [NAL9602](DEBUG): Parsing RMC sentence: $GPRMC,124530.00,A,4145.53029,N,08116.65386,W,0.019,0.00,080923,,,D*79
2023-09-08T12:45:31.745Z,1694177131.745 [NAL9602](INFO): GPS fix at 20230908T124530: (41.758838, -81.277564)
2023-09-08T12:45:31.755Z,1694177131.755 [Default:CheckIn:Read_GPS] Stopped
2023-09-08T12:45:31.755Z,1694177131.755 [Default:CheckIn:Read_Iridium] Running Loop=1
2023-09-08T12:45:44.028Z,1694177144.028 [DataOverHttps](INFO): Sending 207 bytes from file Logs/20230908T123640/Courier0007.lzma
2023-09-08T12:45:45.030Z,1694177145.030 [DataOverHttps](INFO): Moved sent file to Logs/20230908T123640/Courier0007.lzma.bak
2023-09-08T12:45:45.030Z,1694177145.030 [DataOverHttps](INFO): SBD MOMSN=18630847
2023-09-08T12:45:47.195Z,1694177147.195 [NAL9602](INFO): SBD MO Status=0, MOMSN=8971, MT Status=0, MTMSN=0
2023-09-08T12:45:47.200Z,1694177147.200 [NAL9602](INFO): No messages in MT queue
2023-09-08T12:46:04.655Z,1694177164.655 [DataOverHttps](INFO): Sending 163 bytes from file Logs/20230908T123640/Express0008.lzma
2023-09-08T12:46:05.658Z,1694177165.658 [DataOverHttps](INFO): Moved sent file to Logs/20230908T123640/Express0008.lzma.bak
2023-09-08T12:46:05.658Z,1694177165.658 [DataOverHttps](INFO): SBD MOMSN=18630850
2023-09-08T12:46:08.599Z,1694177168.599 [Default:CheckIn:Read_Iridium] Stopped
2023-09-08T12:46:08.599Z,1694177168.599 [Default:CheckIn:C.Wait] Running Loop=1
2023-09-08T12:46:08.599Z,1694177168.599 [Default:CheckIn:C.Wait](DEBUG): Initialize Wait Component.
2023-09-08T12:46:17.868Z,1694177177.868 [NAL9602](INFO): Not Powering down - fast GPS
2023-09-08T12:47:35.682Z,1694177255.682 [CommandExec](IMPORTANT): got command restart application
2023-09-08T12:47:36.684Z,1694177256.684 [Supervisor](INFO): Stop Mission called by Supervisor::terminate
2023-09-08T12:47:36.684Z,1694177256.684 [CommandExec ThreadHandler](INFO): Uninitializing protected caller thread.
2023-09-08T12:47:36.685Z,1694177256.685 [CommandExec](INFO): Uninitializing the command executive.
2023-09-08T12:47:36.685Z,1694177256.685 [CommandExec](INFO): Uninitializing the command scheduler.
2023-09-08T12:47:36.685Z,1694177256.685 [CommandExec ThreadHandler](INFO): Thread cancelled.
2023-09-08T12:47:36.848Z,1694177256.848 [Supervisor](DEBUG): Uninitializing supervisor and starting cleanup.  Bye!
2023-09-08T12:47:36.848Z,1694177256.848 [ComponentRegistry](INFO): Shutting down NavChartDb ThreadHandler
2023-09-08T12:47:36.848Z,1694177256.848 [NavChartDb ThreadHandler](INFO): Thread cancelled.
2023-09-08T12:47:36.849Z,1694177256.849 [NavChartDb](INFO): Join timeout helper Thread ID is 1712
2023-09-08T12:47:36.868Z,1694177256.868 [NavChartDb ThreadHandler](INFO): Uninitializing protected caller thread.
2023-09-08T12:47:36.868Z,1694177256.868 [NavChartDb ThreadHandler](INFO): Thread cancelled.
2023-09-08T12:47:36.869Z,1694177256.869 [ComponentRegistry](INFO): Shutting down Radio_Surface ThreadHandler
2023-09-08T12:47:36.869Z,1694177256.869 [Radio_Surface ThreadHandler](INFO): Thread cancelled.
2023-09-08T12:47:36.870Z,1694177256.870 [Radio_Surface](INFO): Join timeout helper Thread ID is 1713
2023-09-08T12:47:37.176Z,1694177257.176 [Radio_Surface](INFO): Powering down
2023-09-08T12:47:37.177Z,1694177257.177 [Radio_Surface ThreadHandler](INFO): Uninitializing protected caller thread.
2023-09-08T12:47:37.177Z,1694177257.177 [Radio_Surface ThreadHandler](INFO): Thread cancelled.
2023-09-08T12:47:37.203Z,1694177257.203 [ComponentRegistry](INFO): Shutting down Onboard ThreadHandler
2023-09-08T12:47:37.203Z,1694177257.203 [Onboard ThreadHandler](INFO): Thread cancelled.
2023-09-08T12:47:37.203Z,1694177257.203 [Onboard](INFO): Join timeout helper Thread ID is 1714
2023-09-08T12:47:38.068Z,1694177258.068 [DataOverHttps](INFO): Radio surface powered OFF, will not connect.
2023-09-08T12:47:41.944Z,1694177261.944 [Onboard ThreadHandler](INFO): Uninitializing protected caller thread.
2023-09-08T12:47:41.944Z,1694177261.944 [Onboard ThreadHandler](INFO): Thread cancelled.
2023-09-08T12:47:41.968Z,1694177261.968 [ComponentRegistry](INFO): Shutting down DataOverHttps ThreadHandler
2023-09-08T12:47:41.968Z,1694177261.968 [DataOverHttps ThreadHandler](INFO): Thread cancelled.
2023-09-08T12:47:41.968Z,1694177261.968 [DataOverHttps](INFO): Join timeout helper Thread ID is 1715
2023-09-08T12:47:42.084Z,1694177262.084 [DataOverHttps ThreadHandler](INFO): Uninitializing protected caller thread.
2023-09-08T12:47:42.084Z,1694177262.084 [DataOverHttps ThreadHandler](INFO): Thread cancelled.
2023-09-08T12:47:42.096Z,1694177262.096 [ComponentRegistry](INFO): Shutting down BackseatComponent ThreadHandler
2023-09-08T12:47:42.096Z,1694177262.096 [BackseatComponent ThreadHandler](INFO): Thread cancelled.
2023-09-08T12:47:42.096Z,1694177262.096 [BackseatComponent](INFO): Join timeout helper Thread ID is 1716
2023-09-08T12:47:42.220Z,1694177262.220 [BackseatComponent ThreadHandler](INFO): Uninitializing protected caller thread.
2023-09-08T12:47:42.221Z,1694177262.221 [BackseatComponent ThreadHandler](INFO): Thread cancelled.
2023-09-08T12:47:42.241Z,1694177262.241 [ComponentRegistry](INFO): Shutting down WetLabsBB2FL ThreadHandler
2023-09-08T12:47:42.241Z,1694177262.241 [WetLabsBB2FL ThreadHandler](INFO): Thread cancelled.
2023-09-08T12:47:42.241Z,1694177262.241 [WetLabsBB2FL](INFO): Join timeout helper Thread ID is 1717
2023-09-08T12:47:42.340Z,1694177262.340 [WetLabsBB2FL ThreadHandler](INFO): Uninitializing protected caller thread.
2023-09-08T12:47:42.340Z,1694177262.340 [WetLabsBB2FL](INFO): Powering down
2023-09-08T12:47:42.341Z,1694177262.341 [WetLabsBB2FL ThreadHandler](INFO): Thread cancelled.
2023-09-08T12:47:42.360Z,1694177262.360 [ComponentRegistry](INFO): Shutting down CTD_Seabird ThreadHandler
2023-09-08T12:47:42.361Z,1694177262.361 [CTD_Seabird ThreadHandler](INFO): Thread cancelled.
2023-09-08T12:47:42.361Z,1694177262.361 [CTD_Seabird](INFO): Join timeout helper Thread ID is 1718
2023-09-08T12:47:43.176Z,1694177263.176 [CTD_Seabird](INFO): Powering down
2023-09-08T12:47:43.188Z,1694177263.188 [CTD_Seabird ThreadHandler](INFO): Uninitializing protected caller thread.
2023-09-08T12:47:43.188Z,1694177263.188 [CTD_Seabird](INFO): Powering down
2023-09-08T12:47:43.200Z,1694177263.200 [CTD_Seabird ThreadHandler](INFO): Thread cancelled.
2023-09-08T12:47:43.213Z,1694177263.213 [ComponentRegistry](INFO): Shutting down logger ThreadHandler
2023-09-08T12:47:43.213Z,1694177263.213 [logger ThreadHandler](INFO): Thread cancelled.
2023-09-08T12:47:43.213Z,1694177263.213 [logger](INFO): Join timeout helper Thread ID is 1719
2023-09-08T12:47:43.217Z,1694177263.217 [logger ThreadHandler](INFO): Uninitializing protected caller thread.
2023-09-08T12:47:43.218Z,1694177263.218 [logger ThreadHandler](INFO): Thread cancelled.
2023-09-08T12:47:43.219Z,1694177263.219 [ComponentRegistry](INFO): Shutting down CommandLine ThreadHandler
2023-09-08T12:47:43.219Z,1694177263.219 [CommandLine ThreadHandler](INFO): Thread cancelled.
2023-09-08T12:47:43.220Z,1694177263.220 [CommandLine ThreadHandler](INFO): Uninitializing protected caller thread.
2023-09-08T12:47:43.220Z,1694177263.220 [CommandLine ThreadHandler](INFO): Thread cancelled.
2023-09-08T12:47:43.221Z,1694177263.221 [CommandLine](INFO): Join timeout helper Thread ID is 1720
2023-09-08T12:47:43.222Z,1694177263.222 [ComponentRegistry](INFO): Shutting down CommandExec ThreadHandler
2023-09-08T12:47:43.222Z,1694177263.222 [CommandExec ThreadHandler](INFO): Thread cancelled.
2023-09-08T12:47:43.222Z,1694177263.222 [CommandExec](INFO): Join timeout helper Thread ID is 1721
2023-09-08T12:47:43.223Z,1694177263.223 [ComponentRegistry](INFO): Shutting down controlThread ThreadHandler
2023-09-08T12:47:43.223Z,1694177263.223 [controlThread ThreadHandler](INFO): Thread cancelled.
2023-09-08T12:47:43.224Z,1694177263.224 [controlThread](INFO): Join timeout helper Thread ID is 1722
2023-09-08T12:47:43.496Z,1694177263.496 [controlThread ThreadHandler](INFO): Uninitializing protected caller thread.
2023-09-08T12:47:43.496Z,1694177263.496 [controlThread](DEBUG): Uninitializing ControlThread
2023-09-08T12:47:43.498Z,1694177263.498 [AHRS_M2](INFO): Powering down
2023-09-08T12:47:43.664Z,1694177263.664 [DVL_micro](INFO): Powering down
2023-09-08T12:47:43.665Z,1694177263.665 [NAL9602](INFO): Powering down
2023-09-08T12:47:43.666Z,1694177263.666 [Sonardyne_Nano](INFO): Powering down
2023-09-08T12:47:43.784Z,1694177263.784 [DepthRateCalculator](DEBUG): Uninitializing DepthRateCalculator.
2023-09-08T12:47:43.785Z,1694177263.785 [ElevatorOffsetCalculator](DEBUG): Uninitializing ElevatorOffsetCalculator.
2023-09-08T12:47:43.786Z,1694177263.786 [NavChart](DEBUG): Uninitialize NavChart Navigation.
2023-09-08T12:47:43.786Z,1694177263.786 [MissionManager](INFO): Uninitializing Mission Default
2023-09-08T12:47:43.786Z,1694177263.786 [Default] Stopped
2023-09-08T12:47:43.787Z,1694177263.787 [Default](DEBUG): Aggregate::uninitialize Default
2023-09-08T12:47:43.787Z,1694177263.787 [Default:B.GoToSurface] Stopped
2023-09-08T12:47:43.787Z,1694177263.787 [Default:B.GoToSurface](DEBUG): Uninitialize GoToSurfaceComponent.
2023-09-08T12:47:43.787Z,1694177263.787 [Default:CheckIn] Stopped
2023-09-08T12:47:43.787Z,1694177263.787 [Default:CheckIn](DEBUG): Aggregate::uninitialize Default:CheckIn
2023-09-08T12:47:43.787Z,1694177263.787 [Default:CheckIn:C.Wait] Stopped
2023-09-08T12:47:43.787Z,1694177263.787 [Default:CheckIn:C.Wait](DEBUG): Uninitialize Wait Component.
2023-09-08T12:47:43.790Z,1694177263.790 [VerticalControl](DEBUG): Uninitialize VerticalControlComponent.
2023-09-08T12:47:43.790Z,1694177263.790 [HorizontalControl](DEBUG): Uninitialize HorizontalControlComponent.
2023-09-08T12:47:43.790Z,1694177263.790 [SpeedControl](DEBUG): Uninitialize SpeedControlComponent.
2023-09-08T12:47:43.791Z,1694177263.791 [LoopControl](DEBUG): Uninitialize LoopControlComponent.
2023-09-08T12:47:43.791Z,1694177263.791 [BuoyancyServo](DEBUG): Uninitialize Buoyancy Servo.
2023-09-08T12:47:43.791Z,1694177263.791 [BuoyancyServo](INFO): Powering down
2023-09-08T12:47:43.804Z,1694177263.804 [ElevatorServo](DEBUG): Uninitialize Elevator Servo.
2023-09-08T12:47:43.804Z,1694177263.804 [ElevatorServo](INFO): Powering down
2023-09-08T12:47:43.805Z,1694177263.805 [MassServo](DEBUG): Uninitialize Mass Servo.
2023-09-08T12:47:43.805Z,1694177263.805 [MassServo](INFO): Powering down
2023-09-08T12:47:43.806Z,1694177263.806 [RudderServo](DEBUG): Uninitialize Rudder Servo.
2023-09-08T12:47:43.806Z,1694177263.806 [RudderServo](INFO): Powering down
2023-09-08T12:47:43.807Z,1694177263.807 [ThrusterHE](DEBUG): Uninitialize Thruster Servo.
2023-09-08T12:47:43.807Z,1694177263.807 [ThrusterHE](INFO): Powering down
2023-09-08T12:47:43.808Z,1694177263.808 [SBIT](DEBUG): Uninitialize SBIT Component.
2023-09-08T12:47:43.808Z,1694177263.808 [IBIT](DEBUG): Uninitialize IBIT Component.
2023-09-08T12:47:43.809Z,1694177263.809 [CBIT](DEBUG): Uninitialize CBIT Component.
2023-09-08T12:47:43.809Z,1694177263.809 [CBIT](DEBUG): Powering off loads.
2023-09-08T12:47:43.820Z,1694177263.820 [CBIT](DEBUG): Disabling WDT.
2023-09-08T12:47:43.832Z,1694177263.832 [CBIT](DEBUG): Opening all GF detection circuits.
2023-09-08T12:47:43.833Z,1694177263.833 [controlThread ThreadHandler](INFO): Thread cancelled.
2023-09-08T12:47:43.874Z,1694177263.874 [WetLabsBB2FL ThreadHandler](INFO): Thread cancelled.
2023-09-08T12:47:43.881Z,1694177263.881 [CTD_Seabird ThreadHandler](INFO): Thread cancelled.
2023-09-08T12:47:43.911Z,1694177263.911 [Radio_Surface ThreadHandler](INFO): Thread cancelled.
2023-09-08T12:47:43.913Z,1694177263.913 [Onboard ThreadHandler](INFO): Thread cancelled.
2023-09-08T12:47:43.920Z,1694177263.920 [DataOverHttps ThreadHandler](INFO): Thread cancelled.
2023-09-08T12:47:43.964Z,1694177263.964 [BackseatComponent ThreadHandler](INFO): Thread cancelled.
2023-09-08T12:47:44.013Z,1694177264.013 [NavChartDb ThreadHandler](INFO): Thread cancelled.
2023-09-08T12:47:44.062Z,1694177264.062 [logger ThreadHandler](INFO): Thread cancelled.