0 | 0:00 | DEBUG | Using configuration file PurpleWaveAIIDE.config.json
0 | 0:00 | DEBUG | Human: false
0 | 0:00 | DEBUG | Ladder: false
0 | 0:00 | DEBUG | Livestream: false
0 | 0:00 | DEBUG | Tournament: true
0 | 0:00 | DEBUG | Round-robin: true
0 | 0:00 | DEBUG | Elimination: false
0 | 0:00 | DEBUG | Pretraining: false
0 | 0:00 | DEBUG | Debugging: false
0 | 0:00 | DEBUG | DebuggingLive: false
0 | 0:00 | DEBUG | Log stdout: false
0 | 0:00 | DEBUG | Frame MS target: 35
0 | 0:00 | DEBUG | Frame MS limit: 35
0 | 0:00 | DEBUG | Fixed build: 
0 | 0:00 | DEBUG | Melee on Polypoid 1.65 at (4)Polypoid_1.65.scx as PurpleWave (Us, always Protoss) with Microwave (Enemy, always Zerg)
0 | 0:00 | DEBUG | Detecting ownership of base from visible town hall: Our Nexus #24 750/750 (750/750) [288, 272](9, 8)
0 | 0:00 | DEBUG | Found C:\TM\Starcraft\bwapi-data\read\accelerants-polypoid.json
0 | 0:00 | DEBUG | 116 minerals have cached steady zippers
0 | 0:00 | DEBUG | Brazil (Mexico City - Our natural) [34, 6]: CREATED WALL
0 | 0:00 | DEBUG | Permutations:       2
0 | 0:00 | DEBUG | Tiles considered:   59
0 | 0:00 | DEBUG | Constraints:      WallConstraint(1,Dragoon,TerrainTerrain,WrappedArray(Gateway, Forge))
0 | 0:00 | DEBUG | Acceptable walls:
Wall: WallConstraint(1,Dragoon,TerrainTerrain,WrappedArray(Gateway, Forge)) -> Buildings: ArrayBuffer(([32, 12],Gateway), ([36, 14],Forge), ([35, 9],Photon Cannon), ([39, 10],Photon Cannon), ([33, 9],Photon Cannon), ([31, 9],Photon Cannon), ([41, 10],Photon Cannon), ([39, 8],Photon Cannon), ([32, 7],Photon Cannon), ([30, 7],Photon Cannon), ([32, 5],Photon Cannon), ([28, 6],Photon Cannon), ([30, 5],Photon Cannon), ([28, 4],Photon Cannon), ([30, 3],Photon Cannon), ([30, 1],Photon Cannon), ([37, 10],Pylon), ([28, 2],Pylon)), Gap: Some([39, 14]), Hallway: ArrayBuffer([39, 14], [39, 13], [38, 13], [37, 13], [36, 13], [36, 12], [36, 11], [35, 11], [34, 11], [33, 11], [32, 11], [31, 11], [30, 11], [30, 10], [29, 10], [28, 10], [27, 10])
Wall: WallConstraint(1,Dragoon,TerrainTerrain,WrappedArray(Gateway, Forge)) -> Buildings: ArrayBuffer(([32, 13],Forge), ([35, 13],Gateway)), Gap: Some([39, 14]), Hallway: List()
0 | 0:00 | DEBUG | All scores:
0 | 0:00 | DEBUG | Wall: WallConstraint(1,Dragoon,TerrainTerrain,WrappedArray(Gateway, Forge)) -> Buildings: ArrayBuffer(([32, 12],Gateway), ([36, 14],Forge), ([35, 9],Photon Cannon), ([39, 10],Photon Cannon), ([33, 9],Photon Cannon), ([31, 9],Photon Cannon), ([41, 10],Photon Cannon), ([39, 8],Photon Cannon), ([32, 7],Photon Cannon), ([30, 7],Photon Cannon), ([32, 5],Photon Cannon), ([28, 6],Photon Cannon), ([30, 5],Photon Cannon), ([28, 4],Photon Cannon), ([30, 3],Photon Cannon), ([30, 1],Photon Cannon), ([37, 10],Pylon), ([28, 2],Pylon)), Gap: Some([39, 14]), Hallway: ArrayBuffer([39, 14], [39, 13], [38, 13], [37, 13], [36, 13], [36, 12], [36, 11], [35, 11], [34, 11], [33, 11], [32, 11], [31, 11], [30, 11], [30, 10], [29, 10], [28, 10], [27, 10])
Wall: WallConstraint(1,Dragoon,TerrainTerrain,WrappedArray(Gateway, Forge)) -> Buildings: ArrayBuffer(([32, 13],Forge), ([35, 13],Gateway)), Gap: Some([39, 14]), Hallway: List()
0 | 0:00 | DEBUG | 
0 | 0:00 | DEBUG | Choosing tournament policy StrategySelectionGreedy
0 | 0:00 | DEBUG | Activating strategy PvZ2Gate4Gate
0 | 0:00 | DEBUG | Game start time:  Tue Nov 04 19:22:07 NST 2025
0 | 0:00 | DEBUG | OS:               Windows 10 10.0 amd64
0 | 0:00 | DEBUG | JRE:              Oracle Corporation - 1.8.0_471
0 | 0:00 | DEBUG | CPUs available:   12
0 | 0:00 | DEBUG | System memory:    8263 MB
0 | 0:00 | DEBUG | JVM arguments     -XX:MaxGCPauseMillis=15 -Xms2048m -Xmx2048m
0 | 0:00 | DEBUG | Live debugging:   false
0 | 0:00 | DEBUG | Buffer capacity:  42
0 | 0:00 | DEBUG | Using buffer?     true
0 | 0:00 | DEBUG | JVM Max memory:   2026 MB
0 | 0:00 | DEBUG | JVM Total memory: 2026 MB
0 | 0:00 | DEBUG | JVM Free memory:  1589 MB
0 | 0:00 | DEBUG | JVM Used memory:  437 MB
0 | 0:00 | DEBUG | JVM Used, heap:   437 MB
0 | 0:00 | DEBUG | Heap memory PS Survivor Space, current:          0 MB used | 89 MB init | 118 MB max | 118 MB committed
0 | 0:00 | DEBUG | Heap memory PS Survivor Space, peak:             95 MB used | 89 MB init | 120 MB max | 120 MB committed
0 | 0:00 | DEBUG | Non-heap memory Compressed Class Space, current: 6 MB used | 0 MB init | 1073 MB max | 6 MB committed
0 | 0:00 | DEBUG | Non-heap memory Compressed Class Space, peak:    6 MB used | 0 MB init | 1073 MB max | 6 MB committed
0 | 0:00 | DEBUG | Non-heap memory Code Cache, current:             16 MB used | 2 MB init | 251 MB max | 16 MB committed
0 | 0:00 | DEBUG | Non-heap memory Code Cache, peak:                16 MB used | 2 MB init | 251 MB max | 16 MB committed
0 | 0:00 | DEBUG | Non-heap memory Metaspace, current:              38 MB used | 0 MB init | 0 MB max | 46 MB committed
0 | 0:00 | DEBUG | Non-heap memory Metaspace, peak:                 38 MB used | 0 MB init | 0 MB max | 46 MB committed
0 | 0:00 | DEBUG | Heap memory PS Old Gen, current:                 207 MB used | 1431 MB init | 1431 MB max | 1431 MB committed
0 | 0:00 | DEBUG | Heap memory PS Old Gen, peak:                    210 MB used | 1431 MB init | 1431 MB max | 1431 MB committed
0 | 0:00 | DEBUG | Heap memory PS Eden Space, current:              229 MB used | 537 MB init | 478 MB max | 476 MB committed
0 | 0:00 | DEBUG | Heap memory PS Eden Space, peak:                 537 MB used | 537 MB init | 589 MB max | 537 MB committed
0 | 0:00 | DEBUG | This copy of PurpleWave was packaged for distribution on Tue Oct 21 22:54:10 EDT 2025
0 | 0:00 | DEBUG | This copy of PurpleWave came from Git revision b193b3c8b81f9969bde211669eb2a9dda5a34db0
0 | 0:00 | DEBUG | JBWAPI autocontinue: false
0 | 0:00 | DEBUG | JBWAPI debugConnection: true
0 | 0:00 | DEBUG | JBWAPI async: true
0 | 0:00 | DEBUG | JBWAPI async unsafe: true
0 | 0:00 | DEBUG | JBWAPI async frame buffer size: 10
0 | 0:00 | DEBUG | JBWAPI unlimited frame zero: true
0 | 0:00 | DEBUG | JBWAPI max frame duration: 30ms
0 | 0:00 | DEBUG | Map file: (4)Polypoid_1.65.scx
0 | 0:00 | DEBUG | Map hash: ad870839912421dc3b4fd736a954bf770693ba9a
0 | 0:00 | DEBUG | Map id: polypoid
0 | 0:00 | DEBUG | Start: 2 o'clock
0 | 0:00 | DEBUG | Rush distance: 187
0 | 0:00 | DEBUG | PvZ2Gate4Gate: Won 258 of 332 games (108.5 weighted). 77% raw, 71% weighted
0 | 0:00 | DEBUG | PvZGoon: Won 0 of 0 games (0.0 weighted). 70% raw, 70% weighted
0 | 0:00 | DEBUG | PvZMuscle: Won 0 of 0 games (0.0 weighted). 70% raw, 70% weighted
0 | 0:00 | DEBUG | PvZTech: Won 0 of 0 games (0.0 weighted). 70% raw, 70% weighted
0 | 0:00 | DEBUG | PvZ1GateCoreYoloDragoon: Won 0 of 0 games (0.0 weighted). 70% raw, 70% weighted
0 | 0:00 | DEBUG | PvZ1GateCoreExpand: Won 2 of 3 games (0.8 weighted). 66% raw, 66% weighted
0 | 0:00 | DEBUG | PvZFFE: Won 0 of 1 games (0.3 weighted). 0% raw, 0% weighted
0 | 0:00 | DEBUG | PvZ1BaseReactive: Won 0 of 1 games (0.3 weighted). 0% raw, 0% weighted
0 | 0:00 | DEBUG | PvZExpand: Won 0 of 1 games (0.3 weighted). 0% raw, 0% weighted
0 | 0:00 | DEBUG | PvZSpeedlot: Won 0 of 1 games (0.3 weighted). 0% raw, 0% weighted
0 | 0:00 | DEBUG | PvZ1GateCoreYoloSpeedlot: Won 0 of 1 games (0.3 weighted). 0% raw, 0% weighted
0 | 0:00 | DEBUG | Win probability by branch
0 | 0:00 | DEBUG | 71% PvZ2Gate4Gate
0 | 0:00 | DEBUG | 69% PvZ1GateCoreYoloDragoon
0 | 0:00 | DEBUG | 68% PvZ1GateCoreExpand
0 | 0:00 | DEBUG | 64% PvZ1BaseReactive + PvZGoon + PvZMuscle
0 | 0:00 | DEBUG | 64% PvZ1BaseReactive + PvZGoon + PvZTech
0 | 0:00 | DEBUG | 60% PvZFFE
0 | 0:00 | DEBUG | 60% PvZ1GateCoreYoloSpeedlot
0 | 0:00 | DEBUG | 60% PvZ1BaseReactive + PvZSpeedlot + PvZTech
0 | 0:00 | DEBUG | 60% PvZ1BaseReactive + PvZSpeedlot + PvZMuscle
0 | 0:00 | DEBUG | 60% PvZ1BaseReactive + PvZGoon + PvZExpand
0 | 0:00 | DEBUG | 55% PvZ1BaseReactive + PvZSpeedlot + PvZExpand
0 | 0:00 | DEBUG | Latency: LF3 (Turn size 1)
0 | 0:00 | DEBUG | Frame 0 (secs): 3
0 | 0:00 | DEBUG | Opponents: Microwave
0 | 0:00 | DEBUG | Rush distances: 165, 165, 170, 170, 170, 170, 171, 171, 222, 222, 224, 224
0 | 0:00 | DEBUG | Mean rush distance: 187
0 | 0:00 | DEBUG | Playbook: TournamentPlaybook
0 | 0:00 | DEBUG | Policy: StrategySelectionTournament
0 | 0:00 | DEBUG | Enemy race: Zerg
0 | 0:00 | DEBUG | Strategy: PvZ2Gate4Gate
0 | 0:00 | DEBUG | Our bases: 1
0 | 0:00 | DEBUG | Enemy bases: 0
0 | 0:00 | DEBUG | Our mining bases: 1
0 | 0:00 | DEBUG | Enemy mining bases: 0
0 | 0:00 | DEBUG | Our max mining: 1
0 | 0:00 | DEBUG | Enemy max mining: 1
0 | 0:00 | DEBUG | Our techs: 
0 | 0:00 | DEBUG | Enemy techs: 
0 | 0:00 | DEBUG | Our upgrades: 
0 | 0:00 | DEBUG | Enemy upgrades: 
0 | 0:00 | DEBUG | Our Factories: 0
0 | 0:00 | DEBUG | Our Barracks: 0
0 | 0:00 | DEBUG | Our Gateways: 0
0 | 0:00 | DEBUG | Our Hatcheries: 0
0 | 0:00 | DEBUG | Enemy Factories: 0
0 | 0:00 | DEBUG | Enemy Barracks: 0
0 | 0:00 | DEBUG | Enemy Gateways: 0
0 | 0:00 | DEBUG | Enemy Hatcheries: 0
0 | 0:00 | DEBUG | Safe defending: true
0 | 0:00 | DEBUG | Safe pushing: true
0 | 0:00 | DEBUG | Safe skirmishing: true
0 | 0:00 | DEBUG | Skirmish > Defense: false
0 | 0:00 | DEBUG | Kill potential: true
0 | 0:00 | DEBUG | Aggression: 1.0
0 | 0:00 | DEBUG | Want to attack: false
0 | 0:00 | DEBUG | Want to harass: false
0 | 0:00 | DEBUG | Monitor bases: false
0 | 0:00 | DEBUG | Fingerprints: &ZerglingOnly
0 | 0:00 | DEBUG | Status: PvR2Gate4Gate
0 | 0:00 | DEBUG | Performance danger: false
0 | 0:00 | DEBUG | Sluggishness: 0
0 | 0:00 | DEBUG | Gas worker floor: 0
0 | 0:00 | DEBUG | Gas worker ceiling: 200
0 | 0:00 | DEBUG | Gas worker ratio: 0.3
0 | 0:00 | DEBUG | Gas limit floor: 0
0 | 0:00 | DEBUG | Gas limit ceiling: 500
0 | 0:00 | DEBUG | Active tactics: TacticGather
0 | 0:00 | DEBUG | Pulling workers: false
0 | 0:00 | DEBUG | Main fully scouted: false
1 | 0:00 | DEBUG | Frame 0 (secs) changed from 3 to 4
1776 | 1:14 | DEBUG | Our Gateways changed from 0 to 1
2375 | 1:38 | DEBUG | Our Gateways changed from 1 to 2
2375 | 1:38 | DEBUG | Active tactics
  Was: TacticGather
  Now: Group: Debugging.EnumerateUnits$@2dafa33e(groupUnits), TacticGather
3274 | 2:16 | DEBUG | Discovered first Drone
3274 | 2:16 | DEBUG | Foe Drone #10 40/40  [874, 342](27, 10) projects to arrive in 163 frames at 2:23
3350 | 2:19 | DEBUG | Active tactics
  Was: Group: Debugging.EnumerateUnits$@2dafa33e(groupUnits), TacticGather
  Now: Group: Debugging.EnumerateUnits$@2dafa33e(groupUnits), Hold Mosco, TacticGather
3433 | 2:23 | DEBUG | Active tactics
  Was: Group: Debugging.EnumerateUnits$@2dafa33e(groupUnits), Hold Mosco, TacticGather
  Now: Eject, Group: Debugging.EnumerateUnits$@2dafa33e(groupUnits), Hold Mosco, TacticGather
3436 | 2:23 | DEBUG | Active tactics
  Was: Eject, Group: Debugging.EnumerateUnits$@2dafa33e(groupUnits), Hold Mosco, TacticGather
  Now: Group: Debugging.EnumerateUnits$@2dafa33e(groupUnits), Hold Mosco, TacticGather
4131 | 2:52 | DEBUG | Inferred enemy main from process of elimination.
4132 | 2:52 | DEBUG | Assuming Microwave owns ? Enemy main New York City, Mali, Antarctica  [122, 10] as implicit starting location
4132 | 2:52 | DEBUG | Enemy bases changed from 0 to 1
4132 | 2:52 | DEBUG | Enemy mining bases changed from 0 to 1
4825 | 3:21 | DEBUG | Safe skirmishing changed from true to false
4825 | 3:21 | DEBUG | Discovered first Zergling
4825 | 3:21 | DEBUG | Foe Zergling #181 35/35  [3474, 1155](108, 36) projects to arrive in 770 frames at 3:53
4825 | 3:21 | DEBUG | Foe Zergling #191 35/35  [3495, 1119](109, 34) projects to arrive in 787 frames at 3:53
4903 | 3:24 | DEBUG | Enemy Hatcheries changed from 0 to 1
4904 | 3:24 | DEBUG | Detecting ownership of base from visible town hall: Foe Hatchery #164 1250/1250  [3840, 1168](120, 36)
4904 | 3:24 | DEBUG | Discovered first Hatchery
4904 | 3:24 | DEBUG | Foe Hatchery #164 1250/1250  [3840, 1168](120, 36) is already complete
4905 | 3:24 | DEBUG | Recording first enemy expansion frame
4905 | 3:24 | DEBUG | Enemy bases changed from 1 to 2
4905 | 3:24 | DEBUG | Enemy mining bases changed from 1 to 2
4906 | 3:24 | DEBUG | &CompleteBy matched: 1 IsHatchlike complete by 3:40. Incomplete: []
4906 | 3:24 | DEBUG | &CompleteBy matched: 1 IsHatchlike complete by 3:29. Incomplete: []
4909 | 3:24 | DEBUG | Enemy max mining changed from 1 to 2
4910 | 3:24 | DEBUG | Discovered first Egg
4910 | 3:24 | DEBUG | Foe Egg 3:24 #193 200/200  [3840, 1209](120, 37) projects to arrive in 86400 frames at 63:24
4916 | 3:24 | DEBUG | Discovered first Larva
4916 | 3:24 | DEBUG | Foe Larva #188 25/25  [3869, 1219](120, 38) projects to arrive in 86400 frames at 63:24
5013 | 3:28 | DEBUG | Discovered first Overlord
5013 | 3:28 | DEBUG | Foe Overlord #161 200/200  [3680, 607](115, 18) projects to arrive in 4146 frames at 6:21
5046 | 3:30 | DEBUG | Enemy Hatcheries changed from 1 to 2
5054 | 3:30 | DEBUG | Discovered first Spawning Pool
5054 | 3:30 | DEBUG | Foe Spawning Pool #165 750/750  [3888, 480](121, 15) is already complete
5056 | 3:30 | DEBUG | &CompleteBy matched: 1 Spawning Pool complete by 3:40. Incomplete: []
5260 | 3:39 | DEBUG | &CompleteBy matched: 3 IsHatchlike complete by 4:00. Incomplete: []
5260 | 3:39 | DEBUG | &Or matched: Matched children: [&CompleteBy matched: 3 IsHatchlike complete by 4:00. Incomplete: []]
5260 | 3:39 | DEBUG | &12Hatch11Pool13Hatch matched: Unmatched children: []
5260 | 3:39 | DEBUG | &Or matched: Matched children: [&12Hatch11Pool13Hatch matched: Unmatched children: []]
5260 | 3:39 | DEBUG | &3HatchGas matched: Unmatched children: []
5260 | 3:39 | DEBUG | &Not unmatched: [&3HatchGas matched: Unmatched children: []]
5260 | 3:39 | DEBUG | &Not unmatched: [&3HatchGas matched: Unmatched children: []]
5260 | 3:39 | DEBUG | Enemy Hatcheries changed from 2 to 3
5260 | 3:39 | DEBUG | Fingerprints
  Was: &ZerglingOnly
  Now: &12Hatch11Pool13Hatch &3HatchGas &ZerglingOnly
5260 | 3:39 | DEBUG | Discovered first Sunken Colony
5260 | 3:39 | DEBUG | Foe Sunken Colony #156 300/300  [3776, 256](118, 8) is already complete
5265 | 3:39 | DEBUG | Kill potential changed from true to false
5269 | 3:39 | DEBUG | Discovered first Extractor
5269 | 3:39 | DEBUG | Foe Extractor 3:47 #89 525/750  [3808, 160](119, 5) projects to complete in 198 frames at 3:47. Proximity: 0.02120264164059782 between [7, 7] and [117, 9]
5397 | 3:44 | DEBUG | Active tactics
  Was: Group: Debugging.EnumerateUnits$@2dafa33e(groupUnits), Hold Mosco, TacticGather
  Now: Hold Mosco, TacticGather
5467 | 3:47 | DEBUG | Kill potential changed from false to true
5500 | 3:49 | DEBUG | Active tactics
  Was: Hold Mosco, TacticGather
  Now: Guard Mosco, TacticGather
6134 | 4:15 | DEBUG | Kill potential changed from true to false
6300 | 4:22 | DEBUG | Kill potential changed from false to true
6364 | 4:25 | DEBUG | Our Gateways changed from 2 to 3
6381 | 4:25 | DEBUG | Kill potential changed from true to false
6740 | 4:40 | DEBUG | Our Gateways changed from 3 to 4
8179 | 5:40 | DEBUG | Our upgrades
  Was: 
  Now: Singularity Charge = 1
8179 | 5:40 | DEBUG | Want to attack changed from false to true
8179 | 5:40 | DEBUG | Status
  Was: PvR2Gate4Gate
  Now: PvR2Gate4Gate, Attack
8180 | 5:40 | DEBUG | Kill potential changed from false to true
8181 | 5:40 | DEBUG | Active tactics
  Was: Guard Mosco, TacticGather
  Now: Guard Mosco, PushMain Lago, TacticGather
8182 | 5:40 | DEBUG | Safe skirmishing changed from false to true
8185 | 5:41 | DEBUG | Active tactics
  Was: Guard Mosco, PushMain Lago, TacticGather
  Now: PushMain Lago, TacticGather
9115 | 6:19 | DEBUG | Discovered first Creep Colony
9115 | 6:19 | DEBUG | Foe Creep Colony 6:20 #8 367/400  [3744, 1248](117, 39) projects to complete in 27 frames at 6:20. Proximity: 0.2 between [7, 7] and [117, 9]
9139 | 6:20 | DEBUG | Kill potential changed from true to false
9142 | 6:20 | DEBUG | Active tactics
  Was: PushMain Lago, TacticGather
  Now: Contain Lago, TacticGather
9341 | 6:29 | DEBUG | Wall clock: 1 minutes elapsed. Checkpoint game speed: 6.49x. Total game speed: 6.49x
9352 | 6:29 | DEBUG | Enemy upgrades
  Was: 
  Now: Metabolic Boost = 1
9721 | 6:45 | DEBUG | &ZerglingOnly unmatched: (No reason)
9721 | 6:45 | DEBUG | Fingerprints
  Was: &12Hatch11Pool13Hatch &3HatchGas &ZerglingOnly
  Now: &12Hatch11Pool13Hatch &3HatchGas
9722 | 6:45 | DEBUG | Discovered first Hydralisk
9722 | 6:45 | DEBUG | Foe Hydralisk #246 80/80  [3732, 1183](116, 36) projects to arrive in 1225 frames at 7:36
10061 | 6:59 | DEBUG | Active tactics
  Was: Contain Lago, TacticGather
  Now: ClearExpansionBlockers, Contain Lago, TacticGather
10064 | 6:59 | DEBUG | Active tactics
  Was: ClearExpansionBlockers, Contain Lago, TacticGather
  Now: Contain Lago, TacticGather
10081 | 7:00 | DEBUG | Active tactics
  Was: Contain Lago, TacticGather
  Now: Contain Lago, ScoutExpansions, TacticGather
10100 | 7:00 | DEBUG | Active tactics
  Was: Contain Lago, ScoutExpansions, TacticGather
  Now: ClearExpansionBlockers, Contain Lago, ScoutExpansions, TacticGather
10107 | 7:01 | DEBUG | Active tactics
  Was: ClearExpansionBlockers, Contain Lago, ScoutExpansions, TacticGather
  Now: Contain Lago, ScoutExpansions, TacticGather
10213 | 7:05 | DEBUG | Active tactics
  Was: Contain Lago, ScoutExpansions, TacticGather
  Now: ClearExpansionBlockers, Contain Lago, ScoutExpansions, TacticGather
10221 | 7:05 | DEBUG | Active tactics
  Was: ClearExpansionBlockers, Contain Lago, ScoutExpansions, TacticGather
  Now: Contain Lago, ScoutExpansions, TacticGather
10279 | 7:08 | DEBUG | Active tactics
  Was: Contain Lago, ScoutExpansions, TacticGather
  Now: ClearExpansionBlockers, Contain Lago, ScoutExpansions, TacticGather
10286 | 7:08 | DEBUG | Active tactics
  Was: ClearExpansionBlockers, Contain Lago, ScoutExpansions, TacticGather
  Now: Contain Lago, ScoutExpansions, TacticGather
10288 | 7:08 | DEBUG | Enemy techs
  Was: 
  Now: Lurker Aspect
10290 | 7:08 | DEBUG | Discovered first Lurker Egg
10290 | 7:08 | DEBUG | Foe Lurker Egg 7:33 #246 200/200  [3689, 1137](115, 35) projects to arrive in 86401 frames at 67:08
10888 | 7:33 | DEBUG | Discovered first Lurker
10888 | 7:33 | DEBUG | Foe Lurker 7:33 #249 125/125  [3733, 1009](116, 31) projects to arrive in 797 frames at 8:06
10909 | 7:34 | DEBUG | Skirmish > Defense changed from false to true
11127 | 7:43 | DEBUG | Active tactics
  Was: Contain Lago, ScoutExpansions, TacticGather
  Now: Contain Tanz, ScoutExpansions, TacticGather
11172 | 7:45 | DEBUG | Safe defending changed from true to false
11210 | 7:47 | DEBUG | Safe defending changed from false to true
11239 | 7:48 | DEBUG | Safe defending changed from true to false
11294 | 7:50 | DEBUG | Active tactics
  Was: Contain Tanz, ScoutExpansions, TacticGather
  Now: Raze Lago, ScoutExpansions, TacticGather
12101 | 8:24 | DEBUG | Detecting absent base: ? Neutral natural Lagos, Venezuela, Antarctica  [123, 36]
12101 | 8:24 | DEBUG | Enemy Hatcheries changed from 3 to 2
12101 | 8:24 | DEBUG | Active tactics
  Was: Raze Lago, ScoutExpansions, TacticGather
  Now: Contain Tanz, ScoutExpansions, TacticGather
12102 | 8:24 | DEBUG | Detecting ownership of base from visible town hall: Foe Hatchery #164 1250/1250  [3840, 1168](120, 36)
12102 | 8:24 | DEBUG | Enemy Hatcheries changed from 2 to 3
12103 | 8:24 | DEBUG | Active tactics
  Was: Contain Tanz, ScoutExpansions, TacticGather
  Now: Raze Lago, ScoutExpansions, TacticGather
12220 | 8:29 | DEBUG | Safe defending changed from false to true
12305 | 8:32 | DEBUG | Safe defending changed from true to false
12315 | 8:33 | DEBUG | Safe defending changed from false to true
12329 | 8:33 | DEBUG | Safe defending changed from true to false
12869 | 8:56 | DEBUG | Safe pushing changed from true to false
12958 | 8:59 | DEBUG | Safe pushing changed from false to true
12987 | 9:01 | DEBUG | Safe pushing changed from true to false
12990 | 9:01 | DEBUG | Safe pushing changed from false to true
12995 | 9:01 | DEBUG | Safe pushing changed from true to false
12997 | 9:01 | DEBUG | Safe pushing changed from false to true
13003 | 9:01 | DEBUG | Safe pushing changed from true to false
13007 | 9:01 | DEBUG | Safe pushing changed from false to true
13552 | 9:24 | DEBUG | Safe pushing changed from true to false
13556 | 9:24 | DEBUG | Safe pushing changed from false to true
13569 | 9:25 | DEBUG | Safe pushing changed from true to false
13577 | 9:25 | DEBUG | Safe pushing changed from false to true
13856 | 9:37 | DEBUG | Safe defending changed from false to true
14174 | 9:50 | DEBUG | Safe defending changed from true to false
14400 | 10:00 | DEBUG | Storyteller moving to more intermittent updates
15120 | 10:30 | DEBUG | Enemy Hatcheries changed from 3 to 4
15192 | 10:33 | DEBUG | Safe pushing changed from true to false
15216 | 10:34 | DEBUG | Safe pushing changed from false to true
15696 | 10:54 | DEBUG | Active tactics
  Was: Raze Lago, ScoutExpansions, TacticGather
  Now: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather
15720 | 10:55 | DEBUG | Active tactics
  Was: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather
  Now: Raze Lago, ScoutExpansions, TacticGather
15744 | 10:56 | DEBUG | Enemy upgrades
  Was: Metabolic Boost = 1
  Now: Metabolic Boost = 1, Muscular Augments = 1
15744 | 10:56 | DEBUG | Active tactics
  Was: Raze Lago, ScoutExpansions, TacticGather
  Now: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather
15768 | 10:57 | DEBUG | Active tactics
  Was: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather
  Now: Raze Lago, ScoutExpansions, TacticGather
15888 | 11:02 | DEBUG | Our upgrades
  Was: Singularity Charge = 1
  Now: Protoss Ground Weapons = 1, Singularity Charge = 1
15888 | 11:02 | DEBUG | Active tactics
  Was: Raze Lago, ScoutExpansions, TacticGather
  Now: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather
15912 | 11:03 | DEBUG | Active tactics
  Was: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather
  Now: Raze Lago, ScoutExpansions, TacticGather
15960 | 11:05 | DEBUG | Active tactics
  Was: Raze Lago, ScoutExpansions, TacticGather
  Now: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather
15984 | 11:06 | DEBUG | Active tactics
  Was: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather
  Now: Raze Lago, ScoutExpansions, TacticGather
16152 | 11:13 | DEBUG | Active tactics
  Was: Raze Lago, ScoutExpansions, TacticGather
  Now: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather
16296 | 11:19 | DEBUG | Active tactics
  Was: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather
  Now: Raze Lago, ScoutExpansions, TacticGather
16320 | 11:20 | DEBUG | Active tactics
  Was: Raze Lago, ScoutExpansions, TacticGather
  Now: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather
16344 | 11:21 | DEBUG | Active tactics
  Was: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather
  Now: Raze Lago, ScoutExpansions, TacticGather
16392 | 11:23 | DEBUG | Active tactics
  Was: Raze Lago, ScoutExpansions, TacticGather
  Now: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather
16443 | 11:25 | DEBUG | Wall clock: 2 minutes elapsed. Checkpoint game speed: 4.93x. Total game speed: 5.71x
16464 | 11:26 | DEBUG | Active tactics
  Was: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather
  Now: Raze Lago, ScoutExpansions, TacticGather
16488 | 11:27 | DEBUG | Active tactics
  Was: Raze Lago, ScoutExpansions, TacticGather
  Now: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather
16728 | 11:37 | DEBUG | Safe defending changed from false to true
16851 | 11:42 | DEBUG | Detecting ownership of base from visible town hall: Our Nexus 12:57 #388 77/750 (77/750) [1152, 240](36, 7)
16852 | 11:42 | DEBUG | Recording our first expansion frame
16872 | 11:43 | DEBUG | Our bases changed from 1 to 2
16872 | 11:43 | DEBUG | Our mining bases changed from 1 to 2
16872 | 11:43 | DEBUG | Our max mining changed from 1 to 2
16872 | 11:43 | DEBUG | Active tactics
  Was: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather
  Now: Raze Lago, ScoutExpansions, TacticGather, Withdraw Mexic
17184 | 11:56 | DEBUG | Skirmish > Defense changed from true to false
17208 | 11:57 | DEBUG | Skirmish > Defense changed from false to true
17256 | 11:59 | DEBUG | Enemy upgrades
  Was: Metabolic Boost = 1, Muscular Augments = 1
  Now: Grooved Spines = 1, Metabolic Boost = 1, Muscular Augments = 1
17304 | 12:01 | DEBUG | Active tactics
  Was: Raze Lago, ScoutExpansions, TacticGather, Withdraw Mexic
  Now: Raze Lago, Scour Mexic, ScoutExpansions, TacticGather
17400 | 12:05 | DEBUG | Active tactics
  Was: Raze Lago, Scour Mexic, ScoutExpansions, TacticGather
  Now: Raze Lago, ScoutExpansions, TacticGather
17736 | 12:19 | DEBUG | Safe defending changed from true to false
17784 | 12:21 | DEBUG | Enemy upgrades
  Was: Grooved Spines = 1, Metabolic Boost = 1, Muscular Augments = 1
  Now: Grooved Spines = 1, Metabolic Boost = 1, Muscular Augments = 1, Zerg Carapace = 1
17880 | 12:25 | DEBUG | Our mining bases changed from 2 to 1
17904 | 12:26 | DEBUG | Safe defending changed from false to true
17976 | 12:29 | DEBUG | Safe defending changed from true to false
18072 | 12:33 | DEBUG | Active tactics
  Was: Raze Lago, ScoutExpansions, TacticGather
  Now: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather
18096 | 12:34 | DEBUG | Active tactics
  Was: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather
  Now: Raze Lago, ScoutExpansions, TacticGather
18168 | 12:37 | DEBUG | Active tactics
  Was: Raze Lago, ScoutExpansions, TacticGather
  Now: Raze Lago, ScoutExpansions, TacticGather, Withdraw Mexic
18264 | 12:41 | DEBUG | Active tactics
  Was: Raze Lago, ScoutExpansions, TacticGather, Withdraw Mexic
  Now: Raze Lago, ScoutExpansions, TacticGather
18384 | 12:46 | DEBUG | Active tactics
  Was: Raze Lago, ScoutExpansions, TacticGather
  Now: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather
18408 | 12:47 | DEBUG | Active tactics
  Was: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather
  Now: Raze Lago, ScoutExpansions, TacticGather
18432 | 12:48 | DEBUG | Active tactics
  Was: Raze Lago, ScoutExpansions, TacticGather
  Now: Raze Lago, ScoutExpansions, TacticGather, Withdraw Mexic
18456 | 12:49 | DEBUG | Active tactics
  Was: Raze Lago, ScoutExpansions, TacticGather, Withdraw Mexic
  Now: Raze Lago, ScoutExpansions, TacticGather
18480 | 12:50 | DEBUG | Safe defending changed from false to true
18504 | 12:51 | DEBUG | Active tactics
  Was: Raze Lago, ScoutExpansions, TacticGather
  Now: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather
18528 | 12:52 | DEBUG | Active tactics
  Was: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather
  Now: Raze Lago, ScoutExpansions, TacticGather
18552 | 12:53 | DEBUG | Active tactics
  Was: Raze Lago, ScoutExpansions, TacticGather
  Now: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather
18600 | 12:55 | DEBUG | Active tactics
  Was: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather
  Now: Raze Lago, ScoutExpansions, TacticGather, Withdraw Mexic
18624 | 12:56 | DEBUG | Active tactics
  Was: Raze Lago, ScoutExpansions, TacticGather, Withdraw Mexic
  Now: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather, Withdraw Mexic
18720 | 13:00 | DEBUG | Active tactics
  Was: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather, Withdraw Mexic
  Now: Raze Lago, ScoutExpansions, TacticGather, Withdraw Mexic
18744 | 13:01 | DEBUG | Active tactics
  Was: Raze Lago, ScoutExpansions, TacticGather, Withdraw Mexic
  Now: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather, Withdraw Mexic
18816 | 13:04 | DEBUG | Active tactics
  Was: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather, Withdraw Mexic
  Now: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, Scour Mexic, ScoutExpansions, TacticGather
18864 | 13:06 | DEBUG | Active tactics
  Was: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, Scour Mexic, ScoutExpansions, TacticGather
  Now: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather, Withdraw Mexic
18912 | 13:08 | DEBUG | Enemy upgrades
  Was: Grooved Spines = 1, Metabolic Boost = 1, Muscular Augments = 1, Zerg Carapace = 1
  Now: Grooved Spines = 1, Metabolic Boost = 1, Muscular Augments = 1, Zerg Carapace = 1, Zerg Missile Attacks = 1
19008 | 13:12 | DEBUG | Safe defending changed from true to false
19032 | 13:13 | DEBUG | Safe defending changed from false to true
19032 | 13:13 | DEBUG | Active tactics
  Was: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather, Withdraw Mexic
  Now: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, Scour Mexic, ScoutExpansions, TacticGather
19263 | 13:22 | DEBUG | Detecting ownership of base from visible town hall: Our Nexus 14:37 #449 78/750 (78/750) [256, 1840](8, 57)
19272 | 13:23 | DEBUG | Our bases changed from 2 to 3
19272 | 13:23 | DEBUG | Our mining bases changed from 1 to 2
19272 | 13:23 | DEBUG | Active tactics
  Was: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, Scour Mexic, ScoutExpansions, TacticGather
  Now: Raze Lago, ScoutExpansions, TacticGather, Withdraw Mexic
19368 | 13:27 | DEBUG | Safe defending changed from true to false
19368 | 13:27 | DEBUG | Active tactics
  Was: Raze Lago, ScoutExpansions, TacticGather, Withdraw Mexic
  Now: Raze Lago, Scour Mexic, ScoutExpansions, TacticGather
19392 | 13:28 | DEBUG | Safe defending changed from false to true
19392 | 13:28 | DEBUG | Active tactics
  Was: Raze Lago, Scour Mexic, ScoutExpansions, TacticGather
  Now: Raze Lago, ScoutExpansions, TacticGather, Withdraw Mexic
19416 | 13:29 | DEBUG | Safe defending changed from true to false
19440 | 13:30 | DEBUG | Safe defending changed from false to true
19464 | 13:31 | DEBUG | Active tactics
  Was: Raze Lago, ScoutExpansions, TacticGather, Withdraw Mexic
  Now: Raze Lago, Scour Mexic, ScoutExpansions, TacticGather
19488 | 13:32 | DEBUG | Active tactics
  Was: Raze Lago, Scour Mexic, ScoutExpansions, TacticGather
  Now: Raze Lago, ScoutExpansions, TacticGather, Withdraw Mexic
19608 | 13:37 | DEBUG | Safe defending changed from true to false
19608 | 13:37 | DEBUG | Active tactics
  Was: Raze Lago, ScoutExpansions, TacticGather, Withdraw Mexic
  Now: Raze Lago, Scour Mexic, ScoutExpansions, TacticGather
19752 | 13:43 | DEBUG | Active tactics
  Was: Raze Lago, Scour Mexic, ScoutExpansions, TacticGather
  Now: Raze Lago, ScoutExpansions, TacticGather, Withdraw Mexic
19872 | 13:48 | DEBUG | Active tactics
  Was: Raze Lago, ScoutExpansions, TacticGather, Withdraw Mexic
  Now: Raze Lago, Scour Mexic, ScoutExpansions, TacticGather
19896 | 13:49 | DEBUG | Our upgrades
  Was: Protoss Ground Weapons = 1, Singularity Charge = 1
  Now: Protoss Ground Armor = 1, Protoss Ground Weapons = 1, Singularity Charge = 1
19896 | 13:49 | DEBUG | Safe defending changed from false to true
19968 | 13:52 | DEBUG | Active tactics
  Was: Raze Lago, Scour Mexic, ScoutExpansions, TacticGather
  Now: Raze Lago, ScoutExpansions, TacticGather
20112 | 13:58 | DEBUG | Active tactics
  Was: Raze Lago, ScoutExpansions, TacticGather
  Now: Raze Lago, ScoutExpansions, TacticGather, Withdraw Jakar
20256 | 14:04 | DEBUG | Active tactics
  Was: Raze Lago, ScoutExpansions, TacticGather, Withdraw Jakar
  Now: Raze Lago, Scour Jakar, ScoutExpansions, TacticGather
20280 | 14:05 | DEBUG | Enemy upgrades
  Was: Grooved Spines = 1, Metabolic Boost = 1, Muscular Augments = 1, Zerg Carapace = 1, Zerg Missile Attacks = 1
  Now: Grooved Spines = 1, Metabolic Boost = 1, Muscular Augments = 1, Pneumatized Carapace = 1, Zerg Carapace = 1, Zerg Missile Attacks = 1
20400 | 14:10 | DEBUG | Safe defending changed from true to false
20448 | 14:12 | DEBUG | Active tactics
  Was: Raze Lago, Scour Jakar, ScoutExpansions, TacticGather
  Now: Raze Lago, ScoutExpansions, TacticGather, Withdraw Jakar
20592 | 14:18 | DEBUG | Active tactics
  Was: Raze Lago, ScoutExpansions, TacticGather, Withdraw Jakar
  Now: Raze Lago, ScoutExpansions, TacticGather, Withdraw Mexic
20664 | 14:21 | DEBUG | Active tactics
  Was: Raze Lago, ScoutExpansions, TacticGather, Withdraw Mexic
  Now: Raze Lago, ScoutExpansions, TacticGather, Withdraw Jakar
20688 | 14:22 | DEBUG | Active tactics
  Was: Raze Lago, ScoutExpansions, TacticGather, Withdraw Jakar
  Now: Raze Lago, Scour Mexic, ScoutExpansions, TacticGather
20928 | 14:32 | DEBUG | Active tactics
  Was: Raze Lago, Scour Mexic, ScoutExpansions, TacticGather
  Now: Raze Lago, Scour Jakar, ScoutExpansions, TacticGather
20952 | 14:33 | DEBUG | Active tactics
  Was: Raze Lago, Scour Jakar, ScoutExpansions, TacticGather
  Now: Raze Lago, ScoutExpansions, TacticGather, Withdraw Jakar
21540 | 14:57 | DEBUG | Detecting absent base: ? Neutral base Jakarta, Belgium [4, 57]
21552 | 14:58 | DEBUG | Our bases changed from 3 to 2
21552 | 14:58 | DEBUG | Our mining bases changed from 2 to 1
21552 | 14:58 | DEBUG | Active tactics
  Was: Raze Lago, ScoutExpansions, TacticGather, Withdraw Jakar
  Now: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather
21600 | 15:00 | DEBUG | Storyteller moving to more intermittent updates
22080 | 15:20 | DEBUG | Active tactics
  Was: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather
  Now: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather, Withdraw Mexic
22320 | 15:30 | DEBUG | Active tactics
  Was: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather, Withdraw Mexic
  Now: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather, Withdraw Shenz
22413 | 15:33 | DEBUG | Detecting ownership of base from visible town hall: Our Nexus 16:48 #538 77/750 (77/750) [256, 1840](8, 57)
22560 | 15:40 | DEBUG | Our bases changed from 2 to 3
22560 | 15:40 | DEBUG | Our mining bases changed from 1 to 2
22560 | 15:40 | DEBUG | Safe pushing changed from true to false
22560 | 15:40 | DEBUG | Active tactics
  Was: ClearExpansionBlockers, ClearExpansionBlockers, Raze Lago, ScoutExpansions, TacticGather, Withdraw Shenz
  Now: Raze Lago, Scour Mexic, ScoutExpansions, TacticGather
22621 | 15:42 | DEBUG | Substituting Guard arc from [1323, 548](41, 17) to [1263, 463](39, 14) because that results in 4/5.6000000000000005 > 5.6000000000000005/5.6000000000000005 slots
22631 | 15:42 | DEBUG | Substituting Guard arc from [1323, 548](41, 17) to [1263, 463](39, 14) because that results in 6/5.6000000000000005 > 5.6000000000000005/5.6000000000000005 slots
22800 | 15:50 | DEBUG | Safe pushing changed from false to true
22800 | 15:50 | DEBUG | Active tactics
  Was: Raze Lago, Scour Mexic, ScoutExpansions, TacticGather
  Now: Raze Lago, ScoutExpansions, TacticGather, Withdraw Shenz
23013 | 15:58 | DEBUG | Substituting Guard arc from [1323, 548](41, 17) to [1007, 239](31, 7) because that results in 1/3.2 > 3.2/3.2 slots
23029 | 15:59 | DEBUG | Substituting Guard arc from [1323, 548](41, 17) to [1007, 271](31, 8) because that results in 2/3.2 > 3.2/3.2 slots
23031 | 15:59 | DEBUG | Substituting Guard arc from [1323, 548](41, 17) to [1007, 271](31, 8) because that results in 2/3.2 > 3.2/3.2 slots
23040 | 16:00 | DEBUG | Substituting Guard arc from [1323, 548](41, 17) to [1007, 271](31, 8) because that results in 2/3.2 > 3.2/3.2 slots
23040 | 16:00 | DEBUG | Active tactics
  Was: Raze Lago, ScoutExpansions, TacticGather, Withdraw Shenz
  Now: Raze Lago, Scour Mexic, ScoutExpansions, TacticGather
23041 | 16:00 | DEBUG | Substituting Guard arc from [1323, 548](41, 17) to [1007, 271](31, 8) because that results in 2/3.2 > 3.2/3.2 slots
23060 | 16:00 | DEBUG | Substituting Guard arc from [1323, 548](41, 17) to [1007, 303](31, 9) because that results in 1/3.2 > 3.2/3.2 slots
23061 | 16:00 | DEBUG | Substituting Guard arc from [1323, 548](41, 17) to [1007, 303](31, 9) because that results in 1/3.2 > 3.2/3.2 slots
23069 | 16:01 | DEBUG | Substituting Guard arc from [1323, 548](41, 17) to [1007, 303](31, 9) because that results in 1/3.2 > 3.2/3.2 slots
23070 | 16:01 | DEBUG | Substituting Guard arc from [1323, 548](41, 17) to [975, 303](30, 9) because that results in 5/3.2 > 3.2/3.2 slots
23078 | 16:01 | DEBUG | Substituting Guard arc from [1323, 548](41, 17) to [1007, 303](31, 9) because that results in 3/3.2 > 3.2/3.2 slots
23079 | 16:01 | DEBUG | Substituting Guard arc from [1323, 548](41, 17) to [1007, 303](31, 9) because that results in 3/3.2 > 3.2/3.2 slots
23105 | 16:02 | DEBUG | Substituting Guard arc from [1323, 548](41, 17) to [1007, 239](31, 7) because that results in 4/3.2 > 3.2/3.2 slots
23106 | 16:02 | DEBUG | Substituting Guard arc from [1323, 548](41, 17) to [1007, 239](31, 7) because that results in 4/3.2 > 3.2/3.2 slots
23114 | 16:03 | DEBUG | Substituting Guard arc from [1323, 548](41, 17) to [1007, 239](31, 7) because that results in 4/3.2 > 3.2/3.2 slots
23115 | 16:03 | DEBUG | Substituting Guard arc from [1323, 548](41, 17) to [1007, 239](31, 7) because that results in 4/3.2 > 3.2/3.2 slots
23124 | 16:03 | DEBUG | Substituting Guard arc from [1323, 548](41, 17) to [1039, 239](32, 7) because that results in 4/3.2 > 3.2/3.2 slots
23125 | 16:03 | DEBUG | Substituting Guard arc from [1323, 548](41, 17) to [1039, 239](32, 7) because that results in 4/3.2 > 3.2/3.2 slots
23134 | 16:03 | DEBUG | Substituting Guard arc from [1323, 548](41, 17) to [1039, 239](32, 7) because that results in 4/3.2 > 3.2/3.2 slots
23135 | 16:03 | DEBUG | Substituting Guard arc from [1323, 548](41, 17) to [1039, 239](32, 7) because that results in 4/3.2 > 3.2/3.2 slots
23143 | 16:04 | DEBUG | Substituting Guard arc from [1323, 548](41, 17) to [1039, 239](32, 7) because that results in 3/3.2 > 3.2/3.2 slots
23144 | 16:04 | DEBUG | Substituting Guard arc from [1323, 548](41, 17) to [1039, 239](32, 7) because that results in 3/3.2 > 3.2/3.2 slots
23152 | 16:04 | DEBUG | Substituting Guard arc from [1323, 548](41, 17) to [1039, 239](32, 7) because that results in 3/3.2 > 3.2/3.2 slots
23196 | 16:06 | DEBUG | Wall clock: 3 minutes elapsed. Checkpoint game speed: 4.69x. Total game speed: 5.37x
23760 | 16:30 | DEBUG | Enemy upgrades
  Was: Grooved Spines = 1, Metabolic Boost = 1, Muscular Augments = 1, Pneumatized Carapace = 1, Zerg Carapace = 1, Zerg Missile Attacks = 1
  Now: Grooved Spines = 1, Metabolic Boost = 1, Muscular Augments = 1, Pneumatized Carapace = 1, Zerg Carapace = 2, Zerg Missile Attacks = 1
23760 | 16:30 | DEBUG | Safe pushing changed from true to false
23760 | 16:30 | DEBUG | Want to harass changed from false to true
23760 | 16:30 | DEBUG | Status
  Was: PvR2Gate4Gate, Attack
  Now: YOLO: Desperation, PvR2Gate4Gate, Attack, YOLO: Desperation
23760 | 16:30 | DEBUG | Active tactics
  Was: Raze Lago, Scour Mexic, ScoutExpansions, TacticGather
  Now: AllIn Lago, Scour Mexic, ScoutExpansions, TacticGather
23853 | 16:33 | DEBUG | Detecting absent base: ? Our natural Mexico City, Brazil, Borneo  [35, 4]
24000 | 16:40 | DEBUG | Our bases changed from 3 to 2
24000 | 16:40 | DEBUG | Our mining bases changed from 2 to 1
24000 | 16:40 | DEBUG | Enemy upgrades
  Was: Grooved Spines = 1, Metabolic Boost = 1, Muscular Augments = 1, Pneumatized Carapace = 1, Zerg Carapace = 2, Zerg Missile Attacks = 1
  Now: Grooved Spines = 1, Metabolic Boost = 1, Muscular Augments = 1, Pneumatized Carapace = 1, Zerg Carapace = 2, Zerg Melee Attacks = 1, Zerg Missile Attacks = 1
24149 | 16:46 | DEBUG | Detecting absent base: ? Our main Moscow, Senegal, Borneo  [5, 8]
24231 | 16:49 | DEBUG | Detecting ownership of base from visible town hall: Foe Hatchery #307 1250/1250  [3840, 2256](120, 70)
24240 | 16:50 | DEBUG | Our bases changed from 2 to 1
24240 | 16:50 | DEBUG | Enemy bases changed from 2 to 3
24240 | 16:50 | DEBUG | Enemy mining bases changed from 2 to 3
24240 | 16:50 | DEBUG | Enemy max mining changed from 2 to 3
24240 | 16:50 | DEBUG | Enemy Hatcheries changed from 4 to 5
24240 | 16:50 | DEBUG | Safe skirmishing changed from true to false
24240 | 16:50 | DEBUG | Skirmish > Defense changed from true to false
24240 | 16:50 | DEBUG | Active tactics
  Was: AllIn Lago, Scour Mexic, ScoutExpansions, TacticGather
  Now: AllIn Lago, ScoutExpansions, TacticGather
24533 | 17:02 | DEBUG | Assuming Microwave owns ? Enemy main Karachi, Ukraine, America  [122, 117] last scouted at 18594 due to presence of Some(Foe Extractor #146 750/750  [3808, 3584](119, 112))
24720 | 17:10 | DEBUG | Enemy bases changed from 3 to 4
24720 | 17:10 | DEBUG | Enemy mining bases changed from 3 to 4
24720 | 17:10 | DEBUG | Enemy max mining changed from 3 to 4
24894 | 17:17 | DEBUG | Detecting absent base: ? Our main Jakarta, Belgium [4, 57]
24960 | 17:20 | DEBUG | Our bases changed from 1 to 0
24960 | 17:20 | DEBUG | Our mining bases changed from 1 to 0
24960 | 17:20 | DEBUG | Our Gateways changed from 4 to 2
25050 | 17:23 | DEBUG | Game ended in defeat
25050 | 17:23 | DEBUG | Found C:\TM\Starcraft\bwapi-data\read\accelerants-polypoid.json
25050 | 17:23 | DEBUG | Supply block: 0%
25050 | 17:23 | DEBUG | Game duration (fastest):    17m 23s
25050 | 17:23 | DEBUG | Game duration (wall clock): 3m 14s
25050 | 17:23 | DEBUG | 
Bot frames over 35ms: 4
Bot frames over 1000ms: 0
Bot frames over 10000ms: 0
25050 | 17:23 | DEBUG | The bot believes its performance, if it were running synchronously, would have been good
25050 | 17:23 | DEBUG | Performance metrics:
Frame duration: After receiving 'frame ready' -> before sending 'frame done':
25,050 samples averaging 6.3 [1.2 - 327.1]
>= 5: 14906 samples averaging 8
>= 10: 2872 samples averaging 12.5
>= 15: 325 samples averaging 18.9
>= 20: 58 samples averaging 29.2
>= 25: 17 samples averaging 46.7
>= 30: 10 samples averaging 60.6
>= 35: 2 samples averaging 181.1
>= 40: 1 samples averaging 327.1
>= 45: 1 samples averaging 327.1
>= 50: 1 samples averaging 327.1
>= 55: 1 samples averaging 327.1
>= 85: 1 samples averaging 327.1
Frame duration: After receiving 'frame ready' -> after sending 'frame done':
25,050 samples averaging 6.3 [1.2 - 327.1]
>= 5: 14956 samples averaging 8
>= 10: 2887 samples averaging 12.5
>= 15: 328 samples averaging 18.9
>= 20: 58 samples averaging 29.2
>= 25: 17 samples averaging 46.7
>= 30: 10 samples averaging 60.6
>= 35: 2 samples averaging 181.1
>= 40: 1 samples averaging 327.1
>= 45: 1 samples averaging 327.1
>= 50: 1 samples averaging 327.1
>= 55: 1 samples averaging 327.1
>= 85: 1 samples averaging 327.1
Frame duration: After receiving 'frame ready' -> receiving next 'frame ready':
25,050 samples averaging 7.6 [2.1 - 328.9]
>= 5: 19695 samples averaging 8.5
>= 10: 5015 samples averaging 12.7
>= 15: 658 samples averaging 18.2
>= 20: 95 samples averaging 27
>= 25: 27 samples averaging 40
>= 30: 11 samples averaging 59.5
>= 35: 2 samples averaging 182.9
>= 40: 1 samples averaging 328.9
>= 45: 1 samples averaging 328.9
>= 50: 1 samples averaging 328.9
>= 55: 1 samples averaging 328.9
>= 85: 1 samples averaging 328.9
BWAPI duration: Before sending 'frame done' -> After receiving 'frame ready':
25,050 samples averaging 1.3 [0 - 14.2]
>= 1: 20946 samples averaging 1.4
>= 3: 129 samples averaging 4.5
>= 5: 27 samples averaging 8.6
>= 10: 3 samples averaging 12.7
BWAPI duration: Before sending 'frame done' -> After sending 'frame done':
25,050 samples averaging 0 [0 - 0.5]
BWAPI duration: Before listening for 'frame ready' -> After receiving 'frame ready':
25,050 samples averaging 1.3 [0 - 14.1]
>= 1: 20625 samples averaging 1.4
>= 3: 121 samples averaging 4.5
>= 5: 27 samples averaging 8.6
>= 10: 3 samples averaging 12.7
Copying frame to buffer:
25,050 samples averaging 1.2 [0.7 - 9]
>= 5: 1 samples averaging 9
Time holding frame until buffer frees capacity: No samples.
Frames already buffered when enqueuing a new frame:
25,051 samples averaging 0 [0 - 1]
>= 0: 25051 samples averaging 0
>= 1: 3 samples averaging 1
Frames behind real-time when handling events:
25,051 samples averaging 0 [0 - 0]
>= 0: 25051 samples averaging 0
Time flushing side effects:
25,051 samples averaging 0 [0 - 8.4]
>= 1: 1 samples averaging 8.4
>= 3: 1 samples averaging 8.4
>= 5: 1 samples averaging 8.4
Duration of bot event handlers:
25,049 samples averaging 6.2 [0.7 - 330.3]
>= 5: 14545 samples averaging 8
>= 10: 2746 samples averaging 12.5
>= 15: 303 samples averaging 19.1
>= 20: 49 samples averaging 31.3
>= 25: 14 samples averaging 54.3
>= 30: 7 samples averaging 81.6
>= 35: 3 samples averaging 148
>= 40: 3 samples averaging 148
>= 45: 3 samples averaging 148
>= 50: 3 samples averaging 148
>= 55: 2 samples averaging 194.6
>= 85: 1 samples averaging 330.3
Time bot spent idle:
25,051 samples averaging 1.4 [0 - 14.2]
Time client spent waiting for bot:
25,050 samples averaging 5.1 [0 - 326.2]
>= 30: 1 samples averaging 326.2
Excess duration of client sleep:
25,050 samples averaging 0 [0 - 297]
>= 1: 3 samples averaging 101
>= 5: 2 samples averaging 151
>= 10: 1 samples averaging 297
>= 15: 1 samples averaging 297
>= 20: 1 samples averaging 297
>= 25: 1 samples averaging 297
>= 30: 1 samples averaging 297
>= 35: 1 samples averaging 297
>= 40: 1 samples averaging 297
>= 45: 1 samples averaging 297
>= 50: 1 samples averaging 297
>= 55: 1 samples averaging 297
>= 85: 1 samples averaging 297
Number of events received from BWAPI:
25,050 samples averaging 1.3 [0 - 132]
>= 1: 25042 samples averaging 1.3
>= 2: 2668 samples averaging 4.1
>= 3: 2509 samples averaging 4.2
>= 4: 1032 samples averaging 6
>= 5: 485 samples averaging 8.3
>= 6: 256 samples averaging 11.2
>= 8: 124 samples averaging 16.1
>= 10: 88 samples averaging 19.1
>= 15: 48 samples averaging 25.2
>= 20: 26 samples averaging 32.1
Number of events received from BWAPI, multiplied by the receive-to-sent duration of that frame:
25,050 samples averaging 8.7 [0 - 1,654.8]
>= 5: 15661 samples averaging 11.7
>= 10: 4960 samples averaging 22.1
>= 15: 2371 samples averaging 33.3
>= 20: 1624 samples averaging 40.7
>= 25: 1154 samples averaging 48.2
>= 30: 832 samples averaging 56.2
>= 35: 588 samples averaging 66.1
>= 40: 435 samples averaging 76.2
>= 45: 322 samples averaging 88.1
>= 50: 251 samples averaging 99.6
>= 55: 196 samples averaging 112.8
>= 85: 77 samples averaging 185.6
25050 | 17:23 | DEBUG | Target:                      35ms   Cutoff: 35ms 
Task                         Runs   Seconds %Time Budgt (Recnt) Avg ms Max (Rcnt) Max (All time) AcrossTarget AcrossLimit
Global                       25051  138     72%   34            5      24         330            3            3          
Planning                     25050  41      21%   1             1      15         328            3            3          
Tactician                    9732   27      14%   9             8      15         53             2            2          
Squads                       9732   13      7%    9             6      14         46             2            2          
Gathering                    9731   2       1%    3             0      0          327            1            1          
Micro                        25051  49      26%   32            0      1          29             0            0          
Agency                       25051  49      26%   32            0      1          29             0            0          
Battles                      25051  20      10%   33            0      2          13             0            0          
Grids                        25050  11      5%    0             1      8          12             0            0          
Gameplan                     9732   10      5%    4             0      1          12             0            0          
BattleProcessJudge           67911  6       3%    28            0      0          11             0            0          
Geography                    8985   5       2%    1             0      1          9              0            0          
BattleProcessPredict         67912  4       2%    29            0      0          9              0            0          
Intel                        25050  4       2%    0             0      1          9              0            0          
BattleProcessDivisions       11981  4       2%    33            0      1          10             0            0          
Fingerprinting               25050  3       1%    1             0      1          8              0            0          
GameSensor                   7652   2       1%    1             0      1          9              0            0          
Scouting                     7653   2       1%    1             0      1          7              0            0          
BattleProcessCluster         11981  2       1%    33            0      1          4              0            0          
BattleProcessSwap            11980  1       0%    32            0      1          8              0            0          
Yolo                         24678  0       0%    2             0      0          1              0            0          
UnitsShown                   9732   0       0%    3             0      0          10             0            0          
&9Pool                       16299  0       0%    1             0      0          5              0            0          
&1HatchMuta                  16299  0       0%    1             0      0          1              0            0          
&2HatchMuta                  16299  0       0%    1             0      0          6              0            0          
Accounting                   9732   0       0%    3             0      0          1              0            0          
&WorkerRush                  16299  0       0%    1             0      0          1              0            0          
&3HatchMuta                  16299  0       0%    1             0      0          6              0            0          
&4Pool                       16299  0       0%    1             0      0          1              0            0          
ProductionHistory            9732   0       0%    4             0      0          1              0            0          
&12Hatch                     16299  0       0%    1             0      0          1              0            0          
&3HatchGas                   16299  0       0%    1             0      0          4              0            0          
&2HatchGas                   16299  0       0%    1             0      0          1              0            0          
&OverpoolGas                 16299  0       0%    1             0      0          6              0            0          
BattleProcessMatchupAnalysis 687356 0       0%    27            0      0          1              0            0          
&1HatchGas                   16299  0       0%    1             0      0          1              0            0          
&12Hatch11Pool10Gas          16299  0       0%    1             0      0          8              0            0          
&Overpool                    16299  0       0%    1             0      0          1              0            0          
&12Pool11Gas                 16299  0       0%    1             0      0          1              0            0          
&10Hatch9Pool8Gas            16299  0       0%    1             0      0          1              0            0          
&2HatchMain                  16299  0       0%    1             0      0          1              0            0          
&12Pool                      16299  0       0%    1             0      0          1              0            0          
&9PoolHatch                  16299  0       0%    1             0      0          1              0            0          
&10Hatch                     16299  0       0%    1             0      0          1              0            0          
&OverpoolHatch               16299  0       0%    1             0      0          1              0            0          
&GasSteal                    16299  0       0%    1             0      0          1              0            0          
&12Hatch11Pool               16299  0       0%    1             0      0          1              0            0          
&ZerglingOnly                16299  0       0%    1             0      0          1              0            0          
&12Hatch11Pool13Hatch        16299  0       0%    1             0      1          1              0            0          
BattleProcessComplete        11980  0       0%    33            0      0          1              0            0          
&RampBlock                   16299  0       0%    1             0      0          1              0            0          
Manners                      24835  0       0%    2             0      0          1              0            0          
BattleProcessInitial         11981  0       0%    33            0      0          1              0            0          
&9PoolGas                    16299  0       0%    1             0      0          1              0            0          
&10Hatch9Pool                16299  0       0%    1             0      0          1              0            0          
MatchupGraph                 1      0       0%    345678        2      2          0              0            0          
Camera                       0      0       0%    0             0      0          0              0            0          
Visualization                0      0       0%    0             0      0          0              0            0          
25050 | 17:23 | DEBUG | Actions:
Action              Invocations Mean (ms) Total (secs)
Search              1509        0.125     0           
Retreat             26876       0.124     3           
PreserveScout       1509        0.094     0           
SearchWhenBored     1790        0.058     0           
Idle                773170      0.045     34          
Fight               773171      0.027     21          
KnockKnock          1509        0.02      0           
Spot                99757       0.014     1           
BlockConstruction   1509        0.009     0           
SabotageProxy       1509        0.008     0           
FightOrFlee         773171      0.007     5           
Gather              773178      0.005     4           
Brawl               29204       0.005     0           
Harass4PoolWorkers  1509        0.004     0           
Stim                99757       0.003     0           
Recharge            99757       0.002     0           
DroneWarfare        1509        0.001     0           
AttackBuilder       1509        0.001     0           
Stealth             99757       0.001     0           
Potshot             408297      0.001     0           
Build               773170      0.001     0           
Scout               773170      0.001     0           
Produce             773170      0.001     0           
BeFlier             99757       0         0           
Root                99757       0         0           
Crack               773170      0         0           
Bust                99757       0         0           
Cancel              773170      0         0           
Follow              99757       0         0           
OccupyBunker        99757       0         0           
BeCarrier           99757       0         0           
BeArbiter           99757       0         0           
Rally               773170      0         0           
BeCombatSCV         99757       0         0           
EmergencyBunk       99757       0         0           
BeVulture           99757       0         0           
Cast                99757       0         0           
StrategicNuke       99757       0         0           
BeMutalisk          99757       0         0           
BeReaver            99757       0         0           
Unstick             773170      0         0           
Unbunk              773170      0         0           
Liftoff             773170      0         0           
GetRepairedMobile   773170      0         0           
Transport           773170      0         0           
Meld                773170      0         0           
Repair              773170      0         0           
ReloadScarabs       773170      0         0           
Addon               773170      0         0           
GetRepairedBuilding 773170      0         0           
Attack              773170      0         0           
ReloadInterceptors  773170      0         0           
FinishConstruction  773170      0         0           
Bunk                773170      0         0           
Scan                773170      0         0           
Travel              773170      0         0           
25050 | 17:23 | DEBUG | Pathfinding:
A* pathfinds:         165198 
Exploration maxed:    613    
Over 1ms:             98     
Max ms:               11.0646
Mean ms:              0.027  
Path length, max:     103    
Path length, mean:    6.294  
Tiles explored, max:  1024   
Tiles explored, mean: 39     
25050 | 17:23 | DEBUG | JVM Max memory:   2138 MB
25050 | 17:23 | DEBUG | JVM Total memory: 2138 MB
25050 | 17:23 | DEBUG | JVM Free memory:  1781 MB
25050 | 17:23 | DEBUG | JVM Used memory:  356 MB
25050 | 17:23 | DEBUG | JVM Used, heap:   356 MB
25050 | 17:23 | DEBUG | Heap memory PS Survivor Space, current:          7 MB used | 89 MB init | 8 MB max | 8 MB committed
25050 | 17:23 | DEBUG | Heap memory PS Survivor Space, peak:             95 MB used | 89 MB init | 120 MB max | 120 MB committed
25050 | 17:23 | DEBUG | Non-heap memory Compressed Class Space, current: 8 MB used | 0 MB init | 1073 MB max | 8 MB committed
25050 | 17:23 | DEBUG | Non-heap memory Compressed Class Space, peak:    8 MB used | 0 MB init | 1073 MB max | 8 MB committed
25050 | 17:23 | DEBUG | Heap memory PS Eden Space, current:              41 MB used | 537 MB init | 697 MB max | 697 MB committed
25050 | 17:23 | DEBUG | Heap memory PS Eden Space, peak:                 705 MB used | 537 MB init | 705 MB max | 705 MB committed
25050 | 17:23 | DEBUG | Non-heap memory Metaspace, current:              55 MB used | 0 MB init | 0 MB max | 67 MB committed
25050 | 17:23 | DEBUG | Non-heap memory Metaspace, peak:                 55 MB used | 0 MB init | 0 MB max | 67 MB committed
25050 | 17:23 | DEBUG | Non-heap memory Code Cache, current:             60 MB used | 2 MB init | 251 MB max | 61 MB committed
25050 | 17:23 | DEBUG | Non-heap memory Code Cache, peak:                60 MB used | 2 MB init | 251 MB max | 61 MB committed
25050 | 17:23 | DEBUG | Heap memory PS Old Gen, current:                 307 MB used | 1431 MB init | 1431 MB max | 1431 MB committed
25050 | 17:23 | DEBUG | Heap memory PS Old Gen, peak:                    307 MB used | 1431 MB init | 1431 MB max | 1431 MB committed3350 | 2:19 | SPEED | Squads crossed 35ms taking 46ms on a 2ms budget (2ms avg budget), reaching 58ms on the frame.
3350 | 2:19 | SPEED | Global crossed 35ms to 58ms. Task durations: (3ms: Planning) (1ms: Battles) (1ms: Micro) (0ms: Yolo) (0ms: Manners) (0ms: Grids) (0ms: Intel) (0ms: Fingerprinting)
4715 | 3:16 | SPEED | Gathering crossed 35ms taking 327ms on a 2ms budget (1ms avg budget), reaching 329ms on the frame.
4715 | 3:16 | SPEED | Global crossed 35ms to 330ms. Task durations: (3ms: Planning) (1ms: Micro) (0ms: Yolo) (0ms: Battles) (0ms: Manners) (0ms: Intel) (0ms: Fingerprinting) (0ms: Grids)
22621 | 15:42 | SPEED | Squads crossed 35ms taking 45ms on a 6ms budget (6ms avg budget), reaching 55ms on the frame.
22621 | 15:42 | SPEED | Global crossed 35ms to 55ms. Task durations: (2ms: Micro) (1ms: Fingerprinting) (0ms: Yolo) (0ms: Battles) (0ms: Manners) (0ms: Intel) (0ms: Planning) (0ms: Grids)