[00:42:44.710] New invocation is queued and will start shortly
[00:42:46.068] Starting the invocation (attempt 1)
[00:42:46.121] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[00:42:46.121] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[00:42:46.121] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9047430038831102976",
"parameters_json": "{\"builder_name\":\"Linux CFI\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"53836640273c3d45b05ad74bdff7323ef0ffc610\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:Linux CFI",
"scheduler_invocation_id:9047430038831102976",
"scheduler_job_id:chromium/Linux CFI",
"user_agent:luci-scheduler",
"buildset:commit/git/53836640273c3d45b05ad74bdff7323ef0ffc610",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/53836640273c3d45b05ad74bdff7323ef0ffc610",
"gitiles_ref:refs/heads/master"
]
}
[00:42:47.195] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1587861766274840",
"id": "8881999976525617440",
"parameters_json": "{\"builder_name\": \"Linux CFI\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"53836640273c3d45b05ad74bdff7323ef0ffc610\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1587861766850549",
"tags": [
"build_address:luci.chromium.ci/Linux CFI/17016",
"builder:Linux CFI",
"buildset:commit/git/53836640273c3d45b05ad74bdff7323ef0ffc610",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/53836640273c3d45b05ad74bdff7323ef0ffc610",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9047430038831102976",
"scheduler_job_id:chromium/Linux CFI",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8881999976525617440/+/annotations",
"swarming_tag:luci_project:chromium",
"swarming_tag:recipe_name:chromium",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_task_id:",
"user_agent:luci-scheduler"
],
"updated_ts": "1587861766850665",
"url": "https://ci.chromium.org/b/8881999976525617440",
"utcnow_ts": "1587861767182669"
}
}
[00:42:47.195] Task URL: https://ci.chromium.org/b/8881999976525617440
[00:42:47.195] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:2:0) after 1m0s
[00:42:50.396] Received PubSub notification, asking Buildbucket for the build status
[00:42:50.511] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:43:47.224] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:2:0)
[00:43:47.224] Timer tick, asking Buildbucket for the build status
[00:43:47.638] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:43:47.638] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:4:0) after 1m0s
[00:44:47.714] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:4:0)
[00:44:47.714] Timer tick, asking Buildbucket for the build status
[00:44:47.983] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:44:47.983] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:5:0) after 1m0s
[00:45:48.028] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:5:0)
[00:45:48.028] Timer tick, asking Buildbucket for the build status
[00:45:48.304] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:45:48.304] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:6:0) after 1m0s
[00:46:48.373] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:6:0)
[00:46:48.373] Timer tick, asking Buildbucket for the build status
[00:46:48.453] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:46:48.453] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:7:0) after 1m0s
[00:47:48.491] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:7:0)
[00:47:48.491] Timer tick, asking Buildbucket for the build status
[00:47:48.594] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:47:48.594] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:8:0) after 1m0s
[00:48:48.613] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:8:0)
[00:48:48.613] Timer tick, asking Buildbucket for the build status
[00:48:48.726] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:48:48.726] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:9:0) after 1m0s
[00:49:48.907] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:9:0)
[00:49:48.907] Timer tick, asking Buildbucket for the build status
[00:49:49.159] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:49:49.159] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:10:0) after 1m0s
[00:50:49.206] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:10:0)
[00:50:49.206] Timer tick, asking Buildbucket for the build status
[00:50:49.431] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:50:49.431] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:11:0) after 1m0s
[00:51:49.457] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:11:0)
[00:51:49.457] Timer tick, asking Buildbucket for the build status
[00:51:49.599] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:51:49.599] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:12:0) after 1m0s
[00:52:49.763] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:12:0)
[00:52:49.763] Timer tick, asking Buildbucket for the build status
[00:52:49.878] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:52:49.878] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:13:0) after 1m0s
[00:53:49.902] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:13:0)
[00:53:49.902] Timer tick, asking Buildbucket for the build status
[00:53:50.024] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:53:50.024] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:14:0) after 1m0s
[00:54:50.090] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:14:0)
[00:54:50.090] Timer tick, asking Buildbucket for the build status
[00:54:50.595] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:54:50.595] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:15:0) after 1m0s
[00:55:50.661] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:15:0)
[00:55:50.661] Timer tick, asking Buildbucket for the build status
[00:55:51.229] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:55:51.229] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:16:0) after 1m0s
[00:56:51.365] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:16:0)
[00:56:51.365] Timer tick, asking Buildbucket for the build status
[00:56:51.535] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:56:51.535] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:17:0) after 1m0s
[00:57:51.652] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:17:0)
[00:57:51.652] Timer tick, asking Buildbucket for the build status
[00:57:51.836] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:57:51.836] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:18:0) after 1m0s
[00:58:51.923] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:18:0)
[00:58:51.923] Timer tick, asking Buildbucket for the build status
[00:58:52.004] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:58:52.004] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:19:0) after 1m0s
[00:59:52.169] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:19:0)
[00:59:52.169] Timer tick, asking Buildbucket for the build status
[00:59:52.252] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:59:52.252] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:20:0) after 1m0s
[01:00:53.261] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:20:0)
[01:00:53.261] Timer tick, asking Buildbucket for the build status
[01:00:53.465] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:00:53.465] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:21:0) after 1m0s
[01:01:53.835] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:21:0)
[01:01:53.835] Timer tick, asking Buildbucket for the build status
[01:01:54.121] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:01:54.121] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:22:0) after 1m0s
[01:02:54.239] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:22:0)
[01:02:54.239] Timer tick, asking Buildbucket for the build status
[01:02:54.409] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:02:54.409] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:23:0) after 1m0s
[01:03:54.948] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:23:0)
[01:03:54.948] Timer tick, asking Buildbucket for the build status
[01:03:55.112] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:03:55.112] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:24:0) after 1m0s
[01:04:55.253] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:24:0)
[01:04:55.253] Timer tick, asking Buildbucket for the build status
[01:04:55.366] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:04:55.366] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:25:0) after 1m0s
[01:05:55.558] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:25:0)
[01:05:55.558] Timer tick, asking Buildbucket for the build status
[01:05:55.747] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:05:55.747] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:26:0) after 1m0s
[01:06:55.969] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:26:0)
[01:06:55.969] Timer tick, asking Buildbucket for the build status
[01:06:56.258] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:06:56.258] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:27:0) after 1m0s
[01:07:56.325] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:27:0)
[01:07:56.325] Timer tick, asking Buildbucket for the build status
[01:07:56.431] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:07:56.431] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:28:0) after 1m0s
[01:08:56.507] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:28:0)
[01:08:56.507] Timer tick, asking Buildbucket for the build status
[01:08:56.626] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:08:56.626] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:29:0) after 1m0s
[01:09:56.855] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:29:0)
[01:09:56.855] Timer tick, asking Buildbucket for the build status
[01:09:57.147] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:09:57.147] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:30:0) after 1m0s
[01:10:57.151] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:30:0)
[01:10:57.151] Timer tick, asking Buildbucket for the build status
[01:10:57.581] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:10:57.581] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:31:0) after 1m0s
[01:11:57.559] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:31:0)
[01:11:57.559] Timer tick, asking Buildbucket for the build status
[01:11:57.661] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:11:57.661] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:32:0) after 1m0s
[01:12:57.661] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:32:0)
[01:12:57.661] Timer tick, asking Buildbucket for the build status
[01:12:57.793] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:12:57.793] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:33:0) after 1m0s
[01:13:57.868] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:33:0)
[01:13:57.868] Timer tick, asking Buildbucket for the build status
[01:13:58.186] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:13:58.187] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:34:0) after 1m0s
[01:14:58.284] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:34:0)
[01:14:58.284] Timer tick, asking Buildbucket for the build status
[01:14:58.484] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:14:58.484] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:35:0) after 1m0s
[01:15:58.623] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:35:0)
[01:15:58.623] Timer tick, asking Buildbucket for the build status
[01:15:58.747] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:15:58.747] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:36:0) after 1m0s
[01:16:58.769] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:36:0)
[01:16:58.770] Timer tick, asking Buildbucket for the build status
[01:16:59.102] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:16:59.102] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:37:0) after 1m0s
[01:17:59.251] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:37:0)
[01:17:59.251] Timer tick, asking Buildbucket for the build status
[01:17:59.416] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:17:59.416] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:38:0) after 1m0s
[01:18:59.488] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:38:0)
[01:18:59.488] Timer tick, asking Buildbucket for the build status
[01:18:59.650] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:18:59.650] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:39:0) after 1m0s
[01:19:59.750] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:39:0)
[01:19:59.750] Timer tick, asking Buildbucket for the build status
[01:19:59.867] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:19:59.867] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:40:0) after 1m0s
[01:20:59.960] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:40:0)
[01:20:59.960] Timer tick, asking Buildbucket for the build status
[01:21:00.094] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:21:00.094] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:41:0) after 1m0s
[01:22:00.129] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:41:0)
[01:22:00.129] Timer tick, asking Buildbucket for the build status
[01:22:00.403] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:22:00.403] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:42:0) after 1m0s
[01:23:00.437] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:42:0)
[01:23:00.437] Timer tick, asking Buildbucket for the build status
[01:23:00.575] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:23:00.575] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:43:0) after 1m0s
[01:24:01.741] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:43:0)
[01:24:01.741] Timer tick, asking Buildbucket for the build status
[01:24:01.912] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:24:01.912] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:44:0) after 1m0s
[01:25:01.938] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:44:0)
[01:25:01.938] Timer tick, asking Buildbucket for the build status
[01:25:02.064] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:25:02.065] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:45:0) after 1m0s
[01:26:02.097] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:45:0)
[01:26:02.097] Timer tick, asking Buildbucket for the build status
[01:26:02.231] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:26:02.231] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:46:0) after 1m0s
[01:27:02.527] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:46:0)
[01:27:02.527] Timer tick, asking Buildbucket for the build status
[01:27:02.693] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:27:02.693] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:47:0) after 1m0s
[01:28:02.773] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:47:0)
[01:28:02.773] Timer tick, asking Buildbucket for the build status
[01:28:03.234] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:28:03.234] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:48:0) after 1m0s
[01:29:03.312] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:48:0)
[01:29:03.312] Timer tick, asking Buildbucket for the build status
[01:29:03.481] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:29:03.481] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:49:0) after 1m0s
[01:30:03.506] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:49:0)
[01:30:03.506] Timer tick, asking Buildbucket for the build status
[01:30:05.531] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:30:05.531] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:50:0) after 1m0s
[01:31:05.643] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:50:0)
[01:31:05.643] Timer tick, asking Buildbucket for the build status
[01:31:05.788] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:31:05.788] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:51:0) after 1m0s
[01:32:05.792] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:51:0)
[01:32:05.792] Timer tick, asking Buildbucket for the build status
[01:32:05.932] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:32:05.932] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:52:0) after 1m0s
[01:33:05.959] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:52:0)
[01:33:05.959] Timer tick, asking Buildbucket for the build status
[01:33:06.123] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:33:06.123] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:53:0) after 1m0s
[01:34:06.154] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:53:0)
[01:34:06.154] Timer tick, asking Buildbucket for the build status
[01:34:06.305] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:34:06.305] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:54:0) after 1m0s
[01:35:06.412] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:54:0)
[01:35:06.412] Timer tick, asking Buildbucket for the build status
[01:35:06.561] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:35:06.561] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:55:0) after 1m0s
[01:36:07.009] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:55:0)
[01:36:07.009] Timer tick, asking Buildbucket for the build status
[01:36:07.137] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:36:07.137] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:56:0) after 1m0s
[01:37:07.384] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:56:0)
[01:37:07.384] Timer tick, asking Buildbucket for the build status
[01:37:07.500] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:37:07.500] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:57:0) after 1m0s
[01:38:07.810] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:57:0)
[01:38:07.810] Timer tick, asking Buildbucket for the build status
[01:38:08.076] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:38:08.076] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:58:0) after 1m0s
[01:39:08.241] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:58:0)
[01:39:08.241] Timer tick, asking Buildbucket for the build status
[01:39:08.652] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:39:08.652] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:59:0) after 1m0s
[01:40:08.860] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:59:0)
[01:40:08.860] Timer tick, asking Buildbucket for the build status
[01:40:09.127] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:40:09.127] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:60:0) after 1m0s
[01:41:09.259] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:60:0)
[01:41:09.259] Timer tick, asking Buildbucket for the build status
[01:41:09.464] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:41:09.464] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:61:0) after 1m0s
[01:42:09.613] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:61:0)
[01:42:09.613] Timer tick, asking Buildbucket for the build status
[01:42:09.779] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:42:09.779] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:62:0) after 1m0s
[01:43:10.019] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:62:0)
[01:43:10.019] Timer tick, asking Buildbucket for the build status
[01:43:10.438] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:43:10.438] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:63:0) after 1m0s
[01:44:10.741] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:63:0)
[01:44:10.741] Timer tick, asking Buildbucket for the build status
[01:44:10.893] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:44:10.893] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:64:0) after 1m0s
[01:45:11.086] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:64:0)
[01:45:11.086] Timer tick, asking Buildbucket for the build status
[01:45:11.353] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:45:11.353] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:65:0) after 1m0s
[01:46:11.411] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:65:0)
[01:46:11.411] Timer tick, asking Buildbucket for the build status
[01:46:11.511] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:46:11.511] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:66:0) after 1m0s
[01:47:11.581] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:66:0)
[01:47:11.581] Timer tick, asking Buildbucket for the build status
[01:47:11.708] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:47:11.708] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:67:0) after 1m0s
[01:48:11.762] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:67:0)
[01:48:11.762] Timer tick, asking Buildbucket for the build status
[01:48:12.032] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:48:12.033] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:68:0) after 1m0s
[01:49:12.055] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:68:0)
[01:49:12.055] Timer tick, asking Buildbucket for the build status
[01:49:12.178] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:49:12.178] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:69:0) after 1m0s
[01:50:12.256] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:69:0)
[01:50:12.256] Timer tick, asking Buildbucket for the build status
[01:50:12.399] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:50:12.399] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:70:0) after 1m0s
[01:51:12.629] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:70:0)
[01:51:12.629] Timer tick, asking Buildbucket for the build status
[01:51:12.850] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:51:12.850] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:71:0) after 1m0s
[01:52:12.862] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:71:0)
[01:52:12.862] Timer tick, asking Buildbucket for the build status
[01:52:12.964] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:52:12.964] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:72:0) after 1m0s
[01:53:13.001] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:72:0)
[01:53:13.001] Timer tick, asking Buildbucket for the build status
[01:53:13.189] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:53:13.189] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:73:0) after 1m0s
[01:54:13.283] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:73:0)
[01:54:13.283] Timer tick, asking Buildbucket for the build status
[01:54:13.481] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:54:13.481] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:74:0) after 1m0s
[01:55:13.701] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:74:0)
[01:55:13.701] Timer tick, asking Buildbucket for the build status
[01:55:13.809] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:55:13.809] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:75:0) after 1m0s
[01:56:13.881] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:75:0)
[01:56:13.881] Timer tick, asking Buildbucket for the build status
[01:56:14.248] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:56:14.248] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:76:0) after 1m0s
[01:57:14.322] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:76:0)
[01:57:14.322] Timer tick, asking Buildbucket for the build status
[01:57:14.580] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:57:14.580] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:77:0) after 1m0s
[01:58:14.782] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:77:0)
[01:58:14.782] Timer tick, asking Buildbucket for the build status
[01:58:14.935] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:58:14.935] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:78:0) after 1m0s
[01:59:15.022] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:78:0)
[01:59:15.022] Timer tick, asking Buildbucket for the build status
[01:59:15.190] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:59:15.190] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:79:0) after 1m0s
[02:00:15.221] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:79:0)
[02:00:15.221] Timer tick, asking Buildbucket for the build status
[02:00:15.575] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:00:15.575] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:80:0) after 1m0s
[02:01:15.657] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:80:0)
[02:01:15.657] Timer tick, asking Buildbucket for the build status
[02:01:15.855] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:01:15.855] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:81:0) after 1m0s
[02:02:15.976] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:81:0)
[02:02:15.976] Timer tick, asking Buildbucket for the build status
[02:02:16.511] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:02:16.512] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:82:0) after 1m0s
[02:03:16.542] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:82:0)
[02:03:16.542] Timer tick, asking Buildbucket for the build status
[02:03:16.954] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:03:16.954] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:83:0) after 1m0s
[02:04:17.075] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:83:0)
[02:04:17.075] Timer tick, asking Buildbucket for the build status
[02:04:17.222] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:04:17.222] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:84:0) after 1m0s
[02:05:17.274] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:84:0)
[02:05:17.274] Timer tick, asking Buildbucket for the build status
[02:05:17.787] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:05:17.787] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:85:0) after 1m0s
[02:06:22.456] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:85:0)
[02:06:22.456] Timer tick, asking Buildbucket for the build status
[02:06:22.585] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:06:22.585] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:86:0) after 1m0s
[02:07:22.617] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:86:0)
[02:07:22.617] Timer tick, asking Buildbucket for the build status
[02:07:22.744] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:07:22.744] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:87:0) after 1m0s
[02:08:22.856] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:87:0)
[02:08:22.856] Timer tick, asking Buildbucket for the build status
[02:08:23.076] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:08:23.076] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:88:0) after 1m0s
[02:09:23.141] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:88:0)
[02:09:23.141] Timer tick, asking Buildbucket for the build status
[02:09:23.537] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:09:23.537] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:89:0) after 1m0s
[02:10:23.566] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:89:0)
[02:10:23.566] Timer tick, asking Buildbucket for the build status
[02:10:23.764] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:10:23.764] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:90:0) after 1m0s
[02:11:23.894] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:90:0)
[02:11:23.894] Timer tick, asking Buildbucket for the build status
[02:11:24.329] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:11:24.329] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:91:0) after 1m0s
[02:12:24.501] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:91:0)
[02:12:24.501] Timer tick, asking Buildbucket for the build status
[02:12:24.653] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:12:24.653] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:92:0) after 1m0s
[02:13:24.723] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:92:0)
[02:13:24.723] Timer tick, asking Buildbucket for the build status
[02:13:24.939] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:13:24.939] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:93:0) after 1m0s
[02:14:24.963] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:93:0)
[02:14:24.963] Timer tick, asking Buildbucket for the build status
[02:14:25.079] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:14:25.079] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:94:0) after 1m0s
[02:15:25.157] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:94:0)
[02:15:25.157] Timer tick, asking Buildbucket for the build status
[02:15:25.382] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:15:25.382] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:95:0) after 1m0s
[02:16:25.362] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:95:0)
[02:16:25.362] Timer tick, asking Buildbucket for the build status
[02:16:25.510] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:16:25.510] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:96:0) after 1m0s
[02:17:25.556] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:96:0)
[02:17:25.556] Timer tick, asking Buildbucket for the build status
[02:17:25.879] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:17:25.879] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:97:0) after 1m0s
[02:18:25.948] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:97:0)
[02:18:25.948] Timer tick, asking Buildbucket for the build status
[02:18:26.154] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:18:26.154] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:98:0) after 1m0s
[02:19:26.236] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:98:0)
[02:19:26.236] Timer tick, asking Buildbucket for the build status
[02:19:26.400] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:19:26.400] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:99:0) after 1m0s
[02:20:26.429] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:99:0)
[02:20:26.429] Timer tick, asking Buildbucket for the build status
[02:20:26.851] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:20:26.851] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:100:0) after 1m0s
[02:21:26.898] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:100:0)
[02:21:26.898] Timer tick, asking Buildbucket for the build status
[02:21:27.030] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:21:27.030] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:101:0) after 1m0s
[02:22:27.071] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:101:0)
[02:22:27.072] Timer tick, asking Buildbucket for the build status
[02:22:27.215] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:22:27.215] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:102:0) after 1m0s
[02:23:27.206] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:102:0)
[02:23:27.206] Timer tick, asking Buildbucket for the build status
[02:23:27.537] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:23:27.537] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:103:0) after 1m0s
[02:24:27.562] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:103:0)
[02:24:27.562] Timer tick, asking Buildbucket for the build status
[02:24:28.375] Build 8881999976525617440: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:24:28.375] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9047430038831102976:104:0) after 1m0s
[02:25:21.009] Received PubSub notification, asking Buildbucket for the build status
[02:25:21.130] Build 8881999976525617440: status "COMPLETED", result "FAILURE", failure_reason "BUILD_FAILURE", cancelation_reason ""
[02:25:21.130] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1587867919746055",
"created_by": "project:chromium",
"created_ts": "1587861766274840",
"failure_reason": "BUILD_FAILURE",
"id": "8881999976525617440",
"parameters_json": "{\"builder_name\": \"Linux CFI\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"53836640273c3d45b05ad74bdff7323ef0ffc610\"}}",
"project": "chromium",
"result": "FAILURE",
"result_details_json": "{\"error\": {\"message\": \"1 Test Suite(s) failed.\\n\\n**content_browsertests** failed because of:\\n\\n- SitePerProcessHitTestBrowserTest.ScrolledNestedPopupMenuTest\"}, \"properties\": {\"$build/goma\": {\"enable_ats\": true, \"jobs\": 500.0, \"rpc_extra_params\": \"?prod\", \"server_host\": \"goma.chromium.org\"}, \"$recipe_engine/path\": {\"cache_dir\": \"/b/s/w/ir/cache\", \"temp_dir\": \"/b/s/w/ir/tmp/rt\"}, \"$recipe_engine/runtime\": {\"is_experimental\": false, \"is_luci\": true}, \"bot_id\": \"luci-chromium-ci-xenial-32-9-9kvk\", \"branch\": \"refs/heads/master\", \"buildername\": \"Linux CFI\", \"buildnumber\": 17016, \"got_angle_revision\": \"3cb9c4bee9b369a2172d5c22e6eb70da49a799ed\", \"got_dawn_revision\": \"c244f5392178290ec559d8d62a63038ad79309a8\", \"got_nacl_revision\": \"b599fb88f59e617bfed2cf03729f24be5c378e2c\", \"got_revision\": \"53836640273c3d45b05ad74bdff7323ef0ffc610\", \"got_revision_cp\": \"refs/heads/master@{#762673}\", \"got_swarming_client_revision\": \"160b445a44e0daacf6f3f8570ca2707ec451f374\", \"got_swiftshader_revision\": \"60aa34a990fa77553e2d9a69d34f0b3601ced66a\", \"got_v8_revision\": \"0d2d6cca94bc6a2a9eae8dd00de88d923e5b6188\", \"got_v8_revision_cp\": \"refs/heads/8.4.191@{#1}\", \"got_webrtc_revision\": \"1b8ef63876ebfa55a51c8ca9b1d8206bf8233e01\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#31130}\", \"isolate_server\": \"https://isolateserver.appspot.com\", \"mastername\": \"chromium.memory\", \"path_config\": \"generic\", \"recipe\": \"chromium\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"53836640273c3d45b05ad74bdff7323ef0ffc610\", \"swarm_hashes\": {\"accessibility_unittests\": \"c704859fb263d801ef6e6068d22d86d0bbada364\", \"angle_unittests\": \"e9071d7f017f0bc4d3817b3bfcba810087296c43\", \"app_shell_unittests\": \"5171289a55f92f7cc91f3fdd212173a5b5da9dfb\", \"aura_unittests\": \"0e8df4c3210bfa38881e5f75c44ac280de716b32\", \"base_unittests\": \"c6da3d9e688cf98e1805a1e8d4e4bb204d7ca8f9\", \"base_util_unittests\": \"cf023ed3af3e56b3a211e8ce5323657770f5c28d\", \"blink_common_unittests\": \"128de92d54a113a4a34b7cb387efd80f917c6283\", \"blink_fuzzer_unittests\": \"d3c471bb375f565ac78e6c8eba7456e25e0eedc8\", \"blink_heap_unittests\": \"7d00e6431e7f7aacbffe8b399631599bcd6f4c89\", \"blink_platform_unittests\": \"0046d4a67cee5aa4fc30e5088bcdbd65280dab35\", \"blink_unittests\": \"6ead3593938a3b54bc4b6a1694daa00f1f251ad6\", \"boringssl_crypto_tests\": \"4102d97e7f0b20c07aa02b4c6f6ff587b9704390\", \"boringssl_ssl_tests\": \"c9b6702f08ffa3fa562448e2b095d0df2d84f859\", \"browser_tests\": \"9c27155f042a16a40b2981cadfb9aa08b849e880\", \"cacheinvalidation_unittests\": \"7f19be7873e57cadb7626ebb9a3da93e18835911\", \"capture_unittests\": \"6f9ff3bbb120aefe8ed994f1001e385da557d0fa\", \"cast_unittests\": \"527eea897c041b182fdb32fa2a34ee75db2aea85\", \"cc_unittests\": \"20766f1d04a1309b61c3eafd853de696e04724ff\", \"chrome_app_unittests\": \"ccfa95f1996a9c7bb81934aa5e45f4236c4f4739\", \"chromedriver_unittests\": \"ff28f37e7fe461d9feb8f8fceecfac81aaf154fa\", \"components_browsertests\": \"b510ca4cd21eade4b7e1cf34c2432a4563b442bf\", \"components_unittests\": \"0046de483a1195d78d24e24fc9a704e1508e1a8f\", \"compositor_unittests\": \"100c00dace4cbaf5a902d5bddd8880a4daebdc72\", \"content_browsertests\": \"77fd3712c32391c08eec12ec5067c10f8eca6498\", \"content_unittests\": \"df31e5019426489aa2464576654c2125cc5575b4\", \"cronet_tests\": \"7cad34de836cbc8e36f187d27e032e014484326f\", \"cronet_unittests\": \"839771959cb7cf3e0d4918c01f6eb9a6d385c10a\", \"crypto_unittests\": \"e59a45b2c070a022b7baff93ef3748c2caa8f6d1\", \"dbus_unittests\": \"83d12e9f7e91afc046c2e0a84b56288620ad38f6\", \"device_unittests\": \"8f7e6f69cf6db7a721eebb745156e40d8801519a\", \"display_unittests\": \"69af2eef2923bdaf7674df4fc043c79e4423627b\", \"events_unittests\": \"c588a1c410b2885faa8ca8190703fca9a8d9046c\", \"extensions_browsertests\": \"bbab693b85acdc2dfa4d4c859886dc58e6b154a6\", \"extensions_unittests\": \"a9eb3deb9818ea0d33515b98a291faf9b41ca7dc\", \"filesystem_service_unittests\": \"a93e4e221d79136cfe9d2ae5b475d04932484785\", \"gcm_unit_tests\": \"9f4b728b1b06b58955e33cda97c786401f868ede\", \"gfx_unittests\": \"5894b523f03189dec5be74d27ebacd35cc580a58\", \"gin_unittests\": \"b0ae47662627403ae1426dba5be6ad65abe90223\", \"gl_tests\": \"28227a4a4e7e3acad7128a173761e8dd2b4930f6\", \"gl_unittests\": \"3e4c6a062c153979081b5ed62cfaf438b2652c0f\", \"google_apis_unittests\": \"4d5bfaafc3111e31cf8ce7018e17798a2ce4ff09\", \"gpu_unittests\": \"827d88ae2fa3df1f29e469b200dd4eadec02c0a3\", \"gwp_asan_unittests\": \"51b1d47f0500c84faae19e6383cb9ec23a9b5b3c\", \"headless_browsertests\": \"7b89fb634896be385bc309dd968dcdaba6e125f1\", \"headless_unittests\": \"203ac67d0e5ab9e3fbee53d827550acb04d003d4\", \"interactive_ui_tests\": \"9771491536c23027de7f93d8e123a87dddc2e7db\", \"ipc_tests\": \"8346b2563ece3136342010841fbc1165d559673a\", \"jingle_unittests\": \"dd33b480ca160f2b7ba411cb64d668a04bde1e86\", \"latency_unittests\": \"b1fd2dfbd23e58e3c9b2efe9d68b4cf35f3cadce\", \"libjingle_xmpp_unittests\": \"cb19c66c2ce77bf5e756b9be72bcc848636c524e\", \"media_blink_unittests\": \"e640e92566a62735a2e1c3aa291c5e2442168e7e\", \"media_unittests\": \"075e574ba450304aee09ae87c73e53b06ee11e58\", \"message_center_unittests\": \"2c3d659e679e4bba8aee6ce87356f819fcfbc6b2\", \"midi_unittests\": \"3e443d6409e6ce3045032f0f10201dbcdb7b6a4a\", \"mojo_core_unittests\": \"dd2d3cc8af622108bb4c1776e38bc41c1b1b573d\", \"mojo_unittests\": \"3c4bd12ea763d6f799ca034ab464ae91744872d4\", \"nacl_helper_nonsfi_unittests\": \"1b6dd0e875ace786b88491922765b42fd657450d\", \"nacl_loader_unittests\": \"450bd92b5d5ff13dfc57e2b161a65781da2650d3\", \"native_theme_unittests\": \"f152db0451194ef3ee2a0a726889cf5a5f118ecf\", \"net_unittests\": \"77bde036168cff3ca3f6f87764c4f07b95b9091e\", \"pdf_unittests\": \"8b7d85f33e5799b41eeb0612da27c80b9a78d92e\", \"perfetto_unittests\": \"3a94c908ea31038c8828926d87a28ff120b286f2\", \"ppapi_unittests\": \"62143c30dd7ac56d617aad4e091deeb48b1d12c7\", \"printing_unittests\": \"dfde9429d14f38867e190da2b16efc1b2168e39d\", \"remoting_unittests\": \"331416d8d1115049f50cb7b45cbb36e5dd91a53e\", \"sandbox_linux_unittests\": \"0a3c2132770d0a96c8b61416c12f95ef404d1e29\", \"service_manager_unittests\": \"43ded7d18f6ffba4d5e63ee61224ef0b4afa7543\", \"services_unittests\": \"2bffa4aa7048cd018d9905dd5713089496d33657\", \"shell_dialogs_unittests\": \"4658c73577f5f347af6b595efe1376fecd2fed23\", \"skia_unittests\": \"cb3098bfe3f70ced119c99105eac66bfce960561\", \"snapshot_unittests\": \"8f661bae607a8d6970cb28076ea529e82791ee2f\", \"sql_unittests\": \"d83fbf19d682e2d1dbbcf9e2d5a6fdb1be57019a\", \"storage_unittests\": \"19b7d54f1229da6820996218136178ea61e52c48\", \"sync_integration_tests\": \"b296534b59fe73311ddba129e3638dcdf6bdc206\", \"traffic_annotation_auditor_unittests\": \"d02f3094b63d2da0a0bc83618cfdfca769dca61f\", \"ui_base_unittests\": \"d469786dc624f43cd180925b830608e7a2520208\", \"ui_touch_selection_unittests\": \"2a054a9ee9a73a401c0493922b2c85fa67c460c6\", \"unit_tests\": \"b6b7d140afea950c87e440e5de56401a4aabf156\", \"url_unittests\": \"362d5edff9c4b061413c0db6f4bb3ab8f59f5486\", \"views_unittests\": \"7a14c2b303535350b05051208642fe5744a591e1\", \"viz_unittests\": \"dde0aad612b339b37ee968a5f61e27d9bbf32e83\", \"vr_common_unittests\": \"9abe43faae3ca6bb2b9c0c81484a2843931eaae4\", \"vr_pixeltests\": \"6fd64ba4013ace731e434a027f76f304e209d463\", \"wm_unittests\": \"d905157468c8b0ee96d0320d159cb0c3a5efa8ae\", \"wtf_unittests\": \"8311111d1d1915196b867f3fc93dacf2b1441e32\"}, \"swarm_hashes_refs/heads/master(at){#762673}_without_patch\": {\"accessibility_unittests\": \"c704859fb263d801ef6e6068d22d86d0bbada364\", \"angle_unittests\": \"e9071d7f017f0bc4d3817b3bfcba810087296c43\", \"app_shell_unittests\": \"5171289a55f92f7cc91f3fdd212173a5b5da9dfb\", \"aura_unittests\": \"0e8df4c3210bfa38881e5f75c44ac280de716b32\", \"base_unittests\": \"c6da3d9e688cf98e1805a1e8d4e4bb204d7ca8f9\", \"base_util_unittests\": \"cf023ed3af3e56b3a211e8ce5323657770f5c28d\", \"blink_common_unittests\": \"128de92d54a113a4a34b7cb387efd80f917c6283\", \"blink_fuzzer_unittests\": \"d3c471bb375f565ac78e6c8eba7456e25e0eedc8\", \"blink_heap_unittests\": \"7d00e6431e7f7aacbffe8b399631599bcd6f4c89\", \"blink_platform_unittests\": \"0046d4a67cee5aa4fc30e5088bcdbd65280dab35\", \"blink_unittests\": \"6ead3593938a3b54bc4b6a1694daa00f1f251ad6\", \"boringssl_crypto_tests\": \"4102d97e7f0b20c07aa02b4c6f6ff587b9704390\", \"boringssl_ssl_tests\": \"c9b6702f08ffa3fa562448e2b095d0df2d84f859\", \"browser_tests\": \"9c27155f042a16a40b2981cadfb9aa08b849e880\", \"cacheinvalidation_unittests\": \"7f19be7873e57cadb7626ebb9a3da93e18835911\", \"capture_unittests\": \"6f9ff3bbb120aefe8ed994f1001e385da557d0fa\", \"cast_unittests\": \"527eea897c041b182fdb32fa2a34ee75db2aea85\", \"cc_unittests\": \"20766f1d04a1309b61c3eafd853de696e04724ff\", \"chrome_app_unittests\": \"ccfa95f1996a9c7bb81934aa5e45f4236c4f4739\", \"chromedriver_unittests\": \"ff28f37e7fe461d9feb8f8fceecfac81aaf154fa\", \"components_browsertests\": \"b510ca4cd21eade4b7e1cf34c2432a4563b442bf\", \"components_unittests\": \"0046de483a1195d78d24e24fc9a704e1508e1a8f\", \"compositor_unittests\": \"100c00dace4cbaf5a902d5bddd8880a4daebdc72\", \"content_browsertests\": \"77fd3712c32391c08eec12ec5067c10f8eca6498\", \"content_unittests\": \"df31e5019426489aa2464576654c2125cc5575b4\", \"cronet_tests\": \"7cad34de836cbc8e36f187d27e032e014484326f\", \"cronet_unittests\": \"839771959cb7cf3e0d4918c01f6eb9a6d385c10a\", \"crypto_unittests\": \"e59a45b2c070a022b7baff93ef3748c2caa8f6d1\", \"dbus_unittests\": \"83d12e9f7e91afc046c2e0a84b56288620ad38f6\", \"device_unittests\": \"8f7e6f69cf6db7a721eebb745156e40d8801519a\", \"display_unittests\": \"69af2eef2923bdaf7674df4fc043c79e4423627b\", \"events_unittests\": \"c588a1c410b2885faa8ca8190703fca9a8d9046c\", \"extensions_browsertests\": \"bbab693b85acdc2dfa4d4c859886dc58e6b154a6\", \"extensions_unittests\": \"a9eb3deb9818ea0d33515b98a291faf9b41ca7dc\", \"filesystem_service_unittests\": \"a93e4e221d79136cfe9d2ae5b475d04932484785\", \"gcm_unit_tests\": \"9f4b728b1b06b58955e33cda97c786401f868ede\", \"gfx_unittests\": \"5894b523f03189dec5be74d27ebacd35cc580a58\", \"gin_unittests\": \"b0ae47662627403ae1426dba5be6ad65abe90223\", \"gl_tests\": \"28227a4a4e7e3acad7128a173761e8dd2b4930f6\", \"gl_unittests\": \"3e4c6a062c153979081b5ed62cfaf438b2652c0f\", \"google_apis_unittests\": \"4d5bfaafc3111e31cf8ce7018e17798a2ce4ff09\", \"gpu_unittests\": \"827d88ae2fa3df1f29e469b200dd4eadec02c0a3\", \"gwp_asan_unittests\": \"51b1d47f0500c84faae19e6383cb9ec23a9b5b3c\", \"headless_browsertests\": \"7b89fb634896be385bc309dd968dcdaba6e125f1\", \"headless_unittests\": \"203ac67d0e5ab9e3fbee53d827550acb04d003d4\", \"interactive_ui_tests\": \"9771491536c23027de7f93d8e123a87dddc2e7db\", \"ipc_tests\": \"8346b2563ece3136342010841fbc1165d559673a\", \"jingle_unittests\": \"dd33b480ca160f2b7ba411cb64d668a04bde1e86\", \"latency_unittests\": \"b1fd2dfbd23e58e3c9b2efe9d68b4cf35f3cadce\", \"libjingle_xmpp_unittests\": \"cb19c66c2ce77bf5e756b9be72bcc848636c524e\", \"media_blink_unittests\": \"e640e92566a62735a2e1c3aa291c5e2442168e7e\", \"media_unittests\": \"075e574ba450304aee09ae87c73e53b06ee11e58\", \"message_center_unittests\": \"2c3d659e679e4bba8aee6ce87356f819fcfbc6b2\", \"midi_unittests\": \"3e443d6409e6ce3045032f0f10201dbcdb7b6a4a\", \"mojo_core_unittests\": \"dd2d3cc8af622108bb4c1776e38bc41c1b1b573d\", \"mojo_unittests\": \"3c4bd12ea763d6f799ca034ab464ae91744872d4\", \"nacl_helper_nonsfi_unittests\": \"1b6dd0e875ace786b88491922765b42fd657450d\", \"nacl_loader_unittests\": \"450bd92b5d5ff13dfc57e2b161a65781da2650d3\", \"native_theme_unittests\": \"f152db0451194ef3ee2a0a726889cf5a5f118ecf\", \"net_unittests\": \"77bde036168cff3ca3f6f87764c4f07b95b9091e\", \"pdf_unittests\": \"8b7d85f33e5799b41eeb0612da27c80b9a78d92e\", \"perfetto_unittests\": \"3a94c908ea31038c8828926d87a28ff120b286f2\", \"ppapi_unittests\": \"62143c30dd7ac56d617aad4e091deeb48b1d12c7\", \"printing_unittests\": \"dfde9429d14f38867e190da2b16efc1b2168e39d\", \"remoting_unittests\": \"331416d8d1115049f50cb7b45cbb36e5dd91a53e\", \"sandbox_linux_unittests\": \"0a3c2132770d0a96c8b61416c12f95ef404d1e29\", \"service_manager_unittests\": \"43ded7d18f6ffba4d5e63ee61224ef0b4afa7543\", \"services_unittests\": \"2bffa4aa7048cd018d9905dd5713089496d33657\", \"shell_dialogs_unittests\": \"4658c73577f5f347af6b595efe1376fecd2fed23\", \"skia_unittests\": \"cb3098bfe3f70ced119c99105eac66bfce960561\", \"snapshot_unittests\": \"8f661bae607a8d6970cb28076ea529e82791ee2f\", \"sql_unittests\": \"d83fbf19d682e2d1dbbcf9e2d5a6fdb1be57019a\", \"storage_unittests\": \"19b7d54f1229da6820996218136178ea61e52c48\", \"sync_integration_tests\": \"b296534b59fe73311ddba129e3638dcdf6bdc206\", \"traffic_annotation_auditor_unittests\": \"d02f3094b63d2da0a0bc83618cfdfca769dca61f\", \"ui_base_unittests\": \"d469786dc624f43cd180925b830608e7a2520208\", \"ui_touch_selection_unittests\": \"2a054a9ee9a73a401c0493922b2c85fa67c460c6\", \"unit_tests\": \"b6b7d140afea950c87e440e5de56401a4aabf156\", \"url_unittests\": \"362d5edff9c4b061413c0db6f4bb3ab8f59f5486\", \"views_unittests\": \"7a14c2b303535350b05051208642fe5744a591e1\", \"viz_unittests\": \"dde0aad612b339b37ee968a5f61e27d9bbf32e83\", \"vr_common_unittests\": \"9abe43faae3ca6bb2b9c0c81484a2843931eaae4\", \"vr_pixeltests\": \"6fd64ba4013ace731e434a027f76f304e209d463\", \"wm_unittests\": \"d905157468c8b0ee96d0320d159cb0c3a5efa8ae\", \"wtf_unittests\": \"8311111d1d1915196b867f3fc93dacf2b1441e32\"}}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_0449d4990cc4feb415a65e31e9088077715ff3aab07ec56c1ca7c39b14a8bb8d_v2\", \"builder_4546ef179f50eb727f19fe6abd7705a7b8921ff8263e4e2e8e2644dd615ef1a7_v2\", \"git\", \"goma_v2\", \"vpython\"], \"cores\": [\"32\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Broadwell_GCE\", \"x86-64-avx2\"], \"gce\": [\"1\"], \"gcp\": [\"google.com:chromecompute\"], \"gpu\": [\"none\"], \"id\": [\"luci-chromium-ci-xenial-32-9-9kvk\"], \"image\": [\"chrome-xenial-20041200-f56df5dd7ad\"], \"inside_docker\": [\"0\"], \"kvm\": [\"1\"], \"locale\": [\"en_US.UTF-8\"], \"machine_type\": [\"n1-standard-32\"], \"os\": [\"Linux\", \"Ubuntu\", \"Ubuntu-16.04\"], \"pool\": [\"luci.chromium.ci\"], \"python\": [\"2.7.12\"], \"server_version\": [\"5018-c7f912d\"], \"ssd\": [\"0\"], \"zone\": [\"us\", \"us-west\", \"us-west1\", \"us-west1-c\"]}}, \"ui\": {\"info\": \"1 Test Suite(s) failed.\\n\\n**content_browsertests** failed because of:\\n\\n- SitePerProcessHitTestBrowserTest.ScrolledNestedPopupMenuTest\"}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1587861769451914",
"status": "COMPLETED",
"status_changed_ts": "1587861769902725",
"tags": [
"build_address:luci.chromium.ci/Linux CFI/17016",
"builder:Linux CFI",
"buildset:commit/git/53836640273c3d45b05ad74bdff7323ef0ffc610",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/53836640273c3d45b05ad74bdff7323ef0ffc610",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9047430038831102976",
"scheduler_job_id:chromium/Linux CFI",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8881999976525617440/+/annotations",
"swarming_tag:luci_project:chromium",
"swarming_tag:os:Linux",
"swarming_tag:recipe_name:chromium",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_task_id:4bccc14c6ac60210",
"user_agent:luci-scheduler"
],
"updated_ts": "1587867919951109",
"url": "https://ci.chromium.org/b/8881999976525617440",
"utcnow_ts": "1587867921119430"
}
}
[02:25:21.130] Invocation finished in 1h42m36.438106773s with status FAILED