[23:57:50.659] New invocation is queued and will start shortly
[23:57:51.744] Starting the invocation (attempt 1)
[23:57:51.788] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[23:57:51.788] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[23:57:51.788] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9064827481299237552",
"parameters_json": "{\"builder_name\":\"Linux CFI\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"329a688981eb96c9bd772963e5379261789707bf\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:Linux CFI",
"scheduler_invocation_id:9064827481299237552",
"scheduler_job_id:chromium/Linux CFI",
"user_agent:luci-scheduler",
"buildset:commit/git/329a688981eb96c9bd772963e5379261789707bf",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/329a688981eb96c9bd772963e5379261789707bf",
"gitiles_ref:refs/heads/master"
]
}
[23:57:54.175] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1571270272235408",
"id": "8899397418978953728",
"parameters_json": "{\"builder_name\": \"Linux CFI\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"329a688981eb96c9bd772963e5379261789707bf\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1571270273642427",
"tags": [
"build_address:luci.chromium.ci/Linux CFI/15323",
"builder:Linux CFI",
"buildset:commit/git/329a688981eb96c9bd772963e5379261789707bf",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/329a688981eb96c9bd772963e5379261789707bf",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9064827481299237552",
"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/8899397418978953728/+/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": "1571270273642615",
"url": "https://ci.chromium.org/b/8899397418978953728",
"utcnow_ts": "1571270274136057"
}
}
[23:57:54.175] Task URL: https://ci.chromium.org/b/8899397418978953728
[23:57:54.175] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:2:0) after 1m0s
[23:58:54.304] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:2:0)
[23:58:54.304] Timer tick, asking Buildbucket for the build status
[23:58:56.269] Build 8899397418978953728: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[23:58:56.269] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:3:0) after 1m0s
[23:59:56.307] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:3:0)
[23:59:56.307] Timer tick, asking Buildbucket for the build status
[23:59:56.471] Build 8899397418978953728: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[23:59:56.471] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:4:0) after 1m0s
[00:00:56.508] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:4:0)
[00:00:56.508] Timer tick, asking Buildbucket for the build status
[00:00:57.922] Build 8899397418978953728: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[00:00:57.922] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:5:0) after 1m0s
[00:01:57.938] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:5:0)
[00:01:57.938] Timer tick, asking Buildbucket for the build status
[00:01:58.155] Build 8899397418978953728: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[00:01:58.155] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:6:0) after 1m0s
[00:02:58.186] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:6:0)
[00:02:58.186] Timer tick, asking Buildbucket for the build status
[00:03:00.244] Build 8899397418978953728: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[00:03:00.244] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:7:0) after 1m0s
[00:03:43.647] Received PubSub notification, asking Buildbucket for the build status
[00:03:43.966] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:04:00.268] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:7:0)
[00:04:00.268] Timer tick, asking Buildbucket for the build status
[00:04:02.397] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:04:02.397] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:9:0) after 1m0s
[00:05:02.481] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:9:0)
[00:05:02.481] Timer tick, asking Buildbucket for the build status
[00:05:04.388] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:05:04.388] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:10:0) after 1m0s
[00:06:04.419] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:10:0)
[00:06:04.419] Timer tick, asking Buildbucket for the build status
[00:06:05.586] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:06:05.586] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:11:0) after 1m0s
[00:07:05.584] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:11:0)
[00:07:05.584] Timer tick, asking Buildbucket for the build status
[00:07:07.862] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:07:07.862] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:12:0) after 1m0s
[00:08:07.962] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:12:0)
[00:08:07.962] Timer tick, asking Buildbucket for the build status
[00:08:09.701] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:08:09.701] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:13:0) after 1m0s
[00:09:09.798] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:13:0)
[00:09:09.798] Timer tick, asking Buildbucket for the build status
[00:09:12.400] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:09:12.400] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:14:0) after 1m0s
[00:10:12.528] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:14:0)
[00:10:12.528] Timer tick, asking Buildbucket for the build status
[00:10:13.720] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:10:13.720] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:15:0) after 1m0s
[00:11:13.717] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:15:0)
[00:11:13.717] Timer tick, asking Buildbucket for the build status
[00:11:14.093] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:11:14.093] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:16:0) after 1m0s
[00:12:14.162] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:16:0)
[00:12:14.162] Timer tick, asking Buildbucket for the build status
[00:12:14.452] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:12:14.452] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:17:0) after 1m0s
[00:13:14.430] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:17:0)
[00:13:14.430] Timer tick, asking Buildbucket for the build status
[00:13:15.793] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:13:15.793] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:18:0) after 1m0s
[00:14:15.852] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:18:0)
[00:14:15.852] Timer tick, asking Buildbucket for the build status
[00:14:16.980] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:14:16.980] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:19:0) after 1m0s
[00:15:17.129] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:19:0)
[00:15:17.129] Timer tick, asking Buildbucket for the build status
[00:15:18.474] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:15:18.474] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:20:0) after 1m0s
[00:16:18.547] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:20:0)
[00:16:18.547] Timer tick, asking Buildbucket for the build status
[00:16:20.610] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:16:20.610] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:21:0) after 1m0s
[00:17:20.825] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:21:0)
[00:17:20.825] Timer tick, asking Buildbucket for the build status
[00:17:21.295] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:17:21.295] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:22:0) after 1m0s
[00:18:21.432] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:22:0)
[00:18:21.432] Timer tick, asking Buildbucket for the build status
[00:18:23.715] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:18:23.715] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:23:0) after 1m0s
[00:19:23.761] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:23:0)
[00:19:23.761] Timer tick, asking Buildbucket for the build status
[00:19:24.020] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:19:24.020] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:24:0) after 1m0s
[00:20:24.265] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:24:0)
[00:20:24.265] Timer tick, asking Buildbucket for the build status
[00:20:25.978] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:20:25.978] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:25:0) after 1m0s
[00:21:26.135] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:25:0)
[00:21:26.135] Timer tick, asking Buildbucket for the build status
[00:21:26.337] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:21:26.337] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:26:0) after 1m0s
[00:22:26.330] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:26:0)
[00:22:26.330] Timer tick, asking Buildbucket for the build status
[00:22:29.902] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:22:29.902] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:27:0) after 1m0s
[00:23:29.985] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:27:0)
[00:23:29.985] Timer tick, asking Buildbucket for the build status
[00:23:31.515] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:23:31.515] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:28:0) after 1m0s
[00:24:31.608] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:28:0)
[00:24:31.608] Timer tick, asking Buildbucket for the build status
[00:24:31.999] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:24:31.999] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:29:0) after 1m0s
[00:25:32.034] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:29:0)
[00:25:32.034] Timer tick, asking Buildbucket for the build status
[00:25:32.589] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:25:32.589] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:30:0) after 1m0s
[00:26:32.664] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:30:0)
[00:26:32.664] Timer tick, asking Buildbucket for the build status
[00:26:33.281] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:26:33.281] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:31:0) after 1m0s
[00:27:33.350] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:31:0)
[00:27:33.350] Timer tick, asking Buildbucket for the build status
[00:27:35.386] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:27:35.386] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:32:0) after 1m0s
[00:28:35.425] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:32:0)
[00:28:35.425] Timer tick, asking Buildbucket for the build status
[00:28:36.221] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:28:36.221] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:33:0) after 1m0s
[00:29:36.292] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:33:0)
[00:29:36.292] Timer tick, asking Buildbucket for the build status
[00:29:36.449] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:29:36.449] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:34:0) after 1m0s
[00:30:36.464] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:34:0)
[00:30:36.464] Timer tick, asking Buildbucket for the build status
[00:30:36.693] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:30:36.693] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:35:0) after 1m0s
[00:31:36.739] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:35:0)
[00:31:36.739] Timer tick, asking Buildbucket for the build status
[00:31:38.442] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:31:38.442] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:36:0) after 1m0s
[00:32:38.492] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:36:0)
[00:32:38.492] Timer tick, asking Buildbucket for the build status
[00:32:39.979] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:32:39.979] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:37:0) after 1m0s
[00:33:40.062] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:37:0)
[00:33:40.062] Timer tick, asking Buildbucket for the build status
[00:33:41.030] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:33:41.030] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:38:0) after 1m0s
[00:34:41.106] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:38:0)
[00:34:41.106] Timer tick, asking Buildbucket for the build status
[00:34:44.378] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:34:44.378] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:39:0) after 1m0s
[00:35:44.366] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:39:0)
[00:35:44.366] Timer tick, asking Buildbucket for the build status
[00:35:47.657] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:35:47.657] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:40:0) after 1m0s
[00:36:47.716] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:40:0)
[00:36:47.716] Timer tick, asking Buildbucket for the build status
[00:36:48.970] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:36:48.970] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:41:0) after 1m0s
[00:37:48.966] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:41:0)
[00:37:48.966] Timer tick, asking Buildbucket for the build status
[00:37:49.094] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:37:49.094] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:42:0) after 1m0s
[00:38:49.144] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:42:0)
[00:38:49.144] Timer tick, asking Buildbucket for the build status
[00:38:49.815] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:38:49.815] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:43:0) after 1m0s
[00:39:49.849] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:43:0)
[00:39:49.849] Timer tick, asking Buildbucket for the build status
[00:39:50.555] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:39:50.555] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:44:0) after 1m0s
[00:40:50.702] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:44:0)
[00:40:50.702] Timer tick, asking Buildbucket for the build status
[00:40:52.768] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:40:52.768] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:45:0) after 1m0s
[00:41:52.806] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:45:0)
[00:41:52.806] Timer tick, asking Buildbucket for the build status
[00:41:56.206] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:41:56.206] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:46:0) after 1m0s
[00:42:56.285] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:46:0)
[00:42:56.285] Timer tick, asking Buildbucket for the build status
[00:42:56.911] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:42:56.911] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:47:0) after 1m0s
[00:43:57.004] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:47:0)
[00:43:57.004] Timer tick, asking Buildbucket for the build status
[00:43:57.305] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:43:57.305] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:48:0) after 1m0s
[00:44:57.349] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:48:0)
[00:44:57.349] Timer tick, asking Buildbucket for the build status
[00:44:59.836] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:44:59.836] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:49:0) after 1m0s
[00:45:59.975] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:49:0)
[00:45:59.975] Timer tick, asking Buildbucket for the build status
[00:46:00.515] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:46:00.515] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:50:0) after 1m0s
[00:47:00.649] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:50:0)
[00:47:00.649] Timer tick, asking Buildbucket for the build status
[00:47:01.398] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:47:01.398] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:51:0) after 1m0s
[00:48:01.541] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:51:0)
[00:48:01.541] Timer tick, asking Buildbucket for the build status
[00:48:08.383] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:48:08.383] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:52:0) after 1m0s
[00:49:08.510] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:52:0)
[00:49:08.510] Timer tick, asking Buildbucket for the build status
[00:49:08.766] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:49:08.766] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:53:0) after 1m0s
[00:50:08.826] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:53:0)
[00:50:08.826] Timer tick, asking Buildbucket for the build status
[00:50:10.700] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:50:10.700] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:54:0) after 1m0s
[00:51:10.806] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:54:0)
[00:51:10.806] Timer tick, asking Buildbucket for the build status
[00:51:11.084] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:51:11.084] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:55:0) after 1m0s
[00:52:11.115] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:55:0)
[00:52:11.115] Timer tick, asking Buildbucket for the build status
[00:52:12.687] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:52:12.687] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:56:0) after 1m0s
[00:53:12.903] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:56:0)
[00:53:12.903] Timer tick, asking Buildbucket for the build status
[00:53:13.457] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:53:13.457] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:57:0) after 1m0s
[00:54:13.525] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:57:0)
[00:54:13.525] Timer tick, asking Buildbucket for the build status
[00:54:13.843] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:54:13.843] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:58:0) after 1m0s
[00:55:13.863] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:58:0)
[00:55:13.863] Timer tick, asking Buildbucket for the build status
[00:55:13.998] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:55:13.998] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:59:0) after 1m0s
[00:56:13.987] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:59:0)
[00:56:13.987] Timer tick, asking Buildbucket for the build status
[00:56:14.925] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:56:14.925] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:60:0) after 1m0s
[00:57:14.950] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:60:0)
[00:57:14.951] Timer tick, asking Buildbucket for the build status
[00:57:15.522] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:57:15.522] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:61:0) after 1m0s
[00:58:15.561] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:61:0)
[00:58:15.561] Timer tick, asking Buildbucket for the build status
[00:58:15.824] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:58:15.824] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:62:0) after 1m0s
[00:59:15.847] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:62:0)
[00:59:15.847] Timer tick, asking Buildbucket for the build status
[00:59:18.701] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:59:18.701] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:63:0) after 1m0s
[01:00:18.836] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:63:0)
[01:00:18.836] Timer tick, asking Buildbucket for the build status
[01:00:19.815] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:00:19.815] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:64:0) after 1m0s
[01:01:19.896] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:64:0)
[01:01:19.896] Timer tick, asking Buildbucket for the build status
[01:01:20.143] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:01:20.144] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:65:0) after 1m0s
[01:02:20.288] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:65:0)
[01:02:20.288] Timer tick, asking Buildbucket for the build status
[01:02:20.430] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:02:20.431] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:66:0) after 1m0s
[01:03:20.493] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:66:0)
[01:03:20.493] Timer tick, asking Buildbucket for the build status
[01:03:21.721] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:03:21.721] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:67:0) after 1m0s
[01:04:21.736] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:67:0)
[01:04:21.736] Timer tick, asking Buildbucket for the build status
[01:04:22.083] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:04:22.084] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:68:0) after 1m0s
[01:05:22.133] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:68:0)
[01:05:22.133] Timer tick, asking Buildbucket for the build status
[01:05:22.985] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:05:22.985] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:69:0) after 1m0s
[01:06:23.045] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:69:0)
[01:06:23.045] Timer tick, asking Buildbucket for the build status
[01:06:23.473] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:06:23.473] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:70:0) after 1m0s
[01:07:23.536] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:70:0)
[01:07:23.536] Timer tick, asking Buildbucket for the build status
[01:07:27.079] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:07:27.079] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:71:0) after 1m0s
[01:08:27.123] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:71:0)
[01:08:27.123] Timer tick, asking Buildbucket for the build status
[01:08:28.441] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:08:28.441] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:72:0) after 1m0s
[01:09:28.506] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:72:0)
[01:09:28.506] Timer tick, asking Buildbucket for the build status
[01:09:31.239] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:09:31.239] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:73:0) after 1m0s
[01:10:31.352] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:73:0)
[01:10:31.352] Timer tick, asking Buildbucket for the build status
[01:10:31.803] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:10:31.803] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:74:0) after 1m0s
[01:11:31.992] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:74:0)
[01:11:31.992] Timer tick, asking Buildbucket for the build status
[01:11:32.431] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:11:32.431] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:75:0) after 1m0s
[01:12:32.522] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:75:0)
[01:12:32.522] Timer tick, asking Buildbucket for the build status
[01:12:33.085] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:12:33.085] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:76:0) after 1m0s
[01:13:33.229] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:76:0)
[01:13:33.229] Timer tick, asking Buildbucket for the build status
[01:13:33.803] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:13:33.803] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:77:0) after 1m0s
[01:14:33.919] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:77:0)
[01:14:33.919] Timer tick, asking Buildbucket for the build status
[01:14:34.197] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:14:34.197] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:78:0) after 1m0s
[01:15:34.180] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:78:0)
[01:15:34.180] Timer tick, asking Buildbucket for the build status
[01:15:36.344] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:15:36.344] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:79:0) after 1m0s
[01:16:36.443] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:79:0)
[01:16:36.443] Timer tick, asking Buildbucket for the build status
[01:16:36.647] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:16:36.647] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:80:0) after 1m0s
[01:17:36.869] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:80:0)
[01:17:36.869] Timer tick, asking Buildbucket for the build status
[01:17:37.057] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:17:37.057] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:81:0) after 1m0s
[01:18:37.163] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:81:0)
[01:18:37.163] Timer tick, asking Buildbucket for the build status
[01:18:38.038] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:18:38.038] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:82:0) after 1m0s
[01:19:38.184] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:82:0)
[01:19:38.184] Timer tick, asking Buildbucket for the build status
[01:19:39.034] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:19:39.034] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:83:0) after 1m0s
[01:20:39.033] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:83:0)
[01:20:39.033] Timer tick, asking Buildbucket for the build status
[01:20:39.748] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:20:39.748] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:84:0) after 1m0s
[01:21:39.790] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:84:0)
[01:21:39.790] Timer tick, asking Buildbucket for the build status
[01:21:40.452] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:21:40.452] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:85:0) after 1m0s
[01:22:40.551] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:85:0)
[01:22:40.551] Timer tick, asking Buildbucket for the build status
[01:22:45.605] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:22:45.605] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:86:0) after 1m0s
[01:23:45.626] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:86:0)
[01:23:45.626] Timer tick, asking Buildbucket for the build status
[01:23:46.070] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:23:46.070] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:87:0) after 1m0s
[01:24:46.120] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:87:0)
[01:24:46.120] Timer tick, asking Buildbucket for the build status
[01:24:46.335] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:24:46.335] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:88:0) after 1m0s
[01:25:46.442] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:88:0)
[01:25:46.442] Timer tick, asking Buildbucket for the build status
[01:25:46.899] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:25:46.899] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:89:0) after 1m0s
[01:26:46.963] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:89:0)
[01:26:46.963] Timer tick, asking Buildbucket for the build status
[01:26:47.192] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:26:47.192] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:90:0) after 1m0s
[01:27:47.226] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:90:0)
[01:27:47.226] Timer tick, asking Buildbucket for the build status
[01:27:47.904] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:27:47.904] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:91:0) after 1m0s
[01:28:47.882] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:91:0)
[01:28:47.882] Timer tick, asking Buildbucket for the build status
[01:28:48.471] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:28:48.471] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:92:0) after 1m0s
[01:29:48.511] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:92:0)
[01:29:48.511] Timer tick, asking Buildbucket for the build status
[01:29:49.993] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:29:49.993] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:93:0) after 1m0s
[01:30:50.019] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:93:0)
[01:30:50.019] Timer tick, asking Buildbucket for the build status
[01:30:52.156] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:30:52.156] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:94:0) after 1m0s
[01:31:52.435] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:94:0)
[01:31:52.435] Timer tick, asking Buildbucket for the build status
[01:31:52.798] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:31:52.798] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:95:0) after 1m0s
[01:32:52.822] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:95:0)
[01:32:52.822] Timer tick, asking Buildbucket for the build status
[01:32:53.269] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:32:53.269] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:96:0) after 1m0s
[01:33:53.407] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:96:0)
[01:33:53.407] Timer tick, asking Buildbucket for the build status
[01:33:55.473] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:33:55.473] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:97:0) after 1m0s
[01:34:55.500] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:97:0)
[01:34:55.500] Timer tick, asking Buildbucket for the build status
[01:34:55.646] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:34:55.646] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:98:0) after 1m0s
[01:35:55.772] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:98:0)
[01:35:55.772] Timer tick, asking Buildbucket for the build status
[01:35:56.292] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:35:56.292] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:99:0) after 1m0s
[01:36:56.430] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:99:0)
[01:36:56.430] Timer tick, asking Buildbucket for the build status
[01:36:57.587] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:36:57.587] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:100:0) after 1m0s
[01:37:57.642] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:100:0)
[01:37:57.642] Timer tick, asking Buildbucket for the build status
[01:37:57.796] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:37:57.796] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:101:0) after 1m0s
[01:38:57.848] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:101:0)
[01:38:57.848] Timer tick, asking Buildbucket for the build status
[01:38:58.225] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:38:58.225] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:102:0) after 1m0s
[01:39:58.277] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:102:0)
[01:39:58.277] Timer tick, asking Buildbucket for the build status
[01:39:59.403] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:39:59.403] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:103:0) after 1m0s
[01:40:59.469] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:103:0)
[01:40:59.469] Timer tick, asking Buildbucket for the build status
[01:41:00.056] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:41:00.056] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:104:0) after 1m0s
[01:42:00.130] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:104:0)
[01:42:00.130] Timer tick, asking Buildbucket for the build status
[01:42:00.558] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:42:00.558] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:105:0) after 1m0s
[01:43:00.581] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:105:0)
[01:43:00.581] Timer tick, asking Buildbucket for the build status
[01:43:02.821] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:43:02.821] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:106:0) after 1m0s
[01:44:02.941] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:106:0)
[01:44:02.941] Timer tick, asking Buildbucket for the build status
[01:44:03.184] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:44:03.184] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:107:0) after 1m0s
[01:45:03.309] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:107:0)
[01:45:03.309] Timer tick, asking Buildbucket for the build status
[01:45:03.572] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:45:03.573] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:108:0) after 1m0s
[01:46:03.644] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:108:0)
[01:46:03.644] Timer tick, asking Buildbucket for the build status
[01:46:04.129] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:46:04.129] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:109:0) after 1m0s
[01:47:04.166] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:109:0)
[01:47:04.166] Timer tick, asking Buildbucket for the build status
[01:47:04.945] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:47:04.945] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:110:0) after 1m0s
[01:48:05.024] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:110:0)
[01:48:05.024] Timer tick, asking Buildbucket for the build status
[01:48:06.897] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:48:06.897] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:111:0) after 1m0s
[01:49:06.996] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:111:0)
[01:49:06.996] Timer tick, asking Buildbucket for the build status
[01:49:07.909] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:49:07.909] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:112:0) after 1m0s
[01:50:08.070] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:112:0)
[01:50:08.070] Timer tick, asking Buildbucket for the build status
[01:50:08.244] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:50:08.244] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:113:0) after 1m0s
[01:51:08.306] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:113:0)
[01:51:08.306] Timer tick, asking Buildbucket for the build status
[01:51:08.691] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:51:08.691] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:114:0) after 1m0s
[01:52:08.695] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:114:0)
[01:52:08.695] Timer tick, asking Buildbucket for the build status
[01:52:15.456] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:52:15.456] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:115:0) after 1m0s
[01:53:15.529] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:115:0)
[01:53:15.529] Timer tick, asking Buildbucket for the build status
[01:53:15.859] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:53:15.859] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:116:0) after 1m0s
[01:54:15.943] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:116:0)
[01:54:15.943] Timer tick, asking Buildbucket for the build status
[01:54:17.000] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:54:17.000] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:117:0) after 1m0s
[01:55:17.075] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:117:0)
[01:55:17.075] Timer tick, asking Buildbucket for the build status
[01:55:24.259] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:55:24.259] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:118:0) after 1m0s
[01:56:24.331] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:118:0)
[01:56:24.331] Timer tick, asking Buildbucket for the build status
[01:56:28.563] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:56:28.563] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:119:0) after 1m0s
[01:57:28.541] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:119:0)
[01:57:28.541] Timer tick, asking Buildbucket for the build status
[01:57:28.817] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:57:28.817] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:120:0) after 1m0s
[01:58:28.953] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:120:0)
[01:58:28.954] Timer tick, asking Buildbucket for the build status
[01:58:29.181] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:58:29.181] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:121:0) after 1m0s
[01:59:29.244] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:121:0)
[01:59:29.244] Timer tick, asking Buildbucket for the build status
[01:59:29.465] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:59:29.465] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:122:0) after 1m0s
[02:00:29.605] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:122:0)
[02:00:29.605] Timer tick, asking Buildbucket for the build status
[02:00:31.263] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:00:31.263] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:123:0) after 1m0s
[02:01:31.338] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:123:0)
[02:01:31.338] Timer tick, asking Buildbucket for the build status
[02:01:31.496] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:01:31.496] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:124:0) after 1m0s
[02:02:31.526] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:124:0)
[02:02:31.526] Timer tick, asking Buildbucket for the build status
[02:02:31.981] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:02:31.981] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:125:0) after 1m0s
[02:03:32.006] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:125:0)
[02:03:32.006] Timer tick, asking Buildbucket for the build status
[02:03:32.282] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:03:32.283] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:126:0) after 1m0s
[02:04:32.307] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:126:0)
[02:04:32.307] Timer tick, asking Buildbucket for the build status
[02:04:34.456] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:04:34.456] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:127:0) after 1m0s
[02:05:34.508] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:127:0)
[02:05:34.508] Timer tick, asking Buildbucket for the build status
[02:05:34.662] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:05:34.662] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:128:0) after 1m0s
[02:06:34.786] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:128:0)
[02:06:34.786] Timer tick, asking Buildbucket for the build status
[02:06:35.499] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:06:35.499] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:129:0) after 1m0s
[02:07:35.486] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:129:0)
[02:07:35.486] Timer tick, asking Buildbucket for the build status
[02:07:35.731] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:07:35.731] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:130:0) after 1m0s
[02:08:35.767] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:130:0)
[02:08:35.767] Timer tick, asking Buildbucket for the build status
[02:08:35.970] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:08:35.970] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:131:0) after 1m0s
[02:09:36.034] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:131:0)
[02:09:36.034] Timer tick, asking Buildbucket for the build status
[02:09:36.520] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:09:36.520] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:132:0) after 1m0s
[02:10:36.583] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:132:0)
[02:10:36.583] Timer tick, asking Buildbucket for the build status
[02:10:38.176] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:10:38.176] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:133:0) after 1m0s
[02:11:38.186] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:133:0)
[02:11:38.186] Timer tick, asking Buildbucket for the build status
[02:11:38.722] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:11:38.722] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:134:0) after 1m0s
[02:12:38.777] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:134:0)
[02:12:38.777] Timer tick, asking Buildbucket for the build status
[02:12:39.028] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:12:39.028] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:135:0) after 1m0s
[02:13:39.063] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:135:0)
[02:13:39.063] Timer tick, asking Buildbucket for the build status
[02:13:39.527] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:13:39.527] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:136:0) after 1m0s
[02:14:39.689] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:136:0)
[02:14:39.689] Timer tick, asking Buildbucket for the build status
[02:14:40.591] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:14:40.591] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:137:0) after 1m0s
[02:15:40.618] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:137:0)
[02:15:40.618] Timer tick, asking Buildbucket for the build status
[02:15:42.465] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:15:42.465] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:138:0) after 1m0s
[02:16:42.549] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:138:0)
[02:16:42.549] Timer tick, asking Buildbucket for the build status
[02:16:42.793] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:16:42.793] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:139:0) after 1m0s
[02:17:42.925] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:139:0)
[02:17:42.925] Timer tick, asking Buildbucket for the build status
[02:17:44.252] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:17:44.252] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:140:0) after 1m0s
[02:18:44.424] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:140:0)
[02:18:44.424] Timer tick, asking Buildbucket for the build status
[02:18:44.627] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:18:44.627] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:141:0) after 1m0s
[02:19:44.629] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:141:0)
[02:19:44.629] Timer tick, asking Buildbucket for the build status
[02:19:45.634] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:19:45.634] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:142:0) after 1m0s
[02:20:45.664] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:142:0)
[02:20:45.664] Timer tick, asking Buildbucket for the build status
[02:20:46.355] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:20:46.355] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:143:0) after 1m0s
[02:21:46.399] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:143:0)
[02:21:46.399] Timer tick, asking Buildbucket for the build status
[02:21:47.103] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:21:47.103] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:144:0) after 1m0s
[02:22:47.249] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:144:0)
[02:22:47.249] Timer tick, asking Buildbucket for the build status
[02:22:48.132] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:22:48.132] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:145:0) after 1m0s
[02:23:48.212] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:145:0)
[02:23:48.212] Timer tick, asking Buildbucket for the build status
[02:23:48.655] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:23:48.655] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:146:0) after 1m0s
[02:24:48.680] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:146:0)
[02:24:48.681] Timer tick, asking Buildbucket for the build status
[02:24:49.421] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:24:49.421] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:147:0) after 1m0s
[02:25:49.519] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:147:0)
[02:25:49.519] Timer tick, asking Buildbucket for the build status
[02:25:49.840] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:25:49.840] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:148:0) after 1m0s
[02:26:49.939] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:148:0)
[02:26:49.939] Timer tick, asking Buildbucket for the build status
[02:26:50.897] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:26:50.897] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:149:0) after 1m0s
[02:27:50.942] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:149:0)
[02:27:50.942] Timer tick, asking Buildbucket for the build status
[02:27:51.159] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:27:51.159] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:150:0) after 1m0s
[02:28:51.208] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:150:0)
[02:28:51.208] Timer tick, asking Buildbucket for the build status
[02:28:55.442] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:28:55.442] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:151:0) after 1m0s
[02:29:55.565] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:151:0)
[02:29:55.565] Timer tick, asking Buildbucket for the build status
[02:29:55.780] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:29:55.780] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:152:0) after 1m0s
[02:30:55.893] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:152:0)
[02:30:55.893] Timer tick, asking Buildbucket for the build status
[02:30:56.039] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:30:56.039] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:153:0) after 1m0s
[02:31:56.078] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:153:0)
[02:31:56.078] Timer tick, asking Buildbucket for the build status
[02:31:56.839] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:31:56.839] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:154:0) after 1m0s
[02:32:56.946] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:154:0)
[02:32:56.946] Timer tick, asking Buildbucket for the build status
[02:32:59.974] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:32:59.974] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:155:0) after 1m0s
[02:34:00.027] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:155:0)
[02:34:00.027] Timer tick, asking Buildbucket for the build status
[02:34:02.837] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:34:02.837] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:156:0) after 1m0s
[02:35:02.871] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:156:0)
[02:35:02.871] Timer tick, asking Buildbucket for the build status
[02:35:03.093] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:35:03.093] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:157:0) after 1m0s
[02:36:03.224] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:157:0)
[02:36:03.224] Timer tick, asking Buildbucket for the build status
[02:36:04.410] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:36:04.410] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:158:0) after 1m0s
[02:37:04.476] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:158:0)
[02:37:04.476] Timer tick, asking Buildbucket for the build status
[02:37:04.682] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:37:04.682] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:159:0) after 1m0s
[02:38:04.766] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:159:0)
[02:38:04.766] Timer tick, asking Buildbucket for the build status
[02:38:05.061] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:38:05.061] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:160:0) after 1m0s
[02:39:05.269] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:160:0)
[02:39:05.269] Timer tick, asking Buildbucket for the build status
[02:39:06.800] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:39:06.800] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:161:0) after 1m0s
[02:40:06.872] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:161:0)
[02:40:06.872] Timer tick, asking Buildbucket for the build status
[02:40:07.535] Build 8899397418978953728: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:40:07.535] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9064827481299237552:162:0) after 1m0s
[02:40:25.675] Received PubSub notification, asking Buildbucket for the build status
[02:40:26.543] Build 8899397418978953728: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[02:40:26.544] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1571280023999831",
"created_by": "project:chromium",
"created_ts": "1571270272235408",
"id": "8899397418978953728",
"parameters_json": "{\"builder_name\": \"Linux CFI\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"329a688981eb96c9bd772963e5379261789707bf\"}}",
"project": "chromium",
"result": "SUCCESS",
"result_details_json": "{\"properties\": {\"$build/goma\": {\"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-15-kvmo\", \"branch\": \"refs/heads/master\", \"buildername\": \"Linux CFI\", \"buildnumber\": 15323, \"got_angle_revision\": \"16944ed21bc21040f9dec282ef4b3508d1976ca9\", \"got_dawn_revision\": \"e180b591d16658cccb7b7b80a03044e813fe9d04\", \"got_nacl_revision\": \"3651f6c52037c96e034cc422746768d59182bff3\", \"got_revision\": \"329a688981eb96c9bd772963e5379261789707bf\", \"got_revision_cp\": \"refs/heads/master@{#706707}\", \"got_swarming_client_revision\": \"885b3febcc170a60f25795304e60927b77d1e92d\", \"got_v8_revision\": \"fedca19411717706006c21922ded5bf25b6a0f58\", \"got_v8_revision_cp\": \"refs/heads/7.9.321@{#1}\", \"got_webrtc_revision\": \"562a37f926dd40754c0c1627f539f1a5276e5399\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#29502}\", \"isolate_server\": \"https://isolateserver.appspot.com\", \"mastername\": \"chromium.memory\", \"path_config\": \"generic\", \"recipe\": \"chromium\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"329a688981eb96c9bd772963e5379261789707bf\", \"swarm_hashes\": {\"accessibility_unittests\": \"c31005502077aafdf74a9ed9100aa3254dd017dd\", \"angle_unittests\": \"ae8bb8a5fbcafa7ece2278319c379e4bd2a797b4\", \"app_shell_unittests\": \"f39ce0f6cd1970329db15e26f60418e0cb1827f3\", \"aura_unittests\": \"4dfb2566d9c5326f644749758a15fced85c21eb3\", \"base_unittests\": \"62fb3d83093cc17b7d227fd9118fbbbea866ad61\", \"base_util_unittests\": \"8f67d4a87502d972bc9da3ab3b7acfb453390fa1\", \"blink_common_unittests\": \"9f808d6189c1fdd8f05534ab11243e2e131e65f5\", \"blink_fuzzer_unittests\": \"9bee58e9d1bba69bd6a9a92c55d93fdd6125f3b3\", \"blink_heap_unittests\": \"766e2ff3b07dcc88044ac1ab2524e2f1dba0afa4\", \"blink_platform_unittests\": \"432f14eee850949a2dccfd46a8fe0d864a4ffc6e\", \"blink_unittests\": \"d3fc588507ae554cfdfbf3ce10e86b12942c2628\", \"boringssl_crypto_tests\": \"546351ac148d829f7e69b704d7dcb2e09a1dd8b0\", \"boringssl_ssl_tests\": \"001a6fdc9c43136dd8775a782719f819ecd0a400\", \"browser_tests\": \"3ecc1a7cb0450ce243b4be1465b94769fc9978a2\", \"cacheinvalidation_unittests\": \"c1f4de73b1ffb45586d73105a9439ef7c80487a5\", \"capture_unittests\": \"01196654c14362c016cf6e91b6619c85099c63ae\", \"cast_unittests\": \"d131f0b9ef57a5875fc2866003d697491939d80b\", \"cc_unittests\": \"182b2baa293d5fb917321014bdc98895c0279769\", \"chrome_app_unittests\": \"c7b165725c2e6ccf4ca5e0962747e529f51ef30d\", \"chromedriver_unittests\": \"f9a8c6a9577028e4ad5971a7f603423a1c7805ff\", \"color_unittests\": \"0040a2f75fc01169dbca3eba8e5a669cd017848a\", \"components_browsertests\": \"d773403fe9217be8e25de2e34942220d1d4a735a\", \"components_unittests\": \"fe1a3c12cdd0178e950ec42f89741a3d2e423c22\", \"compositor_unittests\": \"d30be82f07e018d504d27961072c835a8cf5db59\", \"content_browsertests\": \"fdf0fbccbd231c937b6b92150b13ebb3ac16a267\", \"content_unittests\": \"0ce2551bcc345a430c295ae05f24bdfe912b7af7\", \"cronet_tests\": \"845f4d23390513fc5e6ea89cc8c5147eb8f4ed53\", \"cronet_unittests\": \"b347788479a0197462c5819446a013e3fa1f361e\", \"crypto_unittests\": \"ff3bd2be6e72ea1c270d12474950e60c3e3fe0bc\", \"dbus_unittests\": \"e3a54691d1dd1e909a344febdfc84e1d99d48374\", \"device_unittests\": \"d724608e24d227c1f217abcc97ac4bf4e1ca34ff\", \"display_unittests\": \"db53ded50672c816dad9b5579f027c27802d7e0f\", \"events_unittests\": \"57159059d45c6aa0c33e459233796f9d6338bbce\", \"extensions_browsertests\": \"6570b694b6a038a4ef1d2ff69718c621b771c079\", \"extensions_unittests\": \"0429d91e17c4895b104aa8acd3633c7bccd3c777\", \"filesystem_service_unittests\": \"1bd7be978067a0fac483591e2595e4d5d3ac03eb\", \"gcm_unit_tests\": \"52ef789a02c5a11b0fffdc01fb9438c98f39247f\", \"gfx_unittests\": \"c5f419533ab7488b22c0b0d348df3d030e19b7b3\", \"gin_unittests\": \"c59f9d9536f3a52c87b5d1ed86a751dfcb4e514b\", \"gl_tests\": \"3b2033087116990f9515b6f8e217a5c8b524ab92\", \"gl_unittests\": \"fd543f321e0f95cb5981cbb6936b45e096d50e81\", \"google_apis_unittests\": \"1aaccea0812fbe8c8951f5518df3369a2bd5a305\", \"gpu_unittests\": \"1dc6c343f31c92c34a8e67da3943e2ac8dfc287c\", \"gwp_asan_unittests\": \"f557c1a1b2891edafbe94ffa6be9b58e8b7f4c30\", \"headless_browsertests\": \"df529b0f6ead7bb1f78122628dc349117ca7db24\", \"headless_unittests\": \"cd0f5679a0780f42945fdc09bfe52e1f23238a29\", \"interactive_ui_tests\": \"8a28b53d8bd8942b68dcccb631dece29d5b23f0f\", \"ipc_tests\": \"18c30dd19905f594f1fb1a230421c50c3473f3be\", \"jingle_unittests\": \"8b374384b855af95b340627a92813c7642017f31\", \"latency_unittests\": \"e7b63833d175fdb0993bcc8c8313141643e12fb5\", \"libjingle_xmpp_unittests\": \"a1d2022b54e2eb77cf55edb3f5fc7ba716e660b3\", \"media_blink_unittests\": \"0de8a94a480794c55626c044e39549b86faac5fe\", \"media_service_unittests\": \"38d554e9d37c61454e86a22d3440a693fdb07aa4\", \"media_unittests\": \"e4a03b6c1c229e547c52bf56d38f0bb045d01d64\", \"message_center_unittests\": \"86cdc9b9882a7fe50de4d8f44177dfc3dac00d04\", \"midi_unittests\": \"a2ee0fd8e5e55275c23a70278e3d692da5e4756e\", \"mojo_core_unittests\": \"e1f8dcd592c4f045f81437d740434d847af3096f\", \"mojo_unittests\": \"f5047ec8627e7f47cdf5a323b86de294a07bdce9\", \"nacl_helper_nonsfi_unittests\": \"985e4c127c832f526ac92654114d64bd13068fdc\", \"nacl_loader_unittests\": \"c8caa40eff05b1cc0b9d5b1a1fb8dbe3c8dfbb93\", \"native_theme_unittests\": \"88d5e68f82c8df68777baf485a6c1c8b18f889f5\", \"net_unittests\": \"c015344852b5f0e78851109efa980f82158b53b3\", \"pdf_unittests\": \"d8ba390dd906f89bfab37ff2e9dd4b1e0e8df4be\", \"perfetto_unittests\": \"d13263ea8f2fe61bc85a46a5658fc8b3c1ac5562\", \"ppapi_unittests\": \"6d28626145bf9ba08cc81c416274467b5db2e45f\", \"printing_unittests\": \"e6a3e2ba800e9ed89cb1b0cdc246f2bf967aef82\", \"remoting_unittests\": \"e2d9c051d80902096dc7d04d81d44e9c98ae7b47\", \"sandbox_linux_unittests\": \"aedaecc5e1e91615e7f7c74cada1c16c0f2c579f\", \"service_manager_unittests\": \"8de4b2d76d2586b9f28caaefab9bb876760858ad\", \"services_unittests\": \"1ad58a3858b29d1b21becafcd5dbf56c2b61975b\", \"shell_dialogs_unittests\": \"dd86269f9a8d5929fa41a5b0fc2a0c2fee44cbe1\", \"skia_unittests\": \"2fd49b0d6b99b43f7c750636b9bc5da44151d0b8\", \"snapshot_unittests\": \"a3fd28ad14ce36468c4567a24a0ea275cbbd332c\", \"sql_unittests\": \"34d231cfe34d6f98de707871d04525bd8f333b4d\", \"storage_unittests\": \"e1b300dab4fecba1b09e2a6157d0ad97384eeb27\", \"sync_integration_tests\": \"13b455c5d3248b12e77c109e8cd95fb0eb3b6230\", \"traffic_annotation_auditor_unittests\": \"6a161d488e067d602f26f7c6fd61428cf6e191b0\", \"ui_base_unittests\": \"2fdec98c5f9f1c4988d7abed8b1d6a5f4686623d\", \"ui_touch_selection_unittests\": \"6cd1292bf1be204a60a6c8b2f2bf0fcb63b5e412\", \"unit_tests\": \"48a1e2a386dfec02852622572909cfa5bd11d7e5\", \"url_unittests\": \"14b93b272343135cee6298ab6a7e7feed5db32d4\", \"views_unittests\": \"7ae148df50fcb3bb83cc53868c704e25fd1b9b60\", \"viz_unittests\": \"b42c178a3d59dd4ec1a7d23a2a555380f6728404\", \"vr_common_unittests\": \"c69ade8c13b700498213cdec0d8318645e7a619d\", \"vr_pixeltests\": \"b28d82f74cfc4d32ce283ad700c16fdd411c70cd\", \"wm_unittests\": \"756816feb31ffd0713c85e2d5596108616d5c8cc\", \"wtf_unittests\": \"3d3d3bf380c4404d56374eaed21893e72931aea4\"}, \"swarm_hashes_refs/heads/master(at){#706707}_without_patch\": {\"accessibility_unittests\": \"c31005502077aafdf74a9ed9100aa3254dd017dd\", \"angle_unittests\": \"ae8bb8a5fbcafa7ece2278319c379e4bd2a797b4\", \"app_shell_unittests\": \"f39ce0f6cd1970329db15e26f60418e0cb1827f3\", \"aura_unittests\": \"4dfb2566d9c5326f644749758a15fced85c21eb3\", \"base_unittests\": \"62fb3d83093cc17b7d227fd9118fbbbea866ad61\", \"base_util_unittests\": \"8f67d4a87502d972bc9da3ab3b7acfb453390fa1\", \"blink_common_unittests\": \"9f808d6189c1fdd8f05534ab11243e2e131e65f5\", \"blink_fuzzer_unittests\": \"9bee58e9d1bba69bd6a9a92c55d93fdd6125f3b3\", \"blink_heap_unittests\": \"766e2ff3b07dcc88044ac1ab2524e2f1dba0afa4\", \"blink_platform_unittests\": \"432f14eee850949a2dccfd46a8fe0d864a4ffc6e\", \"blink_unittests\": \"d3fc588507ae554cfdfbf3ce10e86b12942c2628\", \"boringssl_crypto_tests\": \"546351ac148d829f7e69b704d7dcb2e09a1dd8b0\", \"boringssl_ssl_tests\": \"001a6fdc9c43136dd8775a782719f819ecd0a400\", \"browser_tests\": \"3ecc1a7cb0450ce243b4be1465b94769fc9978a2\", \"cacheinvalidation_unittests\": \"c1f4de73b1ffb45586d73105a9439ef7c80487a5\", \"capture_unittests\": \"01196654c14362c016cf6e91b6619c85099c63ae\", \"cast_unittests\": \"d131f0b9ef57a5875fc2866003d697491939d80b\", \"cc_unittests\": \"182b2baa293d5fb917321014bdc98895c0279769\", \"chrome_app_unittests\": \"c7b165725c2e6ccf4ca5e0962747e529f51ef30d\", \"chromedriver_unittests\": \"f9a8c6a9577028e4ad5971a7f603423a1c7805ff\", \"color_unittests\": \"0040a2f75fc01169dbca3eba8e5a669cd017848a\", \"components_browsertests\": \"d773403fe9217be8e25de2e34942220d1d4a735a\", \"components_unittests\": \"fe1a3c12cdd0178e950ec42f89741a3d2e423c22\", \"compositor_unittests\": \"d30be82f07e018d504d27961072c835a8cf5db59\", \"content_browsertests\": \"fdf0fbccbd231c937b6b92150b13ebb3ac16a267\", \"content_unittests\": \"0ce2551bcc345a430c295ae05f24bdfe912b7af7\", \"cronet_tests\": \"845f4d23390513fc5e6ea89cc8c5147eb8f4ed53\", \"cronet_unittests\": \"b347788479a0197462c5819446a013e3fa1f361e\", \"crypto_unittests\": \"ff3bd2be6e72ea1c270d12474950e60c3e3fe0bc\", \"dbus_unittests\": \"e3a54691d1dd1e909a344febdfc84e1d99d48374\", \"device_unittests\": \"d724608e24d227c1f217abcc97ac4bf4e1ca34ff\", \"display_unittests\": \"db53ded50672c816dad9b5579f027c27802d7e0f\", \"events_unittests\": \"57159059d45c6aa0c33e459233796f9d6338bbce\", \"extensions_browsertests\": \"6570b694b6a038a4ef1d2ff69718c621b771c079\", \"extensions_unittests\": \"0429d91e17c4895b104aa8acd3633c7bccd3c777\", \"filesystem_service_unittests\": \"1bd7be978067a0fac483591e2595e4d5d3ac03eb\", \"gcm_unit_tests\": \"52ef789a02c5a11b0fffdc01fb9438c98f39247f\", \"gfx_unittests\": \"c5f419533ab7488b22c0b0d348df3d030e19b7b3\", \"gin_unittests\": \"c59f9d9536f3a52c87b5d1ed86a751dfcb4e514b\", \"gl_tests\": \"3b2033087116990f9515b6f8e217a5c8b524ab92\", \"gl_unittests\": \"fd543f321e0f95cb5981cbb6936b45e096d50e81\", \"google_apis_unittests\": \"1aaccea0812fbe8c8951f5518df3369a2bd5a305\", \"gpu_unittests\": \"1dc6c343f31c92c34a8e67da3943e2ac8dfc287c\", \"gwp_asan_unittests\": \"f557c1a1b2891edafbe94ffa6be9b58e8b7f4c30\", \"headless_browsertests\": \"df529b0f6ead7bb1f78122628dc349117ca7db24\", \"headless_unittests\": \"cd0f5679a0780f42945fdc09bfe52e1f23238a29\", \"interactive_ui_tests\": \"8a28b53d8bd8942b68dcccb631dece29d5b23f0f\", \"ipc_tests\": \"18c30dd19905f594f1fb1a230421c50c3473f3be\", \"jingle_unittests\": \"8b374384b855af95b340627a92813c7642017f31\", \"latency_unittests\": \"e7b63833d175fdb0993bcc8c8313141643e12fb5\", \"libjingle_xmpp_unittests\": \"a1d2022b54e2eb77cf55edb3f5fc7ba716e660b3\", \"media_blink_unittests\": \"0de8a94a480794c55626c044e39549b86faac5fe\", \"media_service_unittests\": \"38d554e9d37c61454e86a22d3440a693fdb07aa4\", \"media_unittests\": \"e4a03b6c1c229e547c52bf56d38f0bb045d01d64\", \"message_center_unittests\": \"86cdc9b9882a7fe50de4d8f44177dfc3dac00d04\", \"midi_unittests\": \"a2ee0fd8e5e55275c23a70278e3d692da5e4756e\", \"mojo_core_unittests\": \"e1f8dcd592c4f045f81437d740434d847af3096f\", \"mojo_unittests\": \"f5047ec8627e7f47cdf5a323b86de294a07bdce9\", \"nacl_helper_nonsfi_unittests\": \"985e4c127c832f526ac92654114d64bd13068fdc\", \"nacl_loader_unittests\": \"c8caa40eff05b1cc0b9d5b1a1fb8dbe3c8dfbb93\", \"native_theme_unittests\": \"88d5e68f82c8df68777baf485a6c1c8b18f889f5\", \"net_unittests\": \"c015344852b5f0e78851109efa980f82158b53b3\", \"pdf_unittests\": \"d8ba390dd906f89bfab37ff2e9dd4b1e0e8df4be\", \"perfetto_unittests\": \"d13263ea8f2fe61bc85a46a5658fc8b3c1ac5562\", \"ppapi_unittests\": \"6d28626145bf9ba08cc81c416274467b5db2e45f\", \"printing_unittests\": \"e6a3e2ba800e9ed89cb1b0cdc246f2bf967aef82\", \"remoting_unittests\": \"e2d9c051d80902096dc7d04d81d44e9c98ae7b47\", \"sandbox_linux_unittests\": \"aedaecc5e1e91615e7f7c74cada1c16c0f2c579f\", \"service_manager_unittests\": \"8de4b2d76d2586b9f28caaefab9bb876760858ad\", \"services_unittests\": \"1ad58a3858b29d1b21becafcd5dbf56c2b61975b\", \"shell_dialogs_unittests\": \"dd86269f9a8d5929fa41a5b0fc2a0c2fee44cbe1\", \"skia_unittests\": \"2fd49b0d6b99b43f7c750636b9bc5da44151d0b8\", \"snapshot_unittests\": \"a3fd28ad14ce36468c4567a24a0ea275cbbd332c\", \"sql_unittests\": \"34d231cfe34d6f98de707871d04525bd8f333b4d\", \"storage_unittests\": \"e1b300dab4fecba1b09e2a6157d0ad97384eeb27\", \"sync_integration_tests\": \"13b455c5d3248b12e77c109e8cd95fb0eb3b6230\", \"traffic_annotation_auditor_unittests\": \"6a161d488e067d602f26f7c6fd61428cf6e191b0\", \"ui_base_unittests\": \"2fdec98c5f9f1c4988d7abed8b1d6a5f4686623d\", \"ui_touch_selection_unittests\": \"6cd1292bf1be204a60a6c8b2f2bf0fcb63b5e412\", \"unit_tests\": \"48a1e2a386dfec02852622572909cfa5bd11d7e5\", \"url_unittests\": \"14b93b272343135cee6298ab6a7e7feed5db32d4\", \"views_unittests\": \"7ae148df50fcb3bb83cc53868c704e25fd1b9b60\", \"viz_unittests\": \"b42c178a3d59dd4ec1a7d23a2a555380f6728404\", \"vr_common_unittests\": \"c69ade8c13b700498213cdec0d8318645e7a619d\", \"vr_pixeltests\": \"b28d82f74cfc4d32ce283ad700c16fdd411c70cd\", \"wm_unittests\": \"756816feb31ffd0713c85e2d5596108616d5c8cc\", \"wtf_unittests\": \"3d3d3bf380c4404d56374eaed21893e72931aea4\"}}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_02c489102c6b23f720d825d3d639a9c0a891978418b04ce86081f51b1a63cfd3_v2\", \"builder_40303da126085ecb154eea63e5074e5529c0642f56843659ff6929ae6aaa8bba_v2\", \"git\", \"vpython\"], \"cores\": [\"32\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Broadwell_GCE\", \"x86-64-avx2\"], \"gce\": [\"1\"], \"gpu\": [\"none\"], \"id\": [\"luci-chromium-ci-xenial-32-15-kvmo\"], \"image\": [\"chrome-xenial-19100400-6cc5b08ab04\"], \"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\": [\"4512-670bc38\"], \"ssd\": [\"0\"], \"zone\": [\"us\", \"us-west\", \"us-west1\", \"us-west1-c\"]}}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1571270621264378",
"status": "COMPLETED",
"status_changed_ts": "1571280024684608",
"tags": [
"build_address:luci.chromium.ci/Linux CFI/15323",
"builder:Linux CFI",
"buildset:commit/git/329a688981eb96c9bd772963e5379261789707bf",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/329a688981eb96c9bd772963e5379261789707bf",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9064827481299237552",
"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/8899397418978953728/+/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:47efd3c55e5dfa10",
"user_agent:luci-scheduler"
],
"updated_ts": "1571280024711196",
"url": "https://ci.chromium.org/b/8899397418978953728",
"utcnow_ts": "1571280026530722"
}
}
[02:40:26.544] Invocation finished in 2h42m35.904473569s with status SUCCEEDED