2021-06-29T18:00:42.011Z,1624989642.011 [Supervisor](DEBUG): Initializing supervisor.
2021-06-29T18:00:42.015Z,1624989642.015 [SyncHandler](DEBUG): Created PCaller Thread at 404514E0
2021-06-29T18:00:42.015Z,1624989642.015 [SyncHandler](INFO): Protected caller Thread ID is 989
2021-06-29T18:00:42.020Z,1624989642.020 [ComponentRegistry](DEBUG): Component "controlThread" handled in its own thread.
2021-06-29T18:00:42.021Z,1624989642.021 [controlThread ThreadHandler](DEBUG): Created PCaller Thread at 404814E0
2021-06-29T18:00:42.021Z,1624989642.021 [controlThread ThreadHandler](INFO): Protected caller Thread ID is 990
2021-06-29T18:00:42.026Z,1624989642.026 [ComponentRegistry](DEBUG): SyncComponent "CycleStarter" handled in the control thread.
2021-06-29T18:00:42.057Z,1624989642.057 [ComponentRegistry](DEBUG): Component "CommandLine" handled in its own thread.
2021-06-29T18:00:42.058Z,1624989642.058 [CommandLine ThreadHandler](DEBUG): Created PCaller Thread at 404B14E0
2021-06-29T18:00:42.058Z,1624989642.058 [CommandLine ThreadHandler](INFO): Protected caller Thread ID is 991
2021-06-29T18:00:42.060Z,1624989642.060 [ComponentRegistry](DEBUG): Component "logger" handled in its own thread.
2021-06-29T18:00:42.061Z,1624989642.061 [logger ThreadHandler](DEBUG): Created PCaller Thread at 404E14E0
2021-06-29T18:00:42.061Z,1624989642.061 [logger ThreadHandler](INFO): Protected caller Thread ID is 992
2021-06-29T18:00:42.065Z,1624989642.065 [ComponentRegistry](DEBUG): SyncComponent "LogSplitter" handled in the control thread.
2021-06-29T18:00:42.066Z,1624989642.066 [Supervisor](INFO): Looking for Config files in directory: Config/
2021-06-29T18:00:42.067Z,1624989642.067 [Supervisor](INFO): Opening Config file at: Config/vehicle.cfg
2021-06-29T18:00:42.766Z,1624989642.766 [ComponentRegistry](DEBUG): Loaded Config Component "Config/vehicle
2021-06-29T18:00:42.767Z,1624989642.767 [Supervisor](INFO): Opening Config file at: Config/Derivation.cfg
2021-06-29T18:00:42.999Z,1624989642.999 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Derivation
2021-06-29T18:00:42.999Z,1624989642.999 [Supervisor](INFO): Opening Config file at: Config/Guidance.cfg
2021-06-29T18:00:43.127Z,1624989643.127 [Supervisor](INFO): Opening Config file at: Config/Dock.cfg
2021-06-29T18:00:43.491Z,1624989643.491 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Dock
2021-06-29T18:00:43.496Z,1624989643.496 [Supervisor](INFO): Opening Config file at: Config/Sample.cfg
2021-06-29T18:00:43.611Z,1624989643.611 [Supervisor](INFO): Opening Config file at: Config/secure.cfg
2021-06-29T18:00:43.755Z,1624989643.755 [ComponentRegistry](DEBUG): Loaded Config Component "Config/secure
2021-06-29T18:00:43.755Z,1624989643.755 [Supervisor](INFO): Opening Config file at: Config/Science.cfg
2021-06-29T18:00:44.326Z,1624989644.326 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Science
2021-06-29T18:00:44.327Z,1624989644.327 [Supervisor](INFO): Opening Config file at: Config/workSite.cfg
2021-06-29T18:00:44.523Z,1624989644.523 [ComponentRegistry](DEBUG): Loaded Config Component "Config/workSite
2021-06-29T18:00:44.528Z,1624989644.528 [Supervisor](INFO): Opening Config file at: Config/Simulator.cfg
2021-06-29T18:00:45.416Z,1624989645.416 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Simulator
2021-06-29T18:00:45.416Z,1624989645.416 [Supervisor](INFO): Opening Config file at: Config/logger.cfg
2021-06-29T18:00:45.759Z,1624989645.759 [ComponentRegistry](DEBUG): Loaded Config Component "Config/logger
2021-06-29T18:00:45.759Z,1624989645.759 [Supervisor](INFO): Opening Config file at: Config/Servo.cfg
2021-06-29T18:00:46.858Z,1624989646.858 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Servo
2021-06-29T18:00:46.859Z,1624989646.859 [Supervisor](INFO): Opening Config file at: Config/Navigation.cfg
2021-06-29T18:00:47.254Z,1624989647.254 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Navigation
2021-06-29T18:00:47.255Z,1624989647.255 [Supervisor](INFO): Opening Config file at: Config/Estimation.cfg
2021-06-29T18:00:47.422Z,1624989647.422 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Estimation
2021-06-29T18:00:47.423Z,1624989647.423 [Supervisor](INFO): Opening Config file at: Config/Sensor.cfg
2021-06-29T18:00:48.534Z,1624989648.534 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Sensor
2021-06-29T18:00:48.535Z,1624989648.535 [Supervisor](INFO): Opening Config file at: Config/Control.cfg
2021-06-29T18:00:49.108Z,1624989649.108 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Control
2021-06-29T18:00:49.109Z,1624989649.109 [Supervisor](INFO): Opening Config file at: Config/BIT.cfg
2021-06-29T18:00:49.458Z,1624989649.458 [ComponentRegistry](DEBUG): Loaded Config Component "Config/BIT
2021-06-29T18:00:49.460Z,1624989649.460 [Supervisor](INFO): Looking for Config files in directory: Config/lrauv-triton/
2021-06-29T18:00:49.461Z,1624989649.461 [Supervisor](INFO): Opening Config file at: Config/lrauv-triton/vehicle.cfg
2021-06-29T18:00:49.783Z,1624989649.783 [Supervisor](INFO): Opening Config file at: Config/lrauv-triton/secure.cfg
2021-06-29T18:00:49.907Z,1624989649.907 [Supervisor](INFO): Opening Config file at: Config/lrauv-triton/Science.cfg
2021-06-29T18:00:50.131Z,1624989650.131 [Supervisor](INFO): Opening Config file at: Config/lrauv-triton/Simulator.cfg
2021-06-29T18:00:50.255Z,1624989650.255 [Supervisor](INFO): Opening Config file at: Config/lrauv-triton/Battery.cfg
2021-06-29T18:00:50.674Z,1624989650.674 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Battery
2021-06-29T18:00:50.675Z,1624989650.675 [Supervisor](INFO): Opening Config file at: Config/lrauv-triton/logger.cfg
2021-06-29T18:00:50.908Z,1624989650.908 [Supervisor](INFO): Opening Config file at: Config/lrauv-triton/Servo.cfg
2021-06-29T18:00:51.723Z,1624989651.723 [Supervisor](INFO): Opening Config file at: Config/lrauv-triton/Navigation.cfg
2021-06-29T18:00:51.863Z,1624989651.863 [Supervisor](INFO): Opening Config file at: Config/lrauv-triton/Sensor.cfg
2021-06-29T18:00:52.095Z,1624989652.095 [Supervisor](INFO): Opening Config file at: Config/lrauv-triton/Control.cfg
2021-06-29T18:00:52.247Z,1624989652.247 [Supervisor](INFO): Opening Config file at: Config/lrauv-triton/BIT.cfg
2021-06-29T18:00:52.395Z,1624989652.395 [Supervisor](IMPORTANT): Reading configuration overrides from Data/persisted.cfg
2021-06-29T18:00:52.417Z,1624989652.417 [Module Loader](DEBUG): Loading Module at Modules/Sample.so
2021-06-29T18:00:52.434Z,1624989652.434 [Module Loader](DEBUG): Loaded Module: Sample (This is a Sample Module of Sample Components)
2021-06-29T18:00:52.434Z,1624989652.434 [Module Loader](DEBUG): Loading Module at Modules/Dock.so
2021-06-29T18:00:52.603Z,1624989652.603 [Module Loader](DEBUG): Loaded Module: Dock (Contains behaviors and commands for docking)
2021-06-29T18:00:52.603Z,1624989652.603 [Module Loader](DEBUG): Loading Module at Modules/Control.so
2021-06-29T18:00:52.694Z,1624989652.694 [VerticalControl](DEBUG): Construct VerticalControl.
2021-06-29T18:00:52.800Z,1624989652.800 [VerticalControl] Loaded
2021-06-29T18:00:52.800Z,1624989652.800 [ComponentRegistry](DEBUG): SyncComponent "VerticalControl" handled in the control thread.
2021-06-29T18:00:52.803Z,1624989652.803 [HorizontalControl](DEBUG): Construct HorizontalControl.
2021-06-29T18:00:52.860Z,1624989652.860 [HorizontalControl] Loaded
2021-06-29T18:00:52.860Z,1624989652.860 [ComponentRegistry](DEBUG): SyncComponent "HorizontalControl" handled in the control thread.
2021-06-29T18:00:52.863Z,1624989652.863 [SpeedControl](DEBUG): Construct SpeedControl.
2021-06-29T18:00:52.875Z,1624989652.875 [SpeedControl] Loaded
2021-06-29T18:00:52.875Z,1624989652.875 [ComponentRegistry](DEBUG): SyncComponent "SpeedControl" handled in the control thread.
2021-06-29T18:00:52.878Z,1624989652.878 [LoopControl](DEBUG): Construct LoopControl.
2021-06-29T18:00:52.878Z,1624989652.878 [LoopControl] Loaded
2021-06-29T18:00:52.878Z,1624989652.878 [ComponentRegistry](DEBUG): SyncComponent "LoopControl" handled in the control thread.
2021-06-29T18:00:52.879Z,1624989652.879 [Module Loader](DEBUG): Loaded Module: Control (Contains the Control components, such as Depth, Heading, and Speed Control)
2021-06-29T18:00:52.879Z,1624989652.879 [Module Loader](DEBUG): Loading Module at Modules/Servo.so
2021-06-29T18:00:53.108Z,1624989653.108 [BuoyancyServo] Loaded
2021-06-29T18:00:53.108Z,1624989653.108 [ComponentRegistry](DEBUG): SyncComponent "BuoyancyServo" handled in the control thread.
2021-06-29T18:00:53.137Z,1624989653.137 [ElevatorServo] Loaded
2021-06-29T18:00:53.137Z,1624989653.137 [ComponentRegistry](DEBUG): SyncComponent "ElevatorServo" handled in the control thread.
2021-06-29T18:00:53.165Z,1624989653.165 [MassServo] Loaded
2021-06-29T18:00:53.165Z,1624989653.165 [ComponentRegistry](DEBUG): SyncComponent "MassServo" handled in the control thread.
2021-06-29T18:00:53.192Z,1624989653.192 [RudderServo] Loaded
2021-06-29T18:00:53.193Z,1624989653.193 [ComponentRegistry](DEBUG): SyncComponent "RudderServo" handled in the control thread.
2021-06-29T18:00:53.193Z,1624989653.193 [Module Loader](DEBUG): Loaded Module: Servo (This is the module containing motor controllers)
2021-06-29T18:00:53.194Z,1624989653.194 [Module Loader](DEBUG): Loading Module at Modules/Derivation.so
2021-06-29T18:00:53.266Z,1624989653.266 [DepthRateCalculator] Loaded
2021-06-29T18:00:53.267Z,1624989653.267 [ComponentRegistry](DEBUG): SyncComponent "DepthRateCalculator" handled in the control thread.
2021-06-29T18:00:53.271Z,1624989653.271 [PitchRateCalculator] Loaded
2021-06-29T18:00:53.280Z,1624989653.280 [ComponentRegistry](DEBUG): SyncComponent "PitchRateCalculator" handled in the control thread.
2021-06-29T18:00:53.291Z,1624989653.291 [SpeedCalculator] Loaded
2021-06-29T18:00:53.291Z,1624989653.291 [ComponentRegistry](DEBUG): SyncComponent "SpeedCalculator" handled in the control thread.
2021-06-29T18:00:53.313Z,1624989653.313 [TempGradientCalculator] Loaded
2021-06-29T18:00:53.314Z,1624989653.314 [ComponentRegistry](DEBUG): SyncComponent "TempGradientCalculator" handled in the control thread.
2021-06-29T18:00:53.318Z,1624989653.318 [YawRateCalculator] Loaded
2021-06-29T18:00:53.319Z,1624989653.319 [ComponentRegistry](DEBUG): SyncComponent "YawRateCalculator" handled in the control thread.
2021-06-29T18:00:53.353Z,1624989653.353 [ElevatorOffsetCalculator] Loaded
2021-06-29T18:00:53.354Z,1624989653.354 [ComponentRegistry](DEBUG): SyncComponent "ElevatorOffsetCalculator" handled in the control thread.
2021-06-29T18:00:53.354Z,1624989653.354 [Module Loader](DEBUG): Loaded Module: Derivation (Contains the base derivation components)
2021-06-29T18:00:53.355Z,1624989653.355 [Module Loader](DEBUG): Loading Module at Modules/Navigation.so
2021-06-29T18:00:53.482Z,1624989653.482 [DeadReckonUsingMultipleVelocitySources] Loaded
2021-06-29T18:00:53.483Z,1624989653.483 [ComponentRegistry](DEBUG): SyncComponent "DeadReckonUsingMultipleVelocitySources" handled in the control thread.
2021-06-29T18:00:53.505Z,1624989653.505 [NavChart] Loaded
2021-06-29T18:00:53.505Z,1624989653.505 [ComponentRegistry](DEBUG): SyncComponent "NavChart" handled in the control thread.
2021-06-29T18:00:53.511Z,1624989653.511 [UniversalFixResidualReporter] Loaded
2021-06-29T18:00:53.520Z,1624989653.520 [ComponentRegistry](DEBUG): SyncComponent "UniversalFixResidualReporter" handled in the control thread.
2021-06-29T18:00:53.521Z,1624989653.521 [Module Loader](DEBUG): Loaded Module: Navigation (Contains the base navigation components)
2021-06-29T18:00:53.521Z,1624989653.521 [Module Loader](DEBUG): Loading Module at Modules/Sensor.so
2021-06-29T18:00:54.131Z,1624989654.131 [AHRS_M2] Loaded
2021-06-29T18:00:54.140Z,1624989654.140 [ComponentRegistry](DEBUG): SyncComponent "AHRS_M2" handled in the control thread.
2021-06-29T18:00:54.179Z,1624989654.179 [BackseatComponent] Loaded
2021-06-29T18:00:54.179Z,1624989654.179 [ComponentRegistry](DEBUG): Component "BackseatComponent" handled in its own thread.
2021-06-29T18:00:54.188Z,1624989654.188 [BackseatComponent ThreadHandler](DEBUG): Created PCaller Thread at 408684E0
2021-06-29T18:00:54.189Z,1624989654.189 [BackseatComponent ThreadHandler](INFO): Protected caller Thread ID is 1074
2021-06-29T18:00:54.192Z,1624989654.192 [LcmUniversalReporter] Loaded
2021-06-29T18:00:54.192Z,1624989654.192 [ComponentRegistry](DEBUG): SyncComponent "LcmUniversalReporter" handled in the control thread.
2021-06-29T18:00:55.487Z,1624989655.487 [BPC1] Loaded
2021-06-29T18:00:55.487Z,1624989655.487 [ComponentRegistry](DEBUG): SyncComponent "BPC1" handled in the control thread.
2021-06-29T18:00:55.603Z,1624989655.603 [DataOverHttps] Loaded
2021-06-29T18:00:55.603Z,1624989655.603 [ComponentRegistry](DEBUG): Component "DataOverHttps" handled in its own thread.
2021-06-29T18:00:55.608Z,1624989655.608 [DataOverHttps ThreadHandler](DEBUG): Created PCaller Thread at 408984E0
2021-06-29T18:00:55.608Z,1624989655.608 [DataOverHttps ThreadHandler](INFO): Protected caller Thread ID is 1075
2021-06-29T18:00:55.639Z,1624989655.639 [Depth_Keller] Loaded
2021-06-29T18:00:55.639Z,1624989655.639 [ComponentRegistry](DEBUG): SyncComponent "Depth_Keller" handled in the control thread.
2021-06-29T18:00:55.738Z,1624989655.738 [NAL9602] Loaded
2021-06-29T18:00:55.739Z,1624989655.739 [ComponentRegistry](DEBUG): SyncComponent "NAL9602" handled in the control thread.
2021-06-29T18:00:55.786Z,1624989655.786 [Onboard] Loaded
2021-06-29T18:00:55.787Z,1624989655.787 [ComponentRegistry](DEBUG): Component "Onboard" handled in its own thread.
2021-06-29T18:00:55.788Z,1624989655.788 [Onboard ThreadHandler](DEBUG): Created PCaller Thread at 408C84E0
2021-06-29T18:00:55.788Z,1624989655.788 [Onboard ThreadHandler](INFO): Protected caller Thread ID is 1076
2021-06-29T18:00:55.802Z,1624989655.802 [Power24vConverter] Loaded
2021-06-29T18:00:55.802Z,1624989655.802 [ComponentRegistry](DEBUG): SyncComponent "Power24vConverter" handled in the control thread.
2021-06-29T18:00:55.824Z,1624989655.824 [Radio_Surface] Loaded
2021-06-29T18:00:55.824Z,1624989655.824 [ComponentRegistry](DEBUG): Component "Radio_Surface" handled in its own thread.
2021-06-29T18:00:55.832Z,1624989655.832 [Radio_Surface ThreadHandler](DEBUG): Created PCaller Thread at 408F84E0
2021-06-29T18:00:55.832Z,1624989655.832 [Radio_Surface ThreadHandler](INFO): Protected caller Thread ID is 1077
2021-06-29T18:00:55.833Z,1624989655.833 [Module Loader](DEBUG): Loaded Module: Sensor (Contains the sensor components)
2021-06-29T18:00:55.834Z,1624989655.834 [Module Loader](DEBUG): Loading Module at Modules/Estimation.so
2021-06-29T18:00:56.135Z,1624989656.135 [Module Loader](DEBUG): Loaded Module: Estimation (Contains the base estimation components)
2021-06-29T18:00:56.135Z,1624989656.135 [Module Loader](DEBUG): Loading Module at Modules/Simulator.so
2021-06-29T18:00:56.516Z,1624989656.516 [Module Loader](DEBUG): Loaded Module: Simulator (This is the module containing the Simulator)
2021-06-29T18:00:56.517Z,1624989656.517 [Module Loader](DEBUG): Loading Module at Modules/Trigger.so
2021-06-29T18:00:56.612Z,1624989656.612 [Module Loader](DEBUG): Loaded Module: Trigger (Contains triggers for use in missions)
2021-06-29T18:00:56.613Z,1624989656.613 [Module Loader](DEBUG): Loading Module at Modules/Science.so
2021-06-29T18:00:57.165Z,1624989657.165 [CTD_Seabird] Loaded
2021-06-29T18:00:57.165Z,1624989657.165 [ComponentRegistry](DEBUG): Component "CTD_Seabird" handled in its own thread.
2021-06-29T18:00:57.167Z,1624989657.167 [CTD_Seabird ThreadHandler](DEBUG): Created PCaller Thread at 40A174E0
2021-06-29T18:00:57.167Z,1624989657.167 [CTD_Seabird ThreadHandler](INFO): Protected caller Thread ID is 1078
2021-06-29T18:00:57.188Z,1624989657.188 [PAR_Licor] Loaded
2021-06-29T18:00:57.188Z,1624989657.188 [ComponentRegistry](DEBUG): SyncComponent "PAR_Licor" handled in the control thread.
2021-06-29T18:00:57.222Z,1624989657.222 [WetLabsBB2FL] Loaded
2021-06-29T18:00:57.223Z,1624989657.223 [ComponentRegistry](DEBUG): Component "WetLabsBB2FL" handled in its own thread.
2021-06-29T18:00:57.224Z,1624989657.224 [WetLabsBB2FL ThreadHandler](DEBUG): Created PCaller Thread at 40A474E0
2021-06-29T18:00:57.224Z,1624989657.224 [WetLabsBB2FL ThreadHandler](INFO): Protected caller Thread ID is 1079
2021-06-29T18:00:57.225Z,1624989657.225 [Module Loader](DEBUG): Loaded Module: Science (Contains the science components)
2021-06-29T18:00:57.226Z,1624989657.226 [Module Loader](DEBUG): Loading Module at Modules/Guidance.so
2021-06-29T18:00:57.602Z,1624989657.602 [Module Loader](DEBUG): Loaded Module: Guidance (Contains behaviors and commands)
2021-06-29T18:00:57.602Z,1624989657.602 [Module Loader](DEBUG): Loading Module at Modules/BIT.so
2021-06-29T18:00:57.774Z,1624989657.774 [SBIT](DEBUG): Construct Startup Built In Test.
2021-06-29T18:00:57.784Z,1624989657.784 [SBIT] Loaded
2021-06-29T18:00:57.784Z,1624989657.784 [ComponentRegistry](DEBUG): SyncComponent "SBIT" handled in the control thread.
2021-06-29T18:00:57.787Z,1624989657.787 [IBIT](DEBUG): Construct Initiated Built In Test.
2021-06-29T18:00:57.801Z,1624989657.801 [IBIT] Loaded
2021-06-29T18:00:57.801Z,1624989657.801 [ComponentRegistry](DEBUG): SyncComponent "IBIT" handled in the control thread.
2021-06-29T18:00:57.807Z,1624989657.807 [CBIT](DEBUG): Construct Continuous Built In Test.
2021-06-29T18:00:57.912Z,1624989657.912 [CBIT] Loaded
2021-06-29T18:00:57.913Z,1624989657.913 [ComponentRegistry](DEBUG): SyncComponent "CBIT" handled in the control thread.
2021-06-29T18:00:57.913Z,1624989657.913 [Module Loader](DEBUG): Loaded Module: BIT (Contains the BuiltInTest components, such as C Built In Test)
2021-06-29T18:00:57.919Z,1624989657.919 [ComponentRegistry](DEBUG): SyncComponent "MissionManager" handled in the control thread.
2021-06-29T18:00:57.922Z,1624989657.922 [ComponentRegistry](DEBUG): SyncComponent "Reporter" handled in the control thread.
2021-06-29T18:00:57.933Z,1624989657.933 [ComponentRegistry](DEBUG): Component "NavChartDb" handled in its own thread.
2021-06-29T18:00:57.934Z,1624989657.934 [NavChartDb ThreadHandler](DEBUG): Created PCaller Thread at 40B2D4E0
2021-06-29T18:00:57.934Z,1624989657.934 [NavChartDb ThreadHandler](INFO): Protected caller Thread ID is 1080
2021-06-29T18:00:57.939Z,1624989657.939 [Supervisor](INFO): Main Thread ID is 830
2021-06-29T18:00:57.939Z,1624989657.939 [Supervisor](DEBUG): Running supervisor.
2021-06-29T18:00:57.940Z,1624989657.940 [CommandLine ThreadHandler](INFO): Handler Thread ID is 1081
2021-06-29T18:00:57.942Z,1624989657.942 [controlThread ThreadHandler](INFO): Handler Thread ID is 1082
2021-06-29T18:00:57.943Z,1624989657.943 [controlThread](DEBUG): Initializing ControlThread
2021-06-29T18:00:57.944Z,1624989657.944 [VerticalControl](DEBUG): Initialize VerticalControlComponent.
2021-06-29T18:00:57.945Z,1624989657.945 [HorizontalControl](DEBUG): Initialize HorizontalControlComponent.
2021-06-29T18:00:57.946Z,1624989657.946 [SpeedControl](DEBUG): Initialize SpeedControlComponent.
2021-06-29T18:00:57.947Z,1624989657.947 [LoopControl](DEBUG): Initialize LoopControlComponent.
2021-06-29T18:00:57.948Z,1624989657.948 [DepthRateCalculator](DEBUG): Initializing DepthRateCalculator.
2021-06-29T18:00:57.948Z,1624989657.948 [PitchRateCalculator](DEBUG): Initializing PitchRateCalculator.
2021-06-29T18:00:57.949Z,1624989657.949 [SpeedCalculator](DEBUG): Initializing SpeedCalculator.
2021-06-29T18:00:57.949Z,1624989657.949 [TempGradientCalculator](DEBUG): Initializing TempGradientCalculator.
2021-06-29T18:00:57.950Z,1624989657.950 [YawRateCalculator](DEBUG): Initializing YawRateCalculator.
2021-06-29T18:00:57.950Z,1624989657.950 [ElevatorOffsetCalculator](DEBUG): Initializing ElevatorOffsetCalculator.
2021-06-29T18:00:57.952Z,1624989657.952 [NavChart](DEBUG): Initialize NavChart Navigation.
2021-06-29T18:00:57.952Z,1624989657.952 [UniversalFixResidualReporter](DEBUG): Initializing UniversalFixResidualReporter component.
2021-06-29T18:00:57.960Z,1624989657.960 [SBIT](INFO): Initialize SBIT Component.
2021-06-29T18:00:57.961Z,1624989657.961 [SBIT](IMPORTANT): git: 2021-06-25
2021-06-29T18:00:57.961Z,1624989657.961 [SBIT](INFO): git hash: ce6655dd71cbacf6863957f250954322ec92cc29
2021-06-29T18:00:57.961Z,1624989657.961 [SBIT](IMPORTANT): Kernel Release: 2.6.27.8
2021-06-29T18:00:57.962Z,1624989657.962 [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
2021-06-29T18:00:57.964Z,1624989657.964 [SBIT](INFO): Beginning SBIT in 66.000000 seconds.
2021-06-29T18:00:57.964Z,1624989657.964 [IBIT](INFO): Initialize IBIT Component.
2021-06-29T18:00:57.965Z,1624989657.965 [CBIT](DEBUG): Initialize CBIT Component.
2021-06-29T18:00:57.966Z,1624989657.966 [logger ThreadHandler](INFO): Handler Thread ID is 1083
2021-06-29T18:00:57.980Z,1624989657.980 [CBIT](DEBUG): Initialized mux pins.
2021-06-29T18:00:57.980Z,1624989657.980 [CBIT](DEBUG): Initializing the watchdog timer.
2021-06-29T18:00:57.984Z,1624989657.984 [BackseatComponent ThreadHandler](INFO): Handler Thread ID is 1084
2021-06-29T18:00:57.992Z,1624989657.992 [DataOverHttps ThreadHandler](INFO): Handler Thread ID is 1085
2021-06-29T18:00:57.993Z,1624989657.993 [DataOverHttps](DEBUG): dashIP=134.89.2.23 starts with a digit so assuming it is a numeric IP
2021-06-29T18:00:58.000Z,1624989658.000 [Onboard ThreadHandler](INFO): Handler Thread ID is 1086
2021-06-29T18:00:58.004Z,1624989658.004 [CBIT](INFO): Last reboot was NOT due to watchdog timer.
2021-06-29T18:00:58.005Z,1624989658.005 [CBIT](DEBUG): Initializing heartbeat.
2021-06-29T18:00:58.021Z,1624989658.021 [Radio_Surface ThreadHandler](INFO): Handler Thread ID is 1087
2021-06-29T18:00:58.036Z,1624989658.036 [CTD_Seabird ThreadHandler](INFO): Handler Thread ID is 1088
2021-06-29T18:00:58.037Z,1624989658.037 [CTD_Seabird](DEBUG): Initializing CTD_Seabird.
2021-06-29T18:00:58.042Z,1624989658.042 [WetLabsBB2FL ThreadHandler](INFO): Handler Thread ID is 1090
2021-06-29T18:00:58.044Z,1624989658.044 [WetLabsBB2FL](INFO): Powering up
2021-06-29T18:00:58.045Z,1624989658.045 [NavChartDb ThreadHandler](INFO): Handler Thread ID is 1092
2021-06-29T18:00:58.049Z,1624989658.049 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US1WC07M.000
2021-06-29T18:00:58.049Z,1624989658.049 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US1WC07M.000
2021-06-29T18:00:58.049Z,1624989658.049 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US2WC11M.000
2021-06-29T18:00:58.049Z,1624989658.049 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US2WC11M.000
2021-06-29T18:00:58.049Z,1624989658.049 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US3CA52M.000
2021-06-29T18:00:58.050Z,1624989658.050 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US3CA52M.000
2021-06-29T18:00:58.050Z,1624989658.050 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US4CA60M.000
2021-06-29T18:00:58.050Z,1624989658.050 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US4CA60M.000
2021-06-29T18:00:58.050Z,1624989658.050 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US5CA50M.000
2021-06-29T18:00:58.050Z,1624989658.050 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US5CA50M.000
2021-06-29T18:00:58.051Z,1624989658.051 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US5CA61M.000
2021-06-29T18:00:58.051Z,1624989658.051 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US5CA61M.000
2021-06-29T18:00:58.051Z,1624989658.051 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US5CA62M.000
2021-06-29T18:00:58.051Z,1624989658.051 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US5CA62M.000
2021-06-29T18:00:58.051Z,1624989658.051 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US5CA83M.000
2021-06-29T18:00:58.051Z,1624989658.051 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US5CA83M.000
2021-06-29T18:00:58.076Z,1624989658.076 [CBIT](DEBUG): Deactivating GF circuits.
2021-06-29T18:00:58.076Z,1624989658.076 [CBIT](DEBUG): Deactivating emergency mode.
2021-06-29T18:00:58.112Z,1624989658.112 [CBIT](DEBUG): Backplane powered.
2021-06-29T18:00:58.113Z,1624989658.113 [MissionManager](INFO): Loading Mission: Missions/Startup.xml
2021-06-29T18:00:58.126Z,1624989658.126 [Startup:A.GoToSurface](DEBUG): Construct GoToSurface.
2021-06-29T18:00:58.158Z,1624989658.158 [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>


2021-06-29T18:00:58.159Z,1624989658.159 [MissionManager](INFO): Loading Mission: Missions/Default.xml
2021-06-29T18:00:58.229Z,1624989658.229 [MissionManager](INFO): DefineArg Default.ElapsedSinceDefaultStarted = 0.000000 min
2021-06-29T18:00:58.231Z,1624989658.231 [Default:A.Wait](DEBUG): Construct Wait.
2021-06-29T18:00:58.249Z,1624989658.249 [Default:B.GoToSurface](DEBUG): Construct GoToSurface.
2021-06-29T18:00:58.285Z,1624989658.285 [Default:CheckIn:Read_Iridium:A_Timeout:A.Execute](DEBUG): Construct Execute.
2021-06-29T18:00:58.287Z,1624989658.287 [Default:CheckIn:C.Wait](DEBUG): Construct Wait.
2021-06-29T18:00:58.309Z,1624989658.309 [Default:E.Execute](DEBUG): Construct Execute.
2021-06-29T18:00:58.313Z,1624989658.313 [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="P2H">
                <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>


2021-06-29T18:00:58.324Z,1624989658.324 [controlThread](DEBUG): Component order: CycleStarter,AHRS_M2,BPC1,Depth_Keller,NAL9602,Power24vConverter,PAR_Licor,Depth_Keller,PAR_Licor,DepthRateCalculator,PitchRateCalculator,SpeedCalculator,TempGradientCalculator,YawRateCalculator,ElevatorOffsetCalculator,DeadReckonUsingMultipleVelocitySources,NavChart,UniversalFixResidualReporter,MissionManager,VerticalControl,HorizontalControl,SpeedControl,LoopControl,BuoyancyServo,ElevatorServo,MassServo,RudderServo,SBIT,IBIT,CBIT,LcmUniversalReporter,Reporter,LogSplitter,
2021-06-29T18:00:58.336Z,1624989658.336 [AHRS_M2](DEBUG): Initializing AHRS_M2.
2021-06-29T18:00:58.406Z,1624989658.406 [Power24vConverter](INFO): Powering up.
2021-06-29T18:00:58.424Z,1624989658.424 [Radio_Surface](INFO): Powering up
2021-06-29T18:00:58.443Z,1624989658.443 [BuoyancyServo](DEBUG): Initializing EZServoServo.
2021-06-29T18:00:58.452Z,1624989658.452 [BuoyancyServo](DEBUG): Initializing BuoyancyServo.
2021-06-29T18:00:58.453Z,1624989658.453 [ElevatorServo](DEBUG): Initializing EZServoServo.
2021-06-29T18:00:58.460Z,1624989658.460 [ElevatorServo](DEBUG): Initializing ElevatorServo.
2021-06-29T18:00:58.461Z,1624989658.461 [MassServo](DEBUG): Initializing EZServoServo.
2021-06-29T18:00:58.468Z,1624989658.468 [MassServo](DEBUG): Initializing MassServo.
2021-06-29T18:00:58.469Z,1624989658.469 [RudderServo](DEBUG): Initializing EZServoServo.
2021-06-29T18:00:58.476Z,1624989658.476 [RudderServo](DEBUG): Initializing RudderServo.
2021-06-29T18:01:00.152Z,1624989660.152 [WetLabsBB2FL](INFO): Powering down
2021-06-29T18:01:25.809Z,1624989685.809 [NAL9602](INFO): Powering up NAL9602
2021-06-29T18:01:36.721Z,1624989696.721 [NAL9602](INFO): NAL9602 initialized
2021-06-29T18:02:04.653Z,1624989724.653 [SBIT](IMPORTANT): Beginning Startup BIT
2021-06-29T18:02:04.657Z,1624989724.657 [CBIT](IMPORTANT): Beginning ground fault scan
2021-06-29T18:02:15.528Z,1624989735.528 [CBIT](IMPORTANT): No ground fault detected
mA:
CHAN A0 (Batt): 0.025698
CHAN A1 (24V): 0.000523
CHAN A2 (12V): 0.018005
CHAN A3 (5V): 0.006580
CHAN B0 (3.3V): 0.005538
CHAN B1 (3.15aV): 0.004930
CHAN B2 (3.15bV): 0.005125
CHAN B3 (GND): 0.000968
OPEN: 0.005854
Full Scale Calc: 4.765 mA, -1.589 mA
2021-06-29T18:02:58.756Z,1624989778.756 [SBIT](IMPORTANT): SBIT PASSED
2021-06-29T18:02:58.756Z,1624989778.756 [SBIT](IMPORTANT): Listing configuration overrides from Data/persisted.cfg
2021-06-29T18:02:58.757Z,1624989778.757 [SBIT](IMPORTANT): BPC1.batteryMissingStickThreshold=8 count;

2021-06-29T18:02:58.757Z,1624989778.757 [SBIT](IMPORTANT): BPC1.batterySamplingInterval=1 minute;

2021-06-29T18:02:58.757Z,1624989778.757 [SBIT](IMPORTANT): BPC1.batteryStickCommsTimeout=10 second;

2021-06-29T18:02:58.757Z,1624989778.757 [SBIT](IMPORTANT): BackseatComponent.loadAtStartup=1 bool;

2021-06-29T18:02:58.757Z,1624989778.757 [SBIT](IMPORTANT): CBIT.abortDepth=115 meter;

2021-06-29T18:02:58.758Z,1624989778.758 [SBIT](IMPORTANT): CBIT.gf24Offset=-27 microampere;

2021-06-29T18:02:58.758Z,1624989778.758 [SBIT](IMPORTANT): CBIT.stopDepth=110 meter;

2021-06-29T18:02:58.758Z,1624989778.758 [SBIT](IMPORTANT): DAT.loadAtStartup=0 bool;

2021-06-29T18:02:58.758Z,1624989778.758 [SBIT](IMPORTANT): DropWeight.loadAtStartup=0 bool;

2021-06-29T18:02:58.758Z,1624989778.758 [SBIT](IMPORTANT): Express none WetLabsBB2FL.bin_mean_mass_concentration_of_chlorophyll_in_sea_water;

2021-06-29T18:02:58.758Z,1624989778.758 [SBIT](IMPORTANT): Express linearApproximation platform_roll_angle 2.000000 degree;

2021-06-29T18:02:58.758Z,1624989778.758 [SBIT](IMPORTANT): ThrusterServo.loadAtStartup=0 bool;

2021-06-29T18:02:58.759Z,1624989778.759 [SBIT](IMPORTANT): VerticalControl.buoyancyNeutral=184.552860 cubic_centimeter;

2021-06-29T18:02:58.759Z,1624989778.759 [SBIT](IMPORTANT): VerticalControl.massDefault=11.629403 millimeter;

2021-06-29T18:02:59.151Z,1624989779.151 [MissionManager](IMPORTANT): Started mission Startup
2021-06-29T18:02:59.151Z,1624989779.151 [Startup] Running Loop=1
2021-06-29T18:02:59.151Z,1624989779.151 [Startup](DEBUG): Aggregate::initialize Startup
2021-06-29T18:02:59.151Z,1624989779.151 [Startup:A.GoToSurface] Running Loop=1
2021-06-29T18:02:59.152Z,1624989779.152 [Startup:A.GoToSurface](DEBUG): Initialize GoToSurfaceComponent.
2021-06-29T18:02:59.152Z,1624989779.152 [Startup:A.GoToSurface](DEBUG): No depth rate setting specified. Using default value of nan m/s.
2021-06-29T18:02:59.153Z,1624989779.153 [Startup:A.GoToSurface](DEBUG): No pitch setting specified. Using default value of nan degrees.
2021-06-29T18:02:59.153Z,1624989779.153 [Startup:A.GoToSurface](DEBUG): No speed setting specified. Using default value of 1.000000 m/s.
2021-06-29T18:02:59.153Z,1624989779.153 [Startup:A.GoToSurface](DEBUG): No surface timeout specified. Using default value of 1000.000000 seconds.
2021-06-29T18:02:59.154Z,1624989779.154 [Startup:A.GoToSurface](INFO): Received pitch timeout configuration 60.000000 seconds.
2021-06-29T18:02:59.155Z,1624989779.155 [Startup:StartupSatComms] Running Loop=1
2021-06-29T18:02:59.156Z,1624989779.156 [Startup:StartupSatComms](DEBUG): Aggregate::initialize Startup:StartupSatComms
2021-06-29T18:02:59.156Z,1624989779.156 [Startup:StartupSatComms:A] Running Loop=1
2021-06-29T18:02:59.551Z,1624989779.551 [Startup:StartupSatComms:A](DEBUG): Initialize ReadDataComponent to sense latitude_fix
2021-06-29T18:03:52.067Z,1624989832.067 [NAL9602](INFO): SBD MO Status=0, MOMSN=4875, MT Status=0, MTMSN=0
2021-06-29T18:03:52.067Z,1624989832.067 [NAL9602](INFO): No messages in MT queue
2021-06-29T18:03:58.139Z,1624989838.139 [DeadReckonUsingMultipleVelocitySources] Software Fault, FailCount= 1
2021-06-29T18:03:58.139Z,1624989838.139 [DeadReckonUsingMultipleVelocitySources](ERROR): Software Fault
2021-06-29T18:03:58.193Z,1624989838.193 [CBIT](ERROR): Software Fault in component: DeadReckonUsingMultipleVelocitySources
2021-06-29T18:03:58.578Z,1624989838.578 [CBIT](INFO): Clearing failed state for component DeadReckonUsingMultipleVelocitySources
2021-06-29T18:03:58.578Z,1624989838.578 [DeadReckonUsingMultipleVelocitySources] No Fault, FailCount= 1
2021-06-29T18:03:59.358Z,1624989839.358 [Startup:StartupSatComms:A](INFO): Timed out from 2021-06-29T18:02:59.2Z
2021-06-29T18:03:59.358Z,1624989839.358 [Startup:StartupSatComms:A] Stopped
2021-06-29T18:03:59.358Z,1624989839.358 [Startup:StartupSatComms:B] Running Loop=1
2021-06-29T18:03:59.749Z,1624989839.749 [Startup:StartupSatComms:B](DEBUG): Initialize ReadDataComponent to sense platform_communications
2021-06-29T18:04:20.994Z,1624989860.994 [DataOverHttps](INFO): setting available, lastComms_.elapsed()=0.005161
2021-06-29T18:04:30.243Z,1624989870.243 [DataOverHttps](INFO): Sending 39 bytes from file Logs/20210629T175026/Courier0010.lzma
2021-06-29T18:04:31.246Z,1624989871.246 [DataOverHttps](INFO): Moved sent file to Logs/20210629T175026/Courier0010.lzma.bak
2021-06-29T18:04:31.246Z,1624989871.246 [DataOverHttps](INFO): SBD MOMSN=15736890
2021-06-29T18:04:33.523Z,1624989873.523 [NAL9602](INFO): SBD MO Status=2, MOMSN=4876, MT Status=2, MTMSN=0
2021-06-29T18:04:33.523Z,1624989873.523 [NAL9602](ERROR): Failed to initiate SBD session. Error code: 2
2021-06-29T18:04:37.186Z,1624989877.186 [BPC1](ERROR): BPC1B: No match for serial number 1717 in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:04:53.547Z,1624989893.547 [DataOverHttps](INFO): Sending 39 bytes from file Logs/20210629T175026/Courier0013.lzma
2021-06-29T18:04:54.546Z,1624989894.546 [DataOverHttps](INFO): Moved sent file to Logs/20210629T175026/Courier0013.lzma.bak
2021-06-29T18:04:54.546Z,1624989894.546 [DataOverHttps](INFO): SBD MOMSN=15736892
2021-06-29T18:04:59.542Z,1624989899.542 [Startup:StartupSatComms:B](INFO): Timed out from 2021-06-29T18:03:59.4Z
2021-06-29T18:04:59.542Z,1624989899.542 [Startup:StartupSatComms:B] Stopped
2021-06-29T18:04:59.543Z,1624989899.543 [Startup:StartupSatComms](INFO): Completed Startup:StartupSatComms
2021-06-29T18:04:59.543Z,1624989899.543 [Startup:StartupSatComms] Stopped
2021-06-29T18:04:59.543Z,1624989899.543 [Startup:StartupSatComms](DEBUG): Aggregate::uninitialize Startup:StartupSatComms
2021-06-29T18:04:59.548Z,1624989899.548 [Startup](INFO): Completed Startup
2021-06-29T18:04:59.548Z,1624989899.548 [MissionManager](INFO): Startup is completed.
2021-06-29T18:04:59.548Z,1624989899.548 [MissionManager](INFO): Uninitializing Mission Startup
2021-06-29T18:04:59.548Z,1624989899.548 [Startup] Stopped
2021-06-29T18:04:59.548Z,1624989899.548 [Startup](DEBUG): Aggregate::uninitialize Startup
2021-06-29T18:04:59.549Z,1624989899.549 [Startup:A.GoToSurface] Stopped
2021-06-29T18:04:59.549Z,1624989899.549 [Startup:A.GoToSurface](DEBUG): Uninitialize GoToSurfaceComponent.
2021-06-29T18:04:59.941Z,1624989899.941 [MissionManager](IMPORTANT): Started mission Default
2021-06-29T18:04:59.941Z,1624989899.941 [Default] Running Loop=1
2021-06-29T18:04:59.941Z,1624989899.941 [Default](DEBUG): Aggregate::initialize Default
2021-06-29T18:04:59.941Z,1624989899.941 [Default:B.GoToSurface] Running Loop=1
2021-06-29T18:04:59.941Z,1624989899.941 [Default:B.GoToSurface](DEBUG): Initialize GoToSurfaceComponent.
2021-06-29T18:04:59.942Z,1624989899.942 [Default:B.GoToSurface](DEBUG): No depth rate setting specified. Using default value of nan m/s.
2021-06-29T18:04:59.942Z,1624989899.942 [Default:B.GoToSurface](DEBUG): No pitch setting specified. Using default value of nan degrees.
2021-06-29T18:04:59.942Z,1624989899.942 [Default:B.GoToSurface](DEBUG): No speed setting specified. Using default value of 1.000000 m/s.
2021-06-29T18:04:59.943Z,1624989899.943 [Default:B.GoToSurface](DEBUG): No surface timeout specified. Using default value of 1000.000000 seconds.
2021-06-29T18:04:59.943Z,1624989899.943 [Default:B.GoToSurface](INFO): Received pitch timeout configuration 60.000000 seconds.
2021-06-29T18:04:59.943Z,1624989899.943 [Default:A.Wait] Running Loop=1
2021-06-29T18:04:59.943Z,1624989899.943 [Default:A.Wait](DEBUG): Initialize Wait Component.
2021-06-29T18:05:07.995Z,1624989907.995 [NAL9602](DEBUG): Parsing RMC sentence: $GPRMC,180506.00,A,3648.16798,N,12147.28416,W,0.194,284.82,290621,,,A*70
2021-06-29T18:05:07.998Z,1624989907.998 [NAL9602](INFO): GPS fix at 20210629T180506: (36.802800, -121.788069)
2021-06-29T18:05:10.143Z,1624989910.143 [DataOverHttps](INFO): Sending 151 bytes from file Logs/20210629T180041/Courier0000.lzma
2021-06-29T18:05:11.145Z,1624989911.145 [DataOverHttps](INFO): Moved sent file to Logs/20210629T180041/Courier0000.lzma.bak
2021-06-29T18:05:11.146Z,1624989911.146 [DataOverHttps](INFO): SBD MOMSN=15736894
2021-06-29T18:05:13.276Z,1624989913.276 [Default:A.Wait](INFO): Done Waiting.
2021-06-29T18:05:13.276Z,1624989913.276 [Default:A.Wait] Stopped
2021-06-29T18:05:13.276Z,1624989913.276 [Default:A.Wait](DEBUG): Uninitialize Wait Component.
2021-06-29T18:05:13.671Z,1624989913.671 [Default:CheckIn] Running Loop=1
2021-06-29T18:05:13.671Z,1624989913.671 [Default:CheckIn](DEBUG): Aggregate::initialize Default:CheckIn
2021-06-29T18:05:13.671Z,1624989913.671 [Default:CheckIn:Read_GPS] Running Loop=1
2021-06-29T18:05:14.081Z,1624989914.081 [Default:CheckIn:Read_GPS](DEBUG): Initialize ReadDataComponent to sense time_fix
2021-06-29T18:05:15.766Z,1624989915.766 [NAL9602](DEBUG): Parsing RMC sentence: $GPRMC,180513.00,A,3648.16779,N,12147.28419,W,0.097,284.82,290621,,,A*76
2021-06-29T18:05:15.768Z,1624989915.768 [NAL9602](INFO): GPS fix at 20210629T180513: (36.802796, -121.788070)
2021-06-29T18:05:15.778Z,1624989915.778 [Default:CheckIn:Read_GPS] Stopped
2021-06-29T18:05:15.779Z,1624989915.779 [Default:CheckIn:Read_Iridium] Running Loop=1
2021-06-29T18:05:16.169Z,1624989916.169 [Default:CheckIn:Read_Iridium](DEBUG): Initialize ReadDataComponent to sense platform_communications
2021-06-29T18:05:36.836Z,1624989936.836 [DataOverHttps](INFO): Sending 223 bytes from file Logs/20210629T180041/Courier0004.lzma
2021-06-29T18:05:37.838Z,1624989937.838 [DataOverHttps](INFO): Moved sent file to Logs/20210629T180041/Courier0004.lzma.bak
2021-06-29T18:05:37.838Z,1624989937.838 [DataOverHttps](INFO): SBD MOMSN=15736897
2021-06-29T18:05:48.473Z,1624989948.473 [NAL9602](INFO): Not Powering down - fast GPS
2021-06-29T18:05:53.503Z,1624989953.503 [DataOverHttps](INFO): Sending 132 bytes from file Logs/20210629T175026/Express0011.lzma
2021-06-29T18:05:54.507Z,1624989954.507 [DataOverHttps](INFO): Moved sent file to Logs/20210629T175026/Express0011.lzma.bak
2021-06-29T18:05:54.507Z,1624989954.507 [DataOverHttps](INFO): SBD MOMSN=15736900
2021-06-29T18:06:10.995Z,1624989970.995 [DataOverHttps](INFO): Sending 49 bytes from file Logs/20210629T175026/Express0014.lzma
2021-06-29T18:06:11.107Z,1624989971.107 [BPC1](ERROR): BPC1B: No match for serial number 0BEC in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:06:11.998Z,1624989971.998 [DataOverHttps](INFO): Moved sent file to Logs/20210629T175026/Express0014.lzma.bak
2021-06-29T18:06:11.998Z,1624989971.998 [DataOverHttps](INFO): SBD MOMSN=15736904
2021-06-29T18:06:24.450Z,1624989984.450 [BPC1](ERROR): BPC1B: No match for serial number 0BEC in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:06:27.602Z,1624989987.602 [DataOverHttps](INFO): Sending 1152 bytes from file Logs/20210629T180041/Express0001.lzma
2021-06-29T18:06:28.601Z,1624989988.601 [DataOverHttps](INFO): Moved sent file to Logs/20210629T180041/Express0001.lzma.bak
2021-06-29T18:06:28.602Z,1624989988.602 [DataOverHttps](INFO): SBD MOMSN=15736906
2021-06-29T18:06:38.238Z,1624989998.238 [BPC1](ERROR): BPC1B: No match for serial number 0BEC in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:06:50.468Z,1624990010.468 [DataOverHttps](INFO): Sending 246 bytes from file Logs/20210629T180041/Express0005.lzma
2021-06-29T18:06:51.466Z,1624990011.466 [DataOverHttps](INFO): Moved sent file to Logs/20210629T180041/Express0005.lzma.bak
2021-06-29T18:06:51.466Z,1624990011.466 [DataOverHttps](INFO): SBD MOMSN=15736933
2021-06-29T18:06:51.634Z,1624990011.634 [BPC1](ERROR): BPC1B: No match for serial number 0BEC in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:06:54.613Z,1624990014.613 [Default:CheckIn:Read_Iridium] Stopped
2021-06-29T18:06:54.613Z,1624990014.613 [Default:CheckIn:C.Wait] Running Loop=1
2021-06-29T18:06:54.613Z,1624990014.613 [Default:CheckIn:C.Wait](DEBUG): Initialize Wait Component.
2021-06-29T18:06:59.335Z,1624990019.335 [DeadReckonUsingMultipleVelocitySources] Software Fault, FailCount= 1
2021-06-29T18:06:59.335Z,1624990019.335 [DeadReckonUsingMultipleVelocitySources](ERROR): Software Fault
2021-06-29T18:06:59.346Z,1624990019.346 [CBIT](ERROR): Software Fault in component: DeadReckonUsingMultipleVelocitySources
2021-06-29T18:06:59.781Z,1624990019.781 [CBIT](INFO): Clearing failed state for component DeadReckonUsingMultipleVelocitySources
2021-06-29T18:06:59.781Z,1624990019.781 [DeadReckonUsingMultipleVelocitySources] No Fault, FailCount= 1
2021-06-29T18:07:04.990Z,1624990024.990 [BPC1](ERROR): BPC1B: No match for serial number 0BEC in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:07:18.322Z,1624990038.322 [BPC1](ERROR): BPC1B: No match for serial number 0BEC in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:07:31.658Z,1624990051.658 [BPC1](ERROR): BPC1B: No match for serial number 0BEC in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:07:45.379Z,1624990065.379 [BPC1](ERROR): BPC1B: No match for serial number 0BEC in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:07:46.314Z,1624990066.314 [DataOverHttps](IMPORTANT): SBD MTMSN=20210629T180745
2021-06-29T18:07:53.468Z,1624990073.468 [DataOverHttps](INFO): Received command:sched asap "load Maintenance/tank_ballast_and_trim_backseat.xml;set tank_ballast_and_trim_backseat.MissionTimeout 40 min;set tank_ballast_and_trim_backseat.SettleTime 5 min;set tank_ballast_and_trim_backseat.EstimationTimeout 30 min" ed0k 1 2
2021-06-29T18:07:53.525Z,1624990073.525 [CommandLine](IMPORTANT): got command schedule asap "load Maintenance/tank_ballast_and_trim_backseat.xml;set tank_ballast_and_trim_backseat.MissionTimeout 40 min;set tank_ballast_and_trim_backseat.SettleTime 5 min;set tank_ballast_and_trim_backseat.EstimationTimeout 30 min" ed0k 1 2.000000
2021-06-29T18:07:53.525Z,1624990073.525 [CommandLine](IMPORTANT): Scheduling command #1 of 2 with id=ed0k
2021-06-29T18:07:53.526Z,1624990073.526 [CommandLine](IMPORTANT): Scheduled #1 (#1 of 2 with id='ed0k'): "load Maintenance/tank_ballast_and_trim_backseat.xml;set tank_ballast_and_trim_backseat.MissionTimeout 40 min;set tank_ballast_and_trim_backseat.SettleTime 5 min;set tank_ballast_and_trim_backseat.EstimationTimeout 30 min" ASAP
2021-06-29T18:07:54.470Z,1624990074.470 [DataOverHttps](IMPORTANT): SBD MTMSN=20210629T180753
2021-06-29T18:07:59.117Z,1624990079.117 [BPC1](ERROR): BPC1B: No match for serial number 0BEC in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:08:02.003Z,1624990082.003 [DataOverHttps](INFO): Received command:sched asap "set tank_ballast_and_trim_backseat.MassEstimationErrorBound 5 mm;set tank_ballast_and_trim_backseat.BuoyEstimationErrorBound 25 cc;run" ed0k 2 2
2021-06-29T18:08:02.041Z,1624990082.041 [CommandLine](IMPORTANT): got command schedule asap "set tank_ballast_and_trim_backseat.MassEstimationErrorBound 5 mm;set tank_ballast_and_trim_backseat.BuoyEstimationErrorBound 25 cc;run" ed0k 2 2.000000
2021-06-29T18:08:02.041Z,1624990082.041 [CommandLine](IMPORTANT): Scheduling command #2 of 2 with id=ed0k
2021-06-29T18:08:02.042Z,1624990082.042 [CommandLine](IMPORTANT): Scheduled #2 (#2 of 2 with id='ed0k'): "set tank_ballast_and_trim_backseat.MassEstimationErrorBound 5 mm;set tank_ballast_and_trim_backseat.BuoyEstimationErrorBound 25 cc;run" ASAP
2021-06-29T18:08:02.115Z,1624990082.115 [CommandLine](IMPORTANT): got command load ./Missions/Maintenance/tank_ballast_and_trim_backseat.xml
2021-06-29T18:08:02.132Z,1624990082.132 [MissionManager](INFO): Loading Mission: ./Missions/Maintenance/tank_ballast_and_trim_backseat.xml
2021-06-29T18:08:02.229Z,1624990082.229 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat.MissionTimeout = 120.000000 min
2021-06-29T18:08:02.232Z,1624990082.232 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat.SkipComms = 0 bool
2021-06-29T18:08:02.235Z,1624990082.235 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat.Depth1 = 7.000000 m
2021-06-29T18:08:02.238Z,1624990082.238 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat.Depth2 = nan m
2021-06-29T18:08:02.242Z,1624990082.242 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat.DepthDeadband = 0.100000 m
2021-06-29T18:08:02.245Z,1624990082.245 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat.SurfaceThreshold = 2.500000 m
2021-06-29T18:08:02.248Z,1624990082.248 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat.MaxWaitOnSurface = 20.000000 min
2021-06-29T18:08:02.251Z,1624990082.251 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat.SettleTime = 10.000000 min
2021-06-29T18:08:02.254Z,1624990082.254 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat.EstimationTimeout = 45.000000 min
2021-06-29T18:08:02.302Z,1624990082.302 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat.MinEstimationTime = 10.000000 min
2021-06-29T18:08:02.305Z,1624990082.305 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat.MassEstimationErrorBound = 0.250000 mm
2021-06-29T18:08:02.308Z,1624990082.308 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat.BuoyEstimationErrorBound = 15.000000 cc
2021-06-29T18:08:02.323Z,1624990082.323 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat.EstimationConfidence = 99.900000 %
2021-06-29T18:08:02.326Z,1624990082.326 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat.WaitToFloat = 5.000000 min
2021-06-29T18:08:02.327Z,1624990082.327 [MissionManager](INFO): Inserting Stack: Missions/Insert/Science.xml
2021-06-29T18:08:02.870Z,1624990082.870 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:Science.PeakDetectChlActive = 0 bool
2021-06-29T18:08:02.880Z,1624990082.880 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:Science.TimeWindowPeakReport = nan min
2021-06-29T18:08:02.883Z,1624990082.883 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:Science.HighestChlPeakReportActive = 0 bool
2021-06-29T18:08:02.886Z,1624990082.886 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:Science.HighestSaltPeakReportActive = 0 bool
2021-06-29T18:08:02.889Z,1624990082.889 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:Science.HighestOilPeakReportActive = 0 bool
2021-06-29T18:08:02.929Z,1624990082.929 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:Science.PatchTracking = 0 bool
2021-06-29T18:08:02.933Z,1624990082.933 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:Science.FilterWidthHorizontal = 3.000000 count
2021-06-29T18:08:02.936Z,1624990082.936 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:Science.NumProfilesSlidingwindow = 100.000000 count
2021-06-29T18:08:02.939Z,1624990082.939 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:Science.OffPeakFractionHorizontal = 80.000000 %
2021-06-29T18:08:02.942Z,1624990082.942 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:Science.PeakDetectNO3Active = 0 bool
2021-06-29T18:08:02.984Z,1624990082.984 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:Science.PeakDetectOilActive = 0 bool
2021-06-29T18:08:02.987Z,1624990082.987 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:Science.PeakDetectFDOMActive = 0 bool
2021-06-29T18:08:02.989Z,1624990082.989 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:Science.PeakDetectSalinityActive = 0 bool
2021-06-29T18:08:03.009Z,1624990083.009 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:Science.UpwardDerivativeOfTemperatureActive = 0 bool
2021-06-29T18:08:03.013Z,1624990083.013 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:Science.EnabledAanderaaO2 = 0.000000 bool
2021-06-29T18:08:03.017Z,1624990083.017 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:Science.EnabledNeilBrown = 0.000000 bool
2021-06-29T18:08:03.043Z,1624990083.043 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:Science.EnabledSeabird = 1.000000 bool
2021-06-29T18:08:03.046Z,1624990083.046 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:Science.EnabledWetLabsBB2FL = 1.000000 bool
2021-06-29T18:08:03.051Z,1624990083.051 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:Science.EnabledWetLabsSeaOWL_UV_A = 0.000000 bool
2021-06-29T18:08:03.067Z,1624990083.067 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:Science.EnabledWetLabsUBAT = 0.000000 bool
2021-06-29T18:08:03.070Z,1624990083.070 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:Science.LowPassWindowLength = 20.000000 count
2021-06-29T18:08:03.074Z,1624990083.074 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:Science.MedianFilterLen = 5.000000 count
2021-06-29T18:08:03.099Z,1624990083.099 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:Science.PeakShallowBound = nan m
2021-06-29T18:08:03.102Z,1624990083.102 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:Science.PeakDeepBound = nan m
2021-06-29T18:08:03.105Z,1624990083.105 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:Science.DepChangeThreshForAttitudeFlip = 2.000000 m
2021-06-29T18:08:03.121Z,1624990083.121 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PeakChl = 0.000000 ug/l
2021-06-29T18:08:03.124Z,1624990083.124 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PeakChlDepth = 0.000000 m
2021-06-29T18:08:03.128Z,1624990083.128 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PeakChlTemperature = 0.000000 degC
2021-06-29T18:08:03.131Z,1624990083.131 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PeakChlLatitude = nan arcdeg
2021-06-29T18:08:03.183Z,1624990083.183 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PeakChlLongitude = nan arcdeg
2021-06-29T18:08:03.187Z,1624990083.187 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PeakNO3 = 0.000000 umol/l
2021-06-29T18:08:03.215Z,1624990083.215 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PeakNO3Depth = 0.000000 m
2021-06-29T18:08:03.239Z,1624990083.239 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PeakNO3Latitude = nan arcdeg
2021-06-29T18:08:03.242Z,1624990083.242 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PeakNO3Longitude = nan arcdeg
2021-06-29T18:08:03.246Z,1624990083.246 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PeakOil = 0.000000 kg/m3
2021-06-29T18:08:03.270Z,1624990083.270 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PeakOilDepth = 0.000000 m
2021-06-29T18:08:03.274Z,1624990083.274 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PeakOilLatitude = nan arcdeg
2021-06-29T18:08:03.283Z,1624990083.283 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PeakOilLongitude = nan arcdeg
2021-06-29T18:08:03.286Z,1624990083.286 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PeakFDOM = 0.000000 ppb
2021-06-29T18:08:03.289Z,1624990083.289 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PeakFDOMDepth = 0.000000 m
2021-06-29T18:08:03.321Z,1624990083.321 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PeakFDOMTemperature = nan degC
2021-06-29T18:08:03.324Z,1624990083.324 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PeakFDOMLatitude = nan arcdeg
2021-06-29T18:08:03.327Z,1624990083.327 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PeakFDOMLongitude = nan arcdeg
2021-06-29T18:08:03.331Z,1624990083.331 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PatchFDOMDistance = nan m
2021-06-29T18:08:03.343Z,1624990083.343 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PeakSalt = 0.000000 psu
2021-06-29T18:08:03.346Z,1624990083.346 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PeakSaltDepth = 0.000000 m
2021-06-29T18:08:03.349Z,1624990083.349 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PeakSaltTemperature = 0.000000 degC
2021-06-29T18:08:03.397Z,1624990083.397 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PeakSaltLatitude = nan arcdeg
2021-06-29T18:08:03.400Z,1624990083.400 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PeakSaltLongitude = nan arcdeg
2021-06-29T18:08:03.404Z,1624990083.404 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PatchChl = 0.000000 ug/l
2021-06-29T18:08:03.407Z,1624990083.407 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PatchChlDepth = 0.000000 m
2021-06-29T18:08:03.434Z,1624990083.434 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PatchChlLatitude = nan arcdeg
2021-06-29T18:08:03.437Z,1624990083.437 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PatchChlLongitude = nan arcdeg
2021-06-29T18:08:03.467Z,1624990083.467 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PatchChlDistance = nan m
2021-06-29T18:08:03.471Z,1624990083.471 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PatchSalt = 0.000000 psu
2021-06-29T18:08:03.474Z,1624990083.474 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PatchSaltDepth = 0.000000 m
2021-06-29T18:08:03.490Z,1624990083.490 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PatchSaltLatitude = nan arcdeg
2021-06-29T18:08:03.494Z,1624990083.494 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PatchSaltLongitude = nan arcdeg
2021-06-29T18:08:03.497Z,1624990083.497 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PatchSaltDistance = nan m
2021-06-29T18:08:03.538Z,1624990083.538 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PatchOil = 0.000000 psu
2021-06-29T18:08:03.541Z,1624990083.541 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PatchOilDepth = 0.000000 m
2021-06-29T18:08:03.577Z,1624990083.577 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PatchOilLatitude = nan arcdeg
2021-06-29T18:08:03.589Z,1624990083.589 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PatchOilLongitude = nan arcdeg
2021-06-29T18:08:03.601Z,1624990083.601 [MissionManager](INFO): DefineOutput tank_ballast_and_trim_backseat:Science.PatchOilDistance = nan m
2021-06-29T18:08:03.722Z,1624990083.722 [tank_ballast_and_trim_backseat:Science:PeakDetectChl:A.PeakDetectVsDepth](DEBUG): Construct PeakDetectVsDepth.
2021-06-29T18:08:03.751Z,1624990083.751 [tank_ballast_and_trim_backseat:Science:HighestChlPeakReport:A.PeakDetectHorizontal](DEBUG): Construct PeakDetectHorizontal.
2021-06-29T18:08:03.778Z,1624990083.778 [tank_ballast_and_trim_backseat:Science:PeakDetectNO3:A.PeakDetectVsDepth](DEBUG): Construct PeakDetectVsDepth.
2021-06-29T18:08:03.806Z,1624990083.806 [tank_ballast_and_trim_backseat:Science:PeakDetectOil:A.PeakDetectVsDepth](DEBUG): Construct PeakDetectVsDepth.
2021-06-29T18:08:03.838Z,1624990083.838 [tank_ballast_and_trim_backseat:Science:HighestOilPeakReport:A.PeakDetectHorizontal](DEBUG): Construct PeakDetectHorizontal.
2021-06-29T18:08:03.895Z,1624990083.895 [tank_ballast_and_trim_backseat:Science:PeakDetectFDOM:A.PeakDetectVsDepth](DEBUG): Construct PeakDetectVsDepth.
2021-06-29T18:08:03.940Z,1624990083.940 [tank_ballast_and_trim_backseat:Science:PeakDetectSalinity:A.PeakDetectVsDepth](DEBUG): Construct PeakDetectVsDepth.
2021-06-29T18:08:04.014Z,1624990084.014 [tank_ballast_and_trim_backseat:Science:HighestSaltPeakReport:A.PeakDetectHorizontal](DEBUG): Construct PeakDetectHorizontal.
2021-06-29T18:08:04.047Z,1624990084.047 [tank_ballast_and_trim_backseat:RunBallastAndTrim:B.BackseatDriver](DEBUG): Construct BackseatDriver.
2021-06-29T18:08:04.079Z,1624990084.079 [MissionManager](INFO): Inserting Stack: Missions/Insert/BallastAndTrim.xml
2021-06-29T18:08:04.341Z,1624990084.341 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim.InsertDepth = 25.000000 m
2021-06-29T18:08:04.344Z,1624990084.344 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim.InsertApproachSpeed = 0.000000 m/s
2021-06-29T18:08:04.384Z,1624990084.384 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim.InsertApproachDepthRate = 0.400000 m/s
2021-06-29T18:08:04.388Z,1624990084.388 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim.InsertApproachPitchLimit = 20.000000 arcdeg
2021-06-29T18:08:04.391Z,1624990084.391 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim.InsertApproachSettleTimePreDive = 0.000000 min
2021-06-29T18:08:04.429Z,1624990084.429 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim.InsertApproachDepthTimeout = 20.000000 min
2021-06-29T18:08:04.452Z,1624990084.452 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim.InsertSettleTime = 10.000000 min
2021-06-29T18:08:04.456Z,1624990084.456 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim.EstTimeout = 45.000000 min
2021-06-29T18:08:04.459Z,1624990084.459 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim.MinEstTime = 10.000000 min
2021-06-29T18:08:04.462Z,1624990084.462 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim.MassEstErrorBound = 0.250000 mm
2021-06-29T18:08:04.487Z,1624990084.487 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim.BuoyEstErrorBound = 15.000000 cc
2021-06-29T18:08:04.494Z,1624990084.494 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim.EstConfidence = 99.900000 %
2021-06-29T18:08:04.498Z,1624990084.498 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim.InsertDepthDeadband = 1.000000 m
2021-06-29T18:08:04.513Z,1624990084.513 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim.InsertKiDepthBuoy = 0.300000 1/s
2021-06-29T18:08:04.516Z,1624990084.516 [MissionManager](INFO): DefineArg tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim.InsertMassDeadband = 0.250000 mm
2021-06-29T18:08:04.573Z,1624990084.573 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ActuatorHold:A.Point](DEBUG): Construct.
2021-06-29T18:08:04.581Z,1624990084.581 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ActuatorHold:B.Buoyancy](DEBUG): Construct Buoyancy.
2021-06-29T18:08:04.601Z,1624990084.601 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ActuatorHold:C.Pitch](DEBUG): Construct.
2021-06-29T18:08:04.623Z,1624990084.623 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:WaitPreDive:B.Wait](DEBUG): Construct Wait.
2021-06-29T18:08:04.637Z,1624990084.637 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ApproachDepth:B.SetSpeed](DEBUG): Construct.
2021-06-29T18:08:04.640Z,1624990084.640 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ApproachDepth:C.Pitch](DEBUG): Construct.
2021-06-29T18:08:04.675Z,1624990084.675 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ApproachDepth:C.Pitch:A_Timeout:B.Execute](DEBUG): Construct Execute.
2021-06-29T18:08:04.679Z,1624990084.679 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:A.SetSpeed](DEBUG): Construct.
2021-06-29T18:08:04.683Z,1624990084.683 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:B.Pitch](DEBUG): Construct.
2021-06-29T18:08:04.702Z,1624990084.702 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:D.Wait](DEBUG): Construct Wait.
2021-06-29T18:08:04.740Z,1624990084.740 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:F.](DEBUG): Construct BallastAndTrim.
2021-06-29T18:08:04.807Z,1624990084.807 [MissionManager](INFO): RedefineArg tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim.InsertDepthDeadband = reader:tank_ballast_and_trim_backseat.DepthDeadband
2021-06-29T18:08:04.826Z,1624990084.826 [MissionManager](INFO): RedefineArg tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim.InsertApproachDepthTimeout = reader:tank_ballast_and_trim_backseat.MaxWaitOnSurface
2021-06-29T18:08:04.836Z,1624990084.836 [MissionManager](INFO): RedefineArg tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim.InsertSettleTime = reader:tank_ballast_and_trim_backseat.SettleTime
2021-06-29T18:08:04.838Z,1624990084.838 [MissionManager](INFO): RedefineArg tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim.EstTimeout = reader:tank_ballast_and_trim_backseat.EstimationTimeout
2021-06-29T18:08:04.844Z,1624990084.844 [MissionManager](INFO): RedefineArg tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim.MinEstTime = reader:tank_ballast_and_trim_backseat.MinEstimationTime
2021-06-29T18:08:04.846Z,1624990084.846 [MissionManager](INFO): RedefineArg tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim.MassEstErrorBound = reader:tank_ballast_and_trim_backseat.MassEstimationErrorBound
2021-06-29T18:08:04.852Z,1624990084.852 [MissionManager](INFO): RedefineArg tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim.BuoyEstErrorBound = reader:tank_ballast_and_trim_backseat.BuoyEstimationErrorBound
2021-06-29T18:08:04.854Z,1624990084.854 [MissionManager](INFO): RedefineArg tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim.EstConfidence = reader:tank_ballast_and_trim_backseat.EstimationConfidence
2021-06-29T18:08:04.884Z,1624990084.884 [tank_ballast_and_trim_backseat:Float_Up:A.Buoyancy](DEBUG): Construct Buoyancy.
2021-06-29T18:08:04.894Z,1624990084.894 [tank_ballast_and_trim_backseat:Float_Up:B.Wait](DEBUG): Construct Wait.
2021-06-29T18:08:04.942Z,1624990084.942 [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="tank_ballast_and_trim_backseat">

    <DefineArg Name="MissionTimeout"><Description>
        Maximum duration of mission
    </Description><Units:minute/><Value>120</Value></DefineArg>

    <DefineArg Name="SkipComms"><Description>
        Skip communications at start of mission.
    </Description><False/></DefineArg>

    <DefineArg Name="Depth1"><Units:meter/><Value>7</Value></DefineArg>

    <DefineArg Name="Depth2"><Units:meter/><Value>NaN</Value></DefineArg>

    <DefineArg Name="DepthDeadband"><Description>
        How much vertical drift from the specified depth is allowed durnig the
        mission.
    </Description><Units:meter/><Value>0.1</Value></DefineArg>

    <DefineArg Name="SurfaceThreshold"><Description>
        Surface threshold depth.
    </Description><Units:meter/><Value>2.5</Value></DefineArg>

    <DefineArg Name="MaxWaitOnSurface"><Description>
        Maximum wait time for the vehicle to go under the surface (i.e., reach
        the surface threshold depth).
    </Description><Units:minute/><Value>20</Value></DefineArg>

    <DefineArg Name="SettleTime"><Description>
        How long to wait after reaching target depth before starting ballast and
        trim.
    </Description><Units:minute/><Value>10</Value></DefineArg>

    <DefineArg Name="EstimationTimeout"><Description>
        Timeout for ballast and trim estimation.
    </Description><Units:minute/><Value>45</Value></DefineArg>

    <DefineArg Name="MinEstimationTime"><Description>
        Minimum time to run ballast and trim estimation before determining
        convergence (must be shorter than timeout).
    </Description><Units:minute/><Value>10</Value></DefineArg>

    <DefineArg Name="MassEstimationErrorBound"><Description>
        Desired range of the estimated sample mean from the true mean statistic
        (smaller values take longer to converge).
    </Description><Units:millimeter/><Value>0.25</Value></DefineArg>

    <DefineArg Name="BuoyEstimationErrorBound"><Description>
        Desired range of the estimated sample mean from the true mean statistic
        (smaller values take longer to converge).
    </Description><Units:cubic_centimeter/><Value>15</Value></DefineArg>

    <DefineArg Name="EstimationConfidence"><Description>
        Confidence level that the estimator has reached the desired error range
        (larger values take longer to converge).
    </Description><Units:percent/><Value>99.9</Value></DefineArg>

    <DefineArg Name="WaitToFloat"><Units:minute/><Value>5</Value></DefineArg>

    <Timeout Duration="MissionTimeout"/>

    <Insert Filename="Insert/Science.xml"/>


    <Aggregate Id="RunBallastAndTrim">

        <Sequence/>

        <Syslog>Powering up backseat...</Syslog>
        <Guidance:BackseatDriver>
            <Parallel/>
        </Guidance:BackseatDriver>
        <Syslog>Backseat powered.</Syslog>
        
        <Insert Filename="Insert/BallastAndTrim.xml">
            <RedefineArg Name="InsertDepthDeadband"><Arg Name="DepthDeadband"/></RedefineArg>
            <RedefineArg Name="InsertApproachDepthTimeout"><Arg Name="MaxWaitOnSurface"/></RedefineArg>
            <RedefineArg Name="InsertSettleTime"><Arg Name="SettleTime"/></RedefineArg>
            <RedefineArg Name="EstTimeout"><Arg Name="EstimationTimeout"/></RedefineArg>
            <RedefineArg Name="MinEstTime"><Arg Name="MinEstimationTime"/></RedefineArg>
            <RedefineArg Name="MassEstErrorBound"><Arg Name="MassEstimationErrorBound"/></RedefineArg>
            <RedefineArg Name="BuoyEstErrorBound"><Arg Name="BuoyEstimationErrorBound"/></RedefineArg>
            <RedefineArg Name="EstConfidence"><Arg Name="EstimationConfidence"/></RedefineArg>
        </Insert>

        <Aggregate Id="Depth1">

            <Sequence/>

            <Break>
                <IsNaN><Arg Name="Depth1"/>
                </IsNaN>
            </Break>

            <Assign><Sequence/><Arg Name="BallastAndTrim:InsertDepth"/><Arg Name="Depth1"/></Assign>

            <Call RefId="BallastAndTrim"/>

        </Aggregate>

        <Aggregate Id="Depth2">

            <Sequence/>

            <Break>
                <IsNaN><Arg Name="Depth2"/>
                </IsNaN>
            </Break>

            <Assign><Sequence/><Arg Name="BallastAndTrim:InsertDepth"/><Arg Name="Depth1"/></Assign>

            <Call RefId="BallastAndTrim"/>

        </Aggregate>

    </Aggregate>

    <Aggregate Id="Float_Up">

        <Description>
            Float to surface instead of driving.
        </Description>

        <Sequence/>

        <Break>
            <Universal:depth/>
            <Lt><Control:VerticalControl.surfaceThreshold/></Lt>
        </Break>

        <Guidance:Buoyancy>
            <Parallel/>
            <Setting><Guidance:Buoyancy.position/><Control:VerticalControl.buoyancyDefault/></Setting>
        </Guidance:Buoyancy>

        <Guidance:Wait>
            <Sequence/>
            <Setting><Guidance:Wait.duration/><Arg Name="WaitToFloat"/></Setting>
        </Guidance:Wait>

    </Aggregate>

</Mission>


2021-06-29T18:08:04.942Z,1624990084.942 [CommandLine](IMPORTANT): Loaded ./Missions/Maintenance/tank_ballast_and_trim_backseat.xml
2021-06-29T18:08:12.058Z,1624990092.058 [BPC1](ERROR): BPC1B: No match for serial number 0BEC in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:08:15.509Z,1624990095.509 [CommandLine](IMPORTANT): got command set tank_ballast_and_trim_backseat.MissionTimeout 40.000000 minute
2021-06-29T18:08:15.510Z,1624990095.510 [CommandLine](IMPORTANT): got command set tank_ballast_and_trim_backseat.SettleTime 5.000000 minute
2021-06-29T18:08:15.511Z,1624990095.511 [CommandLine](IMPORTANT): got command set tank_ballast_and_trim_backseat.EstimationTimeout 30.000000 minute
2021-06-29T18:08:23.331Z,1624990103.331 [CommandLine](IMPORTANT): got command set tank_ballast_and_trim_backseat.MassEstimationErrorBound 5.000000 millimeter
2021-06-29T18:08:23.332Z,1624990103.332 [CommandLine](IMPORTANT): got command set tank_ballast_and_trim_backseat.BuoyEstimationErrorBound 25.000000 cubic_centimeter
2021-06-29T18:08:23.333Z,1624990103.333 [CommandLine](IMPORTANT): got command run
2021-06-29T18:08:23.425Z,1624990103.425 [CommandLine](IMPORTANT): Running 
2021-06-29T18:08:23.456Z,1624990103.456 [Default] Stopped
2021-06-29T18:08:23.456Z,1624990103.456 [Default](DEBUG): Aggregate::uninitialize Default
2021-06-29T18:08:23.456Z,1624990103.456 [Default:B.GoToSurface] Stopped
2021-06-29T18:08:23.457Z,1624990103.457 [Default:B.GoToSurface](DEBUG): Uninitialize GoToSurfaceComponent.
2021-06-29T18:08:23.457Z,1624990103.457 [Default:CheckIn] Stopped
2021-06-29T18:08:23.457Z,1624990103.457 [Default:CheckIn](DEBUG): Aggregate::uninitialize Default:CheckIn
2021-06-29T18:08:23.457Z,1624990103.457 [Default:CheckIn:C.Wait] Stopped
2021-06-29T18:08:23.457Z,1624990103.457 [Default:CheckIn:C.Wait](DEBUG): Uninitialize Wait Component.
2021-06-29T18:08:23.457Z,1624990103.457 [MissionManager](IMPORTANT): Started mission tank_ballast_and_trim_backseat
2021-06-29T18:08:23.457Z,1624990103.457 [tank_ballast_and_trim_backseat] Running Loop=1
2021-06-29T18:08:23.458Z,1624990103.458 [tank_ballast_and_trim_backseat](DEBUG): Aggregate::initialize tank_ballast_and_trim_backseat
2021-06-29T18:08:23.458Z,1624990103.458 [tank_ballast_and_trim_backseat:Science] Running Loop=1
2021-06-29T18:08:23.458Z,1624990103.458 [tank_ballast_and_trim_backseat:Science](DEBUG): Aggregate::initialize tank_ballast_and_trim_backseat:Science
2021-06-29T18:08:23.458Z,1624990103.458 [tank_ballast_and_trim_backseat:Science:A] Running Loop=1
2021-06-29T18:08:23.458Z,1624990103.458 [tank_ballast_and_trim_backseat:Science:B] Running Loop=1
2021-06-29T18:08:23.458Z,1624990103.458 [tank_ballast_and_trim_backseat:Science:C] Running Loop=1
2021-06-29T18:08:23.458Z,1624990103.458 [tank_ballast_and_trim_backseat:Science:D] Running Loop=1
2021-06-29T18:08:23.458Z,1624990103.458 [tank_ballast_and_trim_backseat:Science:E] Running Loop=1
2021-06-29T18:08:23.458Z,1624990103.458 [tank_ballast_and_trim_backseat:Science:F] Running Loop=1
2021-06-29T18:08:23.458Z,1624990103.458 [tank_ballast_and_trim_backseat:Science:Read_Oil] Running Loop=1
2021-06-29T18:08:23.458Z,1624990103.458 [tank_ballast_and_trim_backseat:Science:PeakDetectChl] Running Loop=1
2021-06-29T18:08:23.459Z,1624990103.459 [tank_ballast_and_trim_backseat:Science:PeakDetectChl](DEBUG): Aggregate::initialize tank_ballast_and_trim_backseat:Science:PeakDetectChl
2021-06-29T18:08:23.459Z,1624990103.459 [tank_ballast_and_trim_backseat:Science:PeakDetectChl:A.PeakDetectVsDepth] Running Loop=1
2021-06-29T18:08:23.459Z,1624990103.459 [tank_ballast_and_trim_backseat:Science:PeakDetectChl:A.PeakDetectVsDepth](DEBUG): Initialize.
2021-06-29T18:08:23.461Z,1624990103.461 [tank_ballast_and_trim_backseat:Science:HighestChlPeakReport] Running Loop=1
2021-06-29T18:08:23.461Z,1624990103.461 [tank_ballast_and_trim_backseat:Science:HighestChlPeakReport](DEBUG): Aggregate::initialize tank_ballast_and_trim_backseat:Science:HighestChlPeakReport
2021-06-29T18:08:23.461Z,1624990103.461 [tank_ballast_and_trim_backseat:Science:HighestChlPeakReport:A.PeakDetectHorizontal] Running Loop=1
2021-06-29T18:08:23.462Z,1624990103.462 [tank_ballast_and_trim_backseat:Science:HighestChlPeakReport:A.PeakDetectHorizontal](INFO): Initialize.
2021-06-29T18:08:23.462Z,1624990103.462 [tank_ballast_and_trim_backseat:Science:PeakDetectNO3] Running Loop=1
2021-06-29T18:08:23.463Z,1624990103.463 [tank_ballast_and_trim_backseat:Science:PeakDetectNO3](DEBUG): Aggregate::initialize tank_ballast_and_trim_backseat:Science:PeakDetectNO3
2021-06-29T18:08:23.463Z,1624990103.463 [tank_ballast_and_trim_backseat:Science:PeakDetectNO3:A.PeakDetectVsDepth] Running Loop=1
2021-06-29T18:08:23.463Z,1624990103.463 [tank_ballast_and_trim_backseat:Science:PeakDetectNO3:A.PeakDetectVsDepth](DEBUG): Initialize.
2021-06-29T18:08:23.473Z,1624990103.473 [tank_ballast_and_trim_backseat:Science:PeakDetectOil] Running Loop=1
2021-06-29T18:08:23.473Z,1624990103.473 [tank_ballast_and_trim_backseat:Science:PeakDetectOil](DEBUG): Aggregate::initialize tank_ballast_and_trim_backseat:Science:PeakDetectOil
2021-06-29T18:08:23.473Z,1624990103.473 [tank_ballast_and_trim_backseat:Science:PeakDetectOil:A.PeakDetectVsDepth] Running Loop=1
2021-06-29T18:08:23.473Z,1624990103.473 [tank_ballast_and_trim_backseat:Science:PeakDetectOil:A.PeakDetectVsDepth](DEBUG): Initialize.
2021-06-29T18:08:23.475Z,1624990103.475 [tank_ballast_and_trim_backseat:Science:HighestOilPeakReport] Running Loop=1
2021-06-29T18:08:23.475Z,1624990103.475 [tank_ballast_and_trim_backseat:Science:HighestOilPeakReport](DEBUG): Aggregate::initialize tank_ballast_and_trim_backseat:Science:HighestOilPeakReport
2021-06-29T18:08:23.493Z,1624990103.493 [tank_ballast_and_trim_backseat:Science:HighestOilPeakReport:A.PeakDetectHorizontal] Running Loop=1
2021-06-29T18:08:23.494Z,1624990103.494 [tank_ballast_and_trim_backseat:Science:HighestOilPeakReport:A.PeakDetectHorizontal](INFO): Initialize.
2021-06-29T18:08:23.494Z,1624990103.494 [tank_ballast_and_trim_backseat:Science:PeakDetectFDOM] Running Loop=1
2021-06-29T18:08:23.494Z,1624990103.494 [tank_ballast_and_trim_backseat:Science:PeakDetectFDOM](DEBUG): Aggregate::initialize tank_ballast_and_trim_backseat:Science:PeakDetectFDOM
2021-06-29T18:08:23.494Z,1624990103.494 [tank_ballast_and_trim_backseat:Science:PeakDetectFDOM:A.PeakDetectVsDepth] Running Loop=1
2021-06-29T18:08:23.495Z,1624990103.495 [tank_ballast_and_trim_backseat:Science:PeakDetectFDOM:A.PeakDetectVsDepth](DEBUG): Initialize.
2021-06-29T18:08:23.497Z,1624990103.497 [tank_ballast_and_trim_backseat:Science:PeakDetectSalinity] Running Loop=1
2021-06-29T18:08:23.497Z,1624990103.497 [tank_ballast_and_trim_backseat:Science:PeakDetectSalinity](DEBUG): Aggregate::initialize tank_ballast_and_trim_backseat:Science:PeakDetectSalinity
2021-06-29T18:08:23.497Z,1624990103.497 [tank_ballast_and_trim_backseat:Science:PeakDetectSalinity:A.PeakDetectVsDepth] Running Loop=1
2021-06-29T18:08:23.497Z,1624990103.497 [tank_ballast_and_trim_backseat:Science:PeakDetectSalinity:A.PeakDetectVsDepth](DEBUG): Initialize.
2021-06-29T18:08:23.499Z,1624990103.499 [tank_ballast_and_trim_backseat:Science:HighestSaltPeakReport] Running Loop=1
2021-06-29T18:08:23.499Z,1624990103.499 [tank_ballast_and_trim_backseat:Science:HighestSaltPeakReport](DEBUG): Aggregate::initialize tank_ballast_and_trim_backseat:Science:HighestSaltPeakReport
2021-06-29T18:08:23.499Z,1624990103.499 [tank_ballast_and_trim_backseat:Science:HighestSaltPeakReport:A.PeakDetectHorizontal] Running Loop=1
2021-06-29T18:08:23.499Z,1624990103.499 [tank_ballast_and_trim_backseat:Science:HighestSaltPeakReport:A.PeakDetectHorizontal](INFO): Initialize.
2021-06-29T18:08:23.500Z,1624990103.500 [tank_ballast_and_trim_backseat:Science:OceanCurrent] Running Loop=1
2021-06-29T18:08:23.500Z,1624990103.500 [tank_ballast_and_trim_backseat:Science:OceanCurrent](DEBUG): Aggregate::initialize tank_ballast_and_trim_backseat:Science:OceanCurrent
2021-06-29T18:08:23.500Z,1624990103.500 [tank_ballast_and_trim_backseat:Science:OceanCurrent:A.] Running Loop=1
2021-06-29T18:08:23.500Z,1624990103.500 [tank_ballast_and_trim_backseat:Science:OceanCurrent:A.](INFO): Initializing CurrentEstimator.
2021-06-29T18:08:23.500Z,1624990103.500 [tank_ballast_and_trim_backseat:RunBallastAndTrim] Running Loop=1
2021-06-29T18:08:23.501Z,1624990103.501 [tank_ballast_and_trim_backseat:RunBallastAndTrim](DEBUG): Aggregate::initialize tank_ballast_and_trim_backseat:RunBallastAndTrim
2021-06-29T18:08:23.501Z,1624990103.501 [tank_ballast_and_trim_backseat:RunBallastAndTrim:B.BackseatDriver] Running Loop=1
2021-06-29T18:08:23.501Z,1624990103.501 [tank_ballast_and_trim_backseat:RunBallastAndTrim:B.BackseatDriver](DEBUG): Initialize.
2021-06-29T18:08:23.560Z,1624990103.560 [BackseatComponent](INFO): Powering up
2021-06-29T18:08:23.561Z,1624990103.561 [BackseatComponent](INFO): Subscribing to LCM channels.
2021-06-29T18:08:23.623Z,1624990103.623 [tank_ballast_and_trim_backseat:RunBallastAndTrim:A] Running Loop=1
2021-06-29T18:08:23.623Z,1624990103.623 [tank_ballast_and_trim_backseat:RunBallastAndTrim:B.BackseatDriver] Running Loop=1
2021-06-29T18:08:23.648Z,1624990103.648 [tank_ballast_and_trim_backseat:RunBallastAndTrim:A](INFO): Powering up backseat...
2021-06-29T18:08:23.648Z,1624990103.648 [tank_ballast_and_trim_backseat:RunBallastAndTrim:A] Stopped
2021-06-29T18:08:23.648Z,1624990103.648 [tank_ballast_and_trim_backseat:RunBallastAndTrim:C] Running Loop=1
2021-06-29T18:08:23.648Z,1624990103.648 [tank_ballast_and_trim_backseat:Science] Running Loop=1
2021-06-29T18:08:23.649Z,1624990103.649 [tank_ballast_and_trim_backseat:Science:HighestSaltPeakReport] Stopped
2021-06-29T18:08:23.650Z,1624990103.650 [tank_ballast_and_trim_backseat:Science:HighestSaltPeakReport](DEBUG): Aggregate::uninitialize tank_ballast_and_trim_backseat:Science:HighestSaltPeakReport
2021-06-29T18:08:23.650Z,1624990103.650 [tank_ballast_and_trim_backseat:Science:HighestSaltPeakReport:A.PeakDetectHorizontal] Stopped
2021-06-29T18:08:23.650Z,1624990103.650 [tank_ballast_and_trim_backseat:Science:HighestSaltPeakReport:A.PeakDetectHorizontal](DEBUG): Uninitialize.
2021-06-29T18:08:23.650Z,1624990103.650 [tank_ballast_and_trim_backseat:Science:PeakDetectSalinity] Stopped
2021-06-29T18:08:23.650Z,1624990103.650 [tank_ballast_and_trim_backseat:Science:PeakDetectSalinity](DEBUG): Aggregate::uninitialize tank_ballast_and_trim_backseat:Science:PeakDetectSalinity
2021-06-29T18:08:23.650Z,1624990103.650 [tank_ballast_and_trim_backseat:Science:PeakDetectSalinity:A.PeakDetectVsDepth] Stopped
2021-06-29T18:08:23.650Z,1624990103.650 [tank_ballast_and_trim_backseat:Science:PeakDetectSalinity:A.PeakDetectVsDepth](DEBUG): Uninitialize.
2021-06-29T18:08:23.650Z,1624990103.650 [tank_ballast_and_trim_backseat:Science:PeakDetectFDOM] Stopped
2021-06-29T18:08:23.650Z,1624990103.650 [tank_ballast_and_trim_backseat:Science:PeakDetectFDOM](DEBUG): Aggregate::uninitialize tank_ballast_and_trim_backseat:Science:PeakDetectFDOM
2021-06-29T18:08:23.651Z,1624990103.651 [tank_ballast_and_trim_backseat:Science:PeakDetectFDOM:A.PeakDetectVsDepth] Stopped
2021-06-29T18:08:23.651Z,1624990103.651 [tank_ballast_and_trim_backseat:Science:PeakDetectFDOM:A.PeakDetectVsDepth](DEBUG): Uninitialize.
2021-06-29T18:08:23.651Z,1624990103.651 [tank_ballast_and_trim_backseat:Science:HighestOilPeakReport] Stopped
2021-06-29T18:08:23.651Z,1624990103.651 [tank_ballast_and_trim_backseat:Science:HighestOilPeakReport](DEBUG): Aggregate::uninitialize tank_ballast_and_trim_backseat:Science:HighestOilPeakReport
2021-06-29T18:08:23.651Z,1624990103.651 [tank_ballast_and_trim_backseat:Science:HighestOilPeakReport:A.PeakDetectHorizontal] Stopped
2021-06-29T18:08:23.651Z,1624990103.651 [tank_ballast_and_trim_backseat:Science:HighestOilPeakReport:A.PeakDetectHorizontal](DEBUG): Uninitialize.
2021-06-29T18:08:23.651Z,1624990103.651 [tank_ballast_and_trim_backseat:Science:PeakDetectOil] Stopped
2021-06-29T18:08:23.651Z,1624990103.651 [tank_ballast_and_trim_backseat:Science:PeakDetectOil](DEBUG): Aggregate::uninitialize tank_ballast_and_trim_backseat:Science:PeakDetectOil
2021-06-29T18:08:23.651Z,1624990103.651 [tank_ballast_and_trim_backseat:Science:PeakDetectOil:A.PeakDetectVsDepth] Stopped
2021-06-29T18:08:23.651Z,1624990103.651 [tank_ballast_and_trim_backseat:Science:PeakDetectOil:A.PeakDetectVsDepth](DEBUG): Uninitialize.
2021-06-29T18:08:23.652Z,1624990103.652 [tank_ballast_and_trim_backseat:Science:PeakDetectNO3] Stopped
2021-06-29T18:08:23.652Z,1624990103.652 [tank_ballast_and_trim_backseat:Science:PeakDetectNO3](DEBUG): Aggregate::uninitialize tank_ballast_and_trim_backseat:Science:PeakDetectNO3
2021-06-29T18:08:23.652Z,1624990103.652 [tank_ballast_and_trim_backseat:Science:PeakDetectNO3:A.PeakDetectVsDepth] Stopped
2021-06-29T18:08:23.652Z,1624990103.652 [tank_ballast_and_trim_backseat:Science:PeakDetectNO3:A.PeakDetectVsDepth](DEBUG): Uninitialize.
2021-06-29T18:08:23.652Z,1624990103.652 [tank_ballast_and_trim_backseat:Science:HighestChlPeakReport] Stopped
2021-06-29T18:08:23.652Z,1624990103.652 [tank_ballast_and_trim_backseat:Science:HighestChlPeakReport](DEBUG): Aggregate::uninitialize tank_ballast_and_trim_backseat:Science:HighestChlPeakReport
2021-06-29T18:08:23.652Z,1624990103.652 [tank_ballast_and_trim_backseat:Science:HighestChlPeakReport:A.PeakDetectHorizontal] Stopped
2021-06-29T18:08:23.652Z,1624990103.652 [tank_ballast_and_trim_backseat:Science:HighestChlPeakReport:A.PeakDetectHorizontal](DEBUG): Uninitialize.
2021-06-29T18:08:23.652Z,1624990103.652 [tank_ballast_and_trim_backseat:Science:PeakDetectChl] Stopped
2021-06-29T18:08:23.653Z,1624990103.653 [tank_ballast_and_trim_backseat:Science:PeakDetectChl](DEBUG): Aggregate::uninitialize tank_ballast_and_trim_backseat:Science:PeakDetectChl
2021-06-29T18:08:23.653Z,1624990103.653 [tank_ballast_and_trim_backseat:Science:PeakDetectChl:A.PeakDetectVsDepth] Stopped
2021-06-29T18:08:23.653Z,1624990103.653 [tank_ballast_and_trim_backseat:Science:PeakDetectChl:A.PeakDetectVsDepth](DEBUG): Uninitialize.
2021-06-29T18:08:23.653Z,1624990103.653 [tank_ballast_and_trim_backseat:Science:OceanCurrent:A.] Running Loop=1
2021-06-29T18:08:23.653Z,1624990103.653 [tank_ballast_and_trim_backseat:Science:Read_Oil] Stopped
2021-06-29T18:08:23.653Z,1624990103.653 [tank_ballast_and_trim_backseat:Science:F] Stopped
2021-06-29T18:08:23.653Z,1624990103.653 [tank_ballast_and_trim_backseat:Science:E] Running Loop=1
2021-06-29T18:08:23.654Z,1624990103.654 [tank_ballast_and_trim_backseat:Science:E](DEBUG): Initialize ReadDataComponent to sense mass_concentration_of_chlorophyll_in_sea_water
2021-06-29T18:08:23.654Z,1624990103.654 [tank_ballast_and_trim_backseat:Science:D] Stopped
2021-06-29T18:08:23.654Z,1624990103.654 [tank_ballast_and_trim_backseat:Science:C] Running Loop=1
2021-06-29T18:08:23.655Z,1624990103.655 [tank_ballast_and_trim_backseat:Science:C](DEBUG): Initialize ReadDataComponent to sense CTD_Seabird.sea_water_temperature
2021-06-29T18:08:23.657Z,1624990103.657 [tank_ballast_and_trim_backseat:Science:C](DEBUG): Initialize ReadDataComponent to sense CTD_Seabird.sea_water_salinity
2021-06-29T18:08:23.657Z,1624990103.657 [tank_ballast_and_trim_backseat:Science:B] Running Loop=1
2021-06-29T18:08:23.658Z,1624990103.658 [tank_ballast_and_trim_backseat:Science:B](DEBUG): Initialize ReadDataComponent to sense sea_water_temperature
2021-06-29T18:08:23.658Z,1624990103.658 [tank_ballast_and_trim_backseat:Science:B](DEBUG): Initialize ReadDataComponent to sense sea_water_salinity
2021-06-29T18:08:23.659Z,1624990103.659 [tank_ballast_and_trim_backseat:Science:A] Stopped
2021-06-29T18:08:23.761Z,1624990103.761 [WetLabsBB2FL](INFO): Powering up
2021-06-29T18:08:23.786Z,1624990103.786 [tank_ballast_and_trim_backseat:RunBallastAndTrim:C](INFO): Backseat powered.
2021-06-29T18:08:23.786Z,1624990103.786 [tank_ballast_and_trim_backseat:RunBallastAndTrim:C] Stopped
2021-06-29T18:08:23.787Z,1624990103.787 [tank_ballast_and_trim_backseat:RunBallastAndTrim:Depth1] Running Loop=1
2021-06-29T18:08:23.787Z,1624990103.787 [tank_ballast_and_trim_backseat:RunBallastAndTrim:Depth1](DEBUG): Aggregate::initialize tank_ballast_and_trim_backseat:RunBallastAndTrim:Depth1
2021-06-29T18:08:23.787Z,1624990103.787 [tank_ballast_and_trim_backseat:RunBallastAndTrim:Depth1:A] Running Loop=1
2021-06-29T18:08:24.186Z,1624990104.186 [tank_ballast_and_trim_backseat:RunBallastAndTrim:Depth1:A] Stopped
2021-06-29T18:08:24.186Z,1624990104.186 [tank_ballast_and_trim_backseat:RunBallastAndTrim:Depth1:B] Running Loop=1
2021-06-29T18:08:24.186Z,1624990104.186 [tank_ballast_and_trim_backseat:RunBallastAndTrim:Depth1:B](DEBUG): Aggregate::initialize tank_ballast_and_trim_backseat:RunBallastAndTrim:Depth1:B
2021-06-29T18:08:24.641Z,1624990104.641 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim] Running Loop=1
2021-06-29T18:08:24.641Z,1624990104.641 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim](DEBUG): Aggregate::initialize tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim
2021-06-29T18:08:24.641Z,1624990104.641 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:A] Running Loop=1
2021-06-29T18:08:24.641Z,1624990104.641 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:B] Running Loop=1
2021-06-29T18:08:24.641Z,1624990104.641 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:C] Running Loop=1
2021-06-29T18:08:24.641Z,1624990104.641 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:D] Running Loop=1
2021-06-29T18:08:24.641Z,1624990104.641 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:E] Running Loop=1
2021-06-29T18:08:24.641Z,1624990104.641 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:F] Running Loop=1
2021-06-29T18:08:24.642Z,1624990104.642 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:G] Running Loop=1
2021-06-29T18:08:24.644Z,1624990104.644 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:G](INFO): Going to target depth. Speed set to 0.000000 m/s 
2021-06-29T18:08:24.644Z,1624990104.644 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:G] Stopped
2021-06-29T18:08:24.645Z,1624990104.645 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth] Running Loop=1
2021-06-29T18:08:24.645Z,1624990104.645 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth](DEBUG): Aggregate::initialize tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth
2021-06-29T18:08:24.645Z,1624990104.645 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:A] Running Loop=1
2021-06-29T18:08:24.645Z,1624990104.645 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ActuatorHold] Running Loop=1
2021-06-29T18:08:24.645Z,1624990104.645 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ActuatorHold](DEBUG): Aggregate::initialize tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ActuatorHold
2021-06-29T18:08:24.645Z,1624990104.645 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ActuatorHold:A.Point] Running Loop=1
2021-06-29T18:08:24.646Z,1624990104.646 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ActuatorHold:A.Point](DEBUG): Initialize.
2021-06-29T18:08:24.646Z,1624990104.646 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ActuatorHold:B.Buoyancy] Running Loop=1
2021-06-29T18:08:24.646Z,1624990104.646 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ActuatorHold:B.Buoyancy](DEBUG): Initialize Buoyancy Component.
2021-06-29T18:08:24.646Z,1624990104.646 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ActuatorHold:C.Pitch] Running Loop=1
2021-06-29T18:08:24.646Z,1624990104.646 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ActuatorHold:C.Pitch](DEBUG): Initialize.
2021-06-29T18:08:24.646Z,1624990104.646 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:WaitPreDive] Running Loop=1
2021-06-29T18:08:24.647Z,1624990104.647 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:WaitPreDive](DEBUG): Aggregate::initialize tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:WaitPreDive
2021-06-29T18:08:24.647Z,1624990104.647 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:WaitPreDive:A] Running Loop=1
2021-06-29T18:08:24.647Z,1624990104.647 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:F] Running Loop=1
2021-06-29T18:08:24.647Z,1624990104.647 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:E] Running Loop=1
2021-06-29T18:08:24.647Z,1624990104.647 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:D] Running Loop=1
2021-06-29T18:08:24.648Z,1624990104.648 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:C] Running Loop=1
2021-06-29T18:08:24.648Z,1624990104.648 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:B] Running Loop=1
2021-06-29T18:08:24.648Z,1624990104.648 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:A] Running Loop=1
2021-06-29T18:08:25.074Z,1624990105.074 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:WaitPreDive] Stopped
2021-06-29T18:08:25.075Z,1624990105.075 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:WaitPreDive](DEBUG): Aggregate::uninitialize tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:WaitPreDive
2021-06-29T18:08:25.075Z,1624990105.075 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:WaitPreDive:A] Stopped
2021-06-29T18:08:25.075Z,1624990105.075 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ApproachDepth] Running Loop=1
2021-06-29T18:08:25.075Z,1624990105.075 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ApproachDepth](DEBUG): Aggregate::initialize tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ApproachDepth
2021-06-29T18:08:25.075Z,1624990105.075 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ApproachDepth:B.SetSpeed] Running Loop=1
2021-06-29T18:08:25.075Z,1624990105.075 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ApproachDepth:B.SetSpeed](DEBUG): Initialize.
2021-06-29T18:08:25.075Z,1624990105.075 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ApproachDepth:A] Running Loop=1
2021-06-29T18:08:25.075Z,1624990105.075 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ActuatorHold] Stopped
2021-06-29T18:08:25.076Z,1624990105.076 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ActuatorHold](DEBUG): Aggregate::uninitialize tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ActuatorHold
2021-06-29T18:08:25.076Z,1624990105.076 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ActuatorHold:A.Point] Stopped
2021-06-29T18:08:25.076Z,1624990105.076 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ActuatorHold:B.Buoyancy] Stopped
2021-06-29T18:08:25.076Z,1624990105.076 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ActuatorHold:B.Buoyancy](DEBUG): Uninitialize Buoyancy Component.
2021-06-29T18:08:25.076Z,1624990105.076 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ActuatorHold:C.Pitch] Stopped
2021-06-29T18:08:25.076Z,1624990105.076 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:A] Running Loop=1
2021-06-29T18:08:25.386Z,1624990105.386 [BPC1](ERROR): BPC1B: No match for serial number 0BEC in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:08:25.421Z,1624990105.421 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ApproachDepth:B.SetSpeed] Running Loop=1
2021-06-29T18:08:25.422Z,1624990105.422 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ApproachDepth:A](INFO): Moving to 7.000000 m 
2021-06-29T18:08:25.422Z,1624990105.422 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ApproachDepth:A] Stopped
2021-06-29T18:08:25.422Z,1624990105.422 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ApproachDepth:C.Pitch] Running Loop=1
2021-06-29T18:08:25.422Z,1624990105.422 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ApproachDepth:C.Pitch](DEBUG): Initialize.
2021-06-29T18:08:27.077Z,1624990107.077 [CTD_Seabird](ERROR): Failed to parse device response: <!--startlogging-->
2021-06-29T18:08:38.668Z,1624990118.668 [BPC1](INFO): Calculating totals. Valid battery stick count: 50. Valid reserve battery stick count: 5.
2021-06-29T18:08:38.703Z,1624990118.703 [BPC1](INFO): Received data from all battery sticks.
2021-06-29T18:09:18.933Z,1624990158.933 [BackseatComponent](IMPORTANT): IBASE917-01: running backseat application.
2021-06-29T18:09:21.639Z,1624990161.639 [BackseatComponent](INFO): Created universal data reader for depth with code: 6
2021-06-29T18:09:21.640Z,1624990161.640 [BackseatComponent](INFO): Requesting data from depth (6). Requested size is: 1
2021-06-29T18:09:21.643Z,1624990161.643 [BackseatComponent](INFO): Created universal data reader for latitude with code: 23
2021-06-29T18:09:21.643Z,1624990161.643 [BackseatComponent](INFO): Requesting data from latitude (23). Requested size is: 2
2021-06-29T18:09:21.646Z,1624990161.646 [BackseatComponent](INFO): Created universal data reader for longitude with code: 26
2021-06-29T18:09:21.647Z,1624990161.647 [BackseatComponent](INFO): Requesting data from longitude (26). Requested size is: 3
2021-06-29T18:09:21.650Z,1624990161.650 [BackseatComponent](INFO): Created universal data reader for platform_orientation with code: 52
2021-06-29T18:09:21.650Z,1624990161.650 [BackseatComponent](INFO): Requesting data from platform_orientation (52). Requested size is: 4
2021-06-29T18:09:21.653Z,1624990161.653 [BackseatComponent](INFO): Created universal data reader for platform_pitch_angle with code: 54
2021-06-29T18:09:21.653Z,1624990161.653 [BackseatComponent](INFO): Requesting data from platform_pitch_angle (54). Requested size is: 5
2021-06-29T18:09:21.656Z,1624990161.656 [BackseatComponent](INFO): Created universal data reader for platform_roll_angle with code: 59
2021-06-29T18:09:21.657Z,1624990161.657 [BackseatComponent](INFO): Requesting data from platform_roll_angle (59). Requested size is: 6
2021-06-29T18:09:21.659Z,1624990161.659 [BackseatComponent](INFO): Created universal data reader for platform_x_velocity_wrt_sea_water with code: 70
2021-06-29T18:09:21.660Z,1624990161.660 [BackseatComponent](INFO): Requesting data from platform_x_velocity_wrt_sea_water (70). Requested size is: 7
2021-06-29T18:10:00.276Z,1624990200.276 [DeadReckonUsingMultipleVelocitySources] Software Fault, FailCount= 2
2021-06-29T18:10:00.276Z,1624990200.276 [DeadReckonUsingMultipleVelocitySources](ERROR): Software Fault
2021-06-29T18:10:00.372Z,1624990200.372 [CBIT](ERROR): Software Fault in component: DeadReckonUsingMultipleVelocitySources
2021-06-29T18:10:00.808Z,1624990200.808 [CBIT](INFO): Clearing failed state for component DeadReckonUsingMultipleVelocitySources
2021-06-29T18:10:00.808Z,1624990200.808 [DeadReckonUsingMultipleVelocitySources] No Fault, FailCount= 2
2021-06-29T18:10:59.250Z,1624990259.250 [Power24vConverter](INFO): Powering down.
2021-06-29T18:11:23.080Z,1624990283.080 [DataOverHttps](INFO): Exceeded connect timeout, disconnecting.
2021-06-29T18:11:25.092Z,1624990285.092 [DataOverHttps](INFO): setting unavailable, lastComms_.elapsed()=60.267323
2021-06-29T18:11:58.224Z,1624990318.224 [DataOverHttps](INFO): Exceeded connect timeout, disconnecting.
2021-06-29T18:12:15.336Z,1624990335.336 [Radio_Surface](INFO): Powering down
2021-06-29T18:12:33.368Z,1624990353.368 [DataOverHttps](INFO): Exceeded connect timeout, disconnecting.
2021-06-29T18:12:34.372Z,1624990354.372 [DataOverHttps](INFO): Radio surface powered OFF, will not connect.
2021-06-29T18:13:01.263Z,1624990381.263 [DeadReckonUsingMultipleVelocitySources] Software Fault, FailCount= 3
2021-06-29T18:13:01.263Z,1624990381.263 [DeadReckonUsingMultipleVelocitySources](ERROR): Software Fault
2021-06-29T18:13:01.340Z,1624990381.340 [CBIT](ERROR): Software Fault in component: DeadReckonUsingMultipleVelocitySources
2021-06-29T18:13:01.748Z,1624990381.748 [CBIT](INFO): Clearing failed state for component DeadReckonUsingMultipleVelocitySources
2021-06-29T18:13:01.748Z,1624990381.748 [DeadReckonUsingMultipleVelocitySources] No Fault, FailCount= 3
2021-06-29T18:14:52.770Z,1624990492.770 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ApproachDepth:C.Pitch] Stopped
2021-06-29T18:14:52.770Z,1624990492.770 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ApproachDepth](INFO): Completed tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ApproachDepth
2021-06-29T18:14:52.770Z,1624990492.770 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ApproachDepth] Stopped
2021-06-29T18:14:52.771Z,1624990492.771 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ApproachDepth](DEBUG): Aggregate::uninitialize tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ApproachDepth
2021-06-29T18:14:52.771Z,1624990492.771 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ApproachDepth:B.SetSpeed] Stopped
2021-06-29T18:14:52.771Z,1624990492.771 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:ApproachDepth:B.SetSpeed](DEBUG): Uninitialize.
2021-06-29T18:14:52.771Z,1624990492.771 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth](INFO): Completed tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth
2021-06-29T18:14:52.771Z,1624990492.771 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth] Stopped
2021-06-29T18:14:52.772Z,1624990492.772 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth](DEBUG): Aggregate::uninitialize tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth
2021-06-29T18:14:52.772Z,1624990492.772 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:GoToTargetDepth:A] Stopped
2021-06-29T18:14:52.772Z,1624990492.772 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth] Running Loop=1
2021-06-29T18:14:52.772Z,1624990492.772 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth](DEBUG): Aggregate::initialize tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth
2021-06-29T18:14:52.772Z,1624990492.772 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:A.SetSpeed] Running Loop=1
2021-06-29T18:14:52.772Z,1624990492.772 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:A.SetSpeed](DEBUG): Initialize.
2021-06-29T18:14:52.773Z,1624990492.773 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:B.Pitch] Running Loop=1
2021-06-29T18:14:52.773Z,1624990492.773 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:B.Pitch](DEBUG): Initialize.
2021-06-29T18:14:52.773Z,1624990492.773 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:C] Running Loop=1
2021-06-29T18:14:53.178Z,1624990493.178 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:C](INFO): Waiting for the vehicle to settle. Depth = 7.027550 m 
2021-06-29T18:14:53.178Z,1624990493.178 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:C] Stopped
2021-06-29T18:14:53.179Z,1624990493.179 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:D.Wait] Running Loop=1
2021-06-29T18:14:53.179Z,1624990493.179 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:D.Wait](DEBUG): Initialize Wait Component.
2021-06-29T18:14:53.179Z,1624990493.179 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:B.Pitch] Running Loop=1
2021-06-29T18:14:53.179Z,1624990493.179 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:A.SetSpeed] Running Loop=1
2021-06-29T18:16:02.261Z,1624990562.261 [DeadReckonUsingMultipleVelocitySources] Software Fault, FailCount= 4
2021-06-29T18:16:02.262Z,1624990562.262 [DeadReckonUsingMultipleVelocitySources](ERROR): Software Fault
2021-06-29T18:16:02.381Z,1624990562.381 [CBIT](ERROR): Software Fault in component: DeadReckonUsingMultipleVelocitySources
2021-06-29T18:16:02.753Z,1624990562.753 [CBIT](INFO): Clearing failed state for component DeadReckonUsingMultipleVelocitySources
2021-06-29T18:16:02.753Z,1624990562.753 [DeadReckonUsingMultipleVelocitySources] No Fault, FailCount= 4
2021-06-29T18:19:03.257Z,1624990743.257 [DeadReckonUsingMultipleVelocitySources] Software Fault, FailCount= 5
2021-06-29T18:19:03.257Z,1624990743.257 [DeadReckonUsingMultipleVelocitySources](ERROR): Software Fault
2021-06-29T18:19:03.404Z,1624990743.404 [CBIT](ERROR): Software Fault in component: DeadReckonUsingMultipleVelocitySources
2021-06-29T18:19:03.812Z,1624990743.812 [CBIT](INFO): Clearing failed state for component DeadReckonUsingMultipleVelocitySources
2021-06-29T18:19:03.813Z,1624990743.813 [DeadReckonUsingMultipleVelocitySources] No Fault, FailCount= 5
2021-06-29T18:19:53.770Z,1624990793.770 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:D.Wait](INFO): Done Waiting.
2021-06-29T18:19:53.770Z,1624990793.770 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:D.Wait] Stopped
2021-06-29T18:19:53.771Z,1624990793.771 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:D.Wait](DEBUG): Uninitialize Wait Component.
2021-06-29T18:19:53.771Z,1624990793.771 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:E] Running Loop=1
2021-06-29T18:19:54.159Z,1624990794.159 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:E](INFO): Running ballast and trim. Depth = 7.414977 m 
2021-06-29T18:19:54.160Z,1624990794.160 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:E] Stopped
2021-06-29T18:19:54.160Z,1624990794.160 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:F.] Running Loop=1
2021-06-29T18:19:54.160Z,1624990794.160 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:F.](INFO): Initializing BallastAndTrim.
2021-06-29T18:21:08.117Z,1624990868.117 [BPC1](ERROR): BPC1B: No match for serial number 0C29 in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:21:21.472Z,1624990881.472 [BPC1](ERROR): BPC1B: No match for serial number 0BEC in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:21:35.167Z,1624990895.167 [BPC1](ERROR): BPC1B: No match for serial number 0BEC in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:21:48.890Z,1624990908.890 [BPC1](ERROR): BPC1B: No match for serial number 0BEC in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:22:03.028Z,1624990923.028 [BPC1](ERROR): BPC1B: No match for serial number 0BEC in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:22:04.243Z,1624990924.243 [DeadReckonUsingMultipleVelocitySources] Software Fault, FailCount= 6
2021-06-29T18:22:04.243Z,1624990924.243 [DeadReckonUsingMultipleVelocitySources](ERROR): Software Fault
2021-06-29T18:22:04.360Z,1624990924.360 [CBIT](ERROR): Software Fault in component: DeadReckonUsingMultipleVelocitySources
2021-06-29T18:22:04.797Z,1624990924.797 [CBIT](INFO): Clearing failed state for component DeadReckonUsingMultipleVelocitySources
2021-06-29T18:22:04.797Z,1624990924.797 [DeadReckonUsingMultipleVelocitySources] No Fault, FailCount= 6
2021-06-29T18:22:16.759Z,1624990936.759 [BPC1](ERROR): BPC1B: No match for serial number 0BEC in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:22:30.092Z,1624990950.092 [BPC1](ERROR): BPC1B: No match for serial number 0BEC in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:22:43.026Z,1624990963.026 [BPC1](ERROR): BPC1B: No match for serial number 0BEC in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:22:56.361Z,1624990976.361 [BPC1](ERROR): BPC1B: No match for serial number 0BEC in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:23:09.680Z,1624990989.680 [BPC1](ERROR): BPC1B: No match for serial number 0BEC in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:23:23.012Z,1624991003.012 [BPC1](ERROR): BPC1B: No match for serial number 0BEC in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:25:05.246Z,1624991105.246 [DeadReckonUsingMultipleVelocitySources] Software Fault, FailCount= 7
2021-06-29T18:25:05.246Z,1624991105.246 [DeadReckonUsingMultipleVelocitySources](ERROR): Software Fault
2021-06-29T18:25:05.380Z,1624991105.380 [CBIT](ERROR): Software Fault in component: DeadReckonUsingMultipleVelocitySources
2021-06-29T18:25:05.800Z,1624991105.800 [CBIT](INFO): Clearing failed state for component DeadReckonUsingMultipleVelocitySources
2021-06-29T18:25:05.800Z,1624991105.800 [DeadReckonUsingMultipleVelocitySources] No Fault, FailCount= 7
2021-06-29T18:26:04.634Z,1624991164.634 [BPC1](INFO): Calculating totals. Valid battery stick count: 54. Valid reserve battery stick count: 5.
2021-06-29T18:26:04.637Z,1624991164.637 [BPC1](INFO): Received data from all battery sticks.
2021-06-29T18:28:06.249Z,1624991286.249 [DeadReckonUsingMultipleVelocitySources] Software Fault, FailCount= 8
2021-06-29T18:28:06.249Z,1624991286.249 [DeadReckonUsingMultipleVelocitySources](ERROR): Software Fault
2021-06-29T18:28:06.336Z,1624991286.336 [CBIT](ERROR): Software Fault in component: DeadReckonUsingMultipleVelocitySources
2021-06-29T18:28:06.728Z,1624991286.728 [CBIT](INFO): Clearing failed state for component DeadReckonUsingMultipleVelocitySources
2021-06-29T18:28:06.728Z,1624991286.728 [DeadReckonUsingMultipleVelocitySources] No Fault, FailCount= 8
2021-06-29T18:29:54.565Z,1624991394.565 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:F.](IMPORTANT): BallastAndTrim completed. Estimation time: 10.00 minutes.
2021-06-29T18:29:54.566Z,1624991394.566 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:F.](IMPORTANT): Estimated buoyancyNeutral: 200.908756 +/- 8.022425 cc (conf. level 99.90%, sigma: 9.779401 cc).
2021-06-29T18:29:54.567Z,1624991394.567 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:F.](IMPORTANT): Estimated massDefault: 12.685495 +/- 2.923775 mm (conf. level 99.90%, sigma: 3.564105 mm).
2021-06-29T18:29:54.568Z,1624991394.568 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:F.](IMPORTANT): Changing persisted config values to: 200.908756 cc buoyancy neutral and 12.685495 mm mass default
2021-06-29T18:29:54.577Z,1624991394.577 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:F.](IMPORTANT): Listing configuration overrides from Data/persisted.cfg
2021-06-29T18:29:54.577Z,1624991394.577 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:F.](IMPORTANT): BPC1.batteryMissingStickThreshold=8 count;

2021-06-29T18:29:54.578Z,1624991394.578 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:F.](IMPORTANT): BPC1.batterySamplingInterval=1 minute;

2021-06-29T18:29:54.578Z,1624991394.578 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:F.](IMPORTANT): BPC1.batteryStickCommsTimeout=10 second;

2021-06-29T18:29:54.578Z,1624991394.578 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:F.](IMPORTANT): BackseatComponent.loadAtStartup=1 bool;

2021-06-29T18:29:54.578Z,1624991394.578 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:F.](IMPORTANT): CBIT.abortDepth=115 meter;

2021-06-29T18:29:54.578Z,1624991394.578 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:F.](IMPORTANT): CBIT.gf24Offset=-27 microampere;

2021-06-29T18:29:54.578Z,1624991394.578 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:F.](IMPORTANT): CBIT.stopDepth=110 meter;

2021-06-29T18:29:54.578Z,1624991394.578 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:F.](IMPORTANT): DAT.loadAtStartup=0 bool;

2021-06-29T18:29:54.579Z,1624991394.579 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:F.](IMPORTANT): DropWeight.loadAtStartup=0 bool;

2021-06-29T18:29:54.579Z,1624991394.579 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:F.](IMPORTANT): Express none WetLabsBB2FL.bin_mean_mass_concentration_of_chlorophyll_in_sea_water;

2021-06-29T18:29:54.579Z,1624991394.579 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:F.](IMPORTANT): Express linearApproximation platform_roll_angle 2.000000 degree;

2021-06-29T18:29:54.579Z,1624991394.579 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:F.](IMPORTANT): ThrusterServo.loadAtStartup=0 bool;

2021-06-29T18:29:54.579Z,1624991394.579 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:F.](IMPORTANT): VerticalControl.buoyancyNeutral=200.908756 cubic_centimeter;

2021-06-29T18:29:54.579Z,1624991394.579 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:F.](IMPORTANT): VerticalControl.massDefault=12.685495 millimeter;

2021-06-29T18:29:54.584Z,1624991394.584 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:F.] Stopped
2021-06-29T18:29:54.584Z,1624991394.584 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:F.](INFO): Uninitializing BallastAndTrim.
2021-06-29T18:29:54.585Z,1624991394.585 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth](INFO): Completed tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth
2021-06-29T18:29:54.585Z,1624991394.585 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth] Stopped
2021-06-29T18:29:54.585Z,1624991394.585 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth](DEBUG): Aggregate::uninitialize tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth
2021-06-29T18:29:54.585Z,1624991394.585 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:A.SetSpeed] Stopped
2021-06-29T18:29:54.585Z,1624991394.585 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:A.SetSpeed](DEBUG): Uninitialize.
2021-06-29T18:29:54.586Z,1624991394.586 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:BallastAndTrimAtTargetDepth:B.Pitch] Stopped
2021-06-29T18:29:54.587Z,1624991394.587 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim](INFO): Completed tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim
2021-06-29T18:29:54.587Z,1624991394.587 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim] Stopped
2021-06-29T18:29:54.587Z,1624991394.587 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim](DEBUG): Aggregate::uninitialize tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim
2021-06-29T18:29:54.587Z,1624991394.587 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:A] Stopped
2021-06-29T18:29:54.587Z,1624991394.587 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:B] Stopped
2021-06-29T18:29:54.592Z,1624991394.592 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:C] Stopped
2021-06-29T18:29:54.592Z,1624991394.592 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:D] Stopped
2021-06-29T18:29:54.592Z,1624991394.592 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:E] Stopped
2021-06-29T18:29:54.592Z,1624991394.592 [tank_ballast_and_trim_backseat:RunBallastAndTrim:BallastAndTrim:F] Stopped
2021-06-29T18:29:54.954Z,1624991394.954 [tank_ballast_and_trim_backseat:RunBallastAndTrim:Depth1:B](INFO): Completed tank_ballast_and_trim_backseat:RunBallastAndTrim:Depth1:B
2021-06-29T18:29:54.954Z,1624991394.954 [tank_ballast_and_trim_backseat:RunBallastAndTrim:Depth1:B] Stopped
2021-06-29T18:29:54.954Z,1624991394.954 [tank_ballast_and_trim_backseat:RunBallastAndTrim:Depth1:B](DEBUG): Aggregate::uninitialize tank_ballast_and_trim_backseat:RunBallastAndTrim:Depth1:B
2021-06-29T18:29:54.954Z,1624991394.954 [tank_ballast_and_trim_backseat:RunBallastAndTrim:Depth1](INFO): Completed tank_ballast_and_trim_backseat:RunBallastAndTrim:Depth1
2021-06-29T18:29:54.954Z,1624991394.954 [tank_ballast_and_trim_backseat:RunBallastAndTrim:Depth1] Stopped
2021-06-29T18:29:54.954Z,1624991394.954 [tank_ballast_and_trim_backseat:RunBallastAndTrim:Depth1](DEBUG): Aggregate::uninitialize tank_ballast_and_trim_backseat:RunBallastAndTrim:Depth1
2021-06-29T18:29:54.954Z,1624991394.954 [tank_ballast_and_trim_backseat:RunBallastAndTrim:Depth2] Running Loop=1
2021-06-29T18:29:54.955Z,1624991394.955 [tank_ballast_and_trim_backseat:RunBallastAndTrim:Depth2](DEBUG): Aggregate::initialize tank_ballast_and_trim_backseat:RunBallastAndTrim:Depth2
2021-06-29T18:29:54.955Z,1624991394.955 [tank_ballast_and_trim_backseat:RunBallastAndTrim:Depth2:A] Running Loop=1
2021-06-29T18:29:55.338Z,1624991395.338 [tank_ballast_and_trim_backseat:RunBallastAndTrim:Depth2] Stopped
2021-06-29T18:29:55.339Z,1624991395.339 [tank_ballast_and_trim_backseat:RunBallastAndTrim:Depth2](DEBUG): Aggregate::uninitialize tank_ballast_and_trim_backseat:RunBallastAndTrim:Depth2
2021-06-29T18:29:55.339Z,1624991395.339 [tank_ballast_and_trim_backseat:RunBallastAndTrim:Depth2:A] Stopped
2021-06-29T18:29:55.376Z,1624991395.376 [tank_ballast_and_trim_backseat:RunBallastAndTrim](INFO): Completed tank_ballast_and_trim_backseat:RunBallastAndTrim
2021-06-29T18:29:55.376Z,1624991395.376 [tank_ballast_and_trim_backseat:RunBallastAndTrim] Stopped
2021-06-29T18:29:55.376Z,1624991395.376 [tank_ballast_and_trim_backseat:RunBallastAndTrim](DEBUG): Aggregate::uninitialize tank_ballast_and_trim_backseat:RunBallastAndTrim
2021-06-29T18:29:55.376Z,1624991395.376 [tank_ballast_and_trim_backseat:RunBallastAndTrim:B.BackseatDriver] Stopped
2021-06-29T18:29:55.376Z,1624991395.376 [tank_ballast_and_trim_backseat:RunBallastAndTrim:B.BackseatDriver](DEBUG): Uninitialize.
2021-06-29T18:29:55.377Z,1624991395.377 [tank_ballast_and_trim_backseat:Float_Up] Running Loop=1
2021-06-29T18:29:55.377Z,1624991395.377 [tank_ballast_and_trim_backseat:Float_Up](DEBUG): Aggregate::initialize tank_ballast_and_trim_backseat:Float_Up
2021-06-29T18:29:55.377Z,1624991395.377 [tank_ballast_and_trim_backseat:Float_Up:A.Buoyancy] Running Loop=1
2021-06-29T18:29:55.377Z,1624991395.377 [tank_ballast_and_trim_backseat:Float_Up:A.Buoyancy](DEBUG): Initialize Buoyancy Component.
2021-06-29T18:29:55.377Z,1624991395.377 [tank_ballast_and_trim_backseat:Float_Up:B.Wait] Running Loop=1
2021-06-29T18:29:55.377Z,1624991395.377 [tank_ballast_and_trim_backseat:Float_Up:B.Wait](DEBUG): Initialize Wait Component.
2021-06-29T18:29:55.709Z,1624991395.709 [BackseatComponent](INFO): Sent LCM shutdown request.
2021-06-29T18:29:55.755Z,1624991395.755 [tank_ballast_and_trim_backseat:Float_Up:A.Buoyancy] Running Loop=1
2021-06-29T18:30:10.844Z,1624991410.844 [BackseatComponent](INFO): Powering down
2021-06-29T18:30:11.048Z,1624991411.048 [BackseatComponent](INFO): Unsubscribing from LCM channels.
2021-06-29T18:30:11.048Z,1624991411.048 [LcmUniversalReporter](INFO): Deactivating messaging.
2021-06-29T18:31:07.247Z,1624991467.247 [DeadReckonUsingMultipleVelocitySources] Software Fault, FailCount= 9
2021-06-29T18:31:07.247Z,1624991467.247 [DeadReckonUsingMultipleVelocitySources](ERROR): Software Fault
2021-06-29T18:31:07.289Z,1624991467.289 [CBIT](ERROR): Software Fault in component: DeadReckonUsingMultipleVelocitySources
2021-06-29T18:31:07.701Z,1624991467.701 [CBIT](INFO): Clearing failed state for component DeadReckonUsingMultipleVelocitySources
2021-06-29T18:31:07.701Z,1624991467.701 [DeadReckonUsingMultipleVelocitySources] No Fault, FailCount= 9
2021-06-29T18:31:43.218Z,1624991503.218 [tank_ballast_and_trim_backseat:Float_Up] Stopped
2021-06-29T18:31:43.218Z,1624991503.218 [tank_ballast_and_trim_backseat:Float_Up](DEBUG): Aggregate::uninitialize tank_ballast_and_trim_backseat:Float_Up
2021-06-29T18:31:43.218Z,1624991503.218 [tank_ballast_and_trim_backseat:Float_Up:A.Buoyancy] Stopped
2021-06-29T18:31:43.218Z,1624991503.218 [tank_ballast_and_trim_backseat:Float_Up:A.Buoyancy](DEBUG): Uninitialize Buoyancy Component.
2021-06-29T18:31:43.218Z,1624991503.218 [tank_ballast_and_trim_backseat:Float_Up:B.Wait] Stopped
2021-06-29T18:31:43.218Z,1624991503.218 [tank_ballast_and_trim_backseat:Float_Up:B.Wait](DEBUG): Uninitialize Wait Component.
2021-06-29T18:31:43.220Z,1624991503.220 [tank_ballast_and_trim_backseat](INFO): Completed tank_ballast_and_trim_backseat
2021-06-29T18:31:43.220Z,1624991503.220 [MissionManager](INFO): tank_ballast_and_trim_backseat is completed.
2021-06-29T18:31:43.220Z,1624991503.220 [MissionManager](INFO): Uninitializing Mission tank_ballast_and_trim_backseat
2021-06-29T18:31:43.221Z,1624991503.221 [tank_ballast_and_trim_backseat] Stopped
2021-06-29T18:31:43.221Z,1624991503.221 [tank_ballast_and_trim_backseat](DEBUG): Aggregate::uninitialize tank_ballast_and_trim_backseat
2021-06-29T18:31:43.221Z,1624991503.221 [tank_ballast_and_trim_backseat:Science] Stopped
2021-06-29T18:31:43.221Z,1624991503.221 [tank_ballast_and_trim_backseat:Science](DEBUG): Aggregate::uninitialize tank_ballast_and_trim_backseat:Science
2021-06-29T18:31:43.221Z,1624991503.221 [tank_ballast_and_trim_backseat:Science:B] Stopped
2021-06-29T18:31:43.221Z,1624991503.221 [tank_ballast_and_trim_backseat:Science:C] Stopped
2021-06-29T18:31:43.221Z,1624991503.221 [tank_ballast_and_trim_backseat:Science:E] Stopped
2021-06-29T18:31:43.221Z,1624991503.221 [tank_ballast_and_trim_backseat:Science:OceanCurrent] Stopped
2021-06-29T18:31:43.221Z,1624991503.221 [tank_ballast_and_trim_backseat:Science:OceanCurrent](DEBUG): Aggregate::uninitialize tank_ballast_and_trim_backseat:Science:OceanCurrent
2021-06-29T18:31:43.221Z,1624991503.221 [tank_ballast_and_trim_backseat:Science:OceanCurrent:A.] Stopped
2021-06-29T18:31:43.476Z,1624991503.476 [WetLabsBB2FL](INFO): Powering down
2021-06-29T18:31:43.613Z,1624991503.613 [MissionManager](IMPORTANT): Started mission Default
2021-06-29T18:31:43.613Z,1624991503.613 [Default] Running Loop=1
2021-06-29T18:31:43.613Z,1624991503.613 [Default](DEBUG): Aggregate::initialize Default
2021-06-29T18:31:43.614Z,1624991503.614 [Default:B.GoToSurface] Running Loop=1
2021-06-29T18:31:43.614Z,1624991503.614 [Default:B.GoToSurface](DEBUG): Initialize GoToSurfaceComponent.
2021-06-29T18:31:43.614Z,1624991503.614 [Default:B.GoToSurface](DEBUG): No depth rate setting specified. Using default value of nan m/s.
2021-06-29T18:31:43.614Z,1624991503.614 [Default:B.GoToSurface](DEBUG): No pitch setting specified. Using default value of nan degrees.
2021-06-29T18:31:43.615Z,1624991503.615 [Default:B.GoToSurface](DEBUG): No speed setting specified. Using default value of 1.000000 m/s.
2021-06-29T18:31:43.615Z,1624991503.615 [Default:B.GoToSurface](DEBUG): No surface timeout specified. Using default value of 1000.000000 seconds.
2021-06-29T18:31:43.615Z,1624991503.615 [Default:B.GoToSurface](INFO): Received pitch timeout configuration 60.000000 seconds.
2021-06-29T18:31:43.616Z,1624991503.616 [Default:A.Wait] Running Loop=1
2021-06-29T18:31:43.616Z,1624991503.616 [Default:A.Wait](DEBUG): Initialize Wait Component.
2021-06-29T18:31:43.824Z,1624991503.824 [Radio_Surface](INFO): Powering up
2021-06-29T18:31:49.164Z,1624991509.164 [DataOverHttps](INFO): Radio surface powered ON.
2021-06-29T18:31:56.941Z,1624991516.941 [Default:A.Wait](INFO): Done Waiting.
2021-06-29T18:31:56.941Z,1624991516.941 [Default:A.Wait] Stopped
2021-06-29T18:31:56.941Z,1624991516.941 [Default:A.Wait](DEBUG): Uninitialize Wait Component.
2021-06-29T18:31:57.345Z,1624991517.345 [Default:CheckIn] Running Loop=1
2021-06-29T18:31:57.345Z,1624991517.345 [Default:CheckIn](DEBUG): Aggregate::initialize Default:CheckIn
2021-06-29T18:31:57.345Z,1624991517.345 [Default:CheckIn:Read_GPS] Running Loop=1
2021-06-29T18:31:59.359Z,1624991519.359 [NAL9602](DEBUG): Parsing RMC sentence: $GPRMC,183157.00,A,3648.16586,N,12147.28245,W,0.175,0.00,290621,,,A*75
2021-06-29T18:31:59.362Z,1624991519.362 [NAL9602](INFO): GPS fix at 20210629T183157: (36.802764, -121.788041)
2021-06-29T18:31:59.372Z,1624991519.372 [Default:CheckIn:Read_GPS] Stopped
2021-06-29T18:31:59.372Z,1624991519.372 [Default:CheckIn:Read_Iridium] Running Loop=1
2021-06-29T18:32:19.285Z,1624991539.285 [DataOverHttps](INFO): Exceeded connect timeout, disconnecting.
2021-06-29T18:32:40.999Z,1624991560.999 [NAL9602](INFO): SBD MO Status=2, MOMSN=4876, MT Status=2, MTMSN=0
2021-06-29T18:32:40.999Z,1624991560.999 [NAL9602](ERROR): Failed to initiate SBD session. Error code: 2
2021-06-29T18:32:54.424Z,1624991574.424 [DataOverHttps](INFO): Exceeded connect timeout, disconnecting.
2021-06-29T18:33:29.564Z,1624991609.564 [DataOverHttps](INFO): Exceeded connect timeout, disconnecting.
2021-06-29T18:33:31.427Z,1624991611.427 [NAL9602](INFO): SBD MO Status=2, MOMSN=4876, MT Status=2, MTMSN=0
2021-06-29T18:33:31.427Z,1624991611.427 [NAL9602](ERROR): Failed to initiate SBD session. Error code: 2
2021-06-29T18:34:04.708Z,1624991644.708 [DataOverHttps](INFO): Exceeded connect timeout, disconnecting.
2021-06-29T18:34:08.436Z,1624991648.436 [DeadReckonUsingMultipleVelocitySources] Software Fault, FailCount= 1
2021-06-29T18:34:08.436Z,1624991648.436 [DeadReckonUsingMultipleVelocitySources](ERROR): Software Fault
2021-06-29T18:34:08.447Z,1624991648.447 [CBIT](ERROR): Software Fault in component: DeadReckonUsingMultipleVelocitySources
2021-06-29T18:34:08.835Z,1624991648.835 [CBIT](INFO): Clearing failed state for component DeadReckonUsingMultipleVelocitySources
2021-06-29T18:34:08.835Z,1624991648.835 [DeadReckonUsingMultipleVelocitySources] No Fault, FailCount= 1
2021-06-29T18:34:29.571Z,1624991669.571 [NAL9602](INFO): SBD MO Status=2, MOMSN=4876, MT Status=2, MTMSN=0
2021-06-29T18:34:29.571Z,1624991669.571 [NAL9602](ERROR): Failed to initiate SBD session. Error code: 2
2021-06-29T18:34:39.848Z,1624991679.848 [DataOverHttps](INFO): Exceeded connect timeout, disconnecting.
2021-06-29T18:34:54.880Z,1624991694.880 [NAL9602](INFO): SBD MO Status=2, MOMSN=4876, MT Status=2, MTMSN=0
2021-06-29T18:34:54.881Z,1624991694.881 [NAL9602](ERROR): Failed to initiate SBD session. Error code: 2
2021-06-29T18:35:12.007Z,1624991712.007 [NAL9602](INFO): SBD MO Status=2, MOMSN=4876, MT Status=2, MTMSN=0
2021-06-29T18:35:12.007Z,1624991712.007 [NAL9602](ERROR): Failed to initiate SBD session. Error code: 2
2021-06-29T18:35:16.148Z,1624991716.148 [DataOverHttps](INFO): setting available, lastComms_.elapsed()=0.003022
2021-06-29T18:35:23.420Z,1624991723.420 [DataOverHttps](INFO): Sending 203 bytes from file Logs/20210629T180041/Courier0007.lzma
2021-06-29T18:35:24.421Z,1624991724.421 [DataOverHttps](INFO): Moved sent file to Logs/20210629T180041/Courier0007.lzma.bak
2021-06-29T18:35:24.422Z,1624991724.422 [DataOverHttps](INFO): SBD MOMSN=15736960
2021-06-29T18:35:33.309Z,1624991733.309 [NAL9602](INFO): SBD MO Status=2, MOMSN=4876, MT Status=2, MTMSN=0
2021-06-29T18:35:33.310Z,1624991733.310 [NAL9602](ERROR): Failed to initiate SBD session. Error code: 2
2021-06-29T18:35:39.939Z,1624991739.939 [DataOverHttps](INFO): Sending 38 bytes from file Logs/20210629T180041/Courier0010.lzma
2021-06-29T18:35:40.941Z,1624991740.941 [DataOverHttps](INFO): Moved sent file to Logs/20210629T180041/Courier0010.lzma.bak
2021-06-29T18:35:40.942Z,1624991740.942 [DataOverHttps](INFO): SBD MOMSN=15736963
2021-06-29T18:35:56.682Z,1624991756.682 [DataOverHttps](INFO): Sending 1685 bytes from file Logs/20210629T180041/Express0008.lzma
2021-06-29T18:35:57.682Z,1624991757.682 [DataOverHttps](INFO): Moved sent file to Logs/20210629T180041/Express0008.lzma.bak
2021-06-29T18:35:57.682Z,1624991757.682 [DataOverHttps](INFO): SBD MOMSN=15736965
2021-06-29T18:36:04.005Z,1624991764.005 [NAL9602](INFO): Not Powering down - fast GPS
2021-06-29T18:36:13.143Z,1624991773.143 [DataOverHttps](INFO): Sending 94 bytes from file Logs/20210629T180041/Express0011.lzma
2021-06-29T18:36:14.146Z,1624991774.146 [DataOverHttps](INFO): Moved sent file to Logs/20210629T180041/Express0011.lzma.bak
2021-06-29T18:36:14.146Z,1624991774.146 [DataOverHttps](INFO): SBD MOMSN=15737006
2021-06-29T18:36:16.135Z,1624991776.135 [Default:CheckIn:Read_Iridium] Stopped
2021-06-29T18:36:16.135Z,1624991776.135 [Default:CheckIn:C.Wait] Running Loop=1
2021-06-29T18:36:16.135Z,1624991776.135 [Default:CheckIn:C.Wait](DEBUG): Initialize Wait Component.
2021-06-29T18:37:09.473Z,1624991829.473 [DeadReckonUsingMultipleVelocitySources] Software Fault, FailCount= 2
2021-06-29T18:37:09.473Z,1624991829.473 [DeadReckonUsingMultipleVelocitySources](ERROR): Software Fault
2021-06-29T18:37:09.484Z,1624991829.484 [CBIT](ERROR): Software Fault in component: DeadReckonUsingMultipleVelocitySources
2021-06-29T18:37:09.912Z,1624991829.912 [CBIT](INFO): Clearing failed state for component DeadReckonUsingMultipleVelocitySources
2021-06-29T18:37:09.912Z,1624991829.912 [DeadReckonUsingMultipleVelocitySources] No Fault, FailCount= 2
2021-06-29T18:38:35.518Z,1624991915.518 [BPC1](ERROR): BPC1B: No match for serial number 0BEC in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:38:48.498Z,1624991928.498 [BPC1](ERROR): BPC1B: No match for serial number 0BEC in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:39:02.234Z,1624991942.234 [BPC1](ERROR): BPC1B: No match for serial number 0BEC in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:39:15.974Z,1624991955.974 [BPC1](ERROR): BPC1B: No match for serial number 0BEC in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:39:29.299Z,1624991969.299 [BPC1](ERROR): BPC1B: No match for serial number 0BEC in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:39:43.038Z,1624991983.038 [BPC1](ERROR): BPC1B: No match for serial number 0BEC in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:39:55.963Z,1624991995.963 [BPC1](ERROR): BPC1B: No match for serial number 0BEC in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:40:09.287Z,1624992009.287 [BPC1](ERROR): BPC1B: No match for serial number 0BEC in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:40:10.529Z,1624992010.529 [DeadReckonUsingMultipleVelocitySources] Software Fault, FailCount= 3
2021-06-29T18:40:10.529Z,1624992010.529 [DeadReckonUsingMultipleVelocitySources](ERROR): Software Fault
2021-06-29T18:40:10.540Z,1624992010.540 [CBIT](ERROR): Software Fault in component: DeadReckonUsingMultipleVelocitySources
2021-06-29T18:40:10.949Z,1624992010.949 [CBIT](INFO): Clearing failed state for component DeadReckonUsingMultipleVelocitySources
2021-06-29T18:40:10.949Z,1624992010.949 [DeadReckonUsingMultipleVelocitySources] No Fault, FailCount= 3
2021-06-29T18:40:23.089Z,1624992023.089 [BPC1](ERROR): BPC1B: No match for serial number 0BEC in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:40:36.361Z,1624992036.361 [BPC1](ERROR): BPC1B: No match for serial number 0BEC in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:40:50.100Z,1624992050.100 [BPC1](ERROR): BPC1B: No match for serial number 0BEC in BPC1B's battery stick inventory (sticks 32-63 in onboard configuration file).
2021-06-29T18:41:16.795Z,1624992076.795 [Default:CheckIn:C.Wait](INFO): Done Waiting.
2021-06-29T18:41:16.795Z,1624992076.795 [Default:CheckIn:C.Wait] Stopped
2021-06-29T18:41:16.795Z,1624992076.795 [Default:CheckIn:C.Wait](DEBUG): Uninitialize Wait Component.
2021-06-29T18:41:16.796Z,1624992076.796 [Default:CheckIn:D] Running Loop=1
2021-06-29T18:41:17.205Z,1624992077.205 [Default:CheckIn:D] Stopped
2021-06-29T18:41:17.205Z,1624992077.205 [Default:CheckIn:E] Running Loop=1
2021-06-29T18:41:17.657Z,1624992077.657 [Default:CheckIn:E](IMPORTANT): Default mission has been running for 9.559857 min 
2021-06-29T18:41:17.657Z,1624992077.657 [Default:CheckIn:E] Stopped
2021-06-29T18:41:17.657Z,1624992077.657 [Default:CheckIn](INFO): Completed Default:CheckIn
2021-06-29T18:41:17.657Z,1624992077.657 [Default:CheckIn] Stopped
2021-06-29T18:41:17.657Z,1624992077.657 [Default:CheckIn](DEBUG): Aggregate::uninitialize Default:CheckIn
2021-06-29T18:41:17.658Z,1624992077.658 [Default:CheckIn](INFO): Running loop #2
2021-06-29T18:41:17.658Z,1624992077.658 [Default:CheckIn] Running Loop=2
2021-06-29T18:41:17.658Z,1624992077.658 [Default:CheckIn](DEBUG): Aggregate::initialize Default:CheckIn
2021-06-29T18:41:17.658Z,1624992077.658 [Default:CheckIn:Read_GPS] Running Loop=1
2021-06-29T18:41:19.603Z,1624992079.603 [NAL9602](DEBUG): Parsing RMC sentence: $GPRMC,184118.00,A,3648.16862,N,12147.27809,W,0.564,249.69,290621,,,A*77
2021-06-29T18:41:19.606Z,1624992079.606 [NAL9602](INFO): GPS fix at 20210629T184118: (36.802810, -121.787968)
2021-06-29T18:41:19.616Z,1624992079.616 [Default:CheckIn:Read_GPS] Stopped
2021-06-29T18:41:19.616Z,1624992079.616 [Default:CheckIn:Read_Iridium] Running Loop=1
2021-06-29T18:41:26.619Z,1624992086.619 [DataOverHttps](INFO): Sending 72 bytes from file Logs/20210629T180041/Courier0013.lzma
2021-06-29T18:41:27.622Z,1624992087.622 [DataOverHttps](INFO): Moved sent file to Logs/20210629T180041/Courier0013.lzma.bak
2021-06-29T18:41:27.622Z,1624992087.622 [DataOverHttps](INFO): SBD MOMSN=15737009
2021-06-29T18:41:43.236Z,1624992103.236 [DataOverHttps](INFO): Sending 171 bytes from file Logs/20210629T180041/Express0014.lzma
2021-06-29T18:41:44.244Z,1624992104.244 [DataOverHttps](INFO): Moved sent file to Logs/20210629T180041/Express0014.lzma.bak
2021-06-29T18:41:44.244Z,1624992104.244 [DataOverHttps](INFO): SBD MOMSN=15737015
2021-06-29T18:41:46.310Z,1624992106.310 [Default:CheckIn:Read_Iridium] Stopped
2021-06-29T18:41:46.310Z,1624992106.310 [Default:CheckIn:C.Wait] Running Loop=1
2021-06-29T18:41:46.310Z,1624992106.310 [Default:CheckIn:C.Wait](DEBUG): Initialize Wait Component.
2021-06-29T18:43:11.557Z,1624992191.557 [DeadReckonUsingMultipleVelocitySources] Software Fault, FailCount= 1
2021-06-29T18:43:11.557Z,1624992191.557 [DeadReckonUsingMultipleVelocitySources](ERROR): Software Fault
2021-06-29T18:43:11.568Z,1624992191.568 [CBIT](ERROR): Software Fault in component: DeadReckonUsingMultipleVelocitySources
2021-06-29T18:43:11.979Z,1624992191.979 [CBIT](INFO): Clearing failed state for component DeadReckonUsingMultipleVelocitySources
2021-06-29T18:43:11.979Z,1624992191.979 [DeadReckonUsingMultipleVelocitySources] No Fault, FailCount= 1
2021-06-29T18:43:30.541Z,1624992210.541 [BPC1](INFO): Calculating totals. Valid battery stick count: 50. Valid reserve battery stick count: 5.
2021-06-29T18:43:30.560Z,1624992210.560 [BPC1](INFO): Received data from all battery sticks.
2021-06-29T18:43:34.167Z,1624992214.167 [NAL9602](INFO): SBD MO Status=2, MOMSN=4876, MT Status=2, MTMSN=0
2021-06-29T18:43:34.167Z,1624992214.167 [NAL9602](ERROR): Failed to initiate SBD session. Error code: 2
2021-06-29T18:44:07.295Z,1624992247.295 [NAL9602](INFO): SBD MO Status=2, MOMSN=4876, MT Status=2, MTMSN=0
2021-06-29T18:44:07.295Z,1624992247.295 [NAL9602](ERROR): Failed to initiate SBD session. Error code: 2
2021-06-29T18:45:33.845Z,1624992333.845 [DataOverHttps](IMPORTANT): SBD MTMSN=20210629T184532
2021-06-29T18:45:40.995Z,1624992340.995 [DataOverHttps](INFO): Received command:restart logs