[13:10:59.728] New invocation is queued and will start shortly
[13:11:01.205] Starting the invocation (attempt 1)
[13:11:01.256] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[13:11:01.257] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[13:11:01.257] Buildbucket request:
{
"bucket": "luci.emscripten-releases.ci",
"client_operation_id": "9018482530706801776",
"parameters_json": "{\"builder_name\":\"mac\",\"properties\":{\"$recipe_engine/scheduler\":{\"hostname\":\"luci-scheduler.appspot.com\",\"triggers\":[{\"gitiles\":{\"ref\":\"refs/heads/master\",\"repo\":\"https://chromium.googlesource.com/emscripten-releases\",\"revision\":\"3001dec5b433e4a3a9c2d9a9a9a730f183d191f6\"},\"id\":\"https://chromium.googlesource.com/emscripten-releases/+/refs/heads/master@3001dec5b433e4a3a9c2d9a9a9a730f183d191f6\",\"title\":\"3001dec5b433e4a3a9c2d9a9a9a730f183d191f6\",\"url\":\"https://chromium.googlesource.com/emscripten-releases/+/3001dec5b433e4a3a9c2d9a9a9a730f183d191f6\"}]},\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/emscripten-releases\",\"revision\":\"3001dec5b433e4a3a9c2d9a9a9a730f183d191f6\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:mac",
"scheduler_invocation_id:9018482530706801776",
"scheduler_job_id:emscripten-releases/mac",
"user_agent:luci-scheduler",
"buildset:commit/git/3001dec5b433e4a3a9c2d9a9a9a730f183d191f6",
"buildset:commit/gitiles/chromium.googlesource.com/emscripten-releases/+/3001dec5b433e4a3a9c2d9a9a9a730f183d191f6",
"gitiles_ref:refs/heads/master"
]
}
[13:11:01.703] Buildbucket response:
{
"build": {
"bucket": "luci.emscripten-releases.ci",
"canary_preference": "PROD",
"created_by": "project:emscripten-releases",
"created_ts": "1615468261357654",
"id": "8853052468337524896",
"parameters_json": "{\"builder_name\": \"mac\", \"properties\": {\"$recipe_engine/scheduler\": {\"hostname\": \"luci-scheduler.appspot.com\", \"triggers\": [{\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://chromium.googlesource.com/emscripten-releases\", \"revision\": \"3001dec5b433e4a3a9c2d9a9a9a730f183d191f6\"}, \"id\": \"https://chromium.googlesource.com/emscripten-releases/+/refs/heads/master@3001dec5b433e4a3a9c2d9a9a9a730f183d191f6\", \"title\": \"3001dec5b433e4a3a9c2d9a9a9a730f183d191f6\", \"url\": \"https://chromium.googlesource.com/emscripten-releases/+/3001dec5b433e4a3a9c2d9a9a9a730f183d191f6\"}]}, \"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/emscripten-releases\", \"revision\": \"3001dec5b433e4a3a9c2d9a9a9a730f183d191f6\"}}",
"project": "emscripten-releases",
"result_details_json": "{\"properties\": {}}",
"service_account": "emscripten-releases-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1615468261548257",
"tags": [
"builder:mac",
"buildset:commit/git/3001dec5b433e4a3a9c2d9a9a9a730f183d191f6",
"buildset:commit/gitiles/chromium.googlesource.com/emscripten-releases/+/3001dec5b433e4a3a9c2d9a9a9a730f183d191f6",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9018482530706801776",
"scheduler_job_id:emscripten-releases/mac",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/emscripten-releases/buildbucket/cr-buildbucket.appspot.com/8853052468337524896/+/annotations",
"swarming_tag:luci_project:emscripten-releases",
"swarming_tag:recipe_name:emscripten_releases",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_task_id:",
"user_agent:luci-scheduler"
],
"updated_ts": "1615468261548365",
"url": "https://ci.chromium.org/b/8853052468337524896",
"utcnow_ts": "1615468261691673"
}
}
[13:11:01.703] Task URL: https://ci.chromium.org/b/8853052468337524896
[13:11:01.703] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:2:0) after 1m0s
[13:12:01.752] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:2:0)
[13:12:01.752] Timer tick, asking Buildbucket for the build status
[13:12:01.890] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:12:01.890] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:3:0) after 1m0s
[13:13:01.948] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:3:0)
[13:13:01.948] Timer tick, asking Buildbucket for the build status
[13:13:02.068] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:13:02.068] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:4:0) after 1m0s
[13:14:02.133] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:4:0)
[13:14:02.133] Timer tick, asking Buildbucket for the build status
[13:14:02.258] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:14:02.258] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:5:0) after 1m0s
[13:15:02.334] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:5:0)
[13:15:02.334] Timer tick, asking Buildbucket for the build status
[13:15:02.423] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:15:02.423] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:6:0) after 1m0s
[13:16:02.440] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:6:0)
[13:16:02.440] Timer tick, asking Buildbucket for the build status
[13:16:02.532] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:16:02.532] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:7:0) after 1m0s
[13:17:02.540] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:7:0)
[13:17:02.540] Timer tick, asking Buildbucket for the build status
[13:17:02.631] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:17:02.631] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:8:0) after 1m0s
[13:18:02.633] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:8:0)
[13:18:02.633] Timer tick, asking Buildbucket for the build status
[13:18:02.696] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:18:02.696] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:9:0) after 1m0s
[13:19:02.746] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:9:0)
[13:19:02.746] Timer tick, asking Buildbucket for the build status
[13:19:02.799] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:19:02.799] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:10:0) after 1m0s
[13:20:02.824] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:10:0)
[13:20:02.824] Timer tick, asking Buildbucket for the build status
[13:20:02.895] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:20:02.895] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:11:0) after 1m0s
[13:21:02.969] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:11:0)
[13:21:02.969] Timer tick, asking Buildbucket for the build status
[13:21:03.090] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:21:03.090] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:12:0) after 1m0s
[13:22:03.224] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:12:0)
[13:22:03.224] Timer tick, asking Buildbucket for the build status
[13:22:03.281] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:22:03.281] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:13:0) after 1m0s
[13:23:03.444] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:13:0)
[13:23:03.444] Timer tick, asking Buildbucket for the build status
[13:23:03.724] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:23:03.724] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:14:0) after 1m0s
[13:24:03.727] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:14:0)
[13:24:03.727] Timer tick, asking Buildbucket for the build status
[13:24:03.936] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:24:03.937] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:15:0) after 1m0s
[13:25:04.016] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:15:0)
[13:25:04.016] Timer tick, asking Buildbucket for the build status
[13:25:04.085] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:25:04.085] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:16:0) after 1m0s
[13:26:04.203] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:16:0)
[13:26:04.203] Timer tick, asking Buildbucket for the build status
[13:26:04.366] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:26:04.366] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:17:0) after 1m0s
[13:27:04.392] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:17:0)
[13:27:04.392] Timer tick, asking Buildbucket for the build status
[13:27:04.535] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:27:04.535] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:18:0) after 1m0s
[13:28:04.526] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:18:0)
[13:28:04.526] Timer tick, asking Buildbucket for the build status
[13:28:04.807] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:28:04.808] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:19:0) after 1m0s
[13:29:04.828] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:19:0)
[13:29:04.828] Timer tick, asking Buildbucket for the build status
[13:29:04.900] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:29:04.900] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:20:0) after 1m0s
[13:30:04.998] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:20:0)
[13:30:04.998] Timer tick, asking Buildbucket for the build status
[13:30:05.087] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:30:05.087] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:21:0) after 1m0s
[13:31:05.414] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:21:0)
[13:31:05.414] Timer tick, asking Buildbucket for the build status
[13:31:05.620] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:31:05.620] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:22:0) after 1m0s
[13:32:05.662] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:22:0)
[13:32:05.662] Timer tick, asking Buildbucket for the build status
[13:32:05.791] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:32:05.791] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:23:0) after 1m0s
[13:33:06.177] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:23:0)
[13:33:06.177] Timer tick, asking Buildbucket for the build status
[13:33:06.328] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:33:06.328] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:24:0) after 1m0s
[13:34:06.333] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:24:0)
[13:34:06.333] Timer tick, asking Buildbucket for the build status
[13:34:06.398] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:34:06.398] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:25:0) after 1m0s
[13:35:06.383] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:25:0)
[13:35:06.383] Timer tick, asking Buildbucket for the build status
[13:35:06.957] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:35:06.957] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:26:0) after 1m0s
[13:36:07.101] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:26:0)
[13:36:07.101] Timer tick, asking Buildbucket for the build status
[13:36:07.178] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:36:07.178] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:27:0) after 1m0s
[13:37:07.239] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:27:0)
[13:37:07.239] Timer tick, asking Buildbucket for the build status
[13:37:07.322] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:37:07.322] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:28:0) after 1m0s
[13:38:07.340] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:28:0)
[13:38:07.340] Timer tick, asking Buildbucket for the build status
[13:38:07.397] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:38:07.397] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:29:0) after 1m0s
[13:39:07.417] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:29:0)
[13:39:07.417] Timer tick, asking Buildbucket for the build status
[13:39:07.481] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:39:07.481] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:30:0) after 1m0s
[13:40:07.510] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:30:0)
[13:40:07.510] Timer tick, asking Buildbucket for the build status
[13:40:07.572] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:40:07.572] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:31:0) after 1m0s
[13:41:07.634] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:31:0)
[13:41:07.634] Timer tick, asking Buildbucket for the build status
[13:41:07.891] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:41:07.891] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:32:0) after 1m0s
[13:42:07.912] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:32:0)
[13:42:07.912] Timer tick, asking Buildbucket for the build status
[13:42:07.976] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:42:07.976] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:33:0) after 1m0s
[13:43:08.059] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:33:0)
[13:43:08.059] Timer tick, asking Buildbucket for the build status
[13:43:08.119] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:43:08.119] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:34:0) after 1m0s
[13:44:08.188] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:34:0)
[13:44:08.188] Timer tick, asking Buildbucket for the build status
[13:44:08.308] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:44:08.308] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:35:0) after 1m0s
[13:45:08.334] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:35:0)
[13:45:08.334] Timer tick, asking Buildbucket for the build status
[13:45:08.394] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:45:08.394] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:36:0) after 1m0s
[13:46:08.473] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:36:0)
[13:46:08.473] Timer tick, asking Buildbucket for the build status
[13:46:08.748] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:46:08.748] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:37:0) after 1m0s
[13:47:08.784] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:37:0)
[13:47:08.784] Timer tick, asking Buildbucket for the build status
[13:47:08.835] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:47:08.835] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:38:0) after 1m0s
[13:48:08.876] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:38:0)
[13:48:08.876] Timer tick, asking Buildbucket for the build status
[13:48:09.097] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:48:09.097] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:39:0) after 1m0s
[13:49:09.174] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:39:0)
[13:49:09.174] Timer tick, asking Buildbucket for the build status
[13:49:09.252] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:49:09.252] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:40:0) after 1m0s
[13:50:09.412] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:40:0)
[13:50:09.412] Timer tick, asking Buildbucket for the build status
[13:50:09.486] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:50:09.486] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:41:0) after 1m0s
[13:51:09.685] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:41:0)
[13:51:09.685] Timer tick, asking Buildbucket for the build status
[13:51:09.763] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:51:09.763] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:42:0) after 1m0s
[13:52:09.973] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:42:0)
[13:52:09.973] Timer tick, asking Buildbucket for the build status
[13:52:10.040] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:52:10.040] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:43:0) after 1m0s
[13:53:10.239] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:43:0)
[13:53:10.239] Timer tick, asking Buildbucket for the build status
[13:53:10.325] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:53:10.325] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:44:0) after 1m0s
[13:54:10.570] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:44:0)
[13:54:10.570] Timer tick, asking Buildbucket for the build status
[13:54:10.655] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:54:10.655] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:45:0) after 1m0s
[13:55:10.853] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:45:0)
[13:55:10.853] Timer tick, asking Buildbucket for the build status
[13:55:11.006] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:55:11.006] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:46:0) after 1m0s
[13:56:11.095] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:46:0)
[13:56:11.095] Timer tick, asking Buildbucket for the build status
[13:56:11.214] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:56:11.214] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:47:0) after 1m0s
[13:57:11.269] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:47:0)
[13:57:11.269] Timer tick, asking Buildbucket for the build status
[13:57:11.411] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:57:11.411] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:48:0) after 1m0s
[13:58:11.432] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:48:0)
[13:58:11.432] Timer tick, asking Buildbucket for the build status
[13:58:11.497] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:58:11.497] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:49:0) after 1m0s
[13:59:11.622] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:49:0)
[13:59:11.622] Timer tick, asking Buildbucket for the build status
[13:59:13.053] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:59:13.053] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:50:0) after 1m0s
[14:00:13.107] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:50:0)
[14:00:13.107] Timer tick, asking Buildbucket for the build status
[14:00:13.175] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[14:00:13.175] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:51:0) after 1m0s
[14:01:13.266] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:51:0)
[14:01:13.266] Timer tick, asking Buildbucket for the build status
[14:01:13.356] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[14:01:13.356] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:52:0) after 1m0s
[14:02:13.468] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:52:0)
[14:02:13.468] Timer tick, asking Buildbucket for the build status
[14:02:13.590] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[14:02:13.590] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:53:0) after 1m0s
[14:03:13.586] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:53:0)
[14:03:13.586] Timer tick, asking Buildbucket for the build status
[14:03:13.648] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[14:03:13.648] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:54:0) after 1m0s
[14:04:13.765] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:54:0)
[14:04:13.765] Timer tick, asking Buildbucket for the build status
[14:04:14.162] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[14:04:14.162] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:55:0) after 1m0s
[14:05:14.241] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:55:0)
[14:05:14.241] Timer tick, asking Buildbucket for the build status
[14:05:14.307] Build 8853052468337524896: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[14:05:14.307] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:56:0) after 1m0s
[14:05:39.289] Received PubSub notification, asking Buildbucket for the build status
[14:05:39.398] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:06:14.641] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:56:0)
[14:06:14.641] Timer tick, asking Buildbucket for the build status
[14:06:14.924] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:06:14.924] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:58:0) after 1m0s
[14:07:15.131] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:58:0)
[14:07:15.131] Timer tick, asking Buildbucket for the build status
[14:07:15.190] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:07:15.191] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:59:0) after 1m0s
[14:08:15.466] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:59:0)
[14:08:15.466] Timer tick, asking Buildbucket for the build status
[14:08:15.542] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:08:15.542] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:60:0) after 1m0s
[14:09:15.647] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:60:0)
[14:09:15.647] Timer tick, asking Buildbucket for the build status
[14:09:15.763] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:09:15.763] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:61:0) after 1m0s
[14:10:15.906] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:61:0)
[14:10:15.906] Timer tick, asking Buildbucket for the build status
[14:10:15.968] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:10:15.968] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:62:0) after 1m0s
[14:11:16.111] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:62:0)
[14:11:16.111] Timer tick, asking Buildbucket for the build status
[14:11:16.188] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:11:16.188] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:63:0) after 1m0s
[14:12:16.288] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:63:0)
[14:12:16.288] Timer tick, asking Buildbucket for the build status
[14:12:16.528] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:12:16.528] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:64:0) after 1m0s
[14:13:16.594] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:64:0)
[14:13:16.594] Timer tick, asking Buildbucket for the build status
[14:13:16.750] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:13:16.750] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:65:0) after 1m0s
[14:14:16.838] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:65:0)
[14:14:16.838] Timer tick, asking Buildbucket for the build status
[14:14:16.909] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:14:16.909] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:66:0) after 1m0s
[14:15:16.964] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:66:0)
[14:15:16.964] Timer tick, asking Buildbucket for the build status
[14:15:17.186] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:15:17.186] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:67:0) after 1m0s
[14:16:17.399] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:67:0)
[14:16:17.399] Timer tick, asking Buildbucket for the build status
[14:16:17.637] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:16:17.637] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:68:0) after 1m0s
[14:17:17.730] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:68:0)
[14:17:17.730] Timer tick, asking Buildbucket for the build status
[14:17:17.850] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:17:17.850] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:69:0) after 1m0s
[14:18:18.000] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:69:0)
[14:18:18.000] Timer tick, asking Buildbucket for the build status
[14:18:18.139] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:18:18.139] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:70:0) after 1m0s
[14:19:18.208] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:70:0)
[14:19:18.208] Timer tick, asking Buildbucket for the build status
[14:19:18.277] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:19:18.277] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:71:0) after 1m0s
[14:20:18.313] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:71:0)
[14:20:18.313] Timer tick, asking Buildbucket for the build status
[14:20:18.392] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:20:18.392] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:72:0) after 1m0s
[14:21:18.456] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:72:0)
[14:21:18.456] Timer tick, asking Buildbucket for the build status
[14:21:18.681] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:21:18.681] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:73:0) after 1m0s
[14:22:18.708] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:73:0)
[14:22:18.708] Timer tick, asking Buildbucket for the build status
[14:22:18.940] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:22:18.940] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:74:0) after 1m0s
[14:23:18.978] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:74:0)
[14:23:18.978] Timer tick, asking Buildbucket for the build status
[14:23:19.048] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:23:19.048] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:75:0) after 1m0s
[14:24:19.065] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:75:0)
[14:24:19.065] Timer tick, asking Buildbucket for the build status
[14:24:19.450] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:24:19.450] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:76:0) after 1m0s
[14:25:19.498] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:76:0)
[14:25:19.498] Timer tick, asking Buildbucket for the build status
[14:25:19.563] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:25:19.563] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:77:0) after 1m0s
[14:26:19.582] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:77:0)
[14:26:19.582] Timer tick, asking Buildbucket for the build status
[14:26:19.850] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:26:19.850] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:78:0) after 1m0s
[14:27:19.945] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:78:0)
[14:27:19.945] Timer tick, asking Buildbucket for the build status
[14:27:20.041] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:27:20.041] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:79:0) after 1m0s
[14:28:20.056] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:79:0)
[14:28:20.056] Timer tick, asking Buildbucket for the build status
[14:28:20.221] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:28:20.221] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:80:0) after 1m0s
[14:29:20.419] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:80:0)
[14:29:20.419] Timer tick, asking Buildbucket for the build status
[14:29:21.981] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:29:21.981] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:81:0) after 1m0s
[14:30:22.029] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:81:0)
[14:30:22.029] Timer tick, asking Buildbucket for the build status
[14:30:22.118] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:30:22.118] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:82:0) after 1m0s
[14:31:22.181] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:82:0)
[14:31:22.181] Timer tick, asking Buildbucket for the build status
[14:31:22.281] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:31:22.281] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:83:0) after 1m0s
[14:32:22.330] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:83:0)
[14:32:22.330] Timer tick, asking Buildbucket for the build status
[14:32:22.391] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:32:22.391] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:84:0) after 1m0s
[14:33:22.426] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:84:0)
[14:33:22.426] Timer tick, asking Buildbucket for the build status
[14:33:22.494] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:33:22.494] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:85:0) after 1m0s
[14:34:22.520] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:85:0)
[14:34:22.520] Timer tick, asking Buildbucket for the build status
[14:34:22.652] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:34:22.652] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:86:0) after 1m0s
[14:35:22.671] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:86:0)
[14:35:22.671] Timer tick, asking Buildbucket for the build status
[14:35:22.769] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:35:22.769] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:87:0) after 1m0s
[14:36:22.809] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:87:0)
[14:36:22.809] Timer tick, asking Buildbucket for the build status
[14:36:22.889] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:36:22.889] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:88:0) after 1m0s
[14:37:22.941] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:88:0)
[14:37:22.941] Timer tick, asking Buildbucket for the build status
[14:37:23.073] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:37:23.073] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:89:0) after 1m0s
[14:38:24.099] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:89:0)
[14:38:24.099] Timer tick, asking Buildbucket for the build status
[14:38:24.165] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:38:24.165] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:90:0) after 1m0s
[14:39:24.253] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:90:0)
[14:39:24.253] Timer tick, asking Buildbucket for the build status
[14:39:24.845] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:39:24.845] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:91:0) after 1m0s
[14:40:25.112] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:91:0)
[14:40:25.112] Timer tick, asking Buildbucket for the build status
[14:40:25.364] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:40:25.364] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:92:0) after 1m0s
[14:41:25.448] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:92:0)
[14:41:25.448] Timer tick, asking Buildbucket for the build status
[14:41:25.542] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:41:25.542] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:93:0) after 1m0s
[14:42:25.688] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:93:0)
[14:42:25.688] Timer tick, asking Buildbucket for the build status
[14:42:25.750] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:42:25.750] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:94:0) after 1m0s
[14:43:25.851] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:94:0)
[14:43:25.851] Timer tick, asking Buildbucket for the build status
[14:43:25.990] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:43:25.990] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:95:0) after 1m0s
[14:44:26.107] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:95:0)
[14:44:26.107] Timer tick, asking Buildbucket for the build status
[14:44:26.234] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:44:26.234] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:96:0) after 1m0s
[14:45:26.339] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:96:0)
[14:45:26.339] Timer tick, asking Buildbucket for the build status
[14:45:26.407] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:45:26.407] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:97:0) after 1m0s
[14:46:26.645] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:97:0)
[14:46:26.645] Timer tick, asking Buildbucket for the build status
[14:46:27.136] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:46:27.136] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:98:0) after 1m0s
[14:47:27.261] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:98:0)
[14:47:27.261] Timer tick, asking Buildbucket for the build status
[14:47:27.336] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:47:27.336] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:99:0) after 1m0s
[14:48:27.388] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:99:0)
[14:48:27.388] Timer tick, asking Buildbucket for the build status
[14:48:27.544] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:48:27.544] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:100:0) after 1m0s
[14:49:27.628] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:100:0)
[14:49:27.628] Timer tick, asking Buildbucket for the build status
[14:49:27.708] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:49:27.708] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:101:0) after 1m0s
[14:50:27.789] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:101:0)
[14:50:27.789] Timer tick, asking Buildbucket for the build status
[14:50:27.858] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:50:27.858] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:102:0) after 1m0s
[14:51:28.403] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:102:0)
[14:51:28.403] Timer tick, asking Buildbucket for the build status
[14:51:28.494] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:51:28.494] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:103:0) after 1m0s
[14:52:28.519] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:103:0)
[14:52:28.519] Timer tick, asking Buildbucket for the build status
[14:52:28.705] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:52:28.705] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:104:0) after 1m0s
[14:53:28.748] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:104:0)
[14:53:28.748] Timer tick, asking Buildbucket for the build status
[14:53:28.816] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:53:28.816] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:105:0) after 1m0s
[14:54:29.032] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:105:0)
[14:54:29.032] Timer tick, asking Buildbucket for the build status
[14:54:29.102] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:54:29.102] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:106:0) after 1m0s
[14:55:29.199] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:106:0)
[14:55:29.199] Timer tick, asking Buildbucket for the build status
[14:55:29.284] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:55:29.284] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:107:0) after 1m0s
[14:56:29.343] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:107:0)
[14:56:29.343] Timer tick, asking Buildbucket for the build status
[14:56:29.483] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:56:29.483] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:108:0) after 1m0s
[14:57:29.571] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:108:0)
[14:57:29.571] Timer tick, asking Buildbucket for the build status
[14:57:29.696] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:57:29.696] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:109:0) after 1m0s
[14:58:29.807] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:109:0)
[14:58:29.807] Timer tick, asking Buildbucket for the build status
[14:58:30.141] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:58:30.141] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:110:0) after 1m0s
[14:59:30.254] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:110:0)
[14:59:30.254] Timer tick, asking Buildbucket for the build status
[14:59:30.332] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:59:30.332] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:111:0) after 1m0s
[15:00:30.548] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:111:0)
[15:00:30.548] Timer tick, asking Buildbucket for the build status
[15:00:30.646] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:00:30.646] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:112:0) after 1m0s
[15:01:30.737] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:112:0)
[15:01:30.737] Timer tick, asking Buildbucket for the build status
[15:01:30.842] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:01:30.842] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:113:0) after 1m0s
[15:02:30.987] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:113:0)
[15:02:30.987] Timer tick, asking Buildbucket for the build status
[15:02:31.100] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:02:31.100] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:114:0) after 1m0s
[15:03:31.155] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:114:0)
[15:03:31.155] Timer tick, asking Buildbucket for the build status
[15:03:31.429] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:03:31.429] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:115:0) after 1m0s
[15:04:31.500] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:115:0)
[15:04:31.500] Timer tick, asking Buildbucket for the build status
[15:04:31.588] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:04:31.588] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:116:0) after 1m0s
[15:05:31.634] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:116:0)
[15:05:31.634] Timer tick, asking Buildbucket for the build status
[15:05:31.724] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:05:31.724] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:117:0) after 1m0s
[15:06:31.751] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:117:0)
[15:06:31.751] Timer tick, asking Buildbucket for the build status
[15:06:32.137] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:06:32.137] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:118:0) after 1m0s
[15:07:32.147] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:118:0)
[15:07:32.147] Timer tick, asking Buildbucket for the build status
[15:07:32.211] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:07:32.211] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:119:0) after 1m0s
[15:08:32.194] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:119:0)
[15:08:32.194] Timer tick, asking Buildbucket for the build status
[15:08:32.456] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:08:32.456] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:120:0) after 1m0s
[15:09:32.479] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:120:0)
[15:09:32.479] Timer tick, asking Buildbucket for the build status
[15:09:32.644] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:09:32.644] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:121:0) after 1m0s
[15:10:32.738] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:121:0)
[15:10:32.738] Timer tick, asking Buildbucket for the build status
[15:10:33.118] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:10:33.118] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:122:0) after 1m0s
[15:11:33.178] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:122:0)
[15:11:33.178] Timer tick, asking Buildbucket for the build status
[15:11:33.509] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:11:33.509] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:123:0) after 1m0s
[15:12:33.592] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:123:0)
[15:12:33.592] Timer tick, asking Buildbucket for the build status
[15:12:33.655] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:12:33.655] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:124:0) after 1m0s
[15:13:33.679] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:124:0)
[15:13:33.679] Timer tick, asking Buildbucket for the build status
[15:13:33.754] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:13:33.754] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:125:0) after 1m0s
[15:14:33.782] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:125:0)
[15:14:33.782] Timer tick, asking Buildbucket for the build status
[15:14:33.852] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:14:33.852] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:126:0) after 1m0s
[15:15:33.891] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:126:0)
[15:15:33.891] Timer tick, asking Buildbucket for the build status
[15:15:33.992] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:15:33.992] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:127:0) after 1m0s
[15:16:34.111] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:127:0)
[15:16:34.111] Timer tick, asking Buildbucket for the build status
[15:16:34.195] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:16:34.195] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:128:0) after 1m0s
[15:17:34.228] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:128:0)
[15:17:34.228] Timer tick, asking Buildbucket for the build status
[15:17:34.294] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:17:34.294] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:129:0) after 1m0s
[15:18:34.421] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:129:0)
[15:18:34.421] Timer tick, asking Buildbucket for the build status
[15:18:34.522] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:18:34.522] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:130:0) after 1m0s
[15:19:34.612] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:130:0)
[15:19:34.612] Timer tick, asking Buildbucket for the build status
[15:19:35.224] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:19:35.224] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:131:0) after 1m0s
[15:20:35.318] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:131:0)
[15:20:35.318] Timer tick, asking Buildbucket for the build status
[15:20:35.388] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:20:35.388] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:132:0) after 1m0s
[15:21:35.376] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:132:0)
[15:21:35.376] Timer tick, asking Buildbucket for the build status
[15:21:35.459] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:21:35.459] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:133:0) after 1m0s
[15:22:35.482] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:133:0)
[15:22:35.482] Timer tick, asking Buildbucket for the build status
[15:22:35.566] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:22:35.566] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:134:0) after 1m0s
[15:23:35.591] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:134:0)
[15:23:35.591] Timer tick, asking Buildbucket for the build status
[15:23:35.922] Build 8853052468337524896: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:23:35.922] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018482530706801776:135:0) after 1m0s
[15:23:56.267] Received PubSub notification, asking Buildbucket for the build status
[15:23:56.356] Build 8853052468337524896: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[15:23:56.356] Buildbucket build:
{
"build": {
"bucket": "luci.emscripten-releases.ci",
"canary_preference": "PROD",
"completed_ts": "1615476235667302",
"created_by": "project:emscripten-releases",
"created_ts": "1615468261357654",
"id": "8853052468337524896",
"parameters_json": "{\"builder_name\": \"mac\", \"properties\": {\"$recipe_engine/scheduler\": {\"hostname\": \"luci-scheduler.appspot.com\", \"triggers\": [{\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://chromium.googlesource.com/emscripten-releases\", \"revision\": \"3001dec5b433e4a3a9c2d9a9a9a730f183d191f6\"}, \"id\": \"https://chromium.googlesource.com/emscripten-releases/+/refs/heads/master@3001dec5b433e4a3a9c2d9a9a9a730f183d191f6\", \"title\": \"3001dec5b433e4a3a9c2d9a9a9a730f183d191f6\", \"url\": \"https://chromium.googlesource.com/emscripten-releases/+/3001dec5b433e4a3a9c2d9a9a9a730f183d191f6\"}]}, \"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/emscripten-releases\", \"revision\": \"3001dec5b433e4a3a9c2d9a9a9a730f183d191f6\"}}",
"project": "emscripten-releases",
"result": "SUCCESS",
"result_details_json": "{\"properties\": {\"$build/goma\": {\"rpc_extra_params\": \"?prod\", \"server_host\": \"goma.chromium.org\", \"use_luci_auth\": true}, \"$recipe_engine/path\": {\"cache_dir\": \"/opt/s/w/ir/cache\", \"temp_dir\": \"/opt/s/w/ir/tmp/rt\"}, \"$recipe_engine/runtime\": {\"is_experimental\": false, \"is_luci\": true}, \"$recipe_engine/scheduler\": {\"hostname\": \"luci-scheduler.appspot.com\", \"triggers\": [{\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://chromium.googlesource.com/emscripten-releases\", \"revision\": \"3001dec5b433e4a3a9c2d9a9a9a730f183d191f6\"}, \"id\": \"https://chromium.googlesource.com/emscripten-releases/+/refs/heads/master@3001dec5b433e4a3a9c2d9a9a9a730f183d191f6\", \"title\": \"3001dec5b433e4a3a9c2d9a9a9a730f183d191f6\", \"url\": \"https://chromium.googlesource.com/emscripten-releases/+/3001dec5b433e4a3a9c2d9a9a9a730f183d191f6\"}]}, \"bot_id\": \"build498-m9\", \"branch\": \"refs/heads/master\", \"buildername\": \"mac\", \"got_revision\": \"3001dec5b433e4a3a9c2d9a9a9a730f183d191f6\", \"path_config\": \"generic\", \"recipe\": \"emscripten_releases\", \"repository\": \"https://chromium.googlesource.com/emscripten-releases\", \"revision\": \"3001dec5b433e4a3a9c2d9a9a9a730f183d191f6\"}, \"swarming\": {\"bot_dimensions\": {\"caches\": [\"builder_0d6fa4fff4995a408e468cf6236551b5d2129f3e939116f3b74cbba851b7eb7d_v2\", \"git\", \"goma_v2\", \"vpython\"], \"cores\": [\"4\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-i7-4578U\"], \"gce\": [\"0\"], \"gpu\": [\"8086\", \"8086:0a2e\"], \"hidpi\": [\"0\"], \"host_class\": [\"default\"], \"id\": [\"build498-m9\"], \"mac_model\": [\"Macmini7,1\"], \"machine_type\": [\"n1-standard-4\"], \"os\": [\"Mac\", \"Mac-10\", \"Mac-10.15\", \"Mac-10.15.6\", \"Mac-10.15.6-19G2021\"], \"pool\": [\"luci.emscripten-releases.ci\"], \"python\": [\"2.7.16\"], \"server_version\": [\"5754-8c4f760\"], \"ssd\": [\"1\"], \"zone\": [\"us\", \"us-atl\", \"us-atl-golo\", \"us-atl-golo-m9\"]}}}",
"service_account": "emscripten-releases-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1615471536727027",
"status": "COMPLETED",
"status_changed_ts": "1615476236004479",
"tags": [
"builder:mac",
"buildset:commit/git/3001dec5b433e4a3a9c2d9a9a9a730f183d191f6",
"buildset:commit/gitiles/chromium.googlesource.com/emscripten-releases/+/3001dec5b433e4a3a9c2d9a9a9a730f183d191f6",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9018482530706801776",
"scheduler_job_id:emscripten-releases/mac",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/emscripten-releases/buildbucket/cr-buildbucket.appspot.com/8853052468337524896/+/annotations",
"swarming_tag:luci_project:emscripten-releases",
"swarming_tag:os:Mac",
"swarming_tag:recipe_name:emscripten_releases",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_task_id:523a3af9aa7a6310",
"user_agent:luci-scheduler"
],
"updated_ts": "1615476236018921",
"url": "https://ci.chromium.org/b/8853052468337524896",
"utcnow_ts": "1615476236349371"
}
}
[15:23:56.356] Invocation finished in 2h12m56.642365262s with status SUCCEEDED