[05:35:04.091] New invocation is queued and will start shortly
[05:35:05.209] Starting the invocation (attempt 1)
[05:35:05.253] Preparing PubSub topic for "https://cr-buildbucket-dev.appspot.com"
[05:35:05.253] PubSub topic is "projects/luci-scheduler-dev/topics/scheduler.buildbucket.cr-buildbucket-dev~appspot.gserviceaccount.com"
[05:35:05.254] Buildbucket request:
{
"bucket": "luci.infra.ci",
"client_operation_id": "9029926432949299552",
"parameters_json": "{\"builder_name\":\"infra-continuous-win10-64\",\"properties\":{\"$recipe_engine/scheduler\":{\"hostname\":\"luci-scheduler-dev.appspot.com\",\"triggers\":[{\"gitiles\":{\"ref\":\"refs/heads/master\",\"repo\":\"https://chromium.googlesource.com/infra/infra\",\"revision\":\"4d3a56617e7954a078629ed2bfd429b253877ff0\"},\"id\":\"https://chromium.googlesource.com/infra/infra/+/refs/heads/master@4d3a56617e7954a078629ed2bfd429b253877ff0\",\"title\":\"4d3a56617e7954a078629ed2bfd429b253877ff0\",\"url\":\"https://chromium.googlesource.com/infra/infra/+/4d3a56617e7954a078629ed2bfd429b253877ff0\"},{\"gitiles\":{\"ref\":\"refs/heads/master\",\"repo\":\"https://chromium.googlesource.com/infra/infra\",\"revision\":\"ce378067a869c985b1e5a47e0882e1f18b4fb42c\"},\"id\":\"https://chromium.googlesource.com/infra/infra/+/refs/heads/master@ce378067a869c985b1e5a47e0882e1f18b4fb42c\",\"title\":\"ce378067a869c985b1e5a47e0882e1f18b4fb42c\",\"url\":\"https://chromium.googlesource.com/infra/infra/+/ce378067a869c985b1e5a47e0882e1f18b4fb42c\"},{\"gitiles\":{\"ref\":\"refs/heads/master\",\"repo\":\"https://chromium.googlesource.com/infra/infra\",\"revision\":\"707f57f3f0f945c35aec6c8318521002cb75516b\"},\"id\":\"https://chromium.googlesource.com/infra/infra/+/refs/heads/master@707f57f3f0f945c35aec6c8318521002cb75516b\",\"title\":\"707f57f3f0f945c35aec6c8318521002cb75516b\",\"url\":\"https://chromium.googlesource.com/infra/infra/+/707f57f3f0f945c35aec6c8318521002cb75516b\"},{\"gitiles\":{\"ref\":\"refs/heads/master\",\"repo\":\"https://chromium.googlesource.com/infra/infra\",\"revision\":\"31ccadbadb0a704cb5c0e99de538c20a8794a3e4\"},\"id\":\"https://chromium.googlesource.com/infra/infra/+/refs/heads/master@31ccadbadb0a704cb5c0e99de538c20a8794a3e4\",\"title\":\"31ccadbadb0a704cb5c0e99de538c20a8794a3e4\",\"url\":\"https://chromium.googlesource.com/infra/infra/+/31ccadbadb0a704cb5c0e99de538c20a8794a3e4\"},{\"gitiles\":{\"ref\":\"refs/heads/master\",\"repo\":\"https://chromium.googlesource.com/infra/infra\",\"revision\":\"8d2e70531b763883abb23ece7ad385a3b136ce06\"},\"id\":\"https://chromium.googlesource.com/infra/infra/+/refs/heads/master@8d2e70531b763883abb23ece7ad385a3b136ce06\",\"title\":\"8d2e70531b763883abb23ece7ad385a3b136ce06\",\"url\":\"https://chromium.googlesource.com/infra/infra/+/8d2e70531b763883abb23ece7ad385a3b136ce06\"},{\"gitiles\":{\"ref\":\"refs/heads/master\",\"repo\":\"https://chromium.googlesource.com/infra/infra\",\"revision\":\"db851204b3a503e947d0de611c4a9afa8d9e48b6\"},\"id\":\"https://chromium.googlesource.com/infra/infra/+/refs/heads/master@db851204b3a503e947d0de611c4a9afa8d9e48b6\",\"title\":\"db851204b3a503e947d0de611c4a9afa8d9e48b6\",\"url\":\"https://chromium.googlesource.com/infra/infra/+/db851204b3a503e947d0de611c4a9afa8d9e48b6\"},{\"gitiles\":{\"ref\":\"refs/heads/master\",\"repo\":\"https://chromium.googlesource.com/infra/infra\",\"revision\":\"71da57380d00a2bf4a2edec291a106edbdf83603\"},\"id\":\"https://chromium.googlesource.com/infra/infra/+/refs/heads/master@71da57380d00a2bf4a2edec291a106edbdf83603\",\"title\":\"71da57380d00a2bf4a2edec291a106edbdf83603\",\"url\":\"https://chromium.googlesource.com/infra/infra/+/71da57380d00a2bf4a2edec291a106edbdf83603\"},{\"gitiles\":{\"ref\":\"refs/heads/master\",\"repo\":\"https://chromium.googlesource.com/infra/infra\",\"revision\":\"438bbccfb5e0b3e33d7f985147535eebe6f7a034\"},\"id\":\"https://chromium.googlesource.com/infra/infra/+/refs/heads/master@438bbccfb5e0b3e33d7f985147535eebe6f7a034\",\"title\":\"438bbccfb5e0b3e33d7f985147535eebe6f7a034\",\"url\":\"https://chromium.googlesource.com/infra/infra/+/438bbccfb5e0b3e33d7f985147535eebe6f7a034\"},{\"gitiles\":{\"ref\":\"refs/heads/master\",\"repo\":\"https://chromium.googlesource.com/infra/infra\",\"revision\":\"49542f8db293ff58100d25995e29ddc096fb25e5\"},\"id\":\"https://chromium.googlesource.com/infra/infra/+/refs/heads/master@49542f8db293ff58100d25995e29ddc096fb25e5\",\"title\":\"49542f8db293ff58100d25995e29ddc096fb25e5\",\"url\":\"https://chromium.googlesource.com/infra/infra/+/49542f8db293ff58100d25995e29ddc096fb25e5\"}]},\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/infra/infra\",\"revision\":\"49542f8db293ff58100d25995e29ddc096fb25e5\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler-dev/topics/scheduler.buildbucket.cr-buildbucket-dev~appspot.gserviceaccount.com"
},
"tags": [
"builder:infra-continuous-win10-64",
"scheduler_invocation_id:9029926432949299552",
"scheduler_job_id:infra/infra-continuous-win10-64",
"user_agent:luci-scheduler-dev",
"buildset:commit/git/49542f8db293ff58100d25995e29ddc096fb25e5",
"buildset:commit/gitiles/chromium.googlesource.com/infra/infra/+/49542f8db293ff58100d25995e29ddc096fb25e5",
"gitiles_ref:refs/heads/master"
]
}
[05:35:06.147] Buildbucket response:
{
"build": {
"bucket": "luci.infra.ci",
"canary_preference": "PROD",
"created_by": "project:infra",
"created_ts": "1604554505367694",
"id": "8864496370939038368",
"parameters_json": "{\"builder_name\": \"infra-continuous-win10-64\", \"properties\": {\"$recipe_engine/scheduler\": {\"hostname\": \"luci-scheduler-dev.appspot.com\", \"triggers\": [{\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://chromium.googlesource.com/infra/infra\", \"revision\": \"4d3a56617e7954a078629ed2bfd429b253877ff0\"}, \"id\": \"https://chromium.googlesource.com/infra/infra/+/refs/heads/master@4d3a56617e7954a078629ed2bfd429b253877ff0\", \"title\": \"4d3a56617e7954a078629ed2bfd429b253877ff0\", \"url\": \"https://chromium.googlesource.com/infra/infra/+/4d3a56617e7954a078629ed2bfd429b253877ff0\"}, {\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://chromium.googlesource.com/infra/infra\", \"revision\": \"ce378067a869c985b1e5a47e0882e1f18b4fb42c\"}, \"id\": \"https://chromium.googlesource.com/infra/infra/+/refs/heads/master@ce378067a869c985b1e5a47e0882e1f18b4fb42c\", \"title\": \"ce378067a869c985b1e5a47e0882e1f18b4fb42c\", \"url\": \"https://chromium.googlesource.com/infra/infra/+/ce378067a869c985b1e5a47e0882e1f18b4fb42c\"}, {\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://chromium.googlesource.com/infra/infra\", \"revision\": \"707f57f3f0f945c35aec6c8318521002cb75516b\"}, \"id\": \"https://chromium.googlesource.com/infra/infra/+/refs/heads/master@707f57f3f0f945c35aec6c8318521002cb75516b\", \"title\": \"707f57f3f0f945c35aec6c8318521002cb75516b\", \"url\": \"https://chromium.googlesource.com/infra/infra/+/707f57f3f0f945c35aec6c8318521002cb75516b\"}, {\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://chromium.googlesource.com/infra/infra\", \"revision\": \"31ccadbadb0a704cb5c0e99de538c20a8794a3e4\"}, \"id\": \"https://chromium.googlesource.com/infra/infra/+/refs/heads/master@31ccadbadb0a704cb5c0e99de538c20a8794a3e4\", \"title\": \"31ccadbadb0a704cb5c0e99de538c20a8794a3e4\", \"url\": \"https://chromium.googlesource.com/infra/infra/+/31ccadbadb0a704cb5c0e99de538c20a8794a3e4\"}, {\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://chromium.googlesource.com/infra/infra\", \"revision\": \"8d2e70531b763883abb23ece7ad385a3b136ce06\"}, \"id\": \"https://chromium.googlesource.com/infra/infra/+/refs/heads/master@8d2e70531b763883abb23ece7ad385a3b136ce06\", \"title\": \"8d2e70531b763883abb23ece7ad385a3b136ce06\", \"url\": \"https://chromium.googlesource.com/infra/infra/+/8d2e70531b763883abb23ece7ad385a3b136ce06\"}, {\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://chromium.googlesource.com/infra/infra\", \"revision\": \"db851204b3a503e947d0de611c4a9afa8d9e48b6\"}, \"id\": \"https://chromium.googlesource.com/infra/infra/+/refs/heads/master@db851204b3a503e947d0de611c4a9afa8d9e48b6\", \"title\": \"db851204b3a503e947d0de611c4a9afa8d9e48b6\", \"url\": \"https://chromium.googlesource.com/infra/infra/+/db851204b3a503e947d0de611c4a9afa8d9e48b6\"}, {\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://chromium.googlesource.com/infra/infra\", \"revision\": \"71da57380d00a2bf4a2edec291a106edbdf83603\"}, \"id\": \"https://chromium.googlesource.com/infra/infra/+/refs/heads/master@71da57380d00a2bf4a2edec291a106edbdf83603\", \"title\": \"71da57380d00a2bf4a2edec291a106edbdf83603\", \"url\": \"https://chromium.googlesource.com/infra/infra/+/71da57380d00a2bf4a2edec291a106edbdf83603\"}, {\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://chromium.googlesource.com/infra/infra\", \"revision\": \"438bbccfb5e0b3e33d7f985147535eebe6f7a034\"}, \"id\": \"https://chromium.googlesource.com/infra/infra/+/refs/heads/master@438bbccfb5e0b3e33d7f985147535eebe6f7a034\", \"title\": \"438bbccfb5e0b3e33d7f985147535eebe6f7a034\", \"url\": \"https://chromium.googlesource.com/infra/infra/+/438bbccfb5e0b3e33d7f985147535eebe6f7a034\"}, {\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://chromium.googlesource.com/infra/infra\", \"revision\": \"49542f8db293ff58100d25995e29ddc096fb25e5\"}, \"id\": \"https://chromium.googlesource.com/infra/infra/+/refs/heads/master@49542f8db293ff58100d25995e29ddc096fb25e5\", \"title\": \"49542f8db293ff58100d25995e29ddc096fb25e5\", \"url\": \"https://chromium.googlesource.com/infra/infra/+/49542f8db293ff58100d25995e29ddc096fb25e5\"}]}, \"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/infra/infra\", \"revision\": \"49542f8db293ff58100d25995e29ddc096fb25e5\"}}",
"project": "infra",
"result_details_json": "{\"properties\": {}}",
"service_account": "adhoc-testing@luci-token-server-dev.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1604554505898364",
"tags": [
"build_address:luci.infra.ci/infra-continuous-win10-64/17976",
"builder:infra-continuous-win10-64",
"buildset:commit/git/49542f8db293ff58100d25995e29ddc096fb25e5",
"buildset:commit/gitiles/chromium.googlesource.com/infra/infra/+/49542f8db293ff58100d25995e29ddc096fb25e5",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9029926432949299552",
"scheduler_job_id:infra/infra-continuous-win10-64",
"swarming_hostname:chromium-swarm-dev.appspot.com",
"swarming_tag:log_location:logdog://luci-logdog-dev.appspot.com/infra/buildbucket/cr-buildbucket-dev.appspot.com/8864496370939038368/+/annotations",
"swarming_tag:luci_project:infra",
"swarming_tag:recipe_name:infra_continuous",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/infra/infra",
"swarming_task_id:",
"user_agent:luci-scheduler-dev"
],
"updated_ts": "1604554505898550",
"url": "https://luci-milo-dev.appspot.com/b/8864496370939038368",
"utcnow_ts": "1604554506070584"
}
}
[05:35:06.147] Task URL: https://luci-milo-dev.appspot.com/b/8864496370939038368
[05:35:06.147] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:2:0) after 1m0s
[05:36:06.168] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:2:0)
[05:36:06.168] Timer tick, asking Buildbucket for the build status
[05:36:06.268] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:36:06.268] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:3:0) after 1m0s
[05:37:06.319] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:3:0)
[05:37:06.319] Timer tick, asking Buildbucket for the build status
[05:37:06.439] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:37:06.439] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:4:0) after 1m0s
[05:38:06.554] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:4:0)
[05:38:06.554] Timer tick, asking Buildbucket for the build status
[05:38:06.674] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:38:06.674] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:5:0) after 1m0s
[05:39:06.725] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:5:0)
[05:39:06.725] Timer tick, asking Buildbucket for the build status
[05:39:06.874] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:39:06.874] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:6:0) after 1m0s
[05:40:06.902] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:6:0)
[05:40:06.902] Timer tick, asking Buildbucket for the build status
[05:40:07.013] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:40:07.013] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:7:0) after 1m0s
[05:41:07.120] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:7:0)
[05:41:07.120] Timer tick, asking Buildbucket for the build status
[05:41:07.239] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:41:07.239] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:8:0) after 1m0s
[05:42:07.266] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:8:0)
[05:42:07.266] Timer tick, asking Buildbucket for the build status
[05:42:07.437] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:42:07.437] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:9:0) after 1m0s
[05:43:07.474] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:9:0)
[05:43:07.474] Timer tick, asking Buildbucket for the build status
[05:43:07.615] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:43:07.615] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:10:0) after 1m0s
[05:44:07.715] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:10:0)
[05:44:07.715] Timer tick, asking Buildbucket for the build status
[05:44:07.811] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:44:07.811] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:11:0) after 1m0s
[05:45:07.852] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:11:0)
[05:45:07.852] Timer tick, asking Buildbucket for the build status
[05:45:07.967] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:45:07.967] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:12:0) after 1m0s
[05:46:08.084] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:12:0)
[05:46:08.084] Timer tick, asking Buildbucket for the build status
[05:46:08.184] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:46:08.184] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:13:0) after 1m0s
[05:47:08.214] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:13:0)
[05:47:08.214] Timer tick, asking Buildbucket for the build status
[05:47:08.307] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:47:08.307] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:14:0) after 1m0s
[05:48:08.385] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:14:0)
[05:48:08.386] Timer tick, asking Buildbucket for the build status
[05:48:08.507] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:48:08.507] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:15:0) after 1m0s
[05:49:08.630] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:15:0)
[05:49:08.630] Timer tick, asking Buildbucket for the build status
[05:49:08.760] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:49:08.760] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:16:0) after 1m0s
[05:50:08.820] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:16:0)
[05:50:08.820] Timer tick, asking Buildbucket for the build status
[05:50:08.975] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:50:08.975] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:17:0) after 1m0s
[05:51:09.054] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:17:0)
[05:51:09.054] Timer tick, asking Buildbucket for the build status
[05:51:09.219] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:51:09.219] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:18:0) after 1m0s
[05:52:09.247] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:18:0)
[05:52:09.247] Timer tick, asking Buildbucket for the build status
[05:52:09.333] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:52:09.333] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:19:0) after 1m0s
[05:53:09.400] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:19:0)
[05:53:09.400] Timer tick, asking Buildbucket for the build status
[05:53:09.642] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:53:09.642] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:20:0) after 1m0s
[05:54:09.783] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:20:0)
[05:54:09.783] Timer tick, asking Buildbucket for the build status
[05:54:09.885] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:54:09.885] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:21:0) after 1m0s
[05:55:09.915] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:21:0)
[05:55:09.915] Timer tick, asking Buildbucket for the build status
[05:55:10.022] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:55:10.022] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:22:0) after 1m0s
[05:56:10.072] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:22:0)
[05:56:10.072] Timer tick, asking Buildbucket for the build status
[05:56:10.187] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:56:10.187] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:23:0) after 1m0s
[05:57:10.209] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:23:0)
[05:57:10.209] Timer tick, asking Buildbucket for the build status
[05:57:10.309] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:57:10.309] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:24:0) after 1m0s
[05:58:10.462] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:24:0)
[05:58:10.462] Timer tick, asking Buildbucket for the build status
[05:58:10.563] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:58:10.563] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:25:0) after 1m0s
[05:59:10.665] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:25:0)
[05:59:10.666] Timer tick, asking Buildbucket for the build status
[05:59:10.861] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:59:10.861] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:26:0) after 1m0s
[06:00:10.950] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:26:0)
[06:00:10.950] Timer tick, asking Buildbucket for the build status
[06:00:11.097] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:00:11.097] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:27:0) after 1m0s
[06:01:11.224] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:27:0)
[06:01:11.224] Timer tick, asking Buildbucket for the build status
[06:01:11.360] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:01:11.360] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:28:0) after 1m0s
[06:02:11.476] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:28:0)
[06:02:11.477] Timer tick, asking Buildbucket for the build status
[06:02:11.606] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:02:11.606] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:29:0) after 1m0s
[06:03:11.678] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:29:0)
[06:03:11.678] Timer tick, asking Buildbucket for the build status
[06:03:11.805] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:03:11.805] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:30:0) after 1m0s
[06:04:11.873] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:30:0)
[06:04:11.873] Timer tick, asking Buildbucket for the build status
[06:04:11.983] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:04:11.983] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:31:0) after 1m0s
[06:05:12.028] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:31:0)
[06:05:12.028] Timer tick, asking Buildbucket for the build status
[06:05:12.171] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:05:12.171] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:32:0) after 1m0s
[06:06:12.235] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:32:0)
[06:06:12.235] Timer tick, asking Buildbucket for the build status
[06:06:12.402] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:06:12.402] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:33:0) after 1m0s
[06:07:12.472] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:33:0)
[06:07:12.472] Timer tick, asking Buildbucket for the build status
[06:07:12.603] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:07:12.603] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:34:0) after 1m0s
[06:08:12.731] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:34:0)
[06:08:12.731] Timer tick, asking Buildbucket for the build status
[06:08:12.901] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:08:12.901] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:35:0) after 1m0s
[06:09:13.014] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:35:0)
[06:09:13.014] Timer tick, asking Buildbucket for the build status
[06:09:13.168] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:09:13.169] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:36:0) after 1m0s
[06:10:13.221] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:36:0)
[06:10:13.221] Timer tick, asking Buildbucket for the build status
[06:10:13.337] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:10:13.337] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:37:0) after 1m0s
[06:11:13.406] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:37:0)
[06:11:13.406] Timer tick, asking Buildbucket for the build status
[06:11:13.533] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:11:13.533] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:38:0) after 1m0s
[06:12:13.622] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:38:0)
[06:12:13.622] Timer tick, asking Buildbucket for the build status
[06:12:13.751] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:12:13.751] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:39:0) after 1m0s
[06:13:13.855] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:39:0)
[06:13:13.855] Timer tick, asking Buildbucket for the build status
[06:13:13.980] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:13:13.980] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:40:0) after 1m0s
[06:14:14.017] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:40:0)
[06:14:14.017] Timer tick, asking Buildbucket for the build status
[06:14:14.169] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:14:14.169] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:41:0) after 1m0s
[06:15:14.270] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:41:0)
[06:15:14.270] Timer tick, asking Buildbucket for the build status
[06:15:14.442] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:15:14.442] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:42:0) after 1m0s
[06:16:14.531] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:42:0)
[06:16:14.531] Timer tick, asking Buildbucket for the build status
[06:16:14.705] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:16:14.705] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:43:0) after 1m0s
[06:17:14.731] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:43:0)
[06:17:14.731] Timer tick, asking Buildbucket for the build status
[06:17:14.866] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:17:14.866] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:44:0) after 1m0s
[06:18:14.921] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:44:0)
[06:18:14.921] Timer tick, asking Buildbucket for the build status
[06:18:15.030] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:18:15.030] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:45:0) after 1m0s
[06:19:15.130] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:45:0)
[06:19:15.130] Timer tick, asking Buildbucket for the build status
[06:19:15.327] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:19:15.327] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:46:0) after 1m0s
[06:20:15.418] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:46:0)
[06:20:15.418] Timer tick, asking Buildbucket for the build status
[06:20:15.566] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:20:15.566] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:47:0) after 1m0s
[06:21:15.649] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:47:0)
[06:21:15.649] Timer tick, asking Buildbucket for the build status
[06:21:15.808] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:21:15.808] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:48:0) after 1m0s
[06:22:15.912] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:48:0)
[06:22:15.912] Timer tick, asking Buildbucket for the build status
[06:22:16.019] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:22:16.019] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:49:0) after 1m0s
[06:23:16.058] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:49:0)
[06:23:16.058] Timer tick, asking Buildbucket for the build status
[06:23:16.199] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:23:16.199] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:50:0) after 1m0s
[06:24:16.263] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:50:0)
[06:24:16.263] Timer tick, asking Buildbucket for the build status
[06:24:16.436] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:24:16.436] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:51:0) after 1m0s
[06:25:16.478] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:51:0)
[06:25:16.478] Timer tick, asking Buildbucket for the build status
[06:25:16.613] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:25:16.613] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:52:0) after 1m0s
[06:26:16.670] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:52:0)
[06:26:16.670] Timer tick, asking Buildbucket for the build status
[06:26:16.770] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:26:16.770] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:53:0) after 1m0s
[06:27:16.853] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:53:0)
[06:27:16.853] Timer tick, asking Buildbucket for the build status
[06:27:16.962] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:27:16.962] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:54:0) after 1m0s
[06:28:17.056] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:54:0)
[06:28:17.056] Timer tick, asking Buildbucket for the build status
[06:28:17.164] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:28:17.164] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:55:0) after 1m0s
[06:29:17.236] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:55:0)
[06:29:17.236] Timer tick, asking Buildbucket for the build status
[06:29:17.365] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:29:17.365] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:56:0) after 1m0s
[06:30:17.456] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:56:0)
[06:30:17.456] Timer tick, asking Buildbucket for the build status
[06:30:17.580] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:30:17.580] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:57:0) after 1m0s
[06:31:17.607] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:57:0)
[06:31:17.607] Timer tick, asking Buildbucket for the build status
[06:31:17.774] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:31:17.774] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:58:0) after 1m0s
[06:32:17.810] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:58:0)
[06:32:17.810] Timer tick, asking Buildbucket for the build status
[06:32:17.917] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:32:17.917] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:59:0) after 1m0s
[06:33:17.968] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:59:0)
[06:33:17.968] Timer tick, asking Buildbucket for the build status
[06:33:18.219] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:33:18.219] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:60:0) after 1m0s
[06:34:18.267] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:60:0)
[06:34:18.267] Timer tick, asking Buildbucket for the build status
[06:34:18.395] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:34:18.395] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:61:0) after 1m0s
[06:35:18.422] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:61:0)
[06:35:18.422] Timer tick, asking Buildbucket for the build status
[06:35:18.543] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:35:18.543] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:62:0) after 1m0s
[06:36:18.571] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:62:0)
[06:36:18.571] Timer tick, asking Buildbucket for the build status
[06:36:18.684] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:36:18.684] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:63:0) after 1m0s
[06:37:18.716] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:63:0)
[06:37:18.716] Timer tick, asking Buildbucket for the build status
[06:37:18.821] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:37:18.821] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:64:0) after 1m0s
[06:38:18.959] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:64:0)
[06:38:18.959] Timer tick, asking Buildbucket for the build status
[06:38:19.155] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:38:19.159] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:65:0) after 1m0s
[06:39:19.251] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:65:0)
[06:39:19.251] Timer tick, asking Buildbucket for the build status
[06:39:19.376] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:39:19.376] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:66:0) after 1m0s
[06:40:19.409] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:66:0)
[06:40:19.409] Timer tick, asking Buildbucket for the build status
[06:40:19.533] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:40:19.533] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:67:0) after 1m0s
[06:41:19.571] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:67:0)
[06:41:19.571] Timer tick, asking Buildbucket for the build status
[06:41:19.669] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:41:19.669] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:68:0) after 1m0s
[06:42:19.768] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:68:0)
[06:42:19.768] Timer tick, asking Buildbucket for the build status
[06:42:19.895] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:42:19.895] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:69:0) after 1m0s
[06:43:19.969] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:69:0)
[06:43:19.969] Timer tick, asking Buildbucket for the build status
[06:43:20.093] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:43:20.093] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:70:0) after 1m0s
[06:44:20.119] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:70:0)
[06:44:20.119] Timer tick, asking Buildbucket for the build status
[06:44:20.234] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:44:20.234] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:71:0) after 1m0s
[06:45:20.265] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:71:0)
[06:45:20.265] Timer tick, asking Buildbucket for the build status
[06:45:20.418] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:45:20.418] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:72:0) after 1m0s
[06:46:20.521] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:72:0)
[06:46:20.521] Timer tick, asking Buildbucket for the build status
[06:46:20.737] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:46:20.737] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:73:0) after 1m0s
[06:47:20.866] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:73:0)
[06:47:20.866] Timer tick, asking Buildbucket for the build status
[06:47:20.992] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:47:20.992] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:74:0) after 1m0s
[06:48:21.101] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:74:0)
[06:48:21.101] Timer tick, asking Buildbucket for the build status
[06:48:21.224] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:48:21.224] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:75:0) after 1m0s
[06:49:21.256] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:75:0)
[06:49:21.256] Timer tick, asking Buildbucket for the build status
[06:49:21.477] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:49:21.477] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:76:0) after 1m0s
[06:50:21.564] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:76:0)
[06:50:21.564] Timer tick, asking Buildbucket for the build status
[06:50:21.801] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:50:21.801] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:77:0) after 1m0s
[06:51:21.866] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:77:0)
[06:51:21.866] Timer tick, asking Buildbucket for the build status
[06:51:21.996] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:51:21.996] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:78:0) after 1m0s
[06:52:22.125] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:78:0)
[06:52:22.125] Timer tick, asking Buildbucket for the build status
[06:52:22.272] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:52:22.272] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:79:0) after 1m0s
[06:53:22.310] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:79:0)
[06:53:22.310] Timer tick, asking Buildbucket for the build status
[06:53:22.424] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:53:22.424] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:80:0) after 1m0s
[06:54:22.452] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:80:0)
[06:54:22.452] Timer tick, asking Buildbucket for the build status
[06:54:22.563] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:54:22.563] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:81:0) after 1m0s
[06:55:22.605] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:81:0)
[06:55:22.605] Timer tick, asking Buildbucket for the build status
[06:55:22.774] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:55:22.774] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:82:0) after 1m0s
[06:56:22.824] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:82:0)
[06:56:22.825] Timer tick, asking Buildbucket for the build status
[06:56:22.953] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:56:22.953] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:83:0) after 1m0s
[06:57:22.981] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:83:0)
[06:57:22.981] Timer tick, asking Buildbucket for the build status
[06:57:23.154] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:57:23.154] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:84:0) after 1m0s
[06:58:23.284] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:84:0)
[06:58:23.284] Timer tick, asking Buildbucket for the build status
[06:58:23.442] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:58:23.442] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:85:0) after 1m0s
[06:59:23.556] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:85:0)
[06:59:23.556] Timer tick, asking Buildbucket for the build status
[06:59:23.643] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:59:23.643] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:86:0) after 1m0s
[07:00:23.676] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:86:0)
[07:00:23.676] Timer tick, asking Buildbucket for the build status
[07:00:23.894] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:00:23.894] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:87:0) after 1m0s
[07:01:24.018] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:87:0)
[07:01:24.018] Timer tick, asking Buildbucket for the build status
[07:01:24.144] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:01:24.144] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:88:0) after 1m0s
[07:02:24.260] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:88:0)
[07:02:24.260] Timer tick, asking Buildbucket for the build status
[07:02:24.415] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:02:24.415] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:89:0) after 1m0s
[07:03:24.519] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:89:0)
[07:03:24.519] Timer tick, asking Buildbucket for the build status
[07:03:24.641] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:03:24.641] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:90:0) after 1m0s
[07:04:24.769] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:90:0)
[07:04:24.769] Timer tick, asking Buildbucket for the build status
[07:04:24.927] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:04:24.927] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:91:0) after 1m0s
[07:05:25.018] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:91:0)
[07:05:25.018] Timer tick, asking Buildbucket for the build status
[07:05:25.122] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:05:25.122] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:92:0) after 1m0s
[07:06:25.187] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:92:0)
[07:06:25.187] Timer tick, asking Buildbucket for the build status
[07:06:25.348] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:06:25.348] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:93:0) after 1m0s
[07:07:25.385] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:93:0)
[07:07:25.385] Timer tick, asking Buildbucket for the build status
[07:07:25.550] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:07:25.550] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:94:0) after 1m0s
[07:08:25.579] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:94:0)
[07:08:25.579] Timer tick, asking Buildbucket for the build status
[07:08:25.694] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:08:25.694] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:95:0) after 1m0s
[07:09:25.757] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:95:0)
[07:09:25.757] Timer tick, asking Buildbucket for the build status
[07:09:26.016] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:09:26.016] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:96:0) after 1m0s
[07:10:26.134] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:96:0)
[07:10:26.134] Timer tick, asking Buildbucket for the build status
[07:10:26.366] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:10:26.366] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:97:0) after 1m0s
[07:11:26.475] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:97:0)
[07:11:26.475] Timer tick, asking Buildbucket for the build status
[07:11:27.013] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:11:27.013] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:98:0) after 1m0s
[07:12:27.108] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:98:0)
[07:12:27.108] Timer tick, asking Buildbucket for the build status
[07:12:27.361] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:12:27.361] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:99:0) after 1m0s
[07:13:27.402] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:99:0)
[07:13:27.402] Timer tick, asking Buildbucket for the build status
[07:13:27.608] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:13:27.608] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:100:0) after 1m0s
[07:14:27.672] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:100:0)
[07:14:27.672] Timer tick, asking Buildbucket for the build status
[07:14:28.225] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:14:28.225] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:101:0) after 1m0s
[07:15:28.269] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:101:0)
[07:15:28.269] Timer tick, asking Buildbucket for the build status
[07:15:28.603] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:15:28.603] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:102:0) after 1m0s
[07:16:28.721] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:102:0)
[07:16:28.721] Timer tick, asking Buildbucket for the build status
[07:16:28.974] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:16:28.974] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:103:0) after 1m0s
[07:17:29.003] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:103:0)
[07:17:29.003] Timer tick, asking Buildbucket for the build status
[07:17:29.211] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:17:29.211] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:104:0) after 1m0s
[07:18:29.311] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:104:0)
[07:18:29.311] Timer tick, asking Buildbucket for the build status
[07:18:29.564] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:18:29.564] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:105:0) after 1m0s
[07:19:29.615] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:105:0)
[07:19:29.615] Timer tick, asking Buildbucket for the build status
[07:19:29.942] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:19:29.942] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:106:0) after 1m0s
[07:20:30.096] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:106:0)
[07:20:30.096] Timer tick, asking Buildbucket for the build status
[07:20:30.420] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:20:30.420] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:107:0) after 1m0s
[07:21:30.473] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:107:0)
[07:21:30.473] Timer tick, asking Buildbucket for the build status
[07:21:30.815] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:21:30.815] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:108:0) after 1m0s
[07:22:30.848] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:108:0)
[07:22:30.848] Timer tick, asking Buildbucket for the build status
[07:22:31.132] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:22:31.132] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:109:0) after 1m0s
[07:23:31.230] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:109:0)
[07:23:31.230] Timer tick, asking Buildbucket for the build status
[07:23:31.463] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:23:31.463] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:110:0) after 1m0s
[07:24:31.558] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:110:0)
[07:24:31.558] Timer tick, asking Buildbucket for the build status
[07:24:31.882] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:24:31.882] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:111:0) after 1m0s
[07:25:31.957] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:111:0)
[07:25:31.957] Timer tick, asking Buildbucket for the build status
[07:25:32.355] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:25:32.355] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:112:0) after 1m0s
[07:26:32.381] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:112:0)
[07:26:32.381] Timer tick, asking Buildbucket for the build status
[07:26:32.743] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:26:32.743] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:113:0) after 1m0s
[07:27:32.812] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:113:0)
[07:27:32.812] Timer tick, asking Buildbucket for the build status
[07:27:33.169] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:27:33.169] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:114:0) after 1m0s
[07:28:33.218] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:114:0)
[07:28:33.218] Timer tick, asking Buildbucket for the build status
[07:28:33.493] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:28:33.493] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:115:0) after 1m0s
[07:29:33.615] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:115:0)
[07:29:33.615] Timer tick, asking Buildbucket for the build status
[07:29:33.908] Build 8864496370939038368: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:29:33.908] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:116:0) after 1m0s
[07:29:48.328] Received PubSub notification, asking Buildbucket for the build status
[07:29:48.454] Build 8864496370939038368: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:30:34.026] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:116:0)
[07:30:34.026] Timer tick, asking Buildbucket for the build status
[07:30:34.413] Build 8864496370939038368: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:30:34.413] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:118:0) after 1m0s
[07:31:34.465] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:118:0)
[07:31:34.465] Timer tick, asking Buildbucket for the build status
[07:31:34.809] Build 8864496370939038368: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:31:34.809] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:119:0) after 1m0s
[07:32:34.923] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:119:0)
[07:32:34.923] Timer tick, asking Buildbucket for the build status
[07:32:35.262] Build 8864496370939038368: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:32:35.262] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:120:0) after 1m0s
[07:33:35.296] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:120:0)
[07:33:35.296] Timer tick, asking Buildbucket for the build status
[07:33:35.632] Build 8864496370939038368: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:33:35.632] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:121:0) after 1m0s
[07:34:36.046] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:121:0)
[07:34:36.046] Timer tick, asking Buildbucket for the build status
[07:34:36.342] Build 8864496370939038368: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:34:36.342] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:122:0) after 1m0s
[07:35:36.398] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:122:0)
[07:35:36.399] Timer tick, asking Buildbucket for the build status
[07:35:36.718] Build 8864496370939038368: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:35:36.718] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:123:0) after 1m0s
[07:36:36.764] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:123:0)
[07:36:36.764] Timer tick, asking Buildbucket for the build status
[07:36:37.187] Build 8864496370939038368: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:36:37.187] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:124:0) after 1m0s
[07:37:37.268] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:124:0)
[07:37:37.268] Timer tick, asking Buildbucket for the build status
[07:37:37.488] Build 8864496370939038368: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:37:37.488] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:125:0) after 1m0s
[07:38:37.522] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:125:0)
[07:38:37.522] Timer tick, asking Buildbucket for the build status
[07:38:37.857] Build 8864496370939038368: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:38:37.857] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:126:0) after 1m0s
[07:39:37.886] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:126:0)
[07:39:37.886] Timer tick, asking Buildbucket for the build status
[07:39:38.102] Build 8864496370939038368: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:39:38.102] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:127:0) after 1m0s
[07:40:38.173] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:127:0)
[07:40:38.173] Timer tick, asking Buildbucket for the build status
[07:40:38.513] Build 8864496370939038368: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:40:38.513] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:128:0) after 1m0s
[07:41:38.558] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:128:0)
[07:41:38.558] Timer tick, asking Buildbucket for the build status
[07:41:38.914] Build 8864496370939038368: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:41:38.914] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:129:0) after 1m0s
[07:42:38.980] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:129:0)
[07:42:38.980] Timer tick, asking Buildbucket for the build status
[07:42:39.247] Build 8864496370939038368: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:42:39.247] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:130:0) after 1m0s
[07:43:39.368] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:130:0)
[07:43:39.368] Timer tick, asking Buildbucket for the build status
[07:43:39.701] Build 8864496370939038368: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:43:39.701] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:131:0) after 1m0s
[07:44:39.752] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:131:0)
[07:44:39.752] Timer tick, asking Buildbucket for the build status
[07:44:40.047] Build 8864496370939038368: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:44:40.047] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:132:0) after 1m0s
[07:45:40.111] Handling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:132:0)
[07:45:40.111] Timer tick, asking Buildbucket for the build status
[07:45:40.448] Build 8864496370939038368: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:45:40.448] Scheduling timer "check-buildbucket-build-status" (infra/infra-continuous-win10-64:9029926432949299552:133:0) after 1m0s
[07:46:22.786] Received PubSub notification, asking Buildbucket for the build status
[07:46:22.876] Build 8864496370939038368: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[07:46:22.876] Buildbucket build:
{
"build": {
"bucket": "luci.infra.ci",
"canary_preference": "PROD",
"completed_ts": "1604562380004861",
"created_by": "project:infra",
"created_ts": "1604554505367694",
"id": "8864496370939038368",
"parameters_json": "{\"builder_name\": \"infra-continuous-win10-64\", \"properties\": {\"$recipe_engine/scheduler\": {\"hostname\": \"luci-scheduler-dev.appspot.com\", \"triggers\": [{\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://chromium.googlesource.com/infra/infra\", \"revision\": \"4d3a56617e7954a078629ed2bfd429b253877ff0\"}, \"id\": \"https://chromium.googlesource.com/infra/infra/+/refs/heads/master@4d3a56617e7954a078629ed2bfd429b253877ff0\", \"title\": \"4d3a56617e7954a078629ed2bfd429b253877ff0\", \"url\": \"https://chromium.googlesource.com/infra/infra/+/4d3a56617e7954a078629ed2bfd429b253877ff0\"}, {\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://chromium.googlesource.com/infra/infra\", \"revision\": \"ce378067a869c985b1e5a47e0882e1f18b4fb42c\"}, \"id\": \"https://chromium.googlesource.com/infra/infra/+/refs/heads/master@ce378067a869c985b1e5a47e0882e1f18b4fb42c\", \"title\": \"ce378067a869c985b1e5a47e0882e1f18b4fb42c\", \"url\": \"https://chromium.googlesource.com/infra/infra/+/ce378067a869c985b1e5a47e0882e1f18b4fb42c\"}, {\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://chromium.googlesource.com/infra/infra\", \"revision\": \"707f57f3f0f945c35aec6c8318521002cb75516b\"}, \"id\": \"https://chromium.googlesource.com/infra/infra/+/refs/heads/master@707f57f3f0f945c35aec6c8318521002cb75516b\", \"title\": \"707f57f3f0f945c35aec6c8318521002cb75516b\", \"url\": \"https://chromium.googlesource.com/infra/infra/+/707f57f3f0f945c35aec6c8318521002cb75516b\"}, {\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://chromium.googlesource.com/infra/infra\", \"revision\": \"31ccadbadb0a704cb5c0e99de538c20a8794a3e4\"}, \"id\": \"https://chromium.googlesource.com/infra/infra/+/refs/heads/master@31ccadbadb0a704cb5c0e99de538c20a8794a3e4\", \"title\": \"31ccadbadb0a704cb5c0e99de538c20a8794a3e4\", \"url\": \"https://chromium.googlesource.com/infra/infra/+/31ccadbadb0a704cb5c0e99de538c20a8794a3e4\"}, {\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://chromium.googlesource.com/infra/infra\", \"revision\": \"8d2e70531b763883abb23ece7ad385a3b136ce06\"}, \"id\": \"https://chromium.googlesource.com/infra/infra/+/refs/heads/master@8d2e70531b763883abb23ece7ad385a3b136ce06\", \"title\": \"8d2e70531b763883abb23ece7ad385a3b136ce06\", \"url\": \"https://chromium.googlesource.com/infra/infra/+/8d2e70531b763883abb23ece7ad385a3b136ce06\"}, {\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://chromium.googlesource.com/infra/infra\", \"revision\": \"db851204b3a503e947d0de611c4a9afa8d9e48b6\"}, \"id\": \"https://chromium.googlesource.com/infra/infra/+/refs/heads/master@db851204b3a503e947d0de611c4a9afa8d9e48b6\", \"title\": \"db851204b3a503e947d0de611c4a9afa8d9e48b6\", \"url\": \"https://chromium.googlesource.com/infra/infra/+/db851204b3a503e947d0de611c4a9afa8d9e48b6\"}, {\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://chromium.googlesource.com/infra/infra\", \"revision\": \"71da57380d00a2bf4a2edec291a106edbdf83603\"}, \"id\": \"https://chromium.googlesource.com/infra/infra/+/refs/heads/master@71da57380d00a2bf4a2edec291a106edbdf83603\", \"title\": \"71da57380d00a2bf4a2edec291a106edbdf83603\", \"url\": \"https://chromium.googlesource.com/infra/infra/+/71da57380d00a2bf4a2edec291a106edbdf83603\"}, {\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://chromium.googlesource.com/infra/infra\", \"revision\": \"438bbccfb5e0b3e33d7f985147535eebe6f7a034\"}, \"id\": \"https://chromium.googlesource.com/infra/infra/+/refs/heads/master@438bbccfb5e0b3e33d7f985147535eebe6f7a034\", \"title\": \"438bbccfb5e0b3e33d7f985147535eebe6f7a034\", \"url\": \"https://chromium.googlesource.com/infra/infra/+/438bbccfb5e0b3e33d7f985147535eebe6f7a034\"}, {\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://chromium.googlesource.com/infra/infra\", \"revision\": \"49542f8db293ff58100d25995e29ddc096fb25e5\"}, \"id\": \"https://chromium.googlesource.com/infra/infra/+/refs/heads/master@49542f8db293ff58100d25995e29ddc096fb25e5\", \"title\": \"49542f8db293ff58100d25995e29ddc096fb25e5\", \"url\": \"https://chromium.googlesource.com/infra/infra/+/49542f8db293ff58100d25995e29ddc096fb25e5\"}]}, \"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/infra/infra\", \"revision\": \"49542f8db293ff58100d25995e29ddc096fb25e5\"}}",
"project": "infra",
"result": "SUCCESS",
"result_details_json": "{\"properties\": {\"got_revision\": \"49542f8db293ff58100d25995e29ddc096fb25e5\", \"got_revision_cp\": \"refs/heads/master@{#36200}\"}, \"swarming\": {\"bot_dimensions\": {\"caches\": [\"builder_a9c54e560aab64ffcab932ab26ad711a72ff73dbcd0bfe47f54d3e3349e5c381_v2\", \"git\", \"goma\", \"vpython\"], \"cores\": [\"8\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Broadwell_GCE\"], \"gce\": [\"1\"], \"gcp\": [\"google.com:chromecompute\"], \"gpu\": [\"none\"], \"id\": [\"dev-luci-chromium-ci-win10-0-85yg\"], \"image\": [\"chrome-win10-1703-20101600-6f576df2987\"], \"integrity\": [\"high\"], \"locale\": [\"en_US.cp1252\"], \"machine_type\": [\"n1-standard-8\"], \"os\": [\"Windows\", \"Windows-10\", \"Windows-10-15063\"], \"pool\": [\"luci.chromium.ci\"], \"python\": [\"2.7.13\"], \"server_version\": [\"5623-231a6fb\"], \"ssd\": [\"0\"], \"windows_client_version\": [\"10\"], \"zone\": [\"us\", \"us-west\", \"us-west1\", \"us-west1-c\"]}}}",
"service_account": "adhoc-testing@luci-token-server-dev.iam.gserviceaccount.com",
"started_ts": "1604561385203971",
"status": "COMPLETED",
"status_changed_ts": "1604562380423112",
"tags": [
"build_address:luci.infra.ci/infra-continuous-win10-64/17976",
"builder:infra-continuous-win10-64",
"buildset:commit/git/49542f8db293ff58100d25995e29ddc096fb25e5",
"buildset:commit/gitiles/chromium.googlesource.com/infra/infra/+/49542f8db293ff58100d25995e29ddc096fb25e5",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9029926432949299552",
"scheduler_job_id:infra/infra-continuous-win10-64",
"swarming_hostname:chromium-swarm-dev.appspot.com",
"swarming_tag:log_location:logdog://luci-logdog-dev.appspot.com/infra/buildbucket/cr-buildbucket-dev.appspot.com/8864496370939038368/+/annotations",
"swarming_tag:luci_project:infra",
"swarming_tag:os:Windows",
"swarming_tag:recipe_name:infra_continuous",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/infra/infra",
"swarming_task_id:4fafb84b084cee10",
"user_agent:luci-scheduler-dev"
],
"updated_ts": "1604562380485826",
"url": "https://luci-milo-dev.appspot.com/b/8864496370939038368",
"utcnow_ts": "1604562382866302"
}
}
[07:46:22.876] Invocation finished in 2h11m18.810192194s with status SUCCEEDED