2021-06-02T03:32:23.001Z,1622604743.001 [Supervisor](DEBUG): Initializing supervisor.
2021-06-02T03:32:23.006Z,1622604743.006 [SyncHandler](DEBUG): Created PCaller Thread at 404514E0
2021-06-02T03:32:23.007Z,1622604743.007 [SyncHandler](INFO): Protected caller Thread ID is 4722
2021-06-02T03:32:23.007Z,1622604743.007 [ComponentRegistry](DEBUG): Component "controlThread" handled in its own thread.
2021-06-02T03:32:23.008Z,1622604743.008 [controlThread ThreadHandler](DEBUG): Created PCaller Thread at 404814E0
2021-06-02T03:32:23.008Z,1622604743.008 [controlThread ThreadHandler](INFO): Protected caller Thread ID is 4723
2021-06-02T03:32:23.013Z,1622604743.013 [ComponentRegistry](DEBUG): SyncComponent "CycleStarter" handled in the control thread.
2021-06-02T03:32:23.033Z,1622604743.033 [ComponentRegistry](DEBUG): Component "CommandLine" handled in its own thread.
2021-06-02T03:32:23.034Z,1622604743.034 [CommandLine ThreadHandler](DEBUG): Created PCaller Thread at 404B14E0
2021-06-02T03:32:23.034Z,1622604743.034 [CommandLine ThreadHandler](INFO): Protected caller Thread ID is 4724
2021-06-02T03:32:23.037Z,1622604743.037 [ComponentRegistry](DEBUG): Component "logger" handled in its own thread.
2021-06-02T03:32:23.038Z,1622604743.038 [logger ThreadHandler](DEBUG): Created PCaller Thread at 404E14E0
2021-06-02T03:32:23.038Z,1622604743.038 [logger ThreadHandler](INFO): Protected caller Thread ID is 4725
2021-06-02T03:32:23.042Z,1622604743.042 [ComponentRegistry](DEBUG): SyncComponent "LogSplitter" handled in the control thread.
2021-06-02T03:32:23.042Z,1622604743.042 [Supervisor](INFO): Looking for Config files in directory: Config/
2021-06-02T03:32:23.044Z,1622604743.044 [Supervisor](INFO): Opening Config file at: Config/secure.cfg
2021-06-02T03:32:23.238Z,1622604743.238 [ComponentRegistry](DEBUG): Loaded Config Component "Config/secure
2021-06-02T03:32:23.239Z,1622604743.239 [Supervisor](INFO): Opening Config file at: Config/Sensor.cfg
2021-06-02T03:32:23.880Z,1622604743.880 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Sensor
2021-06-02T03:32:23.881Z,1622604743.881 [Supervisor](INFO): Opening Config file at: Config/Dock.cfg
2021-06-02T03:32:24.096Z,1622604744.096 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Dock
2021-06-02T03:32:24.097Z,1622604744.097 [Supervisor](INFO): Opening Config file at: Config/Sample.cfg
2021-06-02T03:32:24.177Z,1622604744.177 [Supervisor](INFO): Opening Config file at: Config/workSite.cfg
2021-06-02T03:32:24.304Z,1622604744.304 [ComponentRegistry](DEBUG): Loaded Config Component "Config/workSite
2021-06-02T03:32:24.305Z,1622604744.305 [Supervisor](INFO): Opening Config file at: Config/Guidance.cfg
2021-06-02T03:32:24.386Z,1622604744.386 [Supervisor](INFO): Opening Config file at: Config/Estimation.cfg
2021-06-02T03:32:24.487Z,1622604744.487 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Estimation
2021-06-02T03:32:24.488Z,1622604744.488 [Supervisor](INFO): Opening Config file at: Config/Servo.cfg
2021-06-02T03:32:24.860Z,1622604744.860 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Servo
2021-06-02T03:32:24.861Z,1622604744.861 [Supervisor](INFO): Opening Config file at: Config/Simulator.cfg
2021-06-02T03:32:25.402Z,1622604745.402 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Simulator
2021-06-02T03:32:25.403Z,1622604745.403 [Supervisor](INFO): Opening Config file at: Config/Derivation.cfg
2021-06-02T03:32:25.553Z,1622604745.553 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Derivation
2021-06-02T03:32:25.554Z,1622604745.554 [Supervisor](INFO): Opening Config file at: Config/logger.cfg
2021-06-02T03:32:25.748Z,1622604745.748 [ComponentRegistry](DEBUG): Loaded Config Component "Config/logger
2021-06-02T03:32:25.749Z,1622604745.749 [Supervisor](INFO): Opening Config file at: Config/vehicle.cfg
2021-06-02T03:32:26.205Z,1622604746.205 [ComponentRegistry](DEBUG): Loaded Config Component "Config/vehicle
2021-06-02T03:32:26.206Z,1622604746.206 [Supervisor](INFO): Opening Config file at: Config/Navigation.cfg
2021-06-02T03:32:26.471Z,1622604746.471 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Navigation
2021-06-02T03:32:26.472Z,1622604746.472 [Supervisor](INFO): Opening Config file at: Config/BIT.cfg
2021-06-02T03:32:27.193Z,1622604747.193 [ComponentRegistry](DEBUG): Loaded Config Component "Config/BIT
2021-06-02T03:32:27.193Z,1622604747.193 [Supervisor](INFO): Opening Config file at: Config/Science.cfg
2021-06-02T03:32:27.564Z,1622604747.564 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Science
2021-06-02T03:32:27.565Z,1622604747.565 [Supervisor](INFO): Opening Config file at: Config/Control.cfg
2021-06-02T03:32:27.908Z,1622604747.908 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Control
2021-06-02T03:32:27.910Z,1622604747.910 [Supervisor](INFO): Looking for Config files in directory: Config/lrauv-pontus/
2021-06-02T03:32:27.911Z,1622604747.911 [Supervisor](INFO): Opening Config file at: Config/lrauv-pontus/secure.cfg
2021-06-02T03:32:27.996Z,1622604747.996 [Supervisor](INFO): Opening Config file at: Config/lrauv-pontus/Sensor.cfg
2021-06-02T03:32:28.152Z,1622604748.152 [Supervisor](INFO): Opening Config file at: Config/lrauv-pontus/Servo.cfg
2021-06-02T03:32:28.263Z,1622604748.263 [Supervisor](INFO): Opening Config file at: Config/lrauv-pontus/Simulator.cfg
2021-06-02T03:32:28.349Z,1622604748.349 [Supervisor](INFO): Opening Config file at: Config/lrauv-pontus/logger.cfg
2021-06-02T03:32:28.445Z,1622604748.445 [Supervisor](INFO): Opening Config file at: Config/lrauv-pontus/vehicle.cfg
2021-06-02T03:32:28.637Z,1622604748.637 [Supervisor](INFO): Opening Config file at: Config/lrauv-pontus/Battery.cfg
2021-06-02T03:32:28.900Z,1622604748.900 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Battery
2021-06-02T03:32:28.901Z,1622604748.901 [Supervisor](INFO): Opening Config file at: Config/lrauv-pontus/Navigation.cfg
2021-06-02T03:32:28.995Z,1622604748.995 [Supervisor](INFO): Opening Config file at: Config/lrauv-pontus/BIT.cfg
2021-06-02T03:32:29.095Z,1622604749.095 [Supervisor](INFO): Opening Config file at: Config/lrauv-pontus/Science.cfg
2021-06-02T03:32:29.237Z,1622604749.237 [Supervisor](INFO): Opening Config file at: Config/lrauv-pontus/Control.cfg
2021-06-02T03:32:29.345Z,1622604749.345 [Supervisor](INFO): Looking for Config files in directory: Config/lrauv-pontus/root/
2021-06-02T03:32:29.345Z,1622604749.345 [Supervisor](IMPORTANT): Reading configuration overrides from Data/persisted.cfg
2021-06-02T03:32:29.357Z,1622604749.357 [Module Loader](DEBUG): Loading Module at Modules/Dock.so
2021-06-02T03:32:29.480Z,1622604749.480 [Module Loader](DEBUG): Loaded Module: Dock (Contains behaviors and commands for docking)
2021-06-02T03:32:29.480Z,1622604749.480 [Module Loader](DEBUG): Loading Module at Modules/Control.so
2021-06-02T03:32:29.553Z,1622604749.553 [VerticalControl](DEBUG): Construct VerticalControl.
2021-06-02T03:32:29.615Z,1622604749.615 [VerticalControl] Loaded
2021-06-02T03:32:29.615Z,1622604749.615 [ComponentRegistry](DEBUG): SyncComponent "VerticalControl" handled in the control thread.
2021-06-02T03:32:29.618Z,1622604749.618 [HorizontalControl](DEBUG): Construct HorizontalControl.
2021-06-02T03:32:29.657Z,1622604749.657 [HorizontalControl] Loaded
2021-06-02T03:32:29.657Z,1622604749.657 [ComponentRegistry](DEBUG): SyncComponent "HorizontalControl" handled in the control thread.
2021-06-02T03:32:29.660Z,1622604749.660 [SpeedControl](DEBUG): Construct SpeedControl.
2021-06-02T03:32:29.663Z,1622604749.663 [SpeedControl] Loaded
2021-06-02T03:32:29.663Z,1622604749.663 [ComponentRegistry](DEBUG): SyncComponent "SpeedControl" handled in the control thread.
2021-06-02T03:32:29.666Z,1622604749.666 [LoopControl](DEBUG): Construct LoopControl.
2021-06-02T03:32:29.666Z,1622604749.666 [LoopControl] Loaded
2021-06-02T03:32:29.666Z,1622604749.666 [ComponentRegistry](DEBUG): SyncComponent "LoopControl" handled in the control thread.
2021-06-02T03:32:29.667Z,1622604749.667 [Module Loader](DEBUG): Loaded Module: Control (Contains the Control components, such as Depth, Heading, and Speed Control)
2021-06-02T03:32:29.667Z,1622604749.667 [Module Loader](DEBUG): Loading Module at Modules/Derivation.so
2021-06-02T03:32:29.726Z,1622604749.726 [DepthRateCalculator] Loaded
2021-06-02T03:32:29.726Z,1622604749.726 [ComponentRegistry](DEBUG): SyncComponent "DepthRateCalculator" handled in the control thread.
2021-06-02T03:32:29.731Z,1622604749.731 [PitchRateCalculator] Loaded
2021-06-02T03:32:29.731Z,1622604749.731 [ComponentRegistry](DEBUG): SyncComponent "PitchRateCalculator" handled in the control thread.
2021-06-02T03:32:29.745Z,1622604749.745 [SpeedCalculator] Loaded
2021-06-02T03:32:29.745Z,1622604749.745 [ComponentRegistry](DEBUG): SyncComponent "SpeedCalculator" handled in the control thread.
2021-06-02T03:32:29.759Z,1622604749.759 [TempGradientCalculator] Loaded
2021-06-02T03:32:29.759Z,1622604749.759 [ComponentRegistry](DEBUG): SyncComponent "TempGradientCalculator" handled in the control thread.
2021-06-02T03:32:29.769Z,1622604749.769 [VerticalTemperatureHomogeneityIndexCalculator] Loaded
2021-06-02T03:32:29.770Z,1622604749.770 [ComponentRegistry](DEBUG): SyncComponent "VerticalTemperatureHomogeneityIndexCalculator" handled in the control thread.
2021-06-02T03:32:29.774Z,1622604749.774 [YawRateCalculator] Loaded
2021-06-02T03:32:29.774Z,1622604749.774 [ComponentRegistry](DEBUG): SyncComponent "YawRateCalculator" handled in the control thread.
2021-06-02T03:32:29.791Z,1622604749.791 [ElevatorOffsetCalculator] Loaded
2021-06-02T03:32:29.791Z,1622604749.791 [ComponentRegistry](DEBUG): SyncComponent "ElevatorOffsetCalculator" handled in the control thread.
2021-06-02T03:32:29.792Z,1622604749.792 [Module Loader](DEBUG): Loaded Module: Derivation (Contains the base derivation components)
2021-06-02T03:32:29.792Z,1622604749.792 [Module Loader](DEBUG): Loading Module at Modules/Trigger.so
2021-06-02T03:32:29.835Z,1622604749.835 [Module Loader](DEBUG): Loaded Module: Trigger (Contains triggers for use in missions)
2021-06-02T03:32:29.836Z,1622604749.836 [Module Loader](DEBUG): Loading Module at Modules/Estimation.so
2021-06-02T03:32:29.931Z,1622604749.931 [StratificationFrontDetector](IMPORTANT): threshold set to: 0.999994 degC
2021-06-02T03:32:29.931Z,1622604749.931 [StratificationFrontDetector](INFO): (re)initializing
2021-06-02T03:32:29.932Z,1622604749.932 [StratificationFrontDetector] Loaded
2021-06-02T03:32:29.932Z,1622604749.932 [ComponentRegistry](DEBUG): SyncComponent "StratificationFrontDetector" handled in the control thread.
2021-06-02T03:32:29.932Z,1622604749.932 [Module Loader](DEBUG): Loaded Module: Estimation (Contains the base estimation components)
2021-06-02T03:32:29.933Z,1622604749.933 [Module Loader](DEBUG): Loading Module at Modules/Guidance.so
2021-06-02T03:32:30.322Z,1622604750.322 [Module Loader](DEBUG): Loaded Module: Guidance (Contains behaviors and commands)
2021-06-02T03:32:30.322Z,1622604750.322 [Module Loader](DEBUG): Loading Module at Modules/Simulator.so
2021-06-02T03:32:30.460Z,1622604750.460 [Module Loader](DEBUG): Loaded Module: Simulator (This is the module containing the Simulator)
2021-06-02T03:32:30.461Z,1622604750.461 [Module Loader](DEBUG): Loading Module at Modules/Sensor.so
2021-06-02T03:32:31.070Z,1622604751.070 [CmdTest] Loaded
2021-06-02T03:32:31.070Z,1622604751.070 [ComponentRegistry](DEBUG): Component "CmdTest" handled in its own thread.
2021-06-02T03:32:31.071Z,1622604751.071 [CmdTest ThreadHandler](DEBUG): Created PCaller Thread at 409064E0
2021-06-02T03:32:31.072Z,1622604751.072 [CmdTest ThreadHandler](INFO): Protected caller Thread ID is 4808
2021-06-02T03:32:31.209Z,1622604751.209 [AHRS_M2] Loaded
2021-06-02T03:32:31.209Z,1622604751.209 [ComponentRegistry](DEBUG): SyncComponent "AHRS_M2" handled in the control thread.
2021-06-02T03:32:31.458Z,1622604751.458 [BackseatComponent] Loaded
2021-06-02T03:32:31.459Z,1622604751.459 [ComponentRegistry](DEBUG): Component "BackseatComponent" handled in its own thread.
2021-06-02T03:32:31.460Z,1622604751.460 [BackseatComponent ThreadHandler](DEBUG): Created PCaller Thread at 409364E0
2021-06-02T03:32:31.460Z,1622604751.460 [BackseatComponent ThreadHandler](INFO): Protected caller Thread ID is 4809
2021-06-02T03:32:31.463Z,1622604751.463 [LcmUniversalReporter] Loaded
2021-06-02T03:32:31.463Z,1622604751.463 [ComponentRegistry](DEBUG): SyncComponent "LcmUniversalReporter" handled in the control thread.
2021-06-02T03:32:32.285Z,1622604752.285 [BPC1] Loaded
2021-06-02T03:32:32.285Z,1622604752.285 [ComponentRegistry](DEBUG): SyncComponent "BPC1" handled in the control thread.
2021-06-02T03:32:32.591Z,1622604752.591 [DataOverHttps] Loaded
2021-06-02T03:32:32.591Z,1622604752.591 [ComponentRegistry](DEBUG): Component "DataOverHttps" handled in its own thread.
2021-06-02T03:32:32.592Z,1622604752.592 [DataOverHttps ThreadHandler](DEBUG): Created PCaller Thread at 409664E0
2021-06-02T03:32:32.593Z,1622604752.593 [DataOverHttps ThreadHandler](INFO): Protected caller Thread ID is 4810
2021-06-02T03:32:32.613Z,1622604752.613 [Depth_Keller] Loaded
2021-06-02T03:32:32.613Z,1622604752.613 [ComponentRegistry](DEBUG): SyncComponent "Depth_Keller" handled in the control thread.
2021-06-02T03:32:32.618Z,1622604752.618 [DropWeight] Loaded
2021-06-02T03:32:32.618Z,1622604752.618 [ComponentRegistry](DEBUG): SyncComponent "DropWeight" handled in the control thread.
2021-06-02T03:32:32.679Z,1622604752.679 [NAL9602] Loaded
2021-06-02T03:32:32.679Z,1622604752.679 [ComponentRegistry](DEBUG): SyncComponent "NAL9602" handled in the control thread.
2021-06-02T03:32:32.708Z,1622604752.708 [Onboard] Loaded
2021-06-02T03:32:32.709Z,1622604752.709 [ComponentRegistry](DEBUG): Component "Onboard" handled in its own thread.
2021-06-02T03:32:32.710Z,1622604752.710 [Onboard ThreadHandler](DEBUG): Created PCaller Thread at 409964E0
2021-06-02T03:32:32.710Z,1622604752.710 [Onboard ThreadHandler](INFO): Protected caller Thread ID is 4811
2021-06-02T03:32:32.723Z,1622604752.723 [Power24vConverter] Loaded
2021-06-02T03:32:32.723Z,1622604752.723 [ComponentRegistry](DEBUG): SyncComponent "Power24vConverter" handled in the control thread.
2021-06-02T03:32:32.737Z,1622604752.737 [Radio_Surface] Loaded
2021-06-02T03:32:32.737Z,1622604752.737 [ComponentRegistry](DEBUG): Component "Radio_Surface" handled in its own thread.
2021-06-02T03:32:32.738Z,1622604752.738 [Radio_Surface ThreadHandler](DEBUG): Created PCaller Thread at 409C64E0
2021-06-02T03:32:32.738Z,1622604752.738 [Radio_Surface ThreadHandler](INFO): Protected caller Thread ID is 4812
2021-06-02T03:32:32.781Z,1622604752.781 [RDI_Pathfinder] Loaded
2021-06-02T03:32:32.782Z,1622604752.782 [ComponentRegistry](DEBUG): SyncComponent "RDI_Pathfinder" handled in the control thread.
2021-06-02T03:32:32.865Z,1622604752.865 [DAT] Loaded
2021-06-02T03:32:32.865Z,1622604752.865 [ComponentRegistry](DEBUG): SyncComponent "DAT" handled in the control thread.
2021-06-02T03:32:32.866Z,1622604752.866 [Module Loader](DEBUG): Loaded Module: Sensor (Contains the sensor components)
2021-06-02T03:32:32.866Z,1622604752.866 [Module Loader](DEBUG): Loading Module at Modules/Navigation.so
2021-06-02T03:32:33.164Z,1622604753.164 [DeadReckonUsingMultipleVelocitySources] Loaded
2021-06-02T03:32:33.165Z,1622604753.165 [ComponentRegistry](DEBUG): SyncComponent "DeadReckonUsingMultipleVelocitySources" handled in the control thread.
2021-06-02T03:32:33.178Z,1622604753.178 [NavChart] Loaded
2021-06-02T03:32:33.178Z,1622604753.178 [ComponentRegistry](DEBUG): SyncComponent "NavChart" handled in the control thread.
2021-06-02T03:32:33.184Z,1622604753.184 [UniversalFixResidualReporter] Loaded
2021-06-02T03:32:33.184Z,1622604753.184 [ComponentRegistry](DEBUG): SyncComponent "UniversalFixResidualReporter" handled in the control thread.
2021-06-02T03:32:33.185Z,1622604753.185 [Module Loader](DEBUG): Loaded Module: Navigation (Contains the base navigation components)
2021-06-02T03:32:33.185Z,1622604753.185 [Module Loader](DEBUG): Loading Module at Modules/BIT.so
2021-06-02T03:32:33.693Z,1622604753.693 [SBIT](DEBUG): Construct Startup Built In Test.
2021-06-02T03:32:33.702Z,1622604753.702 [SBIT] Loaded
2021-06-02T03:32:33.702Z,1622604753.702 [ComponentRegistry](DEBUG): SyncComponent "SBIT" handled in the control thread.
2021-06-02T03:32:33.705Z,1622604753.705 [IBIT](DEBUG): Construct Initiated Built In Test.
2021-06-02T03:32:33.718Z,1622604753.718 [IBIT] Loaded
2021-06-02T03:32:33.718Z,1622604753.718 [ComponentRegistry](DEBUG): SyncComponent "IBIT" handled in the control thread.
2021-06-02T03:32:33.724Z,1622604753.724 [CBIT](DEBUG): Construct Continuous Built In Test.
2021-06-02T03:32:33.826Z,1622604753.826 [CBIT] Loaded
2021-06-02T03:32:33.827Z,1622604753.827 [ComponentRegistry](DEBUG): SyncComponent "CBIT" handled in the control thread.
2021-06-02T03:32:33.827Z,1622604753.827 [Module Loader](DEBUG): Loaded Module: BIT (Contains the BuiltInTest components, such as C Built In Test)
2021-06-02T03:32:33.827Z,1622604753.827 [Module Loader](DEBUG): Loading Module at Modules/Servo.so
2021-06-02T03:32:33.983Z,1622604753.983 [BuoyancyServo] Loaded
2021-06-02T03:32:33.983Z,1622604753.983 [ComponentRegistry](DEBUG): SyncComponent "BuoyancyServo" handled in the control thread.
2021-06-02T03:32:34.003Z,1622604754.003 [ElevatorServo] Loaded
2021-06-02T03:32:34.003Z,1622604754.003 [ComponentRegistry](DEBUG): SyncComponent "ElevatorServo" handled in the control thread.
2021-06-02T03:32:34.022Z,1622604754.022 [MassServo] Loaded
2021-06-02T03:32:34.023Z,1622604754.023 [ComponentRegistry](DEBUG): SyncComponent "MassServo" handled in the control thread.
2021-06-02T03:32:34.041Z,1622604754.041 [RudderServo] Loaded
2021-06-02T03:32:34.041Z,1622604754.041 [ComponentRegistry](DEBUG): SyncComponent "RudderServo" handled in the control thread.
2021-06-02T03:32:34.060Z,1622604754.060 [ThrusterServo] Loaded
2021-06-02T03:32:34.060Z,1622604754.060 [ComponentRegistry](DEBUG): SyncComponent "ThrusterServo" handled in the control thread.
2021-06-02T03:32:34.061Z,1622604754.061 [Module Loader](DEBUG): Loaded Module: Servo (This is the module containing motor controllers)
2021-06-02T03:32:34.061Z,1622604754.061 [Module Loader](DEBUG): Loading Module at Modules/Sample.so
2021-06-02T03:32:34.079Z,1622604754.079 [Module Loader](DEBUG): Loaded Module: Sample (This is a Sample Module of Sample Components)
2021-06-02T03:32:34.079Z,1622604754.079 [Module Loader](DEBUG): Loading Module at Modules/Science.so
2021-06-02T03:32:34.314Z,1622604754.314 [CTD_Seabird] Loaded
2021-06-02T03:32:34.314Z,1622604754.314 [ComponentRegistry](DEBUG): Component "CTD_Seabird" handled in its own thread.
2021-06-02T03:32:34.315Z,1622604754.315 [CTD_Seabird ThreadHandler](DEBUG): Created PCaller Thread at 40AFA4E0
2021-06-02T03:32:34.316Z,1622604754.316 [CTD_Seabird ThreadHandler](INFO): Protected caller Thread ID is 4813
2021-06-02T03:32:34.336Z,1622604754.336 [PAR_Licor] Loaded
2021-06-02T03:32:34.336Z,1622604754.336 [ComponentRegistry](DEBUG): SyncComponent "PAR_Licor" handled in the control thread.
2021-06-02T03:32:34.369Z,1622604754.369 [WetLabsBB2FL] Loaded
2021-06-02T03:32:34.369Z,1622604754.369 [ComponentRegistry](DEBUG): Component "WetLabsBB2FL" handled in its own thread.
2021-06-02T03:32:34.370Z,1622604754.370 [WetLabsBB2FL ThreadHandler](DEBUG): Created PCaller Thread at 40B2A4E0
2021-06-02T03:32:34.371Z,1622604754.371 [WetLabsBB2FL ThreadHandler](INFO): Protected caller Thread ID is 4814
2021-06-02T03:32:34.391Z,1622604754.391 [WetLabsUBAT] Loaded
2021-06-02T03:32:34.391Z,1622604754.391 [ComponentRegistry](DEBUG): Component "WetLabsUBAT" handled in its own thread.
2021-06-02T03:32:34.397Z,1622604754.397 [WetLabsUBAT ThreadHandler](DEBUG): Created PCaller Thread at 40B5A4E0
2021-06-02T03:32:34.397Z,1622604754.397 [WetLabsUBAT ThreadHandler](INFO): Protected caller Thread ID is 4815
2021-06-02T03:32:34.398Z,1622604754.398 [Module Loader](DEBUG): Loaded Module: Science (Contains the science components)
2021-06-02T03:32:34.404Z,1622604754.404 [ComponentRegistry](DEBUG): SyncComponent "MissionManager" handled in the control thread.
2021-06-02T03:32:34.407Z,1622604754.407 [ComponentRegistry](DEBUG): SyncComponent "Reporter" handled in the control thread.
2021-06-02T03:32:34.419Z,1622604754.419 [ComponentRegistry](DEBUG): Component "NavChartDb" handled in its own thread.
2021-06-02T03:32:34.420Z,1622604754.420 [NavChartDb ThreadHandler](DEBUG): Created PCaller Thread at 40B8A4E0
2021-06-02T03:32:34.421Z,1622604754.421 [NavChartDb ThreadHandler](INFO): Protected caller Thread ID is 4816
2021-06-02T03:32:34.425Z,1622604754.425 [Supervisor](INFO): Main Thread ID is 4721
2021-06-02T03:32:34.425Z,1622604754.425 [Supervisor](DEBUG): Running supervisor.
2021-06-02T03:32:34.426Z,1622604754.426 [CommandLine ThreadHandler](INFO): Handler Thread ID is 4817
2021-06-02T03:32:34.429Z,1622604754.429 [controlThread ThreadHandler](INFO): Handler Thread ID is 4818
2021-06-02T03:32:34.429Z,1622604754.429 [controlThread](DEBUG): Initializing ControlThread
2021-06-02T03:32:34.430Z,1622604754.430 [VerticalControl](DEBUG): Initialize VerticalControlComponent.
2021-06-02T03:32:34.432Z,1622604754.432 [HorizontalControl](DEBUG): Initialize HorizontalControlComponent.
2021-06-02T03:32:34.433Z,1622604754.433 [SpeedControl](DEBUG): Initialize SpeedControlComponent.
2021-06-02T03:32:34.433Z,1622604754.433 [LoopControl](DEBUG): Initialize LoopControlComponent.
2021-06-02T03:32:34.434Z,1622604754.434 [DepthRateCalculator](DEBUG): Initializing DepthRateCalculator.
2021-06-02T03:32:34.434Z,1622604754.434 [PitchRateCalculator](DEBUG): Initializing PitchRateCalculator.
2021-06-02T03:32:34.435Z,1622604754.435 [SpeedCalculator](DEBUG): Initializing SpeedCalculator.
2021-06-02T03:32:34.435Z,1622604754.435 [TempGradientCalculator](DEBUG): Initializing TempGradientCalculator.
2021-06-02T03:32:34.436Z,1622604754.436 [VerticalTemperatureHomogeneityIndexCalculator](DEBUG): (re)initializing
2021-06-02T03:32:34.436Z,1622604754.436 [YawRateCalculator](DEBUG): Initializing YawRateCalculator.
2021-06-02T03:32:34.437Z,1622604754.437 [ElevatorOffsetCalculator](DEBUG): Initializing ElevatorOffsetCalculator.
2021-06-02T03:32:34.444Z,1622604754.444 [NavChart](DEBUG): Initialize NavChart Navigation.
2021-06-02T03:32:34.444Z,1622604754.444 [UniversalFixResidualReporter](DEBUG): Initializing UniversalFixResidualReporter component.
2021-06-02T03:32:34.445Z,1622604754.445 [SBIT](INFO): Initialize SBIT Component.
2021-06-02T03:32:34.445Z,1622604754.445 [SBIT](IMPORTANT): git: 2021-06-01
2021-06-02T03:32:34.446Z,1622604754.446 [SBIT](INFO): git hash: cf38c2cb22e5f1a07f3566d8bf81cf524e6bff3d
2021-06-02T03:32:34.446Z,1622604754.446 [SBIT](IMPORTANT): Kernel Release: 2.6.27.8
2021-06-02T03:32:34.447Z,1622604754.447 [SBIT](INFO): Kernel Reporting Different Version From Configuration.
Kernel Expected: #1 PREEMPT Thu Feb 21 11:17:40 PST 2019
Kernel Reported: #1 PREEMPT Thu Aug 6 12:04:53 PDT 2020
2021-06-02T03:32:34.448Z,1622604754.448 [SBIT](INFO): Beginning SBIT in 50.000000 seconds.
2021-06-02T03:32:34.449Z,1622604754.449 [logger ThreadHandler](INFO): Handler Thread ID is 4819
2021-06-02T03:32:34.465Z,1622604754.465 [IBIT](INFO): Initialize IBIT Component.
2021-06-02T03:32:34.466Z,1622604754.466 [CBIT](DEBUG): Initialize CBIT Component.
2021-06-02T03:32:34.473Z,1622604754.473 [CmdTest ThreadHandler](INFO): Handler Thread ID is 4820
2021-06-02T03:32:34.477Z,1622604754.477 [CBIT](DEBUG): Initialized mux pins.
2021-06-02T03:32:34.477Z,1622604754.477 [CBIT](DEBUG): Initializing the watchdog timer.
2021-06-02T03:32:34.485Z,1622604754.485 [BackseatComponent ThreadHandler](INFO): Handler Thread ID is 4821
2021-06-02T03:32:34.497Z,1622604754.497 [DataOverHttps ThreadHandler](INFO): Handler Thread ID is 4822
2021-06-02T03:32:34.498Z,1622604754.498 [DataOverHttps](DEBUG): dashIP=134.89.12.62 starts with a digit so assuming it is a numeric IP
2021-06-02T03:32:34.501Z,1622604754.501 [CBIT](INFO): Last reboot was NOT due to watchdog timer.
2021-06-02T03:32:34.501Z,1622604754.501 [CBIT](DEBUG): Initializing heartbeat.
2021-06-02T03:32:34.513Z,1622604754.513 [Onboard ThreadHandler](INFO): Handler Thread ID is 4823
2021-06-02T03:32:34.530Z,1622604754.530 [Radio_Surface ThreadHandler](INFO): Handler Thread ID is 4824
2021-06-02T03:32:34.553Z,1622604754.553 [CTD_Seabird ThreadHandler](INFO): Handler Thread ID is 4825
2021-06-02T03:32:34.554Z,1622604754.554 [CTD_Seabird](DEBUG): Initializing CTD_Seabird.
2021-06-02T03:32:34.558Z,1622604754.558 [WetLabsBB2FL ThreadHandler](INFO): Handler Thread ID is 4827
2021-06-02T03:32:34.561Z,1622604754.561 [WetLabsBB2FL](INFO): Powering up
2021-06-02T03:32:34.562Z,1622604754.562 [WetLabsUBAT ThreadHandler](INFO): Handler Thread ID is 4829
2021-06-02T03:32:34.565Z,1622604754.565 [WetLabsUBAT](INFO): Powering up
2021-06-02T03:32:34.566Z,1622604754.566 [NavChartDb ThreadHandler](INFO): Handler Thread ID is 4831
2021-06-02T03:32:34.573Z,1622604754.573 [CBIT](DEBUG): Deactivating GF circuits.
2021-06-02T03:32:34.573Z,1622604754.573 [CBIT](DEBUG): Deactivating emergency mode.
2021-06-02T03:32:34.576Z,1622604754.576 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US1WC07M.000
2021-06-02T03:32:34.576Z,1622604754.576 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US1WC07M.000
2021-06-02T03:32:34.577Z,1622604754.577 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US2WC11M.000
2021-06-02T03:32:34.577Z,1622604754.577 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US2WC11M.000
2021-06-02T03:32:34.577Z,1622604754.577 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US3CA52M.000
2021-06-02T03:32:34.577Z,1622604754.577 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US3CA52M.000
2021-06-02T03:32:34.577Z,1622604754.577 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US4CA60M.000
2021-06-02T03:32:34.578Z,1622604754.578 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US4CA60M.000
2021-06-02T03:32:34.578Z,1622604754.578 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US5CA50M.000
2021-06-02T03:32:34.578Z,1622604754.578 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US5CA50M.000
2021-06-02T03:32:34.578Z,1622604754.578 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US5CA61M.000
2021-06-02T03:32:34.578Z,1622604754.578 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US5CA61M.000
2021-06-02T03:32:34.579Z,1622604754.579 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US5CA62M.000
2021-06-02T03:32:34.579Z,1622604754.579 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US5CA62M.000
2021-06-02T03:32:34.579Z,1622604754.579 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US5CA83M.000
2021-06-02T03:32:34.579Z,1622604754.579 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US5CA83M.000
2021-06-02T03:32:34.613Z,1622604754.613 [CBIT](DEBUG): Backplane powered.
2021-06-02T03:32:34.618Z,1622604754.618 [MissionManager](INFO): Loading Mission: Missions/Startup.xml
2021-06-02T03:32:34.657Z,1622604754.657 [Startup:A.GoToSurface](DEBUG): Construct GoToSurface.
2021-06-02T03:32:34.697Z,1622604754.697 [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-02T03:32:34.698Z,1622604754.698 [MissionManager](INFO): Loading Mission: Missions/Default.xml
2021-06-02T03:32:34.776Z,1622604754.776 [MissionManager](INFO): DefineArg Default.ElapsedSinceDefaultStarted = 0.000000 min
2021-06-02T03:32:34.777Z,1622604754.777 [Default:A.Wait](DEBUG): Construct Wait.
2021-06-02T03:32:34.780Z,1622604754.780 [Default:B.GoToSurface](DEBUG): Construct GoToSurface.
2021-06-02T03:32:34.821Z,1622604754.821 [Default:CheckIn:Read_Iridium:A_Timeout:A.Execute](DEBUG): Construct Execute.
2021-06-02T03:32:34.824Z,1622604754.824 [Default:CheckIn:C.Wait](DEBUG): Construct Wait.
2021-06-02T03:32:34.846Z,1622604754.846 [Default:E.Execute](DEBUG): Construct Execute.
2021-06-02T03:32:34.866Z,1622604754.866 [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-02T03:32:34.871Z,1622604754.871 [controlThread](DEBUG): Component order: CycleStarter,AHRS_M2,BPC1,Depth_Keller,DropWeight,NAL9602,Power24vConverter,RDI_Pathfinder,DAT,PAR_Licor,Depth_Keller,PAR_Licor,DepthRateCalculator,PitchRateCalculator,SpeedCalculator,TempGradientCalculator,VerticalTemperatureHomogeneityIndexCalculator,YawRateCalculator,ElevatorOffsetCalculator,StratificationFrontDetector,DeadReckonUsingMultipleVelocitySources,NavChart,UniversalFixResidualReporter,MissionManager,VerticalControl,HorizontalControl,SpeedControl,LoopControl,BuoyancyServo,ElevatorServo,MassServo,RudderServo,ThrusterServo,SBIT,IBIT,CBIT,LcmUniversalReporter,Reporter,LogSplitter,
2021-06-02T03:32:34.890Z,1622604754.890 [AHRS_M2](DEBUG): Initializing AHRS_M2.
2021-06-02T03:32:34.945Z,1622604754.945 [Radio_Surface](INFO): Powering up
2021-06-02T03:32:35.012Z,1622604755.012 [Power24vConverter](INFO): Powering up.
2021-06-02T03:32:35.022Z,1622604755.022 [DAT](INFO): Powering up
2021-06-02T03:32:35.022Z,1622604755.022 [DAT](DEBUG): Initializing DAT.
2021-06-02T03:32:35.107Z,1622604755.107 [BuoyancyServo](DEBUG): Initializing EZServoServo.
2021-06-02T03:32:35.113Z,1622604755.113 [BuoyancyServo](DEBUG): Initializing BuoyancyServo.
2021-06-02T03:32:35.114Z,1622604755.114 [ElevatorServo](DEBUG): Initializing EZServoServo.
2021-06-02T03:32:35.121Z,1622604755.121 [ElevatorServo](DEBUG): Initializing ElevatorServo.
2021-06-02T03:32:35.122Z,1622604755.122 [MassServo](DEBUG): Initializing EZServoServo.
2021-06-02T03:32:35.129Z,1622604755.129 [MassServo](DEBUG): Initializing MassServo.
2021-06-02T03:32:35.130Z,1622604755.130 [RudderServo](DEBUG): Initializing EZServoServo.
2021-06-02T03:32:35.137Z,1622604755.137 [RudderServo](DEBUG): Initializing RudderServo.
2021-06-02T03:32:35.138Z,1622604755.138 [ThrusterServo](DEBUG): Initializing EZServoServo.
2021-06-02T03:32:35.145Z,1622604755.145 [ThrusterServo](DEBUG): Initializing ThrusterServo.
2021-06-02T03:32:35.297Z,1622604755.297 [Depth_Keller](ERROR): Pressure reading out of range: 1650.297119 decibar
2021-06-02T03:32:35.298Z,1622604755.298 [DropWeight](CRITICAL): DROP WEIGHT MISSING.

2021-06-02T03:32:35.298Z,1622604755.298 [DropWeight] Hardware Fault, FailCount= 1
2021-06-02T03:32:35.298Z,1622604755.298 [DropWeight](ERROR): Hardware Fault
2021-06-02T03:32:35.367Z,1622604755.367 [CommandLine](FAULT): Scheduling is paused
2021-06-02T03:32:35.367Z,1622604755.367 [CBIT](INFO): Critical error at 20210602T033235
2021-06-02T03:32:35.367Z,1622604755.367 [Supervisor](INFO): Stop Mission called by CBIT::checkCriticals
2021-06-02T03:32:35.370Z,1622604755.370 [CBIT](ERROR): Hardware Fault in component: DropWeight
2021-06-02T03:32:35.371Z,1622604755.371 [CBIT](CRITICAL): Hardware Fault in component: DropWeight
2021-06-02T03:32:36.029Z,1622604756.029 [RudderServo](ERROR): Rudder initialization uart error serial timeout
2021-06-02T03:32:36.029Z,1622604756.029 [RudderServo](FAULT): Rudder failed to initialize
2021-06-02T03:32:36.029Z,1622604756.029 [RudderServo] Communications Fault, FailCount= 1
2021-06-02T03:32:36.029Z,1622604756.029 [RudderServo](ERROR): Communications Fault
2021-06-02T03:32:36.127Z,1622604756.127 [CBIT](INFO): Critical error at 20210602T033235
2021-06-02T03:32:36.130Z,1622604756.130 [CBIT](ERROR): Communications Fault in component: RudderServo
2021-06-02T03:32:36.354Z,1622604756.354 [RudderServo](DEBUG): Uninitialize Rudder Servo.
2021-06-02T03:32:36.354Z,1622604756.354 [RudderServo](INFO): Powering down
2021-06-02T03:32:36.966Z,1622604756.966 [RudderServo](DEBUG): Initializing EZServoServo.
2021-06-02T03:32:37.086Z,1622604757.086 [RudderServo](DEBUG): Initializing RudderServo.
2021-06-02T03:32:37.090Z,1622604757.090 [CBIT](INFO): Clearing failed state for component RudderServo
2021-06-02T03:32:37.090Z,1622604757.090 [RudderServo] No Fault, FailCount= 1
2021-06-02T03:32:37.173Z,1622604757.173 [WetLabsBB2FL](INFO): Powering down
2021-06-02T03:32:40.522Z,1622604760.522 [DataOverHttps](INFO): setting available, lastComms_.elapsed()=0.000713
2021-06-02T03:32:43.837Z,1622604763.837 [WetLabsUBAT](INFO): Powering down
2021-06-02T03:32:49.077Z,1622604769.077 [DAT](INFO): commRate: 800
2021-06-02T03:32:51.091Z,1622604771.091 [DAT](INFO): entering command mode
2021-06-02T03:32:51.495Z,1622604771.495 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:32:51.899Z,1622604771.899 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:32:52.303Z,1622604772.303 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:32:52.748Z,1622604772.748 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:32:53.111Z,1622604773.111 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:32:53.515Z,1622604773.515 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:32:53.927Z,1622604773.927 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:32:54.323Z,1622604774.323 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:32:54.779Z,1622604774.779 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:32:55.135Z,1622604775.135 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:32:55.535Z,1622604775.535 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:32:55.939Z,1622604775.939 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:32:56.343Z,1622604776.343 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:32:56.816Z,1622604776.816 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:32:57.151Z,1622604777.151 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:32:57.555Z,1622604777.555 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:32:57.968Z,1622604777.968 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:32:58.368Z,1622604778.368 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:32:58.795Z,1622604778.795 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:32:59.171Z,1622604779.171 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:32:59.579Z,1622604779.579 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:32:59.985Z,1622604779.985 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:33:00.383Z,1622604780.383 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:33:00.836Z,1622604780.836 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:33:01.195Z,1622604781.195 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:33:01.599Z,1622604781.599 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:33:01.999Z,1622604781.999 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:33:02.403Z,1622604782.403 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:33:02.806Z,1622604782.806 [NAL9602](INFO): Powering up NAL9602
2021-06-02T03:33:02.834Z,1622604782.834 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:33:03.211Z,1622604783.211 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:33:03.615Z,1622604783.615 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:33:04.019Z,1622604784.019 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:33:04.423Z,1622604784.423 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:33:04.859Z,1622604784.859 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:33:05.231Z,1622604785.231 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:33:05.635Z,1622604785.635 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:33:06.039Z,1622604786.039 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:33:06.443Z,1622604786.443 [DAT](DEBUG): checking for command mode acknowledgment
2021-06-02T03:33:06.443Z,1622604786.443 [DAT](FAULT): failed to enter command mode
2021-06-02T03:33:06.893Z,1622604786.893 [DAT](INFO): entering command mode
2021-06-02T03:33:07.252Z,1622604787.252 [DAT](INFO): setting verbose to 3
2021-06-02T03:33:07.657Z,1622604787.657 [DAT](INFO): set verbose to 3
2021-06-02T03:33:07.657Z,1622604787.657 [DAT](INFO): setting DatVerbose to 27440
2021-06-02T03:33:08.060Z,1622604788.060 [DAT](INFO): set DatVerbose to 27440
2021-06-02T03:33:08.061Z,1622604788.061 [DAT](INFO): setting transmit power to 8
2021-06-02T03:33:08.468Z,1622604788.468 [DAT](INFO): set transmit power to 8
2021-06-02T03:33:08.469Z,1622604788.469 [DAT](INFO): setting local address to 9
2021-06-02T03:33:08.913Z,1622604788.913 [DAT](INFO): set local address to 9
2021-06-02T03:33:13.714Z,1622604793.714 [NAL9602](INFO): NAL9602 initialized
2021-06-02T03:33:25.075Z,1622604805.075 [SBIT](IMPORTANT): Beginning Startup BIT
2021-06-02T03:33:25.079Z,1622604805.079 [CBIT](IMPORTANT): Beginning ground fault scan
2021-06-02T03:33:36.015Z,1622604816.015 [CBIT](IMPORTANT): No ground fault detected
mA:
CHAN A0 (Batt): 0.000076
CHAN A1 (24V): 0.000212
CHAN A2 (12V): -0.008104
CHAN A3 (5V): -0.003036
CHAN B0 (3.3V): 0.000491
CHAN B1 (3.15aV): -0.000086
CHAN B2 (3.15bV): 0.000336
CHAN B3 (GND): 0.002319
OPEN: 0.005508
Full Scale Calc: 4.765 mA, -1.589 mA
2021-06-02T03:34:18.805Z,1622604858.805 [SBIT](IMPORTANT): SBIT PASSED
2021-06-02T03:34:18.806Z,1622604858.806 [SBIT](IMPORTANT): Listing configuration overrides from Data/persisted.cfg
2021-06-02T03:34:18.806Z,1622604858.806 [SBIT](IMPORTANT): BPC1.batteryMissingStickThreshold=6 count;

2021-06-02T03:34:18.807Z,1622604858.807 [SBIT](IMPORTANT): CBIT.gf24Offset=143 microampere;

2021-06-02T03:34:18.807Z,1622604858.807 [SBIT](IMPORTANT): Express linearApproximation VerticalTemperatureHomogeneityIndexCalculator.vertical_temperature_homogeneity_index 0.100000 celsius;

2021-06-02T03:34:18.807Z,1622604858.807 [SBIT](IMPORTANT): IBIT.batteryCapacityThreshold=24 ampere_hour;

2021-06-02T03:34:18.807Z,1622604858.807 [SBIT](IMPORTANT): IBIT.batteryVoltageThreshold=13 volt;

2021-06-02T03:34:18.807Z,1622604858.807 [SBIT](IMPORTANT): StratificationFrontDetector.loadAtStartup=1 bool;

2021-06-02T03:34:18.807Z,1622604858.807 [SBIT](IMPORTANT): StratificationFrontDetector.threshold=1 celsius;

2021-06-02T03:34:18.807Z,1622604858.807 [SBIT](IMPORTANT): StratificationFrontDetector.verbosity=1 count;

2021-06-02T03:34:18.808Z,1622604858.808 [SBIT](IMPORTANT): VerticalControl.buoyancyNeutral=195 cubic_centimeter;

2021-06-02T03:34:18.808Z,1622604858.808 [SBIT](IMPORTANT): VerticalControl.massDefault=7.7 millimeter;

2021-06-02T03:34:18.808Z,1622604858.808 [SBIT](IMPORTANT): VerticalTemperatureHomogeneityIndexCalculator.loadAtStartup=1 bool;

2021-06-02T03:34:19.180Z,1622604859.180 [MissionManager](IMPORTANT): Started mission Startup
2021-06-02T03:34:19.181Z,1622604859.181 [Startup] Running Loop=1
2021-06-02T03:34:19.181Z,1622604859.181 [Startup](DEBUG): Aggregate::initialize Startup
2021-06-02T03:34:19.181Z,1622604859.181 [Startup:A.GoToSurface] Running Loop=1
2021-06-02T03:34:19.181Z,1622604859.181 [Startup:A.GoToSurface](DEBUG): Initialize GoToSurfaceComponent.
2021-06-02T03:34:19.182Z,1622604859.182 [Startup:A.GoToSurface](DEBUG): No depth rate setting specified. Using default value of nan m/s.
2021-06-02T03:34:19.182Z,1622604859.182 [Startup:A.GoToSurface](DEBUG): No pitch setting specified. Using default value of nan degrees.
2021-06-02T03:34:19.183Z,1622604859.183 [Startup:A.GoToSurface](DEBUG): No speed setting specified. Using default value of 1.000000 m/s.
2021-06-02T03:34:19.183Z,1622604859.183 [Startup:A.GoToSurface](DEBUG): No surface timeout specified. Using default value of 1000.000000 seconds.
2021-06-02T03:34:19.183Z,1622604859.183 [Startup:A.GoToSurface](INFO): Received pitch timeout configuration 60.000000 seconds.
2021-06-02T03:34:19.185Z,1622604859.185 [Startup:StartupSatComms] Running Loop=1
2021-06-02T03:34:19.185Z,1622604859.185 [Startup:StartupSatComms](DEBUG): Aggregate::initialize Startup:StartupSatComms
2021-06-02T03:34:19.185Z,1622604859.185 [Startup:StartupSatComms:A] Running Loop=1
2021-06-02T03:34:19.596Z,1622604859.596 [Startup:StartupSatComms:A](DEBUG): Initialize ReadDataComponent to sense latitude_fix
2021-06-02T03:34:28.509Z,1622604868.509 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:34:28.510Z,1622604868.510 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:34:28.510Z,1622604868.510 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:34:54.858Z,1622604894.858 [CommandLine](IMPORTANT): got command configSet DropWeight.loadAtStartup 0.000000 bool persist
2021-06-02T03:34:54.858Z,1622604894.858 [CommandLine](IMPORTANT): configSet DropWeight.loadAtStartup requires a restart to take effect.
2021-06-02T03:35:19.382Z,1622604919.382 [Startup:StartupSatComms:A](INFO): Timed out from 2021-06-02T03:34:19.2Z
2021-06-02T03:35:19.382Z,1622604919.382 [Startup:StartupSatComms:A] Stopped
2021-06-02T03:35:19.383Z,1622604919.383 [Startup:StartupSatComms:B] Running Loop=1
2021-06-02T03:35:19.792Z,1622604919.792 [Startup:StartupSatComms:B](DEBUG): Initialize ReadDataComponent to sense platform_communications
2021-06-02T03:35:21.184Z,1622604921.184 [DataOverHttps](INFO): Sending 39 bytes from file Logs/20210528T180846/Courier0030.lzma
2021-06-02T03:35:27.214Z,1622604927.214 [DataOverHttps](INFO): Moved sent file to Logs/20210528T180846/Courier0030.lzma.bak
2021-06-02T03:35:27.214Z,1622604927.214 [DataOverHttps](INFO): SBD MOMSN=15682837
2021-06-02T03:35:34.867Z,1622604934.867 [DeadReckonUsingMultipleVelocitySources] Software Fault, FailCount= 1
2021-06-02T03:35:34.867Z,1622604934.867 [DeadReckonUsingMultipleVelocitySources](ERROR): Software Fault
2021-06-02T03:35:34.949Z,1622604934.949 [CBIT](ERROR): Software Fault in component: DeadReckonUsingMultipleVelocitySources
2021-06-02T03:35:35.133Z,1622604935.133 [CBIT](INFO): Clearing failed state for component DeadReckonUsingMultipleVelocitySources
2021-06-02T03:35:35.134Z,1622604935.134 [DeadReckonUsingMultipleVelocitySources] No Fault, FailCount= 1
2021-06-02T03:35:37.995Z,1622604937.995 [DataOverHttps](INFO): Sending 241 bytes from file Logs/20210602T033222/Courier0000.lzma
2021-06-02T03:35:44.026Z,1622604944.026 [DataOverHttps](INFO): Moved sent file to Logs/20210602T033222/Courier0000.lzma.bak
2021-06-02T03:35:44.026Z,1622604944.026 [DataOverHttps](INFO): SBD MOMSN=15682839
2021-06-02T03:35:53.128Z,1622604953.128 [DataOverHttps](INFO): Sending 96 bytes from file Logs/20210528T180846/Express0031.lzma
2021-06-02T03:35:59.150Z,1622604959.150 [DataOverHttps](INFO): Moved sent file to Logs/20210528T180846/Express0031.lzma.bak
2021-06-02T03:35:59.150Z,1622604959.150 [DataOverHttps](INFO): SBD MOMSN=15682844
2021-06-02T03:36:09.329Z,1622604969.329 [DataOverHttps](INFO): Sending 1139 bytes from file Logs/20210602T033222/Express0001.lzma
2021-06-02T03:36:15.350Z,1622604975.350 [DataOverHttps](INFO): Moved sent file to Logs/20210602T033222/Express0001.lzma.bak
2021-06-02T03:36:15.350Z,1622604975.350 [DataOverHttps](INFO): SBD MOMSN=15682847
2021-06-02T03:36:17.569Z,1622604977.569 [Startup:StartupSatComms:B] Stopped
2021-06-02T03:36:17.570Z,1622604977.570 [Startup:StartupSatComms](INFO): Completed Startup:StartupSatComms
2021-06-02T03:36:17.570Z,1622604977.570 [Startup:StartupSatComms] Stopped
2021-06-02T03:36:17.570Z,1622604977.570 [Startup:StartupSatComms](DEBUG): Aggregate::uninitialize Startup:StartupSatComms
2021-06-02T03:36:17.571Z,1622604977.571 [Startup](INFO): Completed Startup
2021-06-02T03:36:17.571Z,1622604977.571 [MissionManager](INFO): Startup is completed.
2021-06-02T03:36:17.571Z,1622604977.571 [MissionManager](INFO): Uninitializing Mission Startup
2021-06-02T03:36:17.571Z,1622604977.571 [Startup] Stopped
2021-06-02T03:36:17.571Z,1622604977.571 [Startup](DEBUG): Aggregate::uninitialize Startup
2021-06-02T03:36:17.571Z,1622604977.571 [Startup:A.GoToSurface] Stopped
2021-06-02T03:36:17.571Z,1622604977.571 [Startup:A.GoToSurface](DEBUG): Uninitialize GoToSurfaceComponent.
2021-06-02T03:36:17.963Z,1622604977.963 [MissionManager](IMPORTANT): Started mission Default
2021-06-02T03:36:17.963Z,1622604977.963 [Default] Running Loop=1
2021-06-02T03:36:17.963Z,1622604977.963 [Default](DEBUG): Aggregate::initialize Default
2021-06-02T03:36:17.964Z,1622604977.964 [Default:B.GoToSurface] Running Loop=1
2021-06-02T03:36:17.964Z,1622604977.964 [Default:B.GoToSurface](DEBUG): Initialize GoToSurfaceComponent.
2021-06-02T03:36:17.964Z,1622604977.964 [Default:B.GoToSurface](DEBUG): No depth rate setting specified. Using default value of nan m/s.
2021-06-02T03:36:17.964Z,1622604977.964 [Default:B.GoToSurface](DEBUG): No pitch setting specified. Using default value of nan degrees.
2021-06-02T03:36:17.969Z,1622604977.969 [Default:B.GoToSurface](DEBUG): No speed setting specified. Using default value of 1.000000 m/s.
2021-06-02T03:36:17.969Z,1622604977.969 [Default:B.GoToSurface](DEBUG): No surface timeout specified. Using default value of 1000.000000 seconds.
2021-06-02T03:36:17.970Z,1622604977.970 [Default:B.GoToSurface](INFO): Received pitch timeout configuration 60.000000 seconds.
2021-06-02T03:36:17.970Z,1622604977.970 [Default:A.Wait] Running Loop=1
2021-06-02T03:36:17.970Z,1622604977.970 [Default:A.Wait](DEBUG): Initialize Wait Component.
2021-06-02T03:36:25.640Z,1622604985.640 [CommandLine](IMPORTANT): got command run ./Missions/test.xml
2021-06-02T03:36:25.640Z,1622604985.640 [MissionManager](INFO): Loading Mission: ./Missions/test.xml
2021-06-02T03:36:25.716Z,1622604985.716 [MissionManager](INFO): DefineArg test.ElapsedSinceDefaultStarted = 0.000000 min
2021-06-02T03:36:25.729Z,1622604985.729 [test:A.Wait](DEBUG): Construct Wait.
2021-06-02T03:36:25.741Z,1622604985.741 [test:C.GoToSurface](DEBUG): Construct GoToSurface.
2021-06-02T03:36:25.777Z,1622604985.777 [test:CheckIn:Read_Iridium:A_Timeout:A.Execute](DEBUG): Construct Execute.
2021-06-02T03:36:25.779Z,1622604985.779 [test:CheckIn:C.Wait](DEBUG): Construct Wait.
2021-06-02T03:36:25.794Z,1622604985.794 [test:F.Execute](DEBUG): Construct Execute.
2021-06-02T03:36:25.809Z,1622604985.809 [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:Sensor="Tethys/Sensor"
         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/Sensor http://okeanids.mbari.org/tethys/Xml/Sensor.xsd
                             Tethys/Universal http://okeanids.mbari.org/tethys/Xml/Universal.xsd"
         Id="test">

    <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>

    <ReadData>
        <Sensor:CmdTest.cmdTest/>
    </ReadData>

    <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">Test 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-02T03:36:25.812Z,1622604985.812 [CommandLine](IMPORTANT): Running ./Missions/test.xml
2021-06-02T03:36:26.048Z,1622604986.048 [Default] Stopped
2021-06-02T03:36:26.048Z,1622604986.048 [Default](DEBUG): Aggregate::uninitialize Default
2021-06-02T03:36:26.048Z,1622604986.048 [Default:A.Wait] Stopped
2021-06-02T03:36:26.048Z,1622604986.048 [Default:A.Wait](DEBUG): Uninitialize Wait Component.
2021-06-02T03:36:26.048Z,1622604986.048 [Default:B.GoToSurface] Stopped
2021-06-02T03:36:26.049Z,1622604986.049 [Default:B.GoToSurface](DEBUG): Uninitialize GoToSurfaceComponent.
2021-06-02T03:36:26.049Z,1622604986.049 [MissionManager](IMPORTANT): Started mission test
2021-06-02T03:36:26.049Z,1622604986.049 [test] Running Loop=1
2021-06-02T03:36:26.049Z,1622604986.049 [test](DEBUG): Aggregate::initialize test
2021-06-02T03:36:26.049Z,1622604986.049 [test:B] Running Loop=1
2021-06-02T03:36:26.049Z,1622604986.049 [test:C.GoToSurface] Running Loop=1
2021-06-02T03:36:26.049Z,1622604986.049 [test:C.GoToSurface](DEBUG): Initialize GoToSurfaceComponent.
2021-06-02T03:36:26.050Z,1622604986.050 [test:C.GoToSurface](DEBUG): No depth rate setting specified. Using default value of nan m/s.
2021-06-02T03:36:26.050Z,1622604986.050 [test:C.GoToSurface](DEBUG): No pitch setting specified. Using default value of nan degrees.
2021-06-02T03:36:26.050Z,1622604986.050 [test:C.GoToSurface](DEBUG): No speed setting specified. Using default value of 1.000000 m/s.
2021-06-02T03:36:26.051Z,1622604986.051 [test:C.GoToSurface](DEBUG): No surface timeout specified. Using default value of 1000.000000 seconds.
2021-06-02T03:36:26.051Z,1622604986.051 [test:C.GoToSurface](INFO): Received pitch timeout configuration 60.000000 seconds.
2021-06-02T03:36:26.051Z,1622604986.051 [test:A.Wait] Running Loop=1
2021-06-02T03:36:26.051Z,1622604986.051 [test:A.Wait](DEBUG): Initialize Wait Component.
2021-06-02T03:36:26.052Z,1622604986.052 [test:B] Running Loop=1
2021-06-02T03:36:26.069Z,1622604986.069 [test:B](DEBUG): Initialize ReadDataComponent to sense CmdTest.cmdTest
2021-06-02T03:36:26.826Z,1622604986.826 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:26.826Z,1622604986.826 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:26.827Z,1622604986.827 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:27.233Z,1622604987.233 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:27.233Z,1622604987.233 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:27.233Z,1622604987.233 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:27.633Z,1622604987.633 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:27.633Z,1622604987.633 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:27.633Z,1622604987.633 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:28.033Z,1622604988.033 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:28.033Z,1622604988.033 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:28.033Z,1622604988.033 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:28.434Z,1622604988.434 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:28.434Z,1622604988.434 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:28.435Z,1622604988.435 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:28.833Z,1622604988.833 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:28.833Z,1622604988.833 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:28.833Z,1622604988.833 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:29.233Z,1622604989.233 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:29.233Z,1622604989.233 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:29.234Z,1622604989.234 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:29.633Z,1622604989.633 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:29.633Z,1622604989.633 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:29.633Z,1622604989.633 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:30.033Z,1622604990.033 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:30.033Z,1622604990.033 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:30.034Z,1622604990.034 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:30.433Z,1622604990.433 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:30.433Z,1622604990.433 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:30.433Z,1622604990.433 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:30.833Z,1622604990.833 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:30.833Z,1622604990.833 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:30.833Z,1622604990.833 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:31.233Z,1622604991.233 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:31.233Z,1622604991.233 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:31.233Z,1622604991.233 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:31.634Z,1622604991.634 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:31.635Z,1622604991.635 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:31.636Z,1622604991.636 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:32.041Z,1622604992.041 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:32.041Z,1622604992.041 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:32.041Z,1622604992.041 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:32.441Z,1622604992.441 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:32.441Z,1622604992.441 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:32.441Z,1622604992.441 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:32.841Z,1622604992.841 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:32.841Z,1622604992.841 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:32.841Z,1622604992.841 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:33.241Z,1622604993.241 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:33.241Z,1622604993.241 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:33.241Z,1622604993.241 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:33.741Z,1622604993.741 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:33.741Z,1622604993.741 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:33.741Z,1622604993.741 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:34.146Z,1622604994.146 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:34.146Z,1622604994.146 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:34.147Z,1622604994.147 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:34.550Z,1622604994.550 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:34.550Z,1622604994.550 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:34.551Z,1622604994.551 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:34.950Z,1622604994.950 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:34.950Z,1622604994.950 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:34.950Z,1622604994.950 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:35.353Z,1622604995.353 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:35.353Z,1622604995.353 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:35.353Z,1622604995.353 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:35.753Z,1622604995.753 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:35.753Z,1622604995.753 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:35.753Z,1622604995.753 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:36.154Z,1622604996.154 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:36.154Z,1622604996.154 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:36.155Z,1622604996.155 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:36.557Z,1622604996.557 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:36.558Z,1622604996.558 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:36.559Z,1622604996.559 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:36.957Z,1622604996.957 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:36.957Z,1622604996.957 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:36.958Z,1622604996.958 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:37.357Z,1622604997.357 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:37.357Z,1622604997.357 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:37.357Z,1622604997.357 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:37.757Z,1622604997.757 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:37.757Z,1622604997.757 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:37.757Z,1622604997.757 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:38.157Z,1622604998.157 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:38.157Z,1622604998.157 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:38.157Z,1622604998.157 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:38.558Z,1622604998.558 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:38.558Z,1622604998.558 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:38.559Z,1622604998.559 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:38.957Z,1622604998.957 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:38.957Z,1622604998.957 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:38.957Z,1622604998.957 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:39.357Z,1622604999.357 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:39.357Z,1622604999.357 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:39.357Z,1622604999.357 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:39.374Z,1622604999.374 [test:A.Wait](INFO): Done Waiting.
2021-06-02T03:36:39.374Z,1622604999.374 [test:A.Wait] Stopped
2021-06-02T03:36:39.374Z,1622604999.374 [test:A.Wait](DEBUG): Uninitialize Wait Component.
2021-06-02T03:36:39.761Z,1622604999.761 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:39.761Z,1622604999.761 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:39.761Z,1622604999.761 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:39.807Z,1622604999.807 [test:CheckIn] Running Loop=1
2021-06-02T03:36:39.807Z,1622604999.807 [test:CheckIn](DEBUG): Aggregate::initialize test:CheckIn
2021-06-02T03:36:39.807Z,1622604999.807 [test:CheckIn:Read_GPS] Running Loop=1
2021-06-02T03:36:40.161Z,1622605000.161 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:40.161Z,1622605000.161 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:40.161Z,1622605000.161 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:40.185Z,1622605000.185 [test:CheckIn:Read_GPS](DEBUG): Initialize ReadDataComponent to sense time_fix
2021-06-02T03:36:40.569Z,1622605000.569 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:40.570Z,1622605000.570 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:40.571Z,1622605000.571 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:40.982Z,1622605000.982 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:40.982Z,1622605000.982 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:40.982Z,1622605000.982 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:41.393Z,1622605001.393 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:41.393Z,1622605001.393 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:41.393Z,1622605001.393 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:41.793Z,1622605001.793 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:41.793Z,1622605001.793 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:41.793Z,1622605001.793 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:42.193Z,1622605002.193 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:42.193Z,1622605002.193 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:42.193Z,1622605002.193 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:42.601Z,1622605002.601 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:42.602Z,1622605002.602 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:42.603Z,1622605002.603 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:43.002Z,1622605003.002 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:43.002Z,1622605003.002 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:43.003Z,1622605003.003 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:43.405Z,1622605003.405 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:43.406Z,1622605003.406 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:43.406Z,1622605003.406 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:43.805Z,1622605003.805 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:43.805Z,1622605003.805 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:43.806Z,1622605003.806 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:44.205Z,1622605004.205 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:44.205Z,1622605004.205 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:44.205Z,1622605004.205 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:44.606Z,1622605004.606 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:44.606Z,1622605004.606 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:44.607Z,1622605004.607 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:45.007Z,1622605005.007 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:45.007Z,1622605005.007 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:45.008Z,1622605005.008 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:45.411Z,1622605005.411 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:45.411Z,1622605005.411 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:45.411Z,1622605005.411 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:45.813Z,1622605005.813 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:45.813Z,1622605005.813 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:45.813Z,1622605005.813 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:46.214Z,1622605006.214 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:46.214Z,1622605006.214 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:46.215Z,1622605006.215 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:46.613Z,1622605006.613 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:46.613Z,1622605006.613 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:46.613Z,1622605006.613 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:47.013Z,1622605007.013 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:47.013Z,1622605007.013 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:47.013Z,1622605007.013 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:47.413Z,1622605007.413 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:47.413Z,1622605007.413 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:47.413Z,1622605007.413 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:47.813Z,1622605007.813 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:47.813Z,1622605007.813 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:47.813Z,1622605007.813 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:48.213Z,1622605008.213 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:48.213Z,1622605008.213 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:48.213Z,1622605008.213 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:48.614Z,1622605008.614 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:48.614Z,1622605008.614 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:48.615Z,1622605008.615 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:49.013Z,1622605009.013 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:49.013Z,1622605009.013 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:49.013Z,1622605009.013 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:49.413Z,1622605009.413 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:49.413Z,1622605009.413 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:49.413Z,1622605009.413 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:49.813Z,1622605009.813 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:49.813Z,1622605009.813 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:49.813Z,1622605009.813 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:50.213Z,1622605010.213 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:50.213Z,1622605010.213 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:50.213Z,1622605010.213 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:50.613Z,1622605010.613 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:50.613Z,1622605010.613 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:50.614Z,1622605010.614 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:51.113Z,1622605011.113 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:51.113Z,1622605011.113 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:51.113Z,1622605011.113 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:51.514Z,1622605011.514 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:51.514Z,1622605011.514 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:51.514Z,1622605011.514 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:51.917Z,1622605011.917 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:51.917Z,1622605011.917 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:51.917Z,1622605011.917 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:52.321Z,1622605012.321 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:52.321Z,1622605012.321 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:52.321Z,1622605012.321 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:52.722Z,1622605012.722 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:52.722Z,1622605012.722 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:52.723Z,1622605012.723 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:53.125Z,1622605013.125 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:53.125Z,1622605013.125 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:53.125Z,1622605013.125 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:53.526Z,1622605013.526 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:53.526Z,1622605013.526 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:53.527Z,1622605013.527 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:53.929Z,1622605013.929 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:53.929Z,1622605013.929 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:53.929Z,1622605013.929 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:54.329Z,1622605014.329 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:54.329Z,1622605014.329 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:54.330Z,1622605014.330 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:54.730Z,1622605014.730 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:54.731Z,1622605014.731 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:54.731Z,1622605014.731 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:55.134Z,1622605015.134 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:55.134Z,1622605015.134 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:55.135Z,1622605015.135 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:55.477Z,1622605015.477 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:55.477Z,1622605015.477 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:55.477Z,1622605015.477 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:55.878Z,1622605015.878 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:55.878Z,1622605015.878 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:55.878Z,1622605015.878 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:56.282Z,1622605016.282 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:56.282Z,1622605016.282 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:56.282Z,1622605016.282 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:56.686Z,1622605016.686 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:56.686Z,1622605016.686 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:56.687Z,1622605016.687 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:57.090Z,1622605017.090 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:57.090Z,1622605017.090 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:57.091Z,1622605017.091 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:57.493Z,1622605017.493 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:57.493Z,1622605017.493 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:57.493Z,1622605017.493 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:57.894Z,1622605017.894 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:57.894Z,1622605017.894 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:57.895Z,1622605017.895 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:58.298Z,1622605018.298 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:58.298Z,1622605018.298 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:58.299Z,1622605018.299 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:58.702Z,1622605018.702 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:58.702Z,1622605018.702 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:58.702Z,1622605018.702 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:59.106Z,1622605019.106 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:59.106Z,1622605019.106 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:59.107Z,1622605019.107 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:59.513Z,1622605019.513 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:59.513Z,1622605019.513 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:59.513Z,1622605019.513 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:36:59.913Z,1622605019.913 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:36:59.913Z,1622605019.913 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:36:59.913Z,1622605019.913 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:00.313Z,1622605020.313 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:00.313Z,1622605020.313 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:00.314Z,1622605020.314 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:00.714Z,1622605020.714 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:00.714Z,1622605020.714 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:00.715Z,1622605020.715 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:01.118Z,1622605021.118 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:01.118Z,1622605021.118 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:01.118Z,1622605021.118 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:01.522Z,1622605021.522 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:01.522Z,1622605021.522 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:01.523Z,1622605021.523 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:01.927Z,1622605021.927 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:01.927Z,1622605021.927 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:01.927Z,1622605021.927 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:02.329Z,1622605022.329 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:02.329Z,1622605022.329 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:02.329Z,1622605022.329 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:02.829Z,1622605022.829 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:02.829Z,1622605022.829 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:02.830Z,1622605022.830 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:03.230Z,1622605023.230 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:03.230Z,1622605023.230 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:03.231Z,1622605023.231 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:03.549Z,1622605023.549 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:03.549Z,1622605023.549 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:03.549Z,1622605023.549 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:03.949Z,1622605023.949 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:03.949Z,1622605023.949 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:03.949Z,1622605023.949 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:04.349Z,1622605024.349 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:04.349Z,1622605024.349 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:04.349Z,1622605024.349 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:04.849Z,1622605024.849 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:04.849Z,1622605024.849 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:04.849Z,1622605024.849 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:05.250Z,1622605025.250 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:05.250Z,1622605025.250 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:05.251Z,1622605025.251 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:05.653Z,1622605025.653 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:05.653Z,1622605025.653 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:05.653Z,1622605025.653 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:05.882Z,1622605025.882 [DataOverHttps](IMPORTANT): SBD MTMSN=20210602T033700
2021-06-02T03:37:06.053Z,1622605026.053 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:06.053Z,1622605026.053 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:06.053Z,1622605026.053 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:06.453Z,1622605026.453 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:06.453Z,1622605026.453 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:06.453Z,1622605026.453 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:06.853Z,1622605026.853 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:06.853Z,1622605026.853 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:06.853Z,1622605026.853 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:07.253Z,1622605027.253 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:07.253Z,1622605027.253 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:07.254Z,1622605027.254 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:07.653Z,1622605027.653 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:07.653Z,1622605027.653 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:07.653Z,1622605027.653 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:07.891Z,1622605027.891 [DataOverHttps](INFO): Received command:sched asap "load Transport/keepstation.xml;set keepstation.MissionTimeout 1 h;set keepstation.NeedCommsTime 15 min;set keepstation.Latitude 36.807 arcdeg;set keepstation.Longitude -121.82436 arcdeg;set keepstation.Depth 20 m" 44fdo 1 2
2021-06-02T03:37:07.954Z,1622605027.954 [CommandLine](IMPORTANT): got command schedule asap "load Transport/keepstation.xml;set keepstation.MissionTimeout 1 h;set keepstation.NeedCommsTime 15 min;set keepstation.Latitude 36.807 arcdeg;set keepstation.Longitude -121.82436 arcdeg;set keepstation.Depth 20 m" 44fdo 1 2.000000
2021-06-02T03:37:07.954Z,1622605027.954 [CommandLine](IMPORTANT): Scheduling command #1 of 2 with id=44fdo
2021-06-02T03:37:07.955Z,1622605027.955 [CommandLine](IMPORTANT): Scheduled #1 (#1 of 2 with id='44fdo'): "load Transport/keepstation.xml;set keepstation.MissionTimeout 1 h;set keepstation.NeedCommsTime 15 min;set keepstation.Latitude 36.807 arcdeg;set keepstation.Longitude -121.82436 arcdeg;set keepstation.Depth 20 m" ASAP
2021-06-02T03:37:08.053Z,1622605028.053 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:08.053Z,1622605028.053 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:08.053Z,1622605028.053 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:08.453Z,1622605028.453 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:08.453Z,1622605028.453 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:08.453Z,1622605028.453 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:08.853Z,1622605028.853 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:08.853Z,1622605028.853 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:08.853Z,1622605028.853 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:09.257Z,1622605029.257 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:09.257Z,1622605029.257 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:09.257Z,1622605029.257 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:09.661Z,1622605029.661 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:09.661Z,1622605029.661 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:09.661Z,1622605029.661 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:10.065Z,1622605030.065 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:10.065Z,1622605030.065 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:10.065Z,1622605030.065 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:10.465Z,1622605030.465 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:10.465Z,1622605030.465 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:10.466Z,1622605030.466 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:10.884Z,1622605030.884 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:10.886Z,1622605030.886 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:10.886Z,1622605030.886 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:11.289Z,1622605031.289 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:11.289Z,1622605031.289 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:11.289Z,1622605031.289 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:11.690Z,1622605031.690 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:11.690Z,1622605031.690 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:11.691Z,1622605031.691 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:12.093Z,1622605032.093 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:12.093Z,1622605032.093 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:12.093Z,1622605032.093 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:12.493Z,1622605032.493 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:12.493Z,1622605032.493 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:12.493Z,1622605032.493 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:12.894Z,1622605032.894 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:12.894Z,1622605032.894 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:12.895Z,1622605032.895 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:12.909Z,1622605032.909 [DataOverHttps](IMPORTANT): SBD MTMSN=20210602T033707
2021-06-02T03:37:13.297Z,1622605033.297 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:13.297Z,1622605033.297 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:13.297Z,1622605033.297 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:13.697Z,1622605033.697 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:13.697Z,1622605033.697 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:13.697Z,1622605033.697 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:14.097Z,1622605034.097 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:14.097Z,1622605034.097 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:14.097Z,1622605034.097 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:14.502Z,1622605034.502 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:14.502Z,1622605034.502 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:14.503Z,1622605034.503 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:14.902Z,1622605034.902 [CommandLine](IMPORTANT): got command failComponent
2021-06-02T03:37:14.903Z,1622605034.903 [CommandLine](IMPORTANT): Failed components:
2021-06-02T03:37:14.903Z,1622605034.903 [CommandLine](IMPORTANT): DropWeight: Hardware Fault
2021-06-02T03:37:14.918Z,1622605034.918 [DataOverHttps](INFO): Received command:sched asap "set keepstation.DepthDeadband 10 m;set keepstation.Radius 200 m;set keepstation.MaxDepth 33 m;run" 44fdo 2 2
2021-06-02T03:37:15.006Z,1622605035.006 [CommandLine](IMPORTANT): got command schedule asap "set keepstation.DepthDeadband 10 m;set keepstation.Radius 200 m;set keepstation.MaxDepth 33 m;run" 44fdo 2 2.000000
2021-06-02T03:37:15.006Z,1622605035.006 [CommandLine](IMPORTANT): Scheduling command #2 of 2 with id=44fdo
2021-06-02T03:37:15.007Z,1622605035.007 [CommandLine](IMPORTANT): Scheduled #2 (#2 of 2 with id='44fdo'): "set keepstation.DepthDeadband 10 m;set keepstation.Radius 200 m;set keepstation.MaxDepth 33 m;run" ASAP
2021-06-02T03:37:15.120Z,1622605035.120 [CommandLine](IMPORTANT): got command load ./Missions/Transport/keepstation.xml
2021-06-02T03:37:15.120Z,1622605035.120 [MissionManager](INFO): Uninitializing Mission test
2021-06-02T03:37:15.120Z,1622605035.120 [test] Stopped
2021-06-02T03:37:15.129Z,1622605035.129 [test](DEBUG): Aggregate::uninitialize test
2021-06-02T03:37:15.129Z,1622605035.129 [test:B] Stopped
2021-06-02T03:37:15.129Z,1622605035.129 [test:C.GoToSurface] Stopped
2021-06-02T03:37:15.129Z,1622605035.129 [test:C.GoToSurface](DEBUG): Uninitialize GoToSurfaceComponent.
2021-06-02T03:37:15.129Z,1622605035.129 [test:CheckIn] Stopped
2021-06-02T03:37:15.129Z,1622605035.129 [test:CheckIn](DEBUG): Aggregate::uninitialize test:CheckIn
2021-06-02T03:37:15.129Z,1622605035.129 [test:CheckIn:Read_GPS] Stopped
2021-06-02T03:37:15.132Z,1622605035.132 [MissionManager](INFO): Loading Mission: ./Missions/Transport/keepstation.xml
2021-06-02T03:37:15.256Z,1622605035.256 [MissionManager](INFO): DefineArg keepstation.MissionTimeout = 4.000000 h
2021-06-02T03:37:15.259Z,1622605035.259 [MissionManager](INFO): DefineArg keepstation.NeedCommsTime = 45.000000 min
2021-06-02T03:37:15.262Z,1622605035.262 [MissionManager](INFO): DefineArg keepstation.Latitude = nan arcdeg
2021-06-02T03:37:15.265Z,1622605035.265 [MissionManager](INFO): DefineArg keepstation.Longitude = nan arcdeg
2021-06-02T03:37:15.268Z,1622605035.268 [MissionManager](INFO): DefineArg keepstation.Depth = 30.000000 m
2021-06-02T03:37:15.271Z,1622605035.271 [MissionManager](INFO): DefineArg keepstation.ApproachDepth = 15.000000 m
2021-06-02T03:37:15.274Z,1622605035.274 [MissionManager](INFO): DefineArg keepstation.DepthDeadband = 4.000000 m
2021-06-02T03:37:15.278Z,1622605035.278 [MissionManager](INFO): DefineArg keepstation.Speed = 0.750000 m/s
2021-06-02T03:37:15.281Z,1622605035.281 [MissionManager](INFO): DefineArg keepstation.Radius = 200.000000 m
2021-06-02T03:37:15.284Z,1622605035.284 [MissionManager](INFO): DefineArg keepstation.MaxDepth = 45.000000 m
2021-06-02T03:37:15.287Z,1622605035.287 [MissionManager](INFO): DefineArg keepstation.MinOffshore = 2.000000 km
2021-06-02T03:37:15.287Z,1622605035.287 [MissionManager](INFO): Inserting Stack: Missions/Insert/NeedComms.xml
2021-06-02T03:37:15.443Z,1622605035.443 [MissionManager](INFO): DefineArg keepstation:NeedComms.DiveInterval = 3.000000 h
2021-06-02T03:37:15.451Z,1622605035.451 [MissionManager](INFO): DefineArg keepstation:NeedComms.WaitForPitchUp = 10.000000 min
2021-06-02T03:37:15.455Z,1622605035.455 [MissionManager](INFO): DefineArg keepstation:NeedComms.SurfacePitch = 20.000000 arcdeg
2021-06-02T03:37:15.482Z,1622605035.482 [MissionManager](INFO): DefineArg keepstation:NeedComms.SurfaceDepthRate = nan m/s
2021-06-02T03:37:15.489Z,1622605035.489 [MissionManager](INFO): DefineArg keepstation:NeedComms.SurfaceSpeed = 1.000000 m/s
2021-06-02T03:37:15.492Z,1622605035.492 [MissionManager](INFO): DefineArg keepstation:NeedComms.GPSTimeout = 7.000000 min
2021-06-02T03:37:15.504Z,1622605035.504 [MissionManager](INFO): DefineArg keepstation:NeedComms.CommsTimeout = 30.000000 min
2021-06-02T03:37:15.531Z,1622605035.531 [keepstation:NeedComms:B.GoToSurface](DEBUG): Construct GoToSurface.
2021-06-02T03:37:15.574Z,1622605035.574 [MissionManager](INFO): Inserting Stack: Missions/Insert/StandardEnvelopes.xml
2021-06-02T03:37:15.607Z,1622605035.607 [MissionManager](INFO): DefineArg keepstation:StandardEnvelopes.MinAltitude = 5.000000 m
2021-06-02T03:37:15.610Z,1622605035.610 [MissionManager](INFO): DefineArg keepstation:StandardEnvelopes.MaxDepth = 200.000000 m
2021-06-02T03:37:15.621Z,1622605035.621 [MissionManager](INFO): DefineArg keepstation:StandardEnvelopes.MinOffshore = 2000.000000 m
2021-06-02T03:37:15.623Z,1622605035.623 [keepstation:StandardEnvelopes:A.AltitudeEnvelope](DEBUG): Construct AltitudeEnvelope.
2021-06-02T03:37:15.645Z,1622605035.645 [keepstation:StandardEnvelopes:B.DepthEnvelope](DEBUG): Construct DepthEnvelope.
2021-06-02T03:37:15.662Z,1622605035.662 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](DEBUG): Construct OffshoreEnvelope.
2021-06-02T03:37:15.685Z,1622605035.685 [keepstation:F.Pitch](DEBUG): Construct.
2021-06-02T03:37:15.694Z,1622605035.694 [keepstation:TransitToStation:A.Buoyancy](DEBUG): Construct Buoyancy.
2021-06-02T03:37:15.720Z,1622605035.720 [keepstation:TransitToStation:B.Pitch](DEBUG): Construct.
2021-06-02T03:37:15.754Z,1622605035.754 [keepstation:TransitToStation:C.SetSpeed](DEBUG): Construct.
2021-06-02T03:37:15.765Z,1622605035.765 [keepstation:TransitToStation:Wpt1.Waypoint](DEBUG): Construct Waypoint.
2021-06-02T03:37:15.797Z,1622605035.797 [keepstation:KeepStation:B.Pitch](DEBUG): Construct.
2021-06-02T03:37:15.804Z,1622605035.804 [keepstation:KeepStation:C.KeepStation](DEBUG): Construct KeepStation.
2021-06-02T03:37:15.821Z,1622605035.821 [keepstation:KeepStation:D.Wait](DEBUG): Construct Wait.
2021-06-02T03:37:15.866Z,1622605035.866 [MissionManager](DEBUG): 
<?xml version="1.0" encoding="UTF-8"?>
<!-- ====================
     Generated by TethysL
     ==================== -->
<Mission xmlns:xsi="http://www.w3.org/2001/XMLSchema-instance"
         xmlns="Tethys"
         xmlns:Units="Tethys/Units"
         xmlns:Guidance="Tethys/Guidance"
         xmlns:Control="Tethys/Control"
         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/Control http://okeanids.mbari.org/tethys/Xml/Control.xsd"
       Id="keepstation">

    <Description>
        Vehicle transits to desired waypoint (or stays put if none is commanded)
        and stays within the specified radius.
    </Description>

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

    <DefineArg Name="NeedCommsTime"><Description>
        How often to surface for communications
    </Description><Units:minute/><Value>45</Value></DefineArg>

    <DefineArg Name="Latitude"><Description>
        Latitude of waypoint to hold. If NaN, hold the latitude at start of
        mission.
    </Description><Units:degree/><Value>NaN</Value></DefineArg>

    <DefineArg Name="Longitude"><Description>
        Longitude of waypoint to hold. If NaN, hold the longitude at start of
        mission.
    </Description><Units:degree/><Value>NaN</Value></DefineArg>

    <DefineArg Name="Depth"><Description>
        Depth held during drift mode
    </Description><Units:meter/><Value>30</Value></DefineArg>

    <DefineArg Name="ApproachDepth"><Description>
        Depth for initial approach to station.
    </Description><Units:meter/><Value>15</Value></DefineArg>

    <DefineArg Name="DepthDeadband"><Description>
        How much vertical drift from the specified depth is allowed in drift
        mode
    </Description><Units:meter/><Value>4</Value></DefineArg>

    <DefineArg Name="Speed"><Description>
        Vehicle transit speed.
    </Description><Units:meter_per_second/><Value>0.75</Value></DefineArg>

    <DefineArg Name="Radius"><Description>
        Radius of circle around waypoint to hold.
    </Description><Units:meter/><Value>200</Value></DefineArg>

    <DefineArg Name="MaxDepth"><Description>
        Maximum allowable depth during the mission.
    </Description><Units:meter/><Value>45</Value></DefineArg>

    <DefineArg Name="MinOffshore"><Description>
        Minimum distance from the shoreline to maintain
    </Description><Units:kilometer/><Value>2</Value></DefineArg>

    <Timeout Duration="MissionTimeout"/>

    <Insert Filename="Insert/NeedComms.xml" Id="NeedComms"/>

    <Assign><Sequence/><Arg Name="NeedComms:DiveInterval"/><Arg Name="NeedCommsTime"/></Assign>

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

    <Assign><Sequence/><Arg Name="StandardEnvelopes:MaxDepth"/><Arg Name="MaxDepth"/></Assign>

    <Assign><Sequence/><Arg Name="StandardEnvelopes:MinOffshore"/><Arg Name="MinOffshore"/></Assign>

    <Guidance:Pitch>
        <Parallel/>
        <Setting><Guidance:Pitch.massPosition/><Control:VerticalControl.massDefault/></Setting>
    </Guidance:Pitch>

    <Call Id="StartingMission" RefId="NeedComms"/>

    <Aggregate Id="TransitToStation">

        <Description>
            Need a separate aggregate for transit if we want to specify a
            different depth for the approach.
        </Description>

        <Sequence/>

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

        <Guidance:Pitch>
            <Parallel/>
            <Setting><Guidance:Pitch.depth/><Arg Name="ApproachDepth"/></Setting>
        </Guidance:Pitch>

        <Guidance:SetSpeed>
            <Parallel/>
            <Setting><Guidance:SetSpeed.speed/><Arg Name="Speed"/></Setting>
        </Guidance:SetSpeed>

        <Guidance:Waypoint Id="Wpt1">
            <Sequence/>
            <Setting><Guidance:Waypoint.latitude/><Arg Name="Latitude"/></Setting>
            <Setting><Guidance:Waypoint.longitude/><Arg Name="Longitude"/></Setting>
        </Guidance:Waypoint>

    </Aggregate>

    <Call Id="OnStation" RefId="NeedComms"/>

    <Aggregate Id="KeepStation">

        <Sequence/>

        <Assign><Parallel/><Control:VerticalControl.depthDeadband/><Arg Name="DepthDeadband"/></Assign>

        <Guidance:Pitch>
            <Parallel/>
            <Setting><Guidance:Pitch.depth/><Arg Name="Depth"/></Setting>
        </Guidance:Pitch>

        <Guidance:KeepStation>
            <Parallel/>
            <Setting><Guidance:KeepStation.latitude/><Arg Name="Latitude"/></Setting>
            <Setting><Guidance:KeepStation.longitude/><Arg Name="Longitude"/></Setting>
            <Setting><Guidance:KeepStation.radius/><Arg Name="Radius"/></Setting>
            <Setting><Guidance:KeepStation.speed/><Arg Name="Speed"/></Setting>
        </Guidance:KeepStation>

        <Guidance:Wait>
            <Description>
                Due to the way the KeepStation behavior is currently
                implemented, we must run it in parallel and use a Wait to keep
                from completing the mission before the timeout expires. However,
                this new version of the mission uses a top-level timeout so that
                the entire mission will not run for longer then MissionTimeout.
            </Description>
            <Sequence/>
            <Setting><Guidance:Wait.duration/><Arg Name="MissionTimeout"/></Setting>
        </Guidance:Wait>

    </Aggregate>

</Mission>


2021-06-02T03:37:15.867Z,1622605035.867 [CommandLine](IMPORTANT): Loaded ./Missions/Transport/keepstation.xml
2021-06-02T03:37:16.143Z,1622605036.143 [MissionManager](IMPORTANT): Started mission Default
2021-06-02T03:37:16.143Z,1622605036.143 [Default] Running Loop=1
2021-06-02T03:37:16.143Z,1622605036.143 [Default](DEBUG): Aggregate::initialize Default
2021-06-02T03:37:16.143Z,1622605036.143 [Default:B.GoToSurface] Running Loop=1
2021-06-02T03:37:16.144Z,1622605036.144 [Default:B.GoToSurface](DEBUG): Initialize GoToSurfaceComponent.
2021-06-02T03:37:16.144Z,1622605036.144 [Default:B.GoToSurface](DEBUG): No depth rate setting specified. Using default value of nan m/s.
2021-06-02T03:37:16.144Z,1622605036.144 [Default:B.GoToSurface](DEBUG): No pitch setting specified. Using default value of nan degrees.
2021-06-02T03:37:16.153Z,1622605036.153 [Default:B.GoToSurface](DEBUG): No speed setting specified. Using default value of 1.000000 m/s.
2021-06-02T03:37:16.153Z,1622605036.153 [Default:B.GoToSurface](DEBUG): No surface timeout specified. Using default value of 1000.000000 seconds.
2021-06-02T03:37:16.154Z,1622605036.154 [Default:B.GoToSurface](INFO): Received pitch timeout configuration 60.000000 seconds.
2021-06-02T03:37:16.154Z,1622605036.154 [Default:A.Wait] Running Loop=1
2021-06-02T03:37:16.154Z,1622605036.154 [Default:A.Wait](DEBUG): Initialize Wait Component.
2021-06-02T03:37:24.625Z,1622605044.625 [CommandLine](IMPORTANT): got command set keepstation.MissionTimeout 1.000000 hour
2021-06-02T03:37:24.626Z,1622605044.626 [CommandLine](IMPORTANT): got command set keepstation.NeedCommsTime 15.000000 minute
2021-06-02T03:37:24.627Z,1622605044.627 [CommandLine](IMPORTANT): got command set keepstation.Latitude 36.806999 angular_degree
2021-06-02T03:37:24.627Z,1622605044.627 [CommandLine](IMPORTANT): got command set keepstation.Longitude -121.824364 angular_degree
2021-06-02T03:37:24.628Z,1622605044.628 [CommandLine](IMPORTANT): got command set keepstation.Depth 20.000000 meter
2021-06-02T03:37:29.479Z,1622605049.479 [Default:A.Wait](INFO): Done Waiting.
2021-06-02T03:37:29.479Z,1622605049.479 [Default:A.Wait] Stopped
2021-06-02T03:37:29.479Z,1622605049.479 [Default:A.Wait](DEBUG): Uninitialize Wait Component.
2021-06-02T03:37:29.702Z,1622605049.702 [CommandLine](IMPORTANT): got command set keepstation.DepthDeadband 10.000000 meter
2021-06-02T03:37:29.703Z,1622605049.703 [CommandLine](IMPORTANT): got command set keepstation.Radius 200.000000 meter
2021-06-02T03:37:29.703Z,1622605049.703 [CommandLine](IMPORTANT): got command set keepstation.MaxDepth 33.000000 meter
2021-06-02T03:37:29.704Z,1622605049.704 [CommandLine](IMPORTANT): got command run
2021-06-02T03:37:29.706Z,1622605049.706 [CommandLine](IMPORTANT): Running 
2021-06-02T03:37:29.886Z,1622605049.886 [Default] Stopped
2021-06-02T03:37:29.886Z,1622605049.886 [Default](DEBUG): Aggregate::uninitialize Default
2021-06-02T03:37:29.886Z,1622605049.886 [Default:B.GoToSurface] Stopped
2021-06-02T03:37:29.886Z,1622605049.886 [Default:B.GoToSurface](DEBUG): Uninitialize GoToSurfaceComponent.
2021-06-02T03:37:29.887Z,1622605049.887 [MissionManager](IMPORTANT): Started mission keepstation
2021-06-02T03:37:29.887Z,1622605049.887 [keepstation] Running Loop=1
2021-06-02T03:37:29.887Z,1622605049.887 [keepstation](DEBUG): Aggregate::initialize keepstation
2021-06-02T03:37:29.887Z,1622605049.887 [keepstation:StandardEnvelopes] Running Loop=1
2021-06-02T03:37:29.887Z,1622605049.887 [keepstation:StandardEnvelopes](DEBUG): Aggregate::initialize keepstation:StandardEnvelopes
2021-06-02T03:37:29.887Z,1622605049.887 [keepstation:StandardEnvelopes:A.AltitudeEnvelope] Running Loop=1
2021-06-02T03:37:29.887Z,1622605049.887 [keepstation:StandardEnvelopes:A.AltitudeEnvelope](DEBUG): Initialize AltitudeEnvelopeComponent.
2021-06-02T03:37:29.888Z,1622605049.888 [keepstation:StandardEnvelopes:B.DepthEnvelope] Running Loop=1
2021-06-02T03:37:29.888Z,1622605049.888 [keepstation:StandardEnvelopes:B.DepthEnvelope](DEBUG): Initialize DepthEnvelopeComponent.
2021-06-02T03:37:29.888Z,1622605049.888 [keepstation:StandardEnvelopes:C.OffshoreEnvelope] Running Loop=1
2021-06-02T03:37:29.888Z,1622605049.888 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](DEBUG): Initialize OffshoreEnvelopeComponent.
2021-06-02T03:37:29.888Z,1622605049.888 [keepstation:F.Pitch] Running Loop=1
2021-06-02T03:37:29.888Z,1622605049.888 [keepstation:F.Pitch](DEBUG): Initialize.
2021-06-02T03:37:29.889Z,1622605049.889 [keepstation:B] Running Loop=1
2021-06-02T03:37:29.889Z,1622605049.889 [keepstation:F.Pitch] Running Loop=1
2021-06-02T03:37:29.890Z,1622605049.890 [keepstation:StandardEnvelopes] Running Loop=1
2021-06-02T03:37:29.890Z,1622605049.890 [keepstation:StandardEnvelopes:C.OffshoreEnvelope] Running Loop=1
2021-06-02T03:37:29.890Z,1622605049.890 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:29.890Z,1622605049.890 [keepstation:StandardEnvelopes:B.DepthEnvelope] Running Loop=1
2021-06-02T03:37:29.891Z,1622605049.891 [keepstation:StandardEnvelopes:A.AltitudeEnvelope] Running Loop=1
2021-06-02T03:37:29.892Z,1622605049.892 [keepstation:B] Stopped
2021-06-02T03:37:29.892Z,1622605049.892 [keepstation:D] Running Loop=1
2021-06-02T03:37:29.892Z,1622605049.892 [keepstation:NeedComms] Running Loop=1
2021-06-02T03:37:29.892Z,1622605049.892 [keepstation:NeedComms](DEBUG): Aggregate::initialize keepstation:NeedComms
2021-06-02T03:37:29.892Z,1622605049.892 [keepstation:NeedComms:B.GoToSurface] Running Loop=1
2021-06-02T03:37:29.893Z,1622605049.893 [keepstation:NeedComms:B.GoToSurface](DEBUG): Initialize GoToSurfaceComponent.
2021-06-02T03:37:29.893Z,1622605049.893 [keepstation:NeedComms:B.GoToSurface](INFO): Received depth rate setting nan m/s.
2021-06-02T03:37:29.893Z,1622605049.893 [keepstation:NeedComms:B.GoToSurface](INFO): Received pitch setting 19.999999 degrees.
2021-06-02T03:37:29.894Z,1622605049.894 [keepstation:NeedComms:B.GoToSurface](INFO): Received speed setting 1.000000 m/s.
2021-06-02T03:37:29.894Z,1622605049.894 [keepstation:NeedComms:B.GoToSurface](DEBUG): No surface timeout specified. Using default value of 1000.000000 seconds.
2021-06-02T03:37:29.895Z,1622605049.895 [keepstation:NeedComms:B.GoToSurface](INFO): Received pitch timeout configuration 60.000000 seconds.
2021-06-02T03:37:29.895Z,1622605049.895 [keepstation:NeedComms:A] Running Loop=1
2021-06-02T03:37:29.896Z,1622605049.896 [keepstation:NeedComms:A](ERROR): data element is not active.
2021-06-02T03:37:29.896Z,1622605049.896 [keepstation:NeedComms:A](INFO): last time_fix was: nan second since 1970/01/01T00:00:00Z 
2021-06-02T03:37:29.896Z,1622605049.896 [keepstation:NeedComms:A] Stopped
2021-06-02T03:37:30.287Z,1622605050.287 [keepstation:D] Stopped
2021-06-02T03:37:30.288Z,1622605050.288 [keepstation:E] Running Loop=1
2021-06-02T03:37:30.288Z,1622605050.288 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:30.289Z,1622605050.289 [keepstation:NeedComms:C] Running Loop=1
2021-06-02T03:37:30.711Z,1622605050.711 [keepstation:E] Stopped
2021-06-02T03:37:30.711Z,1622605050.711 [keepstation:StartingMission] Running Loop=1
2021-06-02T03:37:30.712Z,1622605050.712 [keepstation:StartingMission](DEBUG): Aggregate::initialize keepstation:StartingMission
2021-06-02T03:37:30.712Z,1622605050.712 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:30.714Z,1622605050.714 [keepstation:NeedComms:C](DEBUG): Initialize ReadDataComponent to sense time_fix
2021-06-02T03:37:31.089Z,1622605051.089 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:31.547Z,1622605051.547 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:31.547Z,1622605051.547 [keepstation:StandardEnvelopes:A.AltitudeEnvelope](ERROR): Altitude Measurement is not Active.
2021-06-02T03:37:31.914Z,1622605051.914 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:32.324Z,1622605052.324 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:32.758Z,1622605052.758 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:33.125Z,1622605053.125 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:33.531Z,1622605053.531 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:33.936Z,1622605053.936 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:34.317Z,1622605054.317 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:34.746Z,1622605054.746 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:35.132Z,1622605055.132 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:35.528Z,1622605055.528 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:35.929Z,1622605055.929 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:36.339Z,1622605056.339 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:36.767Z,1622605056.767 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:37.141Z,1622605057.141 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:37.548Z,1622605057.548 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:37.976Z,1622605057.976 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:38.381Z,1622605058.381 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:38.797Z,1622605058.797 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:39.197Z,1622605059.197 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:39.570Z,1622605059.570 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:39.979Z,1622605059.979 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:40.376Z,1622605060.376 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:40.868Z,1622605060.868 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:41.221Z,1622605061.221 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:41.608Z,1622605061.608 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:42.019Z,1622605062.019 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:42.392Z,1622605062.392 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:42.821Z,1622605062.821 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:43.219Z,1622605063.219 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:43.632Z,1622605063.632 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:44.046Z,1622605064.046 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:44.437Z,1622605064.437 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:44.902Z,1622605064.902 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:45.226Z,1622605065.226 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:45.641Z,1622605065.641 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:46.048Z,1622605066.048 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:46.443Z,1622605066.443 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:46.870Z,1622605066.870 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:46.965Z,1622605066.965 [CommandLine](IMPORTANT): got command stop
2021-06-02T03:37:46.965Z,1622605066.965 [CommandLine](IMPORTANT): Scheduling is paused
2021-06-02T03:37:46.966Z,1622605066.966 [Supervisor](INFO): Stop Mission called by CommandLine::commandStop
2021-06-02T03:37:47.241Z,1622605067.241 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:37:47.242Z,1622605067.242 [MissionManager](INFO): MissionManager is completed.
2021-06-02T03:37:47.242Z,1622605067.242 [MissionManager](INFO): Uninitializing Mission keepstation
2021-06-02T03:37:47.242Z,1622605067.242 [keepstation] Stopped
2021-06-02T03:37:47.243Z,1622605067.243 [keepstation](DEBUG): Aggregate::uninitialize keepstation
2021-06-02T03:37:47.243Z,1622605067.243 [keepstation:NeedComms] Stopped
2021-06-02T03:37:47.243Z,1622605067.243 [keepstation:NeedComms](DEBUG): Aggregate::uninitialize keepstation:NeedComms
2021-06-02T03:37:47.243Z,1622605067.243 [keepstation:NeedComms:B.GoToSurface] Stopped
2021-06-02T03:37:47.243Z,1622605067.243 [keepstation:NeedComms:B.GoToSurface](DEBUG): Uninitialize GoToSurfaceComponent.
2021-06-02T03:37:47.243Z,1622605067.243 [keepstation:NeedComms:C] Stopped
2021-06-02T03:37:47.243Z,1622605067.243 [keepstation:StandardEnvelopes] Stopped
2021-06-02T03:37:47.243Z,1622605067.243 [keepstation:StandardEnvelopes](DEBUG): Aggregate::uninitialize keepstation:StandardEnvelopes
2021-06-02T03:37:47.243Z,1622605067.243 [keepstation:StandardEnvelopes:A.AltitudeEnvelope] Stopped
2021-06-02T03:37:47.243Z,1622605067.243 [keepstation:StandardEnvelopes:A.AltitudeEnvelope](DEBUG): Uninitialize AltitudeEnvelopeComponent.
2021-06-02T03:37:47.244Z,1622605067.244 [keepstation:StandardEnvelopes:B.DepthEnvelope] Stopped
2021-06-02T03:37:47.244Z,1622605067.244 [keepstation:StandardEnvelopes:B.DepthEnvelope](DEBUG): Uninitialize.
2021-06-02T03:37:47.244Z,1622605067.244 [keepstation:StandardEnvelopes:C.OffshoreEnvelope] Stopped
2021-06-02T03:37:47.244Z,1622605067.244 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](DEBUG): Uninitialize OffshoreEnvelopeComponent.
2021-06-02T03:37:47.244Z,1622605067.244 [keepstation:F.Pitch] Stopped
2021-06-02T03:37:47.244Z,1622605067.244 [keepstation:StartingMission] Stopped
2021-06-02T03:37:47.244Z,1622605067.244 [keepstation:StartingMission](DEBUG): Aggregate::uninitialize keepstation:StartingMission
2021-06-02T03:37:47.648Z,1622605067.648 [MissionManager](IMPORTANT): Started mission Default
2021-06-02T03:37:47.648Z,1622605067.648 [Default] Running Loop=1
2021-06-02T03:37:47.648Z,1622605067.648 [Default](DEBUG): Aggregate::initialize Default
2021-06-02T03:37:47.649Z,1622605067.649 [Default:B.GoToSurface] Running Loop=1
2021-06-02T03:37:47.649Z,1622605067.649 [Default:B.GoToSurface](DEBUG): Initialize GoToSurfaceComponent.
2021-06-02T03:37:47.649Z,1622605067.649 [Default:B.GoToSurface](DEBUG): No depth rate setting specified. Using default value of nan m/s.
2021-06-02T03:37:47.649Z,1622605067.649 [Default:B.GoToSurface](DEBUG): No pitch setting specified. Using default value of nan degrees.
2021-06-02T03:37:47.650Z,1622605067.650 [Default:B.GoToSurface](DEBUG): No speed setting specified. Using default value of 1.000000 m/s.
2021-06-02T03:37:47.650Z,1622605067.650 [Default:B.GoToSurface](DEBUG): No surface timeout specified. Using default value of 1000.000000 seconds.
2021-06-02T03:37:47.650Z,1622605067.650 [Default:B.GoToSurface](INFO): Received pitch timeout configuration 60.000000 seconds.
2021-06-02T03:37:47.651Z,1622605067.651 [Default:A.Wait] Running Loop=1
2021-06-02T03:37:47.651Z,1622605067.651 [Default:A.Wait](DEBUG): Initialize Wait Component.
2021-06-02T03:38:01.014Z,1622605081.014 [Default:A.Wait](INFO): Done Waiting.
2021-06-02T03:38:01.014Z,1622605081.014 [Default:A.Wait] Stopped
2021-06-02T03:38:01.014Z,1622605081.014 [Default:A.Wait](DEBUG): Uninitialize Wait Component.
2021-06-02T03:38:01.381Z,1622605081.381 [Default:CheckIn] Running Loop=1
2021-06-02T03:38:01.381Z,1622605081.381 [Default:CheckIn](DEBUG): Aggregate::initialize Default:CheckIn
2021-06-02T03:38:01.382Z,1622605081.382 [Default:CheckIn:Read_GPS] Running Loop=1
2021-06-02T03:38:01.791Z,1622605081.791 [Default:CheckIn:Read_GPS](DEBUG): Initialize ReadDataComponent to sense time_fix
2021-06-02T03:38:16.728Z,1622605096.728 [NAL9602](FAULT): MT Queue status failed to be acquired within timeout. Will not retry this session.
2021-06-02T03:38:35.731Z,1622605115.731 [DeadReckonUsingMultipleVelocitySources] Software Fault, FailCount= 2
2021-06-02T03:38:35.731Z,1622605115.731 [DeadReckonUsingMultipleVelocitySources](ERROR): Software Fault
2021-06-02T03:38:35.742Z,1622605115.742 [CBIT](ERROR): Software Fault in component: DeadReckonUsingMultipleVelocitySources
2021-06-02T03:38:36.154Z,1622605116.154 [CBIT](INFO): Clearing failed state for component DeadReckonUsingMultipleVelocitySources
2021-06-02T03:38:36.154Z,1622605116.154 [DeadReckonUsingMultipleVelocitySources] No Fault, FailCount= 2
2021-06-02T03:39:05.377Z,1622605145.377 [DataOverHttps](IMPORTANT): SBD MTMSN=20210602T033900
2021-06-02T03:39:07.386Z,1622605147.386 [DataOverHttps](INFO): Received command:sched asap "load Transport/keepstation.xml;set keepstation.MissionTimeout 1 h;set keepstation.NeedCommsTime 15 min;set keepstation.Latitude 36.807 arcdeg;set keepstation.Longitude -121.82436 arcdeg;set keepstation.Depth 20 m" 44fgm 1 2
2021-06-02T03:39:07.439Z,1622605147.439 [CommandLine](IMPORTANT): got command schedule asap "load Transport/keepstation.xml;set keepstation.MissionTimeout 1 h;set keepstation.NeedCommsTime 15 min;set keepstation.Latitude 36.807 arcdeg;set keepstation.Longitude -121.82436 arcdeg;set keepstation.Depth 20 m" 44fgm 1 2.000000
2021-06-02T03:39:07.439Z,1622605147.439 [CommandLine](IMPORTANT): Scheduling command #1 of 2 with id=44fgm
2021-06-02T03:39:07.440Z,1622605147.440 [CommandLine](IMPORTANT): Scheduled #3 (#1 of 2 with id='44fgm'): "load Transport/keepstation.xml;set keepstation.MissionTimeout 1 h;set keepstation.NeedCommsTime 15 min;set keepstation.Latitude 36.807 arcdeg;set keepstation.Longitude -121.82436 arcdeg;set keepstation.Depth 20 m" ASAP
2021-06-02T03:39:12.406Z,1622605152.406 [DataOverHttps](IMPORTANT): SBD MTMSN=20210602T033907
2021-06-02T03:39:14.414Z,1622605154.414 [DataOverHttps](INFO): Received command:sched asap "set keepstation.DepthDeadband 10 m;set keepstation.Radius 200 m;set keepstation.MaxDepth 33 m;run" 44fgm 2 2
2021-06-02T03:39:14.455Z,1622605154.455 [CommandLine](IMPORTANT): got command schedule asap "set keepstation.DepthDeadband 10 m;set keepstation.Radius 200 m;set keepstation.MaxDepth 33 m;run" 44fgm 2 2.000000
2021-06-02T03:39:14.456Z,1622605154.456 [CommandLine](IMPORTANT): Scheduling command #2 of 2 with id=44fgm
2021-06-02T03:39:14.457Z,1622605154.457 [CommandLine](IMPORTANT): Scheduled #4 (#2 of 2 with id='44fgm'): "set keepstation.DepthDeadband 10 m;set keepstation.Radius 200 m;set keepstation.MaxDepth 33 m;run" ASAP
2021-06-02T03:39:14.532Z,1622605154.532 [CommandLine](IMPORTANT): got command load ./Missions/Transport/keepstation.xml
2021-06-02T03:39:14.541Z,1622605154.541 [MissionManager](INFO): Loading Mission: ./Missions/Transport/keepstation.xml
2021-06-02T03:39:14.707Z,1622605154.707 [MissionManager](INFO): DefineArg keepstation.MissionTimeout = 4.000000 h
2021-06-02T03:39:14.709Z,1622605154.709 [MissionManager](INFO): DefineArg keepstation.NeedCommsTime = 45.000000 min
2021-06-02T03:39:14.712Z,1622605154.712 [MissionManager](INFO): DefineArg keepstation.Latitude = nan arcdeg
2021-06-02T03:39:14.714Z,1622605154.714 [MissionManager](INFO): DefineArg keepstation.Longitude = nan arcdeg
2021-06-02T03:39:14.717Z,1622605154.717 [MissionManager](INFO): DefineArg keepstation.Depth = 30.000000 m
2021-06-02T03:39:14.719Z,1622605154.719 [MissionManager](INFO): DefineArg keepstation.ApproachDepth = 15.000000 m
2021-06-02T03:39:14.722Z,1622605154.722 [MissionManager](INFO): DefineArg keepstation.DepthDeadband = 4.000000 m
2021-06-02T03:39:14.724Z,1622605154.724 [MissionManager](INFO): DefineArg keepstation.Speed = 0.750000 m/s
2021-06-02T03:39:14.727Z,1622605154.727 [MissionManager](INFO): DefineArg keepstation.Radius = 200.000000 m
2021-06-02T03:39:14.729Z,1622605154.729 [MissionManager](INFO): DefineArg keepstation.MaxDepth = 45.000000 m
2021-06-02T03:39:14.731Z,1622605154.731 [MissionManager](INFO): DefineArg keepstation.MinOffshore = 2.000000 km
2021-06-02T03:39:14.732Z,1622605154.732 [MissionManager](INFO): Inserting Stack: Missions/Insert/NeedComms.xml
2021-06-02T03:39:14.817Z,1622605154.817 [MissionManager](INFO): DefineArg keepstation:NeedComms.DiveInterval = 3.000000 h
2021-06-02T03:39:14.819Z,1622605154.819 [MissionManager](INFO): DefineArg keepstation:NeedComms.WaitForPitchUp = 10.000000 min
2021-06-02T03:39:14.826Z,1622605154.826 [MissionManager](INFO): DefineArg keepstation:NeedComms.SurfacePitch = 20.000000 arcdeg
2021-06-02T03:39:14.828Z,1622605154.828 [MissionManager](INFO): DefineArg keepstation:NeedComms.SurfaceDepthRate = nan m/s
2021-06-02T03:39:14.835Z,1622605154.835 [MissionManager](INFO): DefineArg keepstation:NeedComms.SurfaceSpeed = 1.000000 m/s
2021-06-02T03:39:14.864Z,1622605154.864 [MissionManager](INFO): DefineArg keepstation:NeedComms.GPSTimeout = 7.000000 min
2021-06-02T03:39:14.877Z,1622605154.877 [MissionManager](INFO): DefineArg keepstation:NeedComms.CommsTimeout = 30.000000 min
2021-06-02T03:39:14.897Z,1622605154.897 [keepstation:NeedComms:B.GoToSurface](DEBUG): Construct GoToSurface.
2021-06-02T03:39:14.961Z,1622605154.961 [MissionManager](INFO): Inserting Stack: Missions/Insert/StandardEnvelopes.xml
2021-06-02T03:39:15.017Z,1622605155.017 [MissionManager](INFO): DefineArg keepstation:StandardEnvelopes.MinAltitude = 5.000000 m
2021-06-02T03:39:15.019Z,1622605155.019 [MissionManager](INFO): DefineArg keepstation:StandardEnvelopes.MaxDepth = 200.000000 m
2021-06-02T03:39:15.027Z,1622605155.027 [MissionManager](INFO): DefineArg keepstation:StandardEnvelopes.MinOffshore = 2000.000000 m
2021-06-02T03:39:15.028Z,1622605155.028 [keepstation:StandardEnvelopes:A.AltitudeEnvelope](DEBUG): Construct AltitudeEnvelope.
2021-06-02T03:39:15.057Z,1622605155.057 [keepstation:StandardEnvelopes:B.DepthEnvelope](DEBUG): Construct DepthEnvelope.
2021-06-02T03:39:15.064Z,1622605155.064 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](DEBUG): Construct OffshoreEnvelope.
2021-06-02T03:39:15.081Z,1622605155.081 [keepstation:F.Pitch](DEBUG): Construct.
2021-06-02T03:39:15.092Z,1622605155.092 [keepstation:TransitToStation:A.Buoyancy](DEBUG): Construct Buoyancy.
2021-06-02T03:39:15.106Z,1622605155.106 [keepstation:TransitToStation:B.Pitch](DEBUG): Construct.
2021-06-02T03:39:15.115Z,1622605155.115 [keepstation:TransitToStation:C.SetSpeed](DEBUG): Construct.
2021-06-02T03:39:15.123Z,1622605155.123 [keepstation:TransitToStation:Wpt1.Waypoint](DEBUG): Construct Waypoint.
2021-06-02T03:39:15.147Z,1622605155.147 [keepstation:KeepStation:B.Pitch](DEBUG): Construct.
2021-06-02T03:39:15.152Z,1622605155.152 [keepstation:KeepStation:C.KeepStation](DEBUG): Construct KeepStation.
2021-06-02T03:39:15.165Z,1622605155.165 [keepstation:KeepStation:D.Wait](DEBUG): Construct Wait.
2021-06-02T03:39:15.191Z,1622605155.191 [MissionManager](DEBUG): 
<?xml version="1.0" encoding="UTF-8"?>
<!-- ====================
     Generated by TethysL
     ==================== -->
<Mission xmlns:xsi="http://www.w3.org/2001/XMLSchema-instance"
         xmlns="Tethys"
         xmlns:Units="Tethys/Units"
         xmlns:Guidance="Tethys/Guidance"
         xmlns:Control="Tethys/Control"
         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/Control http://okeanids.mbari.org/tethys/Xml/Control.xsd"
       Id="keepstation">

    <Description>
        Vehicle transits to desired waypoint (or stays put if none is commanded)
        and stays within the specified radius.
    </Description>

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

    <DefineArg Name="NeedCommsTime"><Description>
        How often to surface for communications
    </Description><Units:minute/><Value>45</Value></DefineArg>

    <DefineArg Name="Latitude"><Description>
        Latitude of waypoint to hold. If NaN, hold the latitude at start of
        mission.
    </Description><Units:degree/><Value>NaN</Value></DefineArg>

    <DefineArg Name="Longitude"><Description>
        Longitude of waypoint to hold. If NaN, hold the longitude at start of
        mission.
    </Description><Units:degree/><Value>NaN</Value></DefineArg>

    <DefineArg Name="Depth"><Description>
        Depth held during drift mode
    </Description><Units:meter/><Value>30</Value></DefineArg>

    <DefineArg Name="ApproachDepth"><Description>
        Depth for initial approach to station.
    </Description><Units:meter/><Value>15</Value></DefineArg>

    <DefineArg Name="DepthDeadband"><Description>
        How much vertical drift from the specified depth is allowed in drift
        mode
    </Description><Units:meter/><Value>4</Value></DefineArg>

    <DefineArg Name="Speed"><Description>
        Vehicle transit speed.
    </Description><Units:meter_per_second/><Value>0.75</Value></DefineArg>

    <DefineArg Name="Radius"><Description>
        Radius of circle around waypoint to hold.
    </Description><Units:meter/><Value>200</Value></DefineArg>

    <DefineArg Name="MaxDepth"><Description>
        Maximum allowable depth during the mission.
    </Description><Units:meter/><Value>45</Value></DefineArg>

    <DefineArg Name="MinOffshore"><Description>
        Minimum distance from the shoreline to maintain
    </Description><Units:kilometer/><Value>2</Value></DefineArg>

    <Timeout Duration="MissionTimeout"/>

    <Insert Filename="Insert/NeedComms.xml" Id="NeedComms"/>

    <Assign><Sequence/><Arg Name="NeedComms:DiveInterval"/><Arg Name="NeedCommsTime"/></Assign>

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

    <Assign><Sequence/><Arg Name="StandardEnvelopes:MaxDepth"/><Arg Name="MaxDepth"/></Assign>

    <Assign><Sequence/><Arg Name="StandardEnvelopes:MinOffshore"/><Arg Name="MinOffshore"/></Assign>

    <Guidance:Pitch>
        <Parallel/>
        <Setting><Guidance:Pitch.massPosition/><Control:VerticalControl.massDefault/></Setting>
    </Guidance:Pitch>

    <Call Id="StartingMission" RefId="NeedComms"/>

    <Aggregate Id="TransitToStation">

        <Description>
            Need a separate aggregate for transit if we want to specify a
            different depth for the approach.
        </Description>

        <Sequence/>

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

        <Guidance:Pitch>
            <Parallel/>
            <Setting><Guidance:Pitch.depth/><Arg Name="ApproachDepth"/></Setting>
        </Guidance:Pitch>

        <Guidance:SetSpeed>
            <Parallel/>
            <Setting><Guidance:SetSpeed.speed/><Arg Name="Speed"/></Setting>
        </Guidance:SetSpeed>

        <Guidance:Waypoint Id="Wpt1">
            <Sequence/>
            <Setting><Guidance:Waypoint.latitude/><Arg Name="Latitude"/></Setting>
            <Setting><Guidance:Waypoint.longitude/><Arg Name="Longitude"/></Setting>
        </Guidance:Waypoint>

    </Aggregate>

    <Call Id="OnStation" RefId="NeedComms"/>

    <Aggregate Id="KeepStation">

        <Sequence/>

        <Assign><Parallel/><Control:VerticalControl.depthDeadband/><Arg Name="DepthDeadband"/></Assign>

        <Guidance:Pitch>
            <Parallel/>
            <Setting><Guidance:Pitch.depth/><Arg Name="Depth"/></Setting>
        </Guidance:Pitch>

        <Guidance:KeepStation>
            <Parallel/>
            <Setting><Guidance:KeepStation.latitude/><Arg Name="Latitude"/></Setting>
            <Setting><Guidance:KeepStation.longitude/><Arg Name="Longitude"/></Setting>
            <Setting><Guidance:KeepStation.radius/><Arg Name="Radius"/></Setting>
            <Setting><Guidance:KeepStation.speed/><Arg Name="Speed"/></Setting>
        </Guidance:KeepStation>

        <Guidance:Wait>
            <Description>
                Due to the way the KeepStation behavior is currently
                implemented, we must run it in parallel and use a Wait to keep
                from completing the mission before the timeout expires. However,
                this new version of the mission uses a top-level timeout so that
                the entire mission will not run for longer then MissionTimeout.
            </Description>
            <Sequence/>
            <Setting><Guidance:Wait.duration/><Arg Name="MissionTimeout"/></Setting>
        </Guidance:Wait>

    </Aggregate>

</Mission>


2021-06-02T03:39:15.191Z,1622605155.191 [CommandLine](IMPORTANT): Loaded ./Missions/Transport/keepstation.xml
2021-06-02T03:39:19.433Z,1622605159.433 [DataOverHttps](IMPORTANT): SBD MTMSN=20210602T033914
2021-06-02T03:39:21.442Z,1622605161.442 [DataOverHttps](INFO): Received command:sched asap "load Transport/keepstation.xml;set keepstation.MissionTimeout 1 h;set keepstation.NeedCommsTime 15 min;set keepstation.Latitude 36.807 arcdeg;set keepstation.Longitude -121.82436 arcdeg;set keepstation.Depth 20 m" 44fgr 1 2
2021-06-02T03:39:23.629Z,1622605163.629 [CommandLine](IMPORTANT): got command set keepstation.MissionTimeout 1.000000 hour
2021-06-02T03:39:23.630Z,1622605163.630 [CommandLine](IMPORTANT): got command set keepstation.NeedCommsTime 15.000000 minute
2021-06-02T03:39:23.631Z,1622605163.631 [CommandLine](IMPORTANT): got command set keepstation.Latitude 36.806999 angular_degree
2021-06-02T03:39:23.632Z,1622605163.632 [CommandLine](IMPORTANT): got command set keepstation.Longitude -121.824364 angular_degree
2021-06-02T03:39:23.633Z,1622605163.633 [CommandLine](IMPORTANT): got command set keepstation.Depth 20.000000 meter
2021-06-02T03:39:23.670Z,1622605163.670 [CommandLine](IMPORTANT): got command schedule asap "load Transport/keepstation.xml;set keepstation.MissionTimeout 1 h;set keepstation.NeedCommsTime 15 min;set keepstation.Latitude 36.807 arcdeg;set keepstation.Longitude -121.82436 arcdeg;set keepstation.Depth 20 m" 44fgr 1 2.000000
2021-06-02T03:39:23.677Z,1622605163.677 [CommandLine](IMPORTANT): Scheduling command #1 of 2 with id=44fgr
2021-06-02T03:39:23.678Z,1622605163.678 [CommandLine](IMPORTANT): Scheduled #5 (#1 of 2 with id='44fgr'): "load Transport/keepstation.xml;set keepstation.MissionTimeout 1 h;set keepstation.NeedCommsTime 15 min;set keepstation.Latitude 36.807 arcdeg;set keepstation.Longitude -121.82436 arcdeg;set keepstation.Depth 20 m" ASAP
2021-06-02T03:39:26.673Z,1622605166.673 [DataOverHttps](IMPORTANT): SBD MTMSN=20210602T033921
2021-06-02T03:39:28.684Z,1622605168.684 [DataOverHttps](INFO): Received command:sched asap "set keepstation.DepthDeadband 10 m;set keepstation.Radius 200 m;set keepstation.MaxDepth 33 m;run" 44fgr 2 2
2021-06-02T03:39:28.906Z,1622605168.906 [CommandLine](IMPORTANT): got command set keepstation.DepthDeadband 10.000000 meter
2021-06-02T03:39:28.906Z,1622605168.906 [CommandLine](IMPORTANT): got command set keepstation.Radius 200.000000 meter
2021-06-02T03:39:28.907Z,1622605168.907 [CommandLine](IMPORTANT): got command set keepstation.MaxDepth 33.000000 meter
2021-06-02T03:39:28.908Z,1622605168.908 [CommandLine](IMPORTANT): got command run
2021-06-02T03:39:28.911Z,1622605168.911 [CommandLine](IMPORTANT): Running 
2021-06-02T03:39:28.921Z,1622605168.921 [CommandLine](IMPORTANT): got command schedule asap 
2021-06-02T03:39:28.922Z,1622605168.922 [CommandLine](FAULT): Incomplete syntax. Try: help schedule
2021-06-02T03:39:29.091Z,1622605169.091 [Default] Stopped
2021-06-02T03:39:29.091Z,1622605169.091 [Default](DEBUG): Aggregate::uninitialize Default
2021-06-02T03:39:29.091Z,1622605169.091 [Default:B.GoToSurface] Stopped
2021-06-02T03:39:29.091Z,1622605169.091 [Default:B.GoToSurface](DEBUG): Uninitialize GoToSurfaceComponent.
2021-06-02T03:39:29.091Z,1622605169.091 [Default:CheckIn] Stopped
2021-06-02T03:39:29.091Z,1622605169.091 [Default:CheckIn](DEBUG): Aggregate::uninitialize Default:CheckIn
2021-06-02T03:39:29.092Z,1622605169.092 [Default:CheckIn:Read_GPS] Stopped
2021-06-02T03:39:29.092Z,1622605169.092 [MissionManager](IMPORTANT): Started mission keepstation
2021-06-02T03:39:29.092Z,1622605169.092 [keepstation] Running Loop=1
2021-06-02T03:39:29.092Z,1622605169.092 [keepstation](DEBUG): Aggregate::initialize keepstation
2021-06-02T03:39:29.092Z,1622605169.092 [keepstation:StandardEnvelopes] Running Loop=1
2021-06-02T03:39:29.097Z,1622605169.097 [keepstation:StandardEnvelopes](DEBUG): Aggregate::initialize keepstation:StandardEnvelopes
2021-06-02T03:39:29.097Z,1622605169.097 [keepstation:StandardEnvelopes:A.AltitudeEnvelope] Running Loop=1
2021-06-02T03:39:29.097Z,1622605169.097 [keepstation:StandardEnvelopes:A.AltitudeEnvelope](DEBUG): Initialize AltitudeEnvelopeComponent.
2021-06-02T03:39:29.097Z,1622605169.097 [keepstation:StandardEnvelopes:B.DepthEnvelope] Running Loop=1
2021-06-02T03:39:29.097Z,1622605169.097 [keepstation:StandardEnvelopes:B.DepthEnvelope](DEBUG): Initialize DepthEnvelopeComponent.
2021-06-02T03:39:29.097Z,1622605169.097 [keepstation:StandardEnvelopes:C.OffshoreEnvelope] Running Loop=1
2021-06-02T03:39:29.097Z,1622605169.097 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](DEBUG): Initialize OffshoreEnvelopeComponent.
2021-06-02T03:39:29.097Z,1622605169.097 [keepstation:F.Pitch] Running Loop=1
2021-06-02T03:39:29.098Z,1622605169.098 [keepstation:F.Pitch](DEBUG): Initialize.
2021-06-02T03:39:29.098Z,1622605169.098 [keepstation:B] Running Loop=1
2021-06-02T03:39:29.098Z,1622605169.098 [keepstation:F.Pitch] Running Loop=1
2021-06-02T03:39:29.099Z,1622605169.099 [keepstation:StandardEnvelopes] Running Loop=1
2021-06-02T03:39:29.099Z,1622605169.099 [keepstation:StandardEnvelopes:C.OffshoreEnvelope] Running Loop=1
2021-06-02T03:39:29.099Z,1622605169.099 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:29.099Z,1622605169.099 [keepstation:StandardEnvelopes:B.DepthEnvelope] Running Loop=1
2021-06-02T03:39:29.099Z,1622605169.099 [keepstation:StandardEnvelopes:A.AltitudeEnvelope] Running Loop=1
2021-06-02T03:39:29.100Z,1622605169.100 [keepstation:B] Stopped
2021-06-02T03:39:29.100Z,1622605169.100 [keepstation:D] Running Loop=1
2021-06-02T03:39:29.100Z,1622605169.100 [keepstation:NeedComms] Running Loop=1
2021-06-02T03:39:29.100Z,1622605169.100 [keepstation:NeedComms](DEBUG): Aggregate::initialize keepstation:NeedComms
2021-06-02T03:39:29.100Z,1622605169.100 [keepstation:NeedComms:B.GoToSurface] Running Loop=1
2021-06-02T03:39:29.157Z,1622605169.157 [keepstation:NeedComms:B.GoToSurface](DEBUG): Initialize GoToSurfaceComponent.
2021-06-02T03:39:29.157Z,1622605169.157 [keepstation:NeedComms:B.GoToSurface](INFO): Received depth rate setting nan m/s.
2021-06-02T03:39:29.158Z,1622605169.158 [keepstation:NeedComms:B.GoToSurface](INFO): Received pitch setting 19.999999 degrees.
2021-06-02T03:39:29.158Z,1622605169.158 [keepstation:NeedComms:B.GoToSurface](INFO): Received speed setting 1.000000 m/s.
2021-06-02T03:39:29.159Z,1622605169.159 [keepstation:NeedComms:B.GoToSurface](DEBUG): No surface timeout specified. Using default value of 1000.000000 seconds.
2021-06-02T03:39:29.159Z,1622605169.159 [keepstation:NeedComms:B.GoToSurface](INFO): Received pitch timeout configuration 60.000000 seconds.
2021-06-02T03:39:29.159Z,1622605169.159 [keepstation:NeedComms:A] Running Loop=1
2021-06-02T03:39:29.160Z,1622605169.160 [keepstation:NeedComms:A](ERROR): data element is not active.
2021-06-02T03:39:29.161Z,1622605169.161 [keepstation:NeedComms:A](INFO): last time_fix was: nan second since 1970/01/01T00:00:00Z 
2021-06-02T03:39:29.161Z,1622605169.161 [keepstation:NeedComms:A] Stopped
2021-06-02T03:39:29.488Z,1622605169.488 [keepstation:D] Stopped
2021-06-02T03:39:29.488Z,1622605169.488 [keepstation:E] Running Loop=1
2021-06-02T03:39:29.488Z,1622605169.488 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:29.494Z,1622605169.494 [keepstation:NeedComms:C] Running Loop=1
2021-06-02T03:39:29.910Z,1622605169.910 [keepstation:E] Stopped
2021-06-02T03:39:29.910Z,1622605169.910 [keepstation:StartingMission] Running Loop=1
2021-06-02T03:39:29.910Z,1622605169.911 [keepstation:StartingMission](DEBUG): Aggregate::initialize keepstation:StartingMission
2021-06-02T03:39:29.911Z,1622605169.911 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:29.912Z,1622605169.912 [keepstation:NeedComms:C](DEBUG): Initialize ReadDataComponent to sense time_fix
2021-06-02T03:39:30.307Z,1622605170.307 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:30.709Z,1622605170.709 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:30.709Z,1622605170.709 [keepstation:StandardEnvelopes:A.AltitudeEnvelope](ERROR): Altitude Measurement is not Active.
2021-06-02T03:39:31.079Z,1622605171.079 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:31.476Z,1622605171.476 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:31.908Z,1622605171.908 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:32.278Z,1622605172.278 [CommandLine](IMPORTANT): got command help maintain
2021-06-02T03:39:32.308Z,1622605172.308 [CommandLine](IMPORTANT): got command set keepstation.Radius 200.000000 meter
2021-06-02T03:39:32.309Z,1622605172.309 [CommandLine](IMPORTANT): got command set keepstation.MaxDepth 33.000000 meter
2021-06-02T03:39:32.310Z,1622605172.310 [CommandLine](IMPORTANT): got command run 
2021-06-02T03:39:32.310Z,1622605172.310 [CommandLine](FAULT): Incomplete syntax. Try: help run
2021-06-02T03:39:32.318Z,1622605172.318 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:32.781Z,1622605172.781 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:33.094Z,1622605173.094 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:33.508Z,1622605173.508 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:33.917Z,1622605173.917 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:34.306Z,1622605174.306 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:34.326Z,1622605174.326 [DataOverHttps](IMPORTANT): SBD MTMSN=20210602T033928
2021-06-02T03:39:34.745Z,1622605174.745 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:35.132Z,1622605175.132 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:35.531Z,1622605175.531 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:35.942Z,1622605175.942 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:36.328Z,1622605176.328 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:36.334Z,1622605176.334 [DataOverHttps](INFO): Received command:sched "load Transport/keepstation.xml;set keepstation.MissionTimeout 1 h;set keepstation.NeedCommsTime 15 min;set keepstation.Latitude 36.807 arcdeg;set keepstation.Longitude -121.82436 arcdeg;set keepstation.Depth 20 m" 44fh0 1 2
2021-06-02T03:39:36.409Z,1622605176.409 [CommandLine](IMPORTANT): got command schedule "load Transport/keepstation.xml;set keepstation.MissionTimeout 1 h;set keepstation.NeedCommsTime 15 min;set keepstation.Latitude 36.807 arcdeg;set keepstation.Longitude -121.82436 arcdeg;set keepstation.Depth 20 m" 44fh0 1 2.000000
2021-06-02T03:39:36.410Z,1622605176.410 [CommandLine](IMPORTANT): Scheduling command #1 of 2 with id=44fh0
2021-06-02T03:39:36.411Z,1622605176.411 [CommandLine](IMPORTANT): Scheduled #6 (#1 of 2 with id='44fh0'): "load Transport/keepstation.xml;set keepstation.MissionTimeout 1 h;set keepstation.NeedCommsTime 15 min;set keepstation.Latitude 36.807 arcdeg;set keepstation.Longitude -121.82436 arcdeg;set keepstation.Depth 20 m"
2021-06-02T03:39:36.411Z,1622605176.411 [CommandLine](FAULT): Scheduling was paused by a command at 2021-06-02T03:37:46Z
2021-06-02T03:39:36.799Z,1622605176.799 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:37.130Z,1622605177.130 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:37.537Z,1622605177.537 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:37.961Z,1622605177.961 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:38.373Z,1622605178.373 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:38.795Z,1622605178.795 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:39.153Z,1622605179.153 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:39.560Z,1622605179.560 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:39.974Z,1622605179.974 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:40.362Z,1622605180.362 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:40.813Z,1622605180.813 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:41.247Z,1622605181.247 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:41.354Z,1622605181.354 [DataOverHttps](IMPORTANT): SBD MTMSN=20210602T033936
2021-06-02T03:39:41.624Z,1622605181.624 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:42.020Z,1622605182.020 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:42.401Z,1622605182.401 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:42.810Z,1622605182.810 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:43.203Z,1622605183.203 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:43.362Z,1622605183.362 [DataOverHttps](INFO): Received command:sched "set keepstation.DepthDeadband 10 m;set keepstation.Radius 200 m;set keepstation.MaxDepth 33 m;run" 44fh0 2 2
2021-06-02T03:39:43.430Z,1622605183.430 [CommandLine](IMPORTANT): got command schedule "set keepstation.DepthDeadband 10 m;set keepstation.Radius 200 m;set keepstation.MaxDepth 33 m;run" 44fh0 2 2.000000
2021-06-02T03:39:43.430Z,1622605183.430 [CommandLine](IMPORTANT): Scheduling command #2 of 2 with id=44fh0
2021-06-02T03:39:43.431Z,1622605183.431 [CommandLine](IMPORTANT): Scheduled #7 (#2 of 2 with id='44fh0'): "set keepstation.DepthDeadband 10 m;set keepstation.Radius 200 m;set keepstation.MaxDepth 33 m;run"
2021-06-02T03:39:43.431Z,1622605183.431 [CommandLine](FAULT): Scheduling was paused by a command at 2021-06-02T03:37:46Z
2021-06-02T03:39:43.604Z,1622605183.604 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:44.017Z,1622605184.017 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:44.429Z,1622605184.429 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:44.839Z,1622605184.839 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:45.213Z,1622605185.213 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:45.616Z,1622605185.616 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:46.025Z,1622605186.025 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:46.483Z,1622605186.483 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:46.894Z,1622605186.894 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:47.266Z,1622605187.266 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:47.679Z,1622605187.679 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:48.045Z,1622605188.045 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:48.441Z,1622605188.441 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:48.888Z,1622605188.888 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:49.253Z,1622605189.253 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:49.659Z,1622605189.659 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:50.083Z,1622605190.083 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:50.491Z,1622605190.491 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:50.916Z,1622605190.916 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:51.276Z,1622605191.276 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:51.683Z,1622605191.683 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:52.081Z,1622605192.081 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:52.484Z,1622605192.484 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:52.946Z,1622605192.946 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:53.312Z,1622605193.312 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:53.719Z,1622605193.719 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:54.153Z,1622605194.153 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:54.513Z,1622605194.513 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:54.962Z,1622605194.962 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:55.327Z,1622605195.327 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:55.720Z,1622605195.720 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:56.137Z,1622605196.137 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:56.549Z,1622605196.549 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:56.972Z,1622605196.972 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:57.333Z,1622605197.333 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:57.736Z,1622605197.736 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:58.152Z,1622605198.152 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:58.593Z,1622605198.593 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:58.986Z,1622605198.986 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:59.419Z,1622605199.419 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:39:59.756Z,1622605199.756 [BPC1](INFO): Calculating totals. Valid battery stick count: 51. Valid reserve battery stick count: 6.
2021-06-02T03:39:59.760Z,1622605199.760 [BPC1](INFO): Received data from all battery sticks.
2021-06-02T03:39:59.818Z,1622605199.818 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:00.171Z,1622605200.171 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:00.618Z,1622605200.618 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:01.006Z,1622605201.006 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:01.376Z,1622605201.376 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:01.792Z,1622605201.792 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:02.203Z,1622605202.203 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:02.629Z,1622605202.629 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:03.009Z,1622605203.009 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:03.397Z,1622605203.397 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:03.816Z,1622605203.816 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:04.230Z,1622605204.230 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:04.656Z,1622605204.656 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:05.011Z,1622605205.011 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:05.426Z,1622605205.426 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:05.839Z,1622605205.839 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:06.253Z,1622605206.253 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:06.686Z,1622605206.686 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:07.034Z,1622605207.034 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:07.432Z,1622605207.432 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:07.836Z,1622605207.836 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:08.243Z,1622605208.243 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:08.667Z,1622605208.667 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:09.074Z,1622605209.074 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:09.485Z,1622605209.485 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:09.873Z,1622605209.873 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:10.270Z,1622605210.270 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:10.692Z,1622605210.692 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:11.065Z,1622605211.065 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:11.476Z,1622605211.476 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:11.901Z,1622605211.901 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:12.305Z,1622605212.305 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:12.737Z,1622605212.737 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:13.094Z,1622605213.094 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:13.490Z,1622605213.490 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:13.897Z,1622605213.897 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:14.301Z,1622605214.301 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:14.734Z,1622605214.734 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:15.132Z,1622605215.132 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:15.539Z,1622605215.539 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:15.937Z,1622605215.937 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:16.322Z,1622605216.322 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:16.751Z,1622605216.751 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:17.133Z,1622605217.133 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:17.532Z,1622605217.532 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:17.957Z,1622605217.957 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:18.361Z,1622605218.361 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:18.784Z,1622605218.784 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:19.148Z,1622605219.148 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:19.549Z,1622605219.549 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:19.965Z,1622605219.965 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:20.361Z,1622605220.361 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:20.805Z,1622605220.805 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:21.183Z,1622605221.183 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:21.593Z,1622605221.593 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:21.999Z,1622605221.999 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:22.380Z,1622605222.380 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:22.808Z,1622605222.808 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:23.195Z,1622605223.195 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:23.521Z,1622605223.521 [DataOverHttps](IMPORTANT): SBD MTMSN=20210602T034018
2021-06-02T03:40:23.594Z,1622605223.594 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:24.028Z,1622605224.028 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:24.416Z,1622605224.416 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:24.835Z,1622605224.835 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:25.209Z,1622605225.209 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:25.530Z,1622605225.530 [DataOverHttps](INFO): Received command:stop
2021-06-02T03:40:25.612Z,1622605225.612 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:25.613Z,1622605225.613 [CommandLine](IMPORTANT): got command stop
2021-06-02T03:40:25.613Z,1622605225.613 [Supervisor](INFO): Stop Mission called by CommandLine::commandStop
2021-06-02T03:40:25.618Z,1622605225.618 [MissionManager](INFO): MissionManager is completed.
2021-06-02T03:40:25.618Z,1622605225.618 [MissionManager](INFO): Uninitializing Mission keepstation
2021-06-02T03:40:25.618Z,1622605225.618 [keepstation] Stopped
2021-06-02T03:40:25.619Z,1622605225.619 [keepstation](DEBUG): Aggregate::uninitialize keepstation
2021-06-02T03:40:25.619Z,1622605225.619 [keepstation:NeedComms] Stopped
2021-06-02T03:40:25.619Z,1622605225.619 [keepstation:NeedComms](DEBUG): Aggregate::uninitialize keepstation:NeedComms
2021-06-02T03:40:25.619Z,1622605225.619 [keepstation:NeedComms:B.GoToSurface] Stopped
2021-06-02T03:40:25.619Z,1622605225.619 [keepstation:NeedComms:B.GoToSurface](DEBUG): Uninitialize GoToSurfaceComponent.
2021-06-02T03:40:25.619Z,1622605225.619 [keepstation:NeedComms:C] Stopped
2021-06-02T03:40:25.619Z,1622605225.619 [keepstation:StandardEnvelopes] Stopped
2021-06-02T03:40:25.619Z,1622605225.619 [keepstation:StandardEnvelopes](DEBUG): Aggregate::uninitialize keepstation:StandardEnvelopes
2021-06-02T03:40:25.619Z,1622605225.619 [keepstation:StandardEnvelopes:A.AltitudeEnvelope] Stopped
2021-06-02T03:40:25.619Z,1622605225.619 [keepstation:StandardEnvelopes:A.AltitudeEnvelope](DEBUG): Uninitialize AltitudeEnvelopeComponent.
2021-06-02T03:40:25.620Z,1622605225.620 [keepstation:StandardEnvelopes:B.DepthEnvelope] Stopped
2021-06-02T03:40:25.620Z,1622605225.620 [keepstation:StandardEnvelopes:B.DepthEnvelope](DEBUG): Uninitialize.
2021-06-02T03:40:25.620Z,1622605225.620 [keepstation:StandardEnvelopes:C.OffshoreEnvelope] Stopped
2021-06-02T03:40:25.620Z,1622605225.620 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](DEBUG): Uninitialize OffshoreEnvelopeComponent.
2021-06-02T03:40:25.620Z,1622605225.620 [keepstation:F.Pitch] Stopped
2021-06-02T03:40:25.620Z,1622605225.620 [keepstation:StartingMission] Stopped
2021-06-02T03:40:25.620Z,1622605225.620 [keepstation:StartingMission](DEBUG): Aggregate::uninitialize keepstation:StartingMission
2021-06-02T03:40:26.023Z,1622605226.023 [MissionManager](IMPORTANT): Started mission Default
2021-06-02T03:40:26.023Z,1622605226.023 [Default] Running Loop=1
2021-06-02T03:40:26.023Z,1622605226.023 [Default](DEBUG): Aggregate::initialize Default
2021-06-02T03:40:26.023Z,1622605226.023 [Default:B.GoToSurface] Running Loop=1
2021-06-02T03:40:26.023Z,1622605226.023 [Default:B.GoToSurface](DEBUG): Initialize GoToSurfaceComponent.
2021-06-02T03:40:26.024Z,1622605226.024 [Default:B.GoToSurface](DEBUG): No depth rate setting specified. Using default value of nan m/s.
2021-06-02T03:40:26.024Z,1622605226.024 [Default:B.GoToSurface](DEBUG): No pitch setting specified. Using default value of nan degrees.
2021-06-02T03:40:26.024Z,1622605226.024 [Default:B.GoToSurface](DEBUG): No speed setting specified. Using default value of 1.000000 m/s.
2021-06-02T03:40:26.025Z,1622605226.025 [Default:B.GoToSurface](DEBUG): No surface timeout specified. Using default value of 1000.000000 seconds.
2021-06-02T03:40:26.025Z,1622605226.025 [Default:B.GoToSurface](INFO): Received pitch timeout configuration 60.000000 seconds.
2021-06-02T03:40:26.026Z,1622605226.026 [Default:A.Wait] Running Loop=1
2021-06-02T03:40:26.026Z,1622605226.026 [Default:A.Wait](DEBUG): Initialize Wait Component.
2021-06-02T03:40:30.551Z,1622605230.551 [DataOverHttps](IMPORTANT): SBD MTMSN=20210602T034025
2021-06-02T03:40:32.561Z,1622605232.561 [DataOverHttps](INFO): Received command:sched asap "load Transport/keepstation.xml;set keepstation.MissionTimeout 1 h;set keepstation.NeedCommsTime 15 min;set keepstation.Latitude 36.807 arcdeg;set keepstation.Longitude -121.82436 arcdeg;set keepstation.Depth 20 m" 44fiw 1 2
2021-06-02T03:40:32.618Z,1622605232.618 [CommandLine](IMPORTANT): got command schedule asap "load Transport/keepstation.xml;set keepstation.MissionTimeout 1 h;set keepstation.NeedCommsTime 15 min;set keepstation.Latitude 36.807 arcdeg;set keepstation.Longitude -121.82436 arcdeg;set keepstation.Depth 20 m" 44fiw 1 2.000000
2021-06-02T03:40:32.619Z,1622605232.619 [CommandLine](IMPORTANT): Scheduling command #1 of 2 with id=44fiw
2021-06-02T03:40:32.620Z,1622605232.620 [CommandLine](IMPORTANT): Scheduled #8 (#1 of 2 with id='44fiw'): "load Transport/keepstation.xml;set keepstation.MissionTimeout 1 h;set keepstation.NeedCommsTime 15 min;set keepstation.Latitude 36.807 arcdeg;set keepstation.Longitude -121.82436 arcdeg;set keepstation.Depth 20 m" ASAP
2021-06-02T03:40:37.577Z,1622605237.577 [DataOverHttps](IMPORTANT): SBD MTMSN=20210602T034032
2021-06-02T03:40:39.364Z,1622605239.364 [Default:A.Wait](INFO): Done Waiting.
2021-06-02T03:40:39.380Z,1622605239.380 [Default:A.Wait] Stopped
2021-06-02T03:40:39.380Z,1622605239.380 [Default:A.Wait](DEBUG): Uninitialize Wait Component.
2021-06-02T03:40:39.586Z,1622605239.586 [DataOverHttps](INFO): Received command:sched asap "set keepstation.DepthDeadband 10 m;set keepstation.Radius 200 m;set keepstation.MaxDepth 33 m;run" 44fiw 2 2
2021-06-02T03:40:39.638Z,1622605239.638 [CommandLine](IMPORTANT): got command schedule asap "set keepstation.DepthDeadband 10 m;set keepstation.Radius 200 m;set keepstation.MaxDepth 33 m;run" 44fiw 2 2.000000
2021-06-02T03:40:39.638Z,1622605239.638 [CommandLine](IMPORTANT): Scheduling command #2 of 2 with id=44fiw
2021-06-02T03:40:39.639Z,1622605239.639 [CommandLine](IMPORTANT): Scheduled #9 (#2 of 2 with id='44fiw'): "set keepstation.DepthDeadband 10 m;set keepstation.Radius 200 m;set keepstation.MaxDepth 33 m;run" ASAP
2021-06-02T03:40:39.768Z,1622605239.768 [CommandLine](IMPORTANT): got command load ./Missions/Transport/keepstation.xml
2021-06-02T03:40:39.777Z,1622605239.777 [MissionManager](INFO): Loading Mission: ./Missions/Transport/keepstation.xml
2021-06-02T03:40:39.876Z,1622605239.876 [MissionManager](INFO): DefineArg keepstation.MissionTimeout = 4.000000 h
2021-06-02T03:40:39.879Z,1622605239.879 [MissionManager](INFO): DefineArg keepstation.NeedCommsTime = 45.000000 min
2021-06-02T03:40:39.882Z,1622605239.882 [MissionManager](INFO): DefineArg keepstation.Latitude = nan arcdeg
2021-06-02T03:40:39.884Z,1622605239.884 [MissionManager](INFO): DefineArg keepstation.Longitude = nan arcdeg
2021-06-02T03:40:39.887Z,1622605239.887 [MissionManager](INFO): DefineArg keepstation.Depth = 30.000000 m
2021-06-02T03:40:39.889Z,1622605239.889 [MissionManager](INFO): DefineArg keepstation.ApproachDepth = 15.000000 m
2021-06-02T03:40:39.891Z,1622605239.891 [MissionManager](INFO): DefineArg keepstation.DepthDeadband = 4.000000 m
2021-06-02T03:40:39.935Z,1622605239.935 [MissionManager](INFO): DefineArg keepstation.Speed = 0.750000 m/s
2021-06-02T03:40:39.947Z,1622605239.947 [MissionManager](INFO): DefineArg keepstation.Radius = 200.000000 m
2021-06-02T03:40:39.957Z,1622605239.957 [MissionManager](INFO): DefineArg keepstation.MaxDepth = 45.000000 m
2021-06-02T03:40:39.960Z,1622605239.960 [MissionManager](INFO): DefineArg keepstation.MinOffshore = 2.000000 km
2021-06-02T03:40:39.960Z,1622605239.960 [MissionManager](INFO): Inserting Stack: Missions/Insert/NeedComms.xml
2021-06-02T03:40:40.043Z,1622605240.043 [MissionManager](INFO): DefineArg keepstation:NeedComms.DiveInterval = 3.000000 h
2021-06-02T03:40:40.045Z,1622605240.045 [MissionManager](INFO): DefineArg keepstation:NeedComms.WaitForPitchUp = 10.000000 min
2021-06-02T03:40:40.048Z,1622605240.048 [MissionManager](INFO): DefineArg keepstation:NeedComms.SurfacePitch = 20.000000 arcdeg
2021-06-02T03:40:40.062Z,1622605240.062 [MissionManager](INFO): DefineArg keepstation:NeedComms.SurfaceDepthRate = nan m/s
2021-06-02T03:40:40.064Z,1622605240.064 [MissionManager](INFO): DefineArg keepstation:NeedComms.SurfaceSpeed = 1.000000 m/s
2021-06-02T03:40:40.066Z,1622605240.066 [MissionManager](INFO): DefineArg keepstation:NeedComms.GPSTimeout = 7.000000 min
2021-06-02T03:40:40.069Z,1622605240.069 [MissionManager](INFO): DefineArg keepstation:NeedComms.CommsTimeout = 30.000000 min
2021-06-02T03:40:40.075Z,1622605240.075 [keepstation:NeedComms:B.GoToSurface](DEBUG): Construct GoToSurface.
2021-06-02T03:40:40.088Z,1622605240.088 [MissionManager](INFO): Inserting Stack: Missions/Insert/StandardEnvelopes.xml
2021-06-02T03:40:40.151Z,1622605240.151 [MissionManager](INFO): DefineArg keepstation:StandardEnvelopes.MinAltitude = 5.000000 m
2021-06-02T03:40:40.162Z,1622605240.162 [MissionManager](INFO): DefineArg keepstation:StandardEnvelopes.MaxDepth = 200.000000 m
2021-06-02T03:40:40.164Z,1622605240.164 [MissionManager](INFO): DefineArg keepstation:StandardEnvelopes.MinOffshore = 2000.000000 m
2021-06-02T03:40:40.182Z,1622605240.182 [keepstation:StandardEnvelopes:A.AltitudeEnvelope](DEBUG): Construct AltitudeEnvelope.
2021-06-02T03:40:40.197Z,1622605240.197 [keepstation:StandardEnvelopes:B.DepthEnvelope](DEBUG): Construct DepthEnvelope.
2021-06-02T03:40:40.211Z,1622605240.211 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](DEBUG): Construct OffshoreEnvelope.
2021-06-02T03:40:40.239Z,1622605240.239 [keepstation:F.Pitch](DEBUG): Construct.
2021-06-02T03:40:40.255Z,1622605240.255 [keepstation:TransitToStation:A.Buoyancy](DEBUG): Construct Buoyancy.
2021-06-02T03:40:40.262Z,1622605240.262 [keepstation:TransitToStation:B.Pitch](DEBUG): Construct.
2021-06-02T03:40:40.270Z,1622605240.270 [keepstation:TransitToStation:C.SetSpeed](DEBUG): Construct.
2021-06-02T03:40:40.275Z,1622605240.275 [keepstation:TransitToStation:Wpt1.Waypoint](DEBUG): Construct Waypoint.
2021-06-02T03:40:40.290Z,1622605240.290 [keepstation:KeepStation:B.Pitch](DEBUG): Construct.
2021-06-02T03:40:40.294Z,1622605240.294 [keepstation:KeepStation:C.KeepStation](DEBUG): Construct KeepStation.
2021-06-02T03:40:40.299Z,1622605240.299 [keepstation:KeepStation:D.Wait](DEBUG): Construct Wait.
2021-06-02T03:40:40.307Z,1622605240.307 [MissionManager](DEBUG): 
<?xml version="1.0" encoding="UTF-8"?>
<!-- ====================
     Generated by TethysL
     ==================== -->
<Mission xmlns:xsi="http://www.w3.org/2001/XMLSchema-instance"
         xmlns="Tethys"
         xmlns:Units="Tethys/Units"
         xmlns:Guidance="Tethys/Guidance"
         xmlns:Control="Tethys/Control"
         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/Control http://okeanids.mbari.org/tethys/Xml/Control.xsd"
       Id="keepstation">

    <Description>
        Vehicle transits to desired waypoint (or stays put if none is commanded)
        and stays within the specified radius.
    </Description>

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

    <DefineArg Name="NeedCommsTime"><Description>
        How often to surface for communications
    </Description><Units:minute/><Value>45</Value></DefineArg>

    <DefineArg Name="Latitude"><Description>
        Latitude of waypoint to hold. If NaN, hold the latitude at start of
        mission.
    </Description><Units:degree/><Value>NaN</Value></DefineArg>

    <DefineArg Name="Longitude"><Description>
        Longitude of waypoint to hold. If NaN, hold the longitude at start of
        mission.
    </Description><Units:degree/><Value>NaN</Value></DefineArg>

    <DefineArg Name="Depth"><Description>
        Depth held during drift mode
    </Description><Units:meter/><Value>30</Value></DefineArg>

    <DefineArg Name="ApproachDepth"><Description>
        Depth for initial approach to station.
    </Description><Units:meter/><Value>15</Value></DefineArg>

    <DefineArg Name="DepthDeadband"><Description>
        How much vertical drift from the specified depth is allowed in drift
        mode
    </Description><Units:meter/><Value>4</Value></DefineArg>

    <DefineArg Name="Speed"><Description>
        Vehicle transit speed.
    </Description><Units:meter_per_second/><Value>0.75</Value></DefineArg>

    <DefineArg Name="Radius"><Description>
        Radius of circle around waypoint to hold.
    </Description><Units:meter/><Value>200</Value></DefineArg>

    <DefineArg Name="MaxDepth"><Description>
        Maximum allowable depth during the mission.
    </Description><Units:meter/><Value>45</Value></DefineArg>

    <DefineArg Name="MinOffshore"><Description>
        Minimum distance from the shoreline to maintain
    </Description><Units:kilometer/><Value>2</Value></DefineArg>

    <Timeout Duration="MissionTimeout"/>

    <Insert Filename="Insert/NeedComms.xml" Id="NeedComms"/>

    <Assign><Sequence/><Arg Name="NeedComms:DiveInterval"/><Arg Name="NeedCommsTime"/></Assign>

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

    <Assign><Sequence/><Arg Name="StandardEnvelopes:MaxDepth"/><Arg Name="MaxDepth"/></Assign>

    <Assign><Sequence/><Arg Name="StandardEnvelopes:MinOffshore"/><Arg Name="MinOffshore"/></Assign>

    <Guidance:Pitch>
        <Parallel/>
        <Setting><Guidance:Pitch.massPosition/><Control:VerticalControl.massDefault/></Setting>
    </Guidance:Pitch>

    <Call Id="StartingMission" RefId="NeedComms"/>

    <Aggregate Id="TransitToStation">

        <Description>
            Need a separate aggregate for transit if we want to specify a
            different depth for the approach.
        </Description>

        <Sequence/>

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

        <Guidance:Pitch>
            <Parallel/>
            <Setting><Guidance:Pitch.depth/><Arg Name="ApproachDepth"/></Setting>
        </Guidance:Pitch>

        <Guidance:SetSpeed>
            <Parallel/>
            <Setting><Guidance:SetSpeed.speed/><Arg Name="Speed"/></Setting>
        </Guidance:SetSpeed>

        <Guidance:Waypoint Id="Wpt1">
            <Sequence/>
            <Setting><Guidance:Waypoint.latitude/><Arg Name="Latitude"/></Setting>
            <Setting><Guidance:Waypoint.longitude/><Arg Name="Longitude"/></Setting>
        </Guidance:Waypoint>

    </Aggregate>

    <Call Id="OnStation" RefId="NeedComms"/>

    <Aggregate Id="KeepStation">

        <Sequence/>

        <Assign><Parallel/><Control:VerticalControl.depthDeadband/><Arg Name="DepthDeadband"/></Assign>

        <Guidance:Pitch>
            <Parallel/>
            <Setting><Guidance:Pitch.depth/><Arg Name="Depth"/></Setting>
        </Guidance:Pitch>

        <Guidance:KeepStation>
            <Parallel/>
            <Setting><Guidance:KeepStation.latitude/><Arg Name="Latitude"/></Setting>
            <Setting><Guidance:KeepStation.longitude/><Arg Name="Longitude"/></Setting>
            <Setting><Guidance:KeepStation.radius/><Arg Name="Radius"/></Setting>
            <Setting><Guidance:KeepStation.speed/><Arg Name="Speed"/></Setting>
        </Guidance:KeepStation>

        <Guidance:Wait>
            <Description>
                Due to the way the KeepStation behavior is currently
                implemented, we must run it in parallel and use a Wait to keep
                from completing the mission before the timeout expires. However,
                this new version of the mission uses a top-level timeout so that
                the entire mission will not run for longer then MissionTimeout.
            </Description>
            <Sequence/>
            <Setting><Guidance:Wait.duration/><Arg Name="MissionTimeout"/></Setting>
        </Guidance:Wait>

    </Aggregate>

</Mission>


2021-06-02T03:40:40.308Z,1622605240.308 [CommandLine](IMPORTANT): Loaded ./Missions/Transport/keepstation.xml
2021-06-02T03:40:40.626Z,1622605240.626 [Default:CheckIn] Running Loop=1
2021-06-02T03:40:40.626Z,1622605240.626 [Default:CheckIn](DEBUG): Aggregate::initialize Default:CheckIn
2021-06-02T03:40:40.626Z,1622605240.626 [Default:CheckIn:Read_GPS] Running Loop=1
2021-06-02T03:40:44.607Z,1622605244.607 [DataOverHttps](IMPORTANT): SBD MTMSN=20210602T034039
2021-06-02T03:40:46.614Z,1622605246.614 [DataOverHttps](INFO): Received command:sched "load Transport/keepstation.xml;set keepstation.MissionTimeout 1 h;set keepstation.NeedCommsTime 15 min;set keepstation.Latitude 36.807 arcdeg;set keepstation.Longitude -121.82436 arcdeg;set keepstation.Depth 20 m" 44fj2 1 2
2021-06-02T03:40:49.959Z,1622605249.959 [CommandLine](IMPORTANT): got command set keepstation.MissionTimeout 1.000000 hour
2021-06-02T03:40:49.973Z,1622605249.973 [CommandLine](IMPORTANT): got command set keepstation.NeedCommsTime 15.000000 minute
2021-06-02T03:40:49.974Z,1622605249.974 [CommandLine](IMPORTANT): got command set keepstation.Latitude 36.806999 angular_degree
2021-06-02T03:40:49.975Z,1622605249.975 [CommandLine](IMPORTANT): got command set keepstation.Longitude -121.824364 angular_degree
2021-06-02T03:40:49.976Z,1622605249.976 [CommandLine](IMPORTANT): got command set keepstation.Depth 20.000000 meter
2021-06-02T03:40:49.993Z,1622605249.993 [CommandLine](IMPORTANT): got command schedule 
2021-06-02T03:40:49.994Z,1622605249.994 [CommandLine](FAULT): Incomplete syntax. Try: help schedule
2021-06-02T03:40:50.093Z,1622605250.093 [CommandLine](IMPORTANT): got command exit 
2021-06-02T03:40:50.093Z,1622605250.093 [CommandLine](FAULT): Incomplete syntax. Try: help exit
2021-06-02T03:40:52.018Z,1622605252.018 [DataOverHttps](IMPORTANT): SBD MTMSN=20210602T034046
2021-06-02T03:40:54.034Z,1622605254.034 [DataOverHttps](INFO): Received command:sched "set keepstation.DepthDeadband 10 m;set keepstation.Radius 200 m;set keepstation.MaxDepth 33 m;run" 44fj2 2 2
2021-06-02T03:40:59.002Z,1622605259.002 [CommandLine](IMPORTANT): got command set keepstation.DepthDeadband 10.000000 meter
2021-06-02T03:40:59.003Z,1622605259.003 [CommandLine](IMPORTANT): got command set keepstation.Radius 200.000000 meter
2021-06-02T03:40:59.003Z,1622605259.003 [CommandLine](IMPORTANT): got command set keepstation.MaxDepth 33.000000 meter
2021-06-02T03:40:59.004Z,1622605259.004 [CommandLine](IMPORTANT): got command run
2021-06-02T03:40:59.011Z,1622605259.011 [CommandLine](IMPORTANT): Running 
2021-06-02T03:40:59.046Z,1622605259.046 [CommandLine](IMPORTANT): got command schedule "set keepstation.DepthDeadband 10 m;set keepstation.Radius 200 m;set keepstation.MaxDepth 33 m;run" 44fj2 2 2.000000
2021-06-02T03:40:59.047Z,1622605259.047 [CommandLine](IMPORTANT): Scheduling command #2 of 2 with id=44fj2
2021-06-02T03:40:59.048Z,1622605259.048 [CommandLine](IMPORTANT): Scheduled #10 (#2 of 2 with id='44fj2'): "set keepstation.DepthDeadband 10 m;set keepstation.Radius 200 m;set keepstation.MaxDepth 33 m;run"
2021-06-02T03:40:59.049Z,1622605259.049 [CommandLine](FAULT): Scheduling was paused by a command at 2021-06-02T03:40:25Z
2021-06-02T03:40:59.246Z,1622605259.246 [Default] Stopped
2021-06-02T03:40:59.246Z,1622605259.246 [Default](DEBUG): Aggregate::uninitialize Default
2021-06-02T03:40:59.246Z,1622605259.246 [Default:B.GoToSurface] Stopped
2021-06-02T03:40:59.246Z,1622605259.246 [Default:B.GoToSurface](DEBUG): Uninitialize GoToSurfaceComponent.
2021-06-02T03:40:59.246Z,1622605259.246 [Default:CheckIn] Stopped
2021-06-02T03:40:59.247Z,1622605259.247 [Default:CheckIn](DEBUG): Aggregate::uninitialize Default:CheckIn
2021-06-02T03:40:59.247Z,1622605259.247 [Default:CheckIn:Read_GPS] Stopped
2021-06-02T03:40:59.247Z,1622605259.247 [MissionManager](IMPORTANT): Started mission keepstation
2021-06-02T03:40:59.247Z,1622605259.247 [keepstation] Running Loop=1
2021-06-02T03:40:59.247Z,1622605259.247 [keepstation](DEBUG): Aggregate::initialize keepstation
2021-06-02T03:40:59.248Z,1622605259.248 [keepstation:StandardEnvelopes] Running Loop=1
2021-06-02T03:40:59.248Z,1622605259.248 [keepstation:StandardEnvelopes](DEBUG): Aggregate::initialize keepstation:StandardEnvelopes
2021-06-02T03:40:59.248Z,1622605259.248 [keepstation:StandardEnvelopes:A.AltitudeEnvelope] Running Loop=1
2021-06-02T03:40:59.248Z,1622605259.248 [keepstation:StandardEnvelopes:A.AltitudeEnvelope](DEBUG): Initialize AltitudeEnvelopeComponent.
2021-06-02T03:40:59.248Z,1622605259.248 [keepstation:StandardEnvelopes:B.DepthEnvelope] Running Loop=1
2021-06-02T03:40:59.248Z,1622605259.248 [keepstation:StandardEnvelopes:B.DepthEnvelope](DEBUG): Initialize DepthEnvelopeComponent.
2021-06-02T03:40:59.249Z,1622605259.249 [keepstation:StandardEnvelopes:C.OffshoreEnvelope] Running Loop=1
2021-06-02T03:40:59.249Z,1622605259.249 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](DEBUG): Initialize OffshoreEnvelopeComponent.
2021-06-02T03:40:59.249Z,1622605259.249 [keepstation:F.Pitch] Running Loop=1
2021-06-02T03:40:59.249Z,1622605259.249 [keepstation:F.Pitch](DEBUG): Initialize.
2021-06-02T03:40:59.249Z,1622605259.249 [keepstation:B] Running Loop=1
2021-06-02T03:40:59.250Z,1622605259.250 [keepstation:F.Pitch] Running Loop=1
2021-06-02T03:40:59.250Z,1622605259.250 [keepstation:StandardEnvelopes] Running Loop=1
2021-06-02T03:40:59.250Z,1622605259.250 [keepstation:StandardEnvelopes:C.OffshoreEnvelope] Running Loop=1
2021-06-02T03:40:59.251Z,1622605259.251 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:59.251Z,1622605259.251 [keepstation:StandardEnvelopes:B.DepthEnvelope] Running Loop=1
2021-06-02T03:40:59.251Z,1622605259.251 [keepstation:StandardEnvelopes:A.AltitudeEnvelope] Running Loop=1
2021-06-02T03:40:59.252Z,1622605259.252 [keepstation:B] Stopped
2021-06-02T03:40:59.252Z,1622605259.252 [keepstation:D] Running Loop=1
2021-06-02T03:40:59.252Z,1622605259.252 [keepstation:NeedComms] Running Loop=1
2021-06-02T03:40:59.252Z,1622605259.252 [keepstation:NeedComms](DEBUG): Aggregate::initialize keepstation:NeedComms
2021-06-02T03:40:59.252Z,1622605259.252 [keepstation:NeedComms:B.GoToSurface] Running Loop=1
2021-06-02T03:40:59.252Z,1622605259.252 [keepstation:NeedComms:B.GoToSurface](DEBUG): Initialize GoToSurfaceComponent.
2021-06-02T03:40:59.254Z,1622605259.254 [keepstation:NeedComms:B.GoToSurface](INFO): Received depth rate setting nan m/s.
2021-06-02T03:40:59.254Z,1622605259.254 [keepstation:NeedComms:B.GoToSurface](INFO): Received pitch setting 19.999999 degrees.
2021-06-02T03:40:59.254Z,1622605259.254 [keepstation:NeedComms:B.GoToSurface](INFO): Received speed setting 1.000000 m/s.
2021-06-02T03:40:59.255Z,1622605259.255 [keepstation:NeedComms:B.GoToSurface](DEBUG): No surface timeout specified. Using default value of 1000.000000 seconds.
2021-06-02T03:40:59.255Z,1622605259.255 [keepstation:NeedComms:B.GoToSurface](INFO): Received pitch timeout configuration 60.000000 seconds.
2021-06-02T03:40:59.255Z,1622605259.255 [keepstation:NeedComms:A] Running Loop=1
2021-06-02T03:40:59.256Z,1622605259.256 [keepstation:NeedComms:A](ERROR): data element is not active.
2021-06-02T03:40:59.289Z,1622605259.289 [keepstation:NeedComms:A](INFO): last time_fix was: nan second since 1970/01/01T00:00:00Z 
2021-06-02T03:40:59.289Z,1622605259.289 [keepstation:NeedComms:A] Stopped
2021-06-02T03:40:59.660Z,1622605259.660 [keepstation:D] Stopped
2021-06-02T03:40:59.669Z,1622605259.669 [keepstation:E] Running Loop=1
2021-06-02T03:40:59.669Z,1622605259.669 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:40:59.671Z,1622605259.671 [keepstation:NeedComms:C] Running Loop=1
2021-06-02T03:41:00.053Z,1622605260.053 [keepstation:E] Stopped
2021-06-02T03:41:00.053Z,1622605260.053 [keepstation:StartingMission] Running Loop=1
2021-06-02T03:41:00.053Z,1622605260.053 [keepstation:StartingMission](DEBUG): Aggregate::initialize keepstation:StartingMission
2021-06-02T03:41:00.054Z,1622605260.054 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:41:00.055Z,1622605260.055 [keepstation:NeedComms:C](DEBUG): Initialize ReadDataComponent to sense time_fix
2021-06-02T03:41:00.465Z,1622605260.465 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:41:00.930Z,1622605260.930 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:41:00.930Z,1622605260.930 [keepstation:StandardEnvelopes:A.AltitudeEnvelope](ERROR): Altitude Measurement is not Active.
2021-06-02T03:41:01.253Z,1622605261.253 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:41:01.672Z,1622605261.672 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:41:02.082Z,1622605262.082 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:41:02.488Z,1622605262.488 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:41:02.951Z,1622605262.951 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:41:03.314Z,1622605263.314 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:41:03.704Z,1622605263.704 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:41:04.105Z,1622605264.105 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:41:04.526Z,1622605264.526 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:41:04.694Z,1622605264.694 [CommandLine](IMPORTANT): got command stop
2021-06-02T03:41:04.695Z,1622605264.695 [Supervisor](INFO): Stop Mission called by CommandLine::commandStop
2021-06-02T03:41:04.988Z,1622605264.988 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:41:04.998Z,1622605264.998 [MissionManager](INFO): MissionManager is completed.
2021-06-02T03:41:04.998Z,1622605264.998 [MissionManager](INFO): Uninitializing Mission keepstation
2021-06-02T03:41:04.998Z,1622605264.998 [keepstation] Stopped
2021-06-02T03:41:04.999Z,1622605264.999 [keepstation](DEBUG): Aggregate::uninitialize keepstation
2021-06-02T03:41:04.999Z,1622605264.999 [keepstation:NeedComms] Stopped
2021-06-02T03:41:04.999Z,1622605264.999 [keepstation:NeedComms](DEBUG): Aggregate::uninitialize keepstation:NeedComms
2021-06-02T03:41:04.999Z,1622605264.999 [keepstation:NeedComms:B.GoToSurface] Stopped
2021-06-02T03:41:04.999Z,1622605264.999 [keepstation:NeedComms:B.GoToSurface](DEBUG): Uninitialize GoToSurfaceComponent.
2021-06-02T03:41:04.999Z,1622605264.999 [keepstation:NeedComms:C] Stopped
2021-06-02T03:41:04.999Z,1622605264.999 [keepstation:StandardEnvelopes] Stopped
2021-06-02T03:41:04.999Z,1622605264.999 [keepstation:StandardEnvelopes](DEBUG): Aggregate::uninitialize keepstation:StandardEnvelopes
2021-06-02T03:41:04.999Z,1622605264.999 [keepstation:StandardEnvelopes:A.AltitudeEnvelope] Stopped
2021-06-02T03:41:04.999Z,1622605264.999 [keepstation:StandardEnvelopes:A.AltitudeEnvelope](DEBUG): Uninitialize AltitudeEnvelopeComponent.
2021-06-02T03:41:04.999Z,1622605264.999 [keepstation:StandardEnvelopes:B.DepthEnvelope] Stopped
2021-06-02T03:41:04.000Z,1622605265.000 [keepstation:StandardEnvelopes:B.DepthEnvelope](DEBUG): Uninitialize.
2021-06-02T03:41:04.000Z,1622605265.000 [keepstation:StandardEnvelopes:C.OffshoreEnvelope] Stopped
2021-06-02T03:41:04.000Z,1622605265.000 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](DEBUG): Uninitialize OffshoreEnvelopeComponent.
2021-06-02T03:41:04.000Z,1622605265.000 [keepstation:F.Pitch] Stopped
2021-06-02T03:41:04.000Z,1622605265.000 [keepstation:StartingMission] Stopped
2021-06-02T03:41:05.000Z,1622605265.000 [keepstation:StartingMission](DEBUG): Aggregate::uninitialize keepstation:StartingMission
2021-06-02T03:41:05.319Z,1622605265.319 [MissionManager](IMPORTANT): Started mission Default
2021-06-02T03:41:05.320Z,1622605265.320 [Default] Running Loop=1
2021-06-02T03:41:05.320Z,1622605265.320 [Default](DEBUG): Aggregate::initialize Default
2021-06-02T03:41:05.320Z,1622605265.320 [Default:B.GoToSurface] Running Loop=1
2021-06-02T03:41:05.320Z,1622605265.320 [Default:B.GoToSurface](DEBUG): Initialize GoToSurfaceComponent.
2021-06-02T03:41:05.320Z,1622605265.320 [Default:B.GoToSurface](DEBUG): No depth rate setting specified. Using default value of nan m/s.
2021-06-02T03:41:05.325Z,1622605265.325 [Default:B.GoToSurface](DEBUG): No pitch setting specified. Using default value of nan degrees.
2021-06-02T03:41:05.325Z,1622605265.325 [Default:B.GoToSurface](DEBUG): No speed setting specified. Using default value of 1.000000 m/s.
2021-06-02T03:41:05.326Z,1622605265.326 [Default:B.GoToSurface](DEBUG): No surface timeout specified. Using default value of 1000.000000 seconds.
2021-06-02T03:41:05.326Z,1622605265.326 [Default:B.GoToSurface](INFO): Received pitch timeout configuration 60.000000 seconds.
2021-06-02T03:41:05.326Z,1622605265.326 [Default:A.Wait] Running Loop=1
2021-06-02T03:41:05.326Z,1622605265.326 [Default:A.Wait](DEBUG): Initialize Wait Component.
2021-06-02T03:41:18.808Z,1622605278.808 [Default:A.Wait](INFO): Done Waiting.
2021-06-02T03:41:18.808Z,1622605278.808 [Default:A.Wait] Stopped
2021-06-02T03:41:18.808Z,1622605278.808 [Default:A.Wait](DEBUG): Uninitialize Wait Component.
2021-06-02T03:41:19.101Z,1622605279.101 [Default:CheckIn] Running Loop=1
2021-06-02T03:41:19.101Z,1622605279.101 [Default:CheckIn](DEBUG): Aggregate::initialize Default:CheckIn
2021-06-02T03:41:19.101Z,1622605279.101 [Default:CheckIn:Read_GPS] Running Loop=1
2021-06-02T03:41:34.250Z,1622605294.250 [CommandLine](IMPORTANT): got command schedule list
2021-06-02T03:41:34.251Z,1622605294.251 [CommandLine](IMPORTANT): Scheduled #6 (#1 of 2 with id='44fh0'): "load Transport/keepstation.xml;set keepstation.MissionTimeout 1 h;set keepstation.NeedCommsTime 15 min;set keepstation.Latitude 36.807 arcdeg;set keepstation.Longitude -121.82436 arcdeg;set keepstation.Depth 20 m"
2021-06-02T03:41:34.252Z,1622605294.252 [CommandLine](IMPORTANT): Scheduled #7 (#2 of 2 with id='44fh0'): "set keepstation.DepthDeadband 10 m;set keepstation.Radius 200 m;set keepstation.MaxDepth 33 m;run"
2021-06-02T03:41:34.253Z,1622605294.253 [CommandLine](IMPORTANT): Scheduled #10 (#2 of 2 with id='44fj2'): "set keepstation.DepthDeadband 10 m;set keepstation.Radius 200 m;set keepstation.MaxDepth 33 m;run"
2021-06-02T03:41:34.254Z,1622605294.254 [CommandLine](IMPORTANT): Scheduled #5 (#1 of 2 with id='44fgr'): "load Transport/keepstation.xml;set keepstation.MissionTimeout 1 h;set keepstation.NeedCommsTime 15 min;set keepstation.Latitude 36.807 arcdeg;set keepstation.Longitude -121.82436 arcdeg;set keepstation.Depth 20 m" ASAP
2021-06-02T03:41:34.255Z,1622605294.255 [CommandLine](FAULT): Scheduling was paused by a command at 2021-06-02T03:41:04Z
2021-06-02T03:41:36.840Z,1622605296.840 [DeadReckonUsingMultipleVelocitySources] Software Fault, FailCount= 3
2021-06-02T03:41:36.840Z,1622605296.840 [DeadReckonUsingMultipleVelocitySources](ERROR): Software Fault
2021-06-02T03:41:36.873Z,1622605296.873 [CBIT](ERROR): Software Fault in component: DeadReckonUsingMultipleVelocitySources
2021-06-02T03:41:37.248Z,1622605297.248 [CBIT](INFO): Clearing failed state for component DeadReckonUsingMultipleVelocitySources
2021-06-02T03:41:37.248Z,1622605297.248 [DeadReckonUsingMultipleVelocitySources] No Fault, FailCount= 3
2021-06-02T03:41:40.438Z,1622605300.438 [CommandLine](IMPORTANT): got command schedule clear
2021-06-02T03:41:40.439Z,1622605300.439 [CommandLine](IMPORTANT): #Cleared scheduled commands:4
2021-06-02T03:42:44.469Z,1622605364.469 [DataOverHttps](IMPORTANT): SBD MTMSN=20210602T034239
2021-06-02T03:42:46.478Z,1622605366.478 [DataOverHttps](INFO): Received command:stop;! echo 1 > /dev/loadB2
2021-06-02T03:42:46.578Z,1622605366.578 [CommandLine](IMPORTANT): got command stop
2021-06-02T03:42:46.578Z,1622605366.578 [CommandLine](IMPORTANT): got command ! echo 1 > /dev/loadB2
2021-06-02T03:42:51.498Z,1622605371.498 [DataOverHttps](IMPORTANT): SBD MTMSN=20210602T034246
2021-06-02T03:42:53.507Z,1622605373.507 [DataOverHttps](INFO): Received command:sched asap "load Transport/keepstation.xml;set keepstation.MissionTimeout 1 h;set keepstation.NeedCommsTime 15 min;set keepstation.Latitude 36.807 arcdeg;set keepstation.Longitude -121.82436 arcdeg;set keepstation.Depth 20 m" 44fmh 1 2
2021-06-02T03:42:53.576Z,1622605373.576 [CommandLine](IMPORTANT): got command schedule asap "load Transport/keepstation.xml;set keepstation.MissionTimeout 1 h;set keepstation.NeedCommsTime 15 min;set keepstation.Latitude 36.807 arcdeg;set keepstation.Longitude -121.82436 arcdeg;set keepstation.Depth 20 m" 44fmh 1 2.000000
2021-06-02T03:42:53.576Z,1622605373.576 [CommandLine](IMPORTANT): Scheduling command #1 of 2 with id=44fmh
2021-06-02T03:42:53.586Z,1622605373.586 [CommandLine](IMPORTANT): Scheduled #11 (#1 of 2 with id='44fmh'): "load Transport/keepstation.xml;set keepstation.MissionTimeout 1 h;set keepstation.NeedCommsTime 15 min;set keepstation.Latitude 36.807 arcdeg;set keepstation.Longitude -121.82436 arcdeg;set keepstation.Depth 20 m" ASAP
2021-06-02T03:42:58.527Z,1622605378.527 [DataOverHttps](IMPORTANT): SBD MTMSN=20210602T034253
2021-06-02T03:43:00.534Z,1622605380.534 [DataOverHttps](INFO): Received command:sched asap "set keepstation.DepthDeadband 10 m;set keepstation.Radius 200 m;set keepstation.MaxDepth 33 m;run" 44fmh 2 2
2021-06-02T03:43:00.593Z,1622605380.593 [CommandLine](IMPORTANT): got command schedule asap "set keepstation.DepthDeadband 10 m;set keepstation.Radius 200 m;set keepstation.MaxDepth 33 m;run" 44fmh 2 2.000000
2021-06-02T03:43:00.594Z,1622605380.594 [CommandLine](IMPORTANT): Scheduling command #2 of 2 with id=44fmh
2021-06-02T03:43:00.597Z,1622605380.597 [CommandLine](IMPORTANT): Scheduled #12 (#2 of 2 with id='44fmh'): "set keepstation.DepthDeadband 10 m;set keepstation.Radius 200 m;set keepstation.MaxDepth 33 m;run" ASAP
2021-06-02T03:43:00.714Z,1622605380.714 [CommandLine](IMPORTANT): got command load ./Missions/Transport/keepstation.xml
2021-06-02T03:43:00.714Z,1622605380.714 [MissionManager](INFO): Loading Mission: ./Missions/Transport/keepstation.xml
2021-06-02T03:43:00.781Z,1622605380.781 [MissionManager](INFO): DefineArg keepstation.MissionTimeout = 4.000000 h
2021-06-02T03:43:00.783Z,1622605380.783 [MissionManager](INFO): DefineArg keepstation.NeedCommsTime = 45.000000 min
2021-06-02T03:43:00.786Z,1622605380.786 [MissionManager](INFO): DefineArg keepstation.Latitude = nan arcdeg
2021-06-02T03:43:00.811Z,1622605380.811 [MissionManager](INFO): DefineArg keepstation.Longitude = nan arcdeg
2021-06-02T03:43:00.850Z,1622605380.850 [MissionManager](INFO): DefineArg keepstation.Depth = 30.000000 m
2021-06-02T03:43:00.852Z,1622605380.852 [MissionManager](INFO): DefineArg keepstation.ApproachDepth = 15.000000 m
2021-06-02T03:43:00.879Z,1622605380.879 [MissionManager](INFO): DefineArg keepstation.DepthDeadband = 4.000000 m
2021-06-02T03:43:00.889Z,1622605380.889 [MissionManager](INFO): DefineArg keepstation.Speed = 0.750000 m/s
2021-06-02T03:43:00.891Z,1622605380.891 [MissionManager](INFO): DefineArg keepstation.Radius = 200.000000 m
2021-06-02T03:43:00.918Z,1622605380.918 [MissionManager](INFO): DefineArg keepstation.MaxDepth = 45.000000 m
2021-06-02T03:43:00.925Z,1622605380.925 [MissionManager](INFO): DefineArg keepstation.MinOffshore = 2.000000 km
2021-06-02T03:43:00.926Z,1622605380.926 [MissionManager](INFO): Inserting Stack: Missions/Insert/NeedComms.xml
2021-06-02T03:43:01.023Z,1622605381.023 [MissionManager](INFO): DefineArg keepstation:NeedComms.DiveInterval = 3.000000 h
2021-06-02T03:43:01.030Z,1622605381.030 [MissionManager](INFO): DefineArg keepstation:NeedComms.WaitForPitchUp = 10.000000 min
2021-06-02T03:43:01.032Z,1622605381.032 [MissionManager](INFO): DefineArg keepstation:NeedComms.SurfacePitch = 20.000000 arcdeg
2021-06-02T03:43:01.038Z,1622605381.038 [MissionManager](INFO): DefineArg keepstation:NeedComms.SurfaceDepthRate = nan m/s
2021-06-02T03:43:01.045Z,1622605381.045 [MissionManager](INFO): DefineArg keepstation:NeedComms.SurfaceSpeed = 1.000000 m/s
2021-06-02T03:43:01.047Z,1622605381.047 [MissionManager](INFO): DefineArg keepstation:NeedComms.GPSTimeout = 7.000000 min
2021-06-02T03:43:01.060Z,1622605381.060 [MissionManager](INFO): DefineArg keepstation:NeedComms.CommsTimeout = 30.000000 min
2021-06-02T03:43:01.066Z,1622605381.066 [keepstation:NeedComms:B.GoToSurface](DEBUG): Construct GoToSurface.
2021-06-02T03:43:01.109Z,1622605381.109 [MissionManager](INFO): Inserting Stack: Missions/Insert/StandardEnvelopes.xml
2021-06-02T03:43:01.129Z,1622605381.129 [MissionManager](INFO): DefineArg keepstation:StandardEnvelopes.MinAltitude = 5.000000 m
2021-06-02T03:43:01.131Z,1622605381.131 [MissionManager](INFO): DefineArg keepstation:StandardEnvelopes.MaxDepth = 200.000000 m
2021-06-02T03:43:01.134Z,1622605381.134 [MissionManager](INFO): DefineArg keepstation:StandardEnvelopes.MinOffshore = 2000.000000 m
2021-06-02T03:43:01.135Z,1622605381.135 [keepstation:StandardEnvelopes:A.AltitudeEnvelope](DEBUG): Construct AltitudeEnvelope.
2021-06-02T03:43:01.141Z,1622605381.141 [keepstation:StandardEnvelopes:B.DepthEnvelope](DEBUG): Construct DepthEnvelope.
2021-06-02T03:43:01.148Z,1622605381.148 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](DEBUG): Construct OffshoreEnvelope.
2021-06-02T03:43:01.156Z,1622605381.156 [keepstation:F.Pitch](DEBUG): Construct.
2021-06-02T03:43:01.162Z,1622605381.162 [keepstation:TransitToStation:A.Buoyancy](DEBUG): Construct Buoyancy.
2021-06-02T03:43:01.165Z,1622605381.165 [keepstation:TransitToStation:B.Pitch](DEBUG): Construct.
2021-06-02T03:43:01.169Z,1622605381.169 [keepstation:TransitToStation:C.SetSpeed](DEBUG): Construct.
2021-06-02T03:43:01.172Z,1622605381.172 [keepstation:TransitToStation:Wpt1.Waypoint](DEBUG): Construct Waypoint.
2021-06-02T03:43:01.205Z,1622605381.205 [keepstation:KeepStation:B.Pitch](DEBUG): Construct.
2021-06-02T03:43:01.269Z,1622605381.269 [keepstation:KeepStation:C.KeepStation](DEBUG): Construct KeepStation.
2021-06-02T03:43:01.282Z,1622605381.282 [keepstation:KeepStation:D.Wait](DEBUG): Construct Wait.
2021-06-02T03:43:01.305Z,1622605381.305 [MissionManager](DEBUG): 
<?xml version="1.0" encoding="UTF-8"?>
<!-- ====================
     Generated by TethysL
     ==================== -->
<Mission xmlns:xsi="http://www.w3.org/2001/XMLSchema-instance"
         xmlns="Tethys"
         xmlns:Units="Tethys/Units"
         xmlns:Guidance="Tethys/Guidance"
         xmlns:Control="Tethys/Control"
         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/Control http://okeanids.mbari.org/tethys/Xml/Control.xsd"
       Id="keepstation">

    <Description>
        Vehicle transits to desired waypoint (or stays put if none is commanded)
        and stays within the specified radius.
    </Description>

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

    <DefineArg Name="NeedCommsTime"><Description>
        How often to surface for communications
    </Description><Units:minute/><Value>45</Value></DefineArg>

    <DefineArg Name="Latitude"><Description>
        Latitude of waypoint to hold. If NaN, hold the latitude at start of
        mission.
    </Description><Units:degree/><Value>NaN</Value></DefineArg>

    <DefineArg Name="Longitude"><Description>
        Longitude of waypoint to hold. If NaN, hold the longitude at start of
        mission.
    </Description><Units:degree/><Value>NaN</Value></DefineArg>

    <DefineArg Name="Depth"><Description>
        Depth held during drift mode
    </Description><Units:meter/><Value>30</Value></DefineArg>

    <DefineArg Name="ApproachDepth"><Description>
        Depth for initial approach to station.
    </Description><Units:meter/><Value>15</Value></DefineArg>

    <DefineArg Name="DepthDeadband"><Description>
        How much vertical drift from the specified depth is allowed in drift
        mode
    </Description><Units:meter/><Value>4</Value></DefineArg>

    <DefineArg Name="Speed"><Description>
        Vehicle transit speed.
    </Description><Units:meter_per_second/><Value>0.75</Value></DefineArg>

    <DefineArg Name="Radius"><Description>
        Radius of circle around waypoint to hold.
    </Description><Units:meter/><Value>200</Value></DefineArg>

    <DefineArg Name="MaxDepth"><Description>
        Maximum allowable depth during the mission.
    </Description><Units:meter/><Value>45</Value></DefineArg>

    <DefineArg Name="MinOffshore"><Description>
        Minimum distance from the shoreline to maintain
    </Description><Units:kilometer/><Value>2</Value></DefineArg>

    <Timeout Duration="MissionTimeout"/>

    <Insert Filename="Insert/NeedComms.xml" Id="NeedComms"/>

    <Assign><Sequence/><Arg Name="NeedComms:DiveInterval"/><Arg Name="NeedCommsTime"/></Assign>

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

    <Assign><Sequence/><Arg Name="StandardEnvelopes:MaxDepth"/><Arg Name="MaxDepth"/></Assign>

    <Assign><Sequence/><Arg Name="StandardEnvelopes:MinOffshore"/><Arg Name="MinOffshore"/></Assign>

    <Guidance:Pitch>
        <Parallel/>
        <Setting><Guidance:Pitch.massPosition/><Control:VerticalControl.massDefault/></Setting>
    </Guidance:Pitch>

    <Call Id="StartingMission" RefId="NeedComms"/>

    <Aggregate Id="TransitToStation">

        <Description>
            Need a separate aggregate for transit if we want to specify a
            different depth for the approach.
        </Description>

        <Sequence/>

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

        <Guidance:Pitch>
            <Parallel/>
            <Setting><Guidance:Pitch.depth/><Arg Name="ApproachDepth"/></Setting>
        </Guidance:Pitch>

        <Guidance:SetSpeed>
            <Parallel/>
            <Setting><Guidance:SetSpeed.speed/><Arg Name="Speed"/></Setting>
        </Guidance:SetSpeed>

        <Guidance:Waypoint Id="Wpt1">
            <Sequence/>
            <Setting><Guidance:Waypoint.latitude/><Arg Name="Latitude"/></Setting>
            <Setting><Guidance:Waypoint.longitude/><Arg Name="Longitude"/></Setting>
        </Guidance:Waypoint>

    </Aggregate>

    <Call Id="OnStation" RefId="NeedComms"/>

    <Aggregate Id="KeepStation">

        <Sequence/>

        <Assign><Parallel/><Control:VerticalControl.depthDeadband/><Arg Name="DepthDeadband"/></Assign>

        <Guidance:Pitch>
            <Parallel/>
            <Setting><Guidance:Pitch.depth/><Arg Name="Depth"/></Setting>
        </Guidance:Pitch>

        <Guidance:KeepStation>
            <Parallel/>
            <Setting><Guidance:KeepStation.latitude/><Arg Name="Latitude"/></Setting>
            <Setting><Guidance:KeepStation.longitude/><Arg Name="Longitude"/></Setting>
            <Setting><Guidance:KeepStation.radius/><Arg Name="Radius"/></Setting>
            <Setting><Guidance:KeepStation.speed/><Arg Name="Speed"/></Setting>
        </Guidance:KeepStation>

        <Guidance:Wait>
            <Description>
                Due to the way the KeepStation behavior is currently
                implemented, we must run it in parallel and use a Wait to keep
                from completing the mission before the timeout expires. However,
                this new version of the mission uses a top-level timeout so that
                the entire mission will not run for longer then MissionTimeout.
            </Description>
            <Sequence/>
            <Setting><Guidance:Wait.duration/><Arg Name="MissionTimeout"/></Setting>
        </Guidance:Wait>

    </Aggregate>

</Mission>


2021-06-02T03:43:01.305Z,1622605381.305 [CommandLine](IMPORTANT): Loaded ./Missions/Transport/keepstation.xml
2021-06-02T03:43:05.554Z,1622605385.554 [DataOverHttps](IMPORTANT): SBD MTMSN=20210602T034300
2021-06-02T03:43:07.563Z,1622605387.563 [DataOverHttps](INFO): Received command:sched "load Transport/keepstation.xml;set keepstation.MissionTimeout 1 h;set keepstation.NeedCommsTime 15 min;set keepstation.Latitude 36.807 arcdeg;set keepstation.Longitude -121.82436 arcdeg;set keepstation.Depth 20 m" 44fmq 1 2
2021-06-02T03:43:09.589Z,1622605389.589 [CommandLine](IMPORTANT): got command set keepstation.MissionTimeout 1.000000 hour
2021-06-02T03:43:09.590Z,1622605389.590 [CommandLine](IMPORTANT): got command set keepstation.NeedCommsTime 15.000000 minute
2021-06-02T03:43:09.591Z,1622605389.591 [CommandLine](IMPORTANT): got command set keepstation.Latitude 36.806999 angular_degree
2021-06-02T03:43:09.591Z,1622605389.591 [CommandLine](IMPORTANT): got command set keepstation.Longitude -121.824364 angular_degree
2021-06-02T03:43:09.592Z,1622605389.592 [CommandLine](IMPORTANT): got command set keepstation.Depth 20.000000 meter
2021-06-02T03:43:09.601Z,1622605389.601 [CommandLine](IMPORTANT): got command schedule 
2021-06-02T03:43:09.601Z,1622605389.601 [CommandLine](FAULT): Incomplete syntax. Try: help schedule
2021-06-02T03:43:12.617Z,1622605392.617 [DataOverHttps](IMPORTANT): SBD MTMSN=20210602T034307
2021-06-02T03:43:14.501Z,1622605394.501 [CommandLine](IMPORTANT): got command set keepstation.DepthDeadband 10.000000 meter
2021-06-02T03:43:14.502Z,1622605394.502 [CommandLine](IMPORTANT): got command set keepstation.Radius 200.000000 meter
2021-06-02T03:43:14.502Z,1622605394.502 [CommandLine](IMPORTANT): got command set keepstation.MaxDepth 33.000000 meter
2021-06-02T03:43:14.503Z,1622605394.503 [CommandLine](IMPORTANT): got command run
2021-06-02T03:43:14.504Z,1622605394.504 [CommandLine](IMPORTANT): Running 
2021-06-02T03:43:14.590Z,1622605394.590 [NAL9602](FAULT): GPS failed to acquire within timeout.
2021-06-02T03:43:14.590Z,1622605394.590 [NAL9602] Data Fault, FailCount= 1
2021-06-02T03:43:14.590Z,1622605394.590 [NAL9602](ERROR): Data Fault
2021-06-02T03:43:14.626Z,1622605394.626 [DataOverHttps](INFO): Received command:sched "set keepstation.DepthDeadband 10 m;set keepstation.Radius 200 m;set keepstation.MaxDepth 33 m;run" 44fmq 2 2
2021-06-02T03:43:14.643Z,1622605394.643 [Default] Stopped
2021-06-02T03:43:14.643Z,1622605394.643 [Default](DEBUG): Aggregate::uninitialize Default
2021-06-02T03:43:14.643Z,1622605394.643 [Default:B.GoToSurface] Stopped
2021-06-02T03:43:14.643Z,1622605394.643 [Default:B.GoToSurface](DEBUG): Uninitialize GoToSurfaceComponent.
2021-06-02T03:43:14.644Z,1622605394.644 [Default:CheckIn] Stopped
2021-06-02T03:43:14.644Z,1622605394.644 [Default:CheckIn](DEBUG): Aggregate::uninitialize Default:CheckIn
2021-06-02T03:43:14.644Z,1622605394.644 [Default:CheckIn:Read_GPS] Stopped
2021-06-02T03:43:14.644Z,1622605394.644 [MissionManager](IMPORTANT): Started mission keepstation
2021-06-02T03:43:14.644Z,1622605394.644 [keepstation] Running Loop=1
2021-06-02T03:43:14.661Z,1622605394.661 [keepstation](DEBUG): Aggregate::initialize keepstation
2021-06-02T03:43:14.661Z,1622605394.661 [keepstation:StandardEnvelopes] Running Loop=1
2021-06-02T03:43:14.661Z,1622605394.661 [keepstation:StandardEnvelopes](DEBUG): Aggregate::initialize keepstation:StandardEnvelopes
2021-06-02T03:43:14.661Z,1622605394.661 [keepstation:StandardEnvelopes:A.AltitudeEnvelope] Running Loop=1
2021-06-02T03:43:14.661Z,1622605394.661 [keepstation:StandardEnvelopes:A.AltitudeEnvelope](DEBUG): Initialize AltitudeEnvelopeComponent.
2021-06-02T03:43:14.661Z,1622605394.661 [keepstation:StandardEnvelopes:B.DepthEnvelope] Running Loop=1
2021-06-02T03:43:14.661Z,1622605394.661 [keepstation:StandardEnvelopes:B.DepthEnvelope](DEBUG): Initialize DepthEnvelopeComponent.
2021-06-02T03:43:14.662Z,1622605394.662 [keepstation:StandardEnvelopes:C.OffshoreEnvelope] Running Loop=1
2021-06-02T03:43:14.662Z,1622605394.662 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](DEBUG): Initialize OffshoreEnvelopeComponent.
2021-06-02T03:43:14.662Z,1622605394.662 [keepstation:F.Pitch] Running Loop=1
2021-06-02T03:43:14.662Z,1622605394.662 [keepstation:F.Pitch](DEBUG): Initialize.
2021-06-02T03:43:14.662Z,1622605394.662 [keepstation:B] Running Loop=1
2021-06-02T03:43:14.663Z,1622605394.663 [keepstation:F.Pitch] Running Loop=1
2021-06-02T03:43:14.663Z,1622605394.663 [keepstation:StandardEnvelopes] Running Loop=1
2021-06-02T03:43:14.663Z,1622605394.663 [keepstation:StandardEnvelopes:C.OffshoreEnvelope] Running Loop=1
2021-06-02T03:43:14.663Z,1622605394.663 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:14.663Z,1622605394.663 [keepstation:StandardEnvelopes:B.DepthEnvelope] Running Loop=1
2021-06-02T03:43:14.664Z,1622605394.664 [keepstation:StandardEnvelopes:A.AltitudeEnvelope] Running Loop=1
2021-06-02T03:43:14.664Z,1622605394.664 [keepstation:B] Stopped
2021-06-02T03:43:14.673Z,1622605394.673 [keepstation:D] Running Loop=1
2021-06-02T03:43:14.673Z,1622605394.673 [keepstation:NeedComms] Running Loop=1
2021-06-02T03:43:14.673Z,1622605394.673 [keepstation:NeedComms](DEBUG): Aggregate::initialize keepstation:NeedComms
2021-06-02T03:43:14.673Z,1622605394.673 [keepstation:NeedComms:B.GoToSurface] Running Loop=1
2021-06-02T03:43:14.673Z,1622605394.673 [keepstation:NeedComms:B.GoToSurface](DEBUG): Initialize GoToSurfaceComponent.
2021-06-02T03:43:14.674Z,1622605394.674 [keepstation:NeedComms:B.GoToSurface](INFO): Received depth rate setting nan m/s.
2021-06-02T03:43:14.674Z,1622605394.674 [keepstation:NeedComms:B.GoToSurface](INFO): Received pitch setting 19.999999 degrees.
2021-06-02T03:43:14.674Z,1622605394.674 [keepstation:NeedComms:B.GoToSurface](INFO): Received speed setting 1.000000 m/s.
2021-06-02T03:43:14.675Z,1622605394.675 [keepstation:NeedComms:B.GoToSurface](DEBUG): No surface timeout specified. Using default value of 1000.000000 seconds.
2021-06-02T03:43:14.675Z,1622605394.675 [keepstation:NeedComms:B.GoToSurface](INFO): Received pitch timeout configuration 60.000000 seconds.
2021-06-02T03:43:14.675Z,1622605394.675 [keepstation:NeedComms:A] Running Loop=1
2021-06-02T03:43:14.676Z,1622605394.676 [keepstation:NeedComms:A](ERROR): data element is not active.
2021-06-02T03:43:14.685Z,1622605394.685 [keepstation:NeedComms:A](INFO): last time_fix was: nan second since 1970/01/01T00:00:00Z 
2021-06-02T03:43:14.685Z,1622605394.685 [keepstation:NeedComms:A] Stopped
2021-06-02T03:43:14.707Z,1622605394.707 [CBIT](ERROR): Data Fault in component: NAL9602
2021-06-02T03:43:14.709Z,1622605394.709 [CommandLine](IMPORTANT): got command schedule "set keepstation.DepthDeadband 10 m;set keepstation.Radius 200 m;set keepstation.MaxDepth 33 m;run" 44fmq 2 2.000000
2021-06-02T03:43:14.710Z,1622605394.710 [CommandLine](IMPORTANT): Scheduling command #2 of 2 with id=44fmq
2021-06-02T03:43:14.711Z,1622605394.711 [CommandLine](IMPORTANT): Scheduled #13 (#2 of 2 with id='44fmq'): "set keepstation.DepthDeadband 10 m;set keepstation.Radius 200 m;set keepstation.MaxDepth 33 m;run"
2021-06-02T03:43:14.711Z,1622605394.711 [CommandLine](FAULT): Scheduling was paused by a command at 2021-06-02T03:42:46Z
2021-06-02T03:43:14.982Z,1622605394.982 [NAL9602](INFO): Powering down
2021-06-02T03:43:15.022Z,1622605395.022 [keepstation:D] Stopped
2021-06-02T03:43:15.023Z,1622605395.023 [keepstation:E] Running Loop=1
2021-06-02T03:43:15.023Z,1622605395.023 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:15.024Z,1622605395.024 [keepstation:NeedComms:C] Running Loop=1
2021-06-02T03:43:15.386Z,1622605395.386 [keepstation:E] Stopped
2021-06-02T03:43:15.386Z,1622605395.386 [keepstation:StartingMission] Running Loop=1
2021-06-02T03:43:15.386Z,1622605395.386 [keepstation:StartingMission](DEBUG): Aggregate::initialize keepstation:StartingMission
2021-06-02T03:43:15.386Z,1622605395.386 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:15.388Z,1622605395.388 [keepstation:NeedComms:C](DEBUG): Initialize ReadDataComponent to sense time_fix
2021-06-02T03:43:15.788Z,1622605395.788 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:15.799Z,1622605395.799 [CBIT](INFO): Clearing failed state for component NAL9602
2021-06-02T03:43:15.799Z,1622605395.799 [NAL9602] No Fault, FailCount= 1
2021-06-02T03:43:16.197Z,1622605396.197 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:16.198Z,1622605396.198 [keepstation:StandardEnvelopes:A.AltitudeEnvelope](ERROR): Altitude Measurement is not Active.
2021-06-02T03:43:16.643Z,1622605396.643 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:16.994Z,1622605396.994 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:17.405Z,1622605397.405 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:17.813Z,1622605397.813 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:18.206Z,1622605398.206 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:18.651Z,1622605398.651 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:19.017Z,1622605399.017 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:19.426Z,1622605399.426 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:19.645Z,1622605399.645 [DataOverHttps](IMPORTANT): SBD MTMSN=20210602T034314
2021-06-02T03:43:19.835Z,1622605399.835 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:20.232Z,1622605400.232 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:20.673Z,1622605400.673 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:21.044Z,1622605401.044 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:21.451Z,1622605401.451 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:21.662Z,1622605401.662 [DataOverHttps](INFO): Received command:schedule resume
2021-06-02T03:43:21.729Z,1622605401.729 [CommandLine](IMPORTANT): got command schedule resume
2021-06-02T03:43:21.729Z,1622605401.729 [CommandLine](IMPORTANT): Scheduling is resumed
2021-06-02T03:43:21.844Z,1622605401.844 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:22.252Z,1622605402.252 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:22.685Z,1622605402.685 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:23.066Z,1622605403.066 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:23.468Z,1622605403.468 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:23.871Z,1622605403.871 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:24.271Z,1622605404.271 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:24.699Z,1622605404.699 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:25.101Z,1622605405.101 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:25.484Z,1622605405.484 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:25.891Z,1622605405.891 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:26.304Z,1622605406.304 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:26.733Z,1622605406.733 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:27.100Z,1622605407.100 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:27.501Z,1622605407.501 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:27.919Z,1622605407.919 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:28.313Z,1622605408.313 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:28.736Z,1622605408.736 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:29.124Z,1622605409.124 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:29.531Z,1622605409.531 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:29.927Z,1622605409.927 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:30.326Z,1622605410.326 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:30.759Z,1622605410.759 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:30.870Z,1622605410.870 [CommandLine](IMPORTANT): got command stop
2021-06-02T03:43:30.870Z,1622605410.870 [CommandLine](IMPORTANT): Scheduling is paused for 1 commands
2021-06-02T03:43:30.870Z,1622605410.870 [Supervisor](INFO): Stop Mission called by CommandLine::commandStop
2021-06-02T03:43:31.151Z,1622605411.151 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](ERROR): Location Measurement is not Active.
2021-06-02T03:43:31.152Z,1622605411.152 [MissionManager](INFO): MissionManager is completed.
2021-06-02T03:43:31.153Z,1622605411.153 [MissionManager](INFO): Uninitializing Mission keepstation
2021-06-02T03:43:31.153Z,1622605411.153 [keepstation] Stopped
2021-06-02T03:43:31.153Z,1622605411.153 [keepstation](DEBUG): Aggregate::uninitialize keepstation
2021-06-02T03:43:31.153Z,1622605411.153 [keepstation:NeedComms] Stopped
2021-06-02T03:43:31.153Z,1622605411.153 [keepstation:NeedComms](DEBUG): Aggregate::uninitialize keepstation:NeedComms
2021-06-02T03:43:31.153Z,1622605411.153 [keepstation:NeedComms:B.GoToSurface] Stopped
2021-06-02T03:43:31.153Z,1622605411.153 [keepstation:NeedComms:B.GoToSurface](DEBUG): Uninitialize GoToSurfaceComponent.
2021-06-02T03:43:31.153Z,1622605411.153 [keepstation:NeedComms:C] Stopped
2021-06-02T03:43:31.153Z,1622605411.153 [keepstation:StandardEnvelopes] Stopped
2021-06-02T03:43:31.153Z,1622605411.153 [keepstation:StandardEnvelopes](DEBUG): Aggregate::uninitialize keepstation:StandardEnvelopes
2021-06-02T03:43:31.154Z,1622605411.154 [keepstation:StandardEnvelopes:A.AltitudeEnvelope] Stopped
2021-06-02T03:43:31.154Z,1622605411.154 [keepstation:StandardEnvelopes:A.AltitudeEnvelope](DEBUG): Uninitialize AltitudeEnvelopeComponent.
2021-06-02T03:43:31.154Z,1622605411.154 [keepstation:StandardEnvelopes:B.DepthEnvelope] Stopped
2021-06-02T03:43:31.154Z,1622605411.154 [keepstation:StandardEnvelopes:B.DepthEnvelope](DEBUG): Uninitialize.
2021-06-02T03:43:31.154Z,1622605411.154 [keepstation:StandardEnvelopes:C.OffshoreEnvelope] Stopped
2021-06-02T03:43:31.154Z,1622605411.154 [keepstation:StandardEnvelopes:C.OffshoreEnvelope](DEBUG): Uninitialize OffshoreEnvelopeComponent.
2021-06-02T03:43:31.154Z,1622605411.154 [keepstation:F.Pitch] Stopped
2021-06-02T03:43:31.154Z,1622605411.154 [keepstation:StartingMission] Stopped
2021-06-02T03:43:31.154Z,1622605411.154 [keepstation:StartingMission](DEBUG): Aggregate::uninitialize keepstation:StartingMission
2021-06-02T03:43:31.547Z,1622605411.547 [MissionManager](IMPORTANT): Started mission Default
2021-06-02T03:43:31.547Z,1622605411.547 [Default] Running Loop=1
2021-06-02T03:43:31.547Z,1622605411.547 [Default](DEBUG): Aggregate::initialize Default
2021-06-02T03:43:31.547Z,1622605411.547 [Default:B.GoToSurface] Running Loop=1
2021-06-02T03:43:31.547Z,1622605411.547 [Default:B.GoToSurface](DEBUG): Initialize GoToSurfaceComponent.
2021-06-02T03:43:31.548Z,1622605411.548 [Default:B.GoToSurface](DEBUG): No depth rate setting specified. Using default value of nan m/s.
2021-06-02T03:43:31.548Z,1622605411.548 [Default:B.GoToSurface](DEBUG): No pitch setting specified. Using default value of nan degrees.
2021-06-02T03:43:31.548Z,1622605411.548 [Default:B.GoToSurface](DEBUG): No speed setting specified. Using default value of 1.000000 m/s.
2021-06-02T03:43:31.549Z,1622605411.549 [Default:B.GoToSurface](DEBUG): No surface timeout specified. Using default value of 1000.000000 seconds.
2021-06-02T03:43:31.549Z,1622605411.549 [Default:B.GoToSurface](INFO): Received pitch timeout configuration 60.000000 seconds.
2021-06-02T03:43:31.550Z,1622605411.550 [Default:A.Wait] Running Loop=1
2021-06-02T03:43:31.550Z,1622605411.550 [Default:A.Wait](DEBUG): Initialize Wait Component.