[14:47:20.456] New invocation is queued and will start shortly
[14:47:21.567] Starting the invocation (attempt 1)
[14:47:21.619] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[14:47:21.619] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[14:47:21.619] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9030435268742308320",
"parameters_json": "{\"builder_name\":\"Linux Builder (dbg)\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"263ace9b190e7b3244e9e989325f3b5e2ac2f751\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:Linux Builder (dbg)",
"scheduler_invocation_id:9030435268742308320",
"scheduler_job_id:chromium/Linux Builder (dbg)",
"user_agent:luci-scheduler",
"buildset:commit/git/263ace9b190e7b3244e9e989325f3b5e2ac2f751",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/263ace9b190e7b3244e9e989325f3b5e2ac2f751",
"gitiles_ref:refs/heads/master"
]
}
[14:47:22.432] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1604069241730563",
"id": "8865005206741854672",
"parameters_json": "{\"builder_name\": \"Linux Builder (dbg)\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"263ace9b190e7b3244e9e989325f3b5e2ac2f751\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1604069242274426",
"tags": [
"build_address:luci.chromium.ci/Linux Builder (dbg)/177181",
"builder:Linux Builder (dbg)",
"buildset:commit/git/263ace9b190e7b3244e9e989325f3b5e2ac2f751",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/263ace9b190e7b3244e9e989325f3b5e2ac2f751",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9030435268742308320",
"scheduler_job_id:chromium/Linux Builder (dbg)",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8865005206741854672/+/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": "1604069242274536",
"url": "https://ci.chromium.org/b/8865005206741854672",
"utcnow_ts": "1604069242422003"
}
}
[14:47:22.433] Task URL: https://ci.chromium.org/b/8865005206741854672
[14:47:22.433] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:2:0) after 1m0s
[14:47:25.344] Received PubSub notification, asking Buildbucket for the build status
[14:47:25.422] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:48:22.449] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:2:0)
[14:48:22.449] Timer tick, asking Buildbucket for the build status
[14:48:22.672] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:48:22.672] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:4:0) after 1m0s
[14:49:22.722] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:4:0)
[14:49:22.722] Timer tick, asking Buildbucket for the build status
[14:49:22.802] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:49:22.802] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:5:0) after 1m0s
[14:50:22.922] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:5:0)
[14:50:22.922] Timer tick, asking Buildbucket for the build status
[14:50:23.102] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:50:23.102] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:6:0) after 1m0s
[14:51:23.135] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:6:0)
[14:51:23.135] Timer tick, asking Buildbucket for the build status
[14:51:23.317] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:51:23.317] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:7:0) after 1m0s
[14:52:23.403] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:7:0)
[14:52:23.403] Timer tick, asking Buildbucket for the build status
[14:52:23.526] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:52:23.526] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:8:0) after 1m0s
[14:53:23.573] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:8:0)
[14:53:23.573] Timer tick, asking Buildbucket for the build status
[14:53:23.936] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:53:23.936] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:9:0) after 1m0s
[14:54:24.049] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:9:0)
[14:54:24.049] Timer tick, asking Buildbucket for the build status
[14:54:24.159] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:54:24.159] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:10:0) after 1m0s
[14:55:24.267] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:10:0)
[14:55:24.267] Timer tick, asking Buildbucket for the build status
[14:55:24.346] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:55:24.346] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:11:0) after 1m0s
[14:56:24.576] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:11:0)
[14:56:24.576] Timer tick, asking Buildbucket for the build status
[14:56:24.659] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:56:24.659] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:12:0) after 1m0s
[14:57:24.678] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:12:0)
[14:57:24.678] Timer tick, asking Buildbucket for the build status
[14:57:24.957] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:57:24.957] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:13:0) after 1m0s
[14:58:24.984] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:13:0)
[14:58:24.984] Timer tick, asking Buildbucket for the build status
[14:58:25.142] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:58:25.142] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:14:0) after 1m0s
[14:59:25.175] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:14:0)
[14:59:25.175] Timer tick, asking Buildbucket for the build status
[14:59:25.461] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:59:25.461] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:15:0) after 1m0s
[15:00:25.589] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:15:0)
[15:00:25.589] Timer tick, asking Buildbucket for the build status
[15:00:26.441] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:00:26.441] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:16:0) after 1m0s
[15:01:26.447] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:16:0)
[15:01:26.447] Timer tick, asking Buildbucket for the build status
[15:01:26.786] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:01:26.786] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:17:0) after 1m0s
[15:02:26.867] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:17:0)
[15:02:26.867] Timer tick, asking Buildbucket for the build status
[15:02:27.063] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:02:27.063] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:18:0) after 1m0s
[15:03:27.188] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:18:0)
[15:03:27.188] Timer tick, asking Buildbucket for the build status
[15:03:27.476] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:03:27.476] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:19:0) after 1m0s
[15:04:27.809] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:19:0)
[15:04:27.809] Timer tick, asking Buildbucket for the build status
[15:04:27.901] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:04:27.901] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:20:0) after 1m0s
[15:05:29.600] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:20:0)
[15:05:29.600] Timer tick, asking Buildbucket for the build status
[15:05:29.760] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:05:29.760] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:21:0) after 1m0s
[15:06:29.819] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:21:0)
[15:06:29.819] Timer tick, asking Buildbucket for the build status
[15:06:29.912] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:06:29.912] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:22:0) after 1m0s
[15:07:29.977] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:22:0)
[15:07:29.977] Timer tick, asking Buildbucket for the build status
[15:07:30.184] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:07:30.184] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:23:0) after 1m0s
[15:08:30.275] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:23:0)
[15:08:30.275] Timer tick, asking Buildbucket for the build status
[15:08:30.452] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:08:30.452] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:24:0) after 1m0s
[15:09:30.551] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:24:0)
[15:09:30.551] Timer tick, asking Buildbucket for the build status
[15:09:30.794] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:09:30.794] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:25:0) after 1m0s
[15:10:30.874] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:25:0)
[15:10:30.874] Timer tick, asking Buildbucket for the build status
[15:10:30.979] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:10:30.979] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:26:0) after 1m0s
[15:11:31.150] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:26:0)
[15:11:31.150] Timer tick, asking Buildbucket for the build status
[15:11:31.254] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:11:31.254] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:27:0) after 1m0s
[15:12:31.338] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:27:0)
[15:12:31.338] Timer tick, asking Buildbucket for the build status
[15:12:31.530] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:12:31.530] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:28:0) after 1m0s
[15:13:31.804] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:28:0)
[15:13:31.804] Timer tick, asking Buildbucket for the build status
[15:13:31.878] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:13:31.878] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:29:0) after 1m0s
[15:14:32.066] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:29:0)
[15:14:32.066] Timer tick, asking Buildbucket for the build status
[15:14:32.142] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:14:32.142] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:30:0) after 1m0s
[15:15:32.214] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:30:0)
[15:15:32.214] Timer tick, asking Buildbucket for the build status
[15:15:32.347] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:15:32.347] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:31:0) after 1m0s
[15:16:32.396] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:31:0)
[15:16:32.396] Timer tick, asking Buildbucket for the build status
[15:16:32.468] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:16:32.468] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:32:0) after 1m0s
[15:17:32.688] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:32:0)
[15:17:32.688] Timer tick, asking Buildbucket for the build status
[15:17:33.235] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:17:33.235] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:33:0) after 1m0s
[15:18:33.302] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:33:0)
[15:18:33.302] Timer tick, asking Buildbucket for the build status
[15:18:33.466] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:18:33.466] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:34:0) after 1m0s
[15:19:33.493] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:34:0)
[15:19:33.493] Timer tick, asking Buildbucket for the build status
[15:19:33.568] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:19:33.568] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:35:0) after 1m0s
[15:20:33.594] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:35:0)
[15:20:33.594] Timer tick, asking Buildbucket for the build status
[15:20:33.672] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:20:33.672] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:36:0) after 1m0s
[15:21:34.274] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:36:0)
[15:21:34.274] Timer tick, asking Buildbucket for the build status
[15:21:34.333] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:21:34.333] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:37:0) after 1m0s
[15:22:34.462] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:37:0)
[15:22:34.462] Timer tick, asking Buildbucket for the build status
[15:22:34.662] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:22:34.662] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:38:0) after 1m0s
[15:23:34.710] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:38:0)
[15:23:34.710] Timer tick, asking Buildbucket for the build status
[15:23:34.857] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:23:34.857] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:39:0) after 1m0s
[15:24:34.921] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:39:0)
[15:24:34.922] Timer tick, asking Buildbucket for the build status
[15:24:34.999] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:24:34.999] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:40:0) after 1m0s
[15:25:35.101] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:40:0)
[15:25:35.101] Timer tick, asking Buildbucket for the build status
[15:25:35.175] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:25:35.175] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:41:0) after 1m0s
[15:26:35.347] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:41:0)
[15:26:35.347] Timer tick, asking Buildbucket for the build status
[15:26:35.451] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:26:35.451] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:42:0) after 1m0s
[15:27:35.593] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:42:0)
[15:27:35.593] Timer tick, asking Buildbucket for the build status
[15:27:35.726] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:27:35.726] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:43:0) after 1m0s
[15:28:35.926] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:43:0)
[15:28:35.926] Timer tick, asking Buildbucket for the build status
[15:28:36.025] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:28:36.025] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:44:0) after 1m0s
[15:29:36.087] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:44:0)
[15:29:36.087] Timer tick, asking Buildbucket for the build status
[15:29:36.163] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:29:36.163] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:45:0) after 1m0s
[15:30:36.290] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:45:0)
[15:30:36.290] Timer tick, asking Buildbucket for the build status
[15:30:36.453] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:30:36.453] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:46:0) after 1m0s
[15:31:36.558] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:46:0)
[15:31:36.558] Timer tick, asking Buildbucket for the build status
[15:31:36.653] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:31:36.671] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:47:0) after 1m0s
[15:32:36.731] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:47:0)
[15:32:36.731] Timer tick, asking Buildbucket for the build status
[15:32:36.883] Build 8865005206741854672: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:32:36.883] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9030435268742308320:48:0) after 1m0s
[15:32:57.900] Received PubSub notification, asking Buildbucket for the build status
[15:32:57.983] Build 8865005206741854672: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[15:32:57.983] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1604071976723261",
"created_by": "project:chromium",
"created_ts": "1604069241730563",
"id": "8865005206741854672",
"parameters_json": "{\"builder_name\": \"Linux Builder (dbg)\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"263ace9b190e7b3244e9e989325f3b5e2ac2f751\"}}",
"project": "chromium",
"result": "SUCCESS",
"result_details_json": "{\"properties\": {\"$build/goma\": {\"enable_ats\": true, \"jobs\": 500.0, \"rpc_extra_params\": \"?prod\", \"server_host\": \"goma.chromium.org\", \"use_luci_auth\": true}, \"$recipe_engine/isolated\": {\"server\": \"https://isolateserver.appspot.com\"}, \"$recipe_engine/milo/blamelist_pins\": [{\"host\": \"chromium.googlesource.com\", \"id\": \"263ace9b190e7b3244e9e989325f3b5e2ac2f751\", \"project\": \"chromium/src\"}], \"$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-us-central1-b-8-163-dpfz\", \"branch\": \"refs/heads/master\", \"builder_group\": \"chromium.linux\", \"buildername\": \"Linux Builder (dbg)\", \"buildnumber\": 177181, \"got_angle_revision\": \"a8c01862f57fa91092304bcd02f8072783160848\", \"got_dawn_revision\": \"25eb373eede4aaa8ed069457e2c05b9c9eab9db2\", \"got_nacl_revision\": \"0fabd6dc4222dfae664e55a84326e0c904f5b62c\", \"got_revision\": \"263ace9b190e7b3244e9e989325f3b5e2ac2f751\", \"got_revision_cp\": \"refs/heads/master@{#822637}\", \"got_swarming_client_revision\": \"d46ea7635f2911208268170512cb611412488fd8\", \"got_swiftshader_revision\": \"1459d852b166b479ff206246cfa9fa530ffbae7d\", \"got_v8_revision\": \"ffc771df4710e998f73be031890f60ce2f69d513\", \"got_v8_revision_cp\": \"refs/heads/8.8.211@{#1}\", \"got_webrtc_revision\": \"ee24eb66d23ffea5ef729dc340e1fc4381c72a4a\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#32507}\", \"isolate_server\": \"https://isolateserver.appspot.com\", \"path_config\": \"generic\", \"recipe\": \"chromium\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"263ace9b190e7b3244e9e989325f3b5e2ac2f751\", \"swarm_hashes_refs/heads/master(at){#822637}_without_patch\": {\"absl_hardening_tests\": \"30b8160a27877799f19394a5bbbac88347bf7d49\", \"accessibility_unittests\": \"fd583921ddd68e5131b913b5137dd31321b1bfd0\", \"angle_unittests\": \"5fd3546ab4513e67a5ede1d283e10a1232b50a63\", \"app_shell_unittests\": \"dcd56f08006b9dbacbaa2e553c85af915f5dac97\", \"aura_unittests\": \"b8f2c8d0c33d296f912fbdc25e5411a756f81e97\", \"base_unittests\": \"811ee795d4ed6515c318a9debe9c7cce2be8fb87\", \"base_util_unittests\": \"073b8853c7f4de333d38fba7aa6ee7714b627689\", \"blink_common_unittests\": \"c51e6ce1adfc53043cbef1dcb34d8abb5c9fe82f\", \"blink_fuzzer_unittests\": \"addb78dc72bc2269d9fb3b2a4f2f6963df922f61\", \"blink_heap_unittests\": \"f0c7dd6aa2216a233d3b1e7ba0d3817c3a606763\", \"blink_platform_unittests\": \"2f85f98bffd93ec1115d859a70f886f94ee6db1c\", \"blink_python_tests\": \"14f920f10b5f5439ab4d194c9c6e3c18798fa766\", \"blink_unittests\": \"87ac0512310bc2043d894226f520b05bec024ebb\", \"blink_web_tests\": \"49c60211d67f2d6d1556a94572b7a81f6c980cc1\", \"boringssl_crypto_tests\": \"5aedccb3b69d0d4d3bbb82fc394d5e65e83fbcbf\", \"boringssl_ssl_tests\": \"725b2ff56e095e7adc7260752490a77bca72a830\", \"browser_tests\": \"2afb288f4e8f4de644f70ccff5d61567e6eb36e5\", \"capture_unittests\": \"51bbe28ae688182e53e4529d48134300d81beefa\", \"cast_unittests\": \"ad208b08d0164000fea15a1df7e5a06013ac2039\", \"cc_unittests\": \"f23d61beded920abb50dda11ba2ba45520454657\", \"chrome_app_unittests\": \"b0d8846f4cd90883e663820d312241d66a820ebe\", \"chromedriver_unittests\": \"6831065bc804511a4a3d786ae2cbeab5b3335260\", \"components_browsertests\": \"2d28497879b6d9d0efe4d90e97714d5fdc4078fd\", \"components_unittests\": \"03d957c7c21a84f1d76eb657ffe9513135693706\", \"compositor_unittests\": \"a25d6446ee3adc4acb4dd809b3a34f7d060484a7\", \"content_browsertests\": \"3e9b47da1a3c9d69c63166d639d28313f97b100a\", \"content_shell_crash_test\": \"9c216ee236d7dc4fc7a838ce4706069a6c16a36e\", \"content_unittests\": \"cdc3b053f025ef999c25c614eff450f21de43efb\", \"crashpad_tests\": \"fa33f12ba7e9a1e7c86b6a6607f86b85bf88b82b\", \"cronet_tests\": \"4dab0f53ef1177b5ba22e82e9016d65f2185726f\", \"cronet_unittests\": \"b38a8d8e714518427ddf36db88eeb8a7040d2888\", \"crypto_unittests\": \"72ca8383447e02aee87e0a264aac18ea64475715\", \"dbus_unittests\": \"4f157e9d2d6ca47a5fceaf0bce279cdb0eacffc9\", \"device_unittests\": \"80b36a7e2bd0e6786d00d6d1f716e9a2cbc0a402\", \"display_unittests\": \"4bd49d99cea666bb3b7618dd7ec534ecc511bc98\", \"events_unittests\": \"5b3a54453f58fc6be16bbe50adec588ca8752ed5\", \"extension_docserver_python_unittests\": \"06bfc182fc46ba9ae0dd12e3e9e7982ca4c8fa47\", \"extensions_browsertests\": \"439de3fd73836851e7a2a3c995b16e3d64bd0943\", \"extensions_unittests\": \"4c42a513557b969eae764cfdeb08925c5cce101e\", \"filesystem_service_unittests\": \"2343b46b9b20eac4f02b7bb5c666c295548e51f4\", \"flatbuffers_unittests\": \"ca986cd6c8ae1796858da669da1b4475f0113d71\", \"gcm_unit_tests\": \"dd41bf9766869e0ec1d42e782d4c3dd99678fd97\", \"gfx_unittests\": \"ea13835b59e656c3f7a64c12c6b9c5ff5e97874c\", \"gin_unittests\": \"6f5d3563ad1fdfb99227d91d92fc78d6fe1fc239\", \"google_apis_unittests\": \"11dbe90e299275a387513526f9df02e515b2c214\", \"gpu_unittests\": \"dda576d422c3ab2b71f5061e8c5edd425bc87b64\", \"grit_python_unittests\": \"c57107c549d400957552f9572189db48595072fe\", \"gwp_asan_unittests\": \"27afabaedff67a19e56a79c486a97ab728df20fc\", \"headless_browsertests\": \"32c6a4eb067a7c8fe5ce26b0ad4607c617fbeb66\", \"headless_unittests\": \"ee05e4af1003de2d1aa8a4a07977ff67c169d3ba\", \"interactive_ui_tests\": \"ddd1458ff5c9770aef94768124d217fc5699edfb\", \"ipc_tests\": \"9bb412fddf0ecd840426eac6f23e63326026c65b\", \"jingle_unittests\": \"1544be9f854e43e9c0e102ab7ce65251ff67db29\", \"latency_unittests\": \"4e22fe56d04cd0e3591afaadbe7364e67b2df71a\", \"libjingle_xmpp_unittests\": \"3a89b25b24015f1316b555778bd6e48764f2bb1a\", \"liburlpattern_unittests\": \"c1192f6a9868565cc25bd667ab7c2b0b10b55d99\", \"media_blink_unittests\": \"41bf64912f8703816818ae1c3d58ec5c89c586d2\", \"media_unittests\": \"00d335d24c82f4677dbf635dfa89cafdc906596a\", \"message_center_unittests\": \"e9bac4dde25b2e24f6596f7a9bfe3ddd62e44b5d\", \"metrics_python_tests\": \"7cfcb6426092ff0e57e89114b0f97a7f9be04d37\", \"midi_unittests\": \"3065478f70423477f98fb460c8c7070bab17ec1b\", \"mojo_core_unittests\": \"023c2559533ae4f0825f2a9541042680f7c38a62\", \"mojo_unittests\": \"62831c31126890a6da057304abd46a5f26764953\", \"nacl_helper_nonsfi_unittests\": \"e0f0d587562b6b9bf435f23e5bd30cba9ffd89ae\", \"nacl_loader_unittests\": \"a9cd4a5301cd4f40f0d54e95847d48f25fcf2636\", \"native_theme_unittests\": \"84c31268ff0fb29c5addfda9891840e17ed6c921\", \"net_unittests\": \"7e5d3f93273133da9365c1cd11332c623a57a58c\", \"openscreen_unittests\": \"f652d4a252b2debbf1b6b64f4132a2ff5aacc9e1\", \"pdf_unittests\": \"638bc7fac8f5385c6ff726584184169282384ea0\", \"perfetto_unittests\": \"7270d91443f1339a1b2ae9f9f7442a9c75fe4c5d\", \"ppapi_unittests\": \"4f23deec6b2a5de78e3b0139852a674950deb7fc\", \"printing_unittests\": \"907427631827d7fdd4d32a0935012db51c745f3a\", \"remoting_unittests\": \"c770337fe03beaa083bbec1d566e084718cec28c\", \"sandbox_linux_unittests\": \"83ac0655c158d6cb6ccaffdf0160e8f198b91440\", \"service_manager_unittests\": \"4915b4e323cc30e6a0c6a6bc52ea3d3226488c9f\", \"services_unittests\": \"452971842f0e9a8e37107c6c8f110bccdc96d5c1\", \"shell_dialogs_unittests\": \"74ca7c64bf4a5e23022b2a7f6952799883497d76\", \"skia_unittests\": \"814b1c14c7933916e93366e41e8834d47bbf92b5\", \"snapshot_unittests\": \"021a3cd3b5ea5e6be7080c9c6df0c4540a2d99a5\", \"sql_unittests\": \"19a6bd61a0a41b7a1abb97236baffe24fa5744fd\", \"storage_unittests\": \"7e149c23ef9a21bbde73536d1fad83e11577f752\", \"sync_integration_tests\": \"af523351199f3dec22419307252baaf5fa893562\", \"telemetry_gpu_unittests\": \"28ea338a61e619e455ba2c1eabe3ca3bad41837b\", \"telemetry_perf_unittests\": \"30c07ccce553726ed2513bf252cae553629f608e\", \"telemetry_unittests\": \"b28b1b497b6adb79281213337734f26e0d52e4ce\", \"traffic_annotation_auditor_unittests\": \"c52c992b1b6a3ae021dea6c868802d1ca3204357\", \"ui_base_unittests\": \"6ced14dc5d9f9a4d6330f3e2eda65788d64e5d1b\", \"ui_touch_selection_unittests\": \"2b131da812621942b8d81c71a3d57e9b95437543\", \"unit_tests\": \"3e34fdf384675218785a628a79e13c8d07c93c93\", \"url_unittests\": \"4adaffc3c1391289dea0ac4aa92f63d38795b248\", \"views_perftests\": \"e63c9dc730cdd636d24153eb1045aa354ecadacc\", \"views_unittests\": \"1199719a8549d78cbde5d636d81f901c07c80f09\", \"viz_unittests\": \"2138c441a5c5020c06a6b0fe10410daa2e9be5a9\", \"vr_common_unittests\": \"578ac78bd4d1c4c86262f8076eb145117b1f74e7\", \"vr_pixeltests\": \"b387da380ef1cf17d1eb14cf4af7e50248421ef1\", \"webdriver_wpt_tests\": \"ca80490e9083607116a2e813c1c29f42eec16652\", \"weblayer_browsertests\": \"da6ea2f2ce8fb727d900df925319cef02785d8ce\", \"weblayer_unittests\": \"e8a634ba836e6faf0bc6a1623c844ab0718edc26\", \"wm_unittests\": \"6a655e79bf5db21be9f1cef13b05322fd0dc9747\", \"wtf_unittests\": \"a3aafbd068ab4c9c37fa8fe8073284b272b4922b\", \"x11_unittests\": \"9c2e5ea73beb583017e75ac34d7755d4cbdc4345\", \"xr_browser_tests\": \"907c07645e7c1995b8319ba58aefadddbc1ae8e1\", \"zlib_unittests\": \"f22fceaff8c974a8c9dab2d2f3eac5e0e90cabf8\"}}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_08506e22a0e0fdc29bd318165699b599f0671cf91287ea7a96642b02d7ff24e4_v2\", \"builder_361cbaa79261c75a92fc63a8f8c6fc117764238b3277286fa51086e6da3301df_v2\", \"builder_578c225c2c50d5653cce8ddfaab266952737b31d66b6113fbb64cc6f5229aebd_v2\", \"builder_5c906bad1aaeae24a2a7f043536626a3e8df9b2c7401ab4a0dd83c120911bddd_v2\", \"builder_bee64b857be6df8b7c1ab34ae7b2c6eab296c35495667b8b8424b2083d103b1e_v2\", \"builder_d0ba3cd99c36b697d8651140d51bf4b4f4b9cd9aa25af11363af5ede5f6e35b1_v2\", \"builder_e21c17032b725bcf1c922976a36352546baf3f39ec148d1e6730a93c0400d8cc_v2\", \"git\", \"goma_v2\", \"vpython\"], \"cores\": [\"8\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Haswell_GCE\", \"x86-64-avx2\"], \"gce\": [\"1\"], \"gcp\": [\"google.com:chromecompute\"], \"gpu\": [\"none\"], \"id\": [\"luci-chromium-ci-xenial-us-central1-b-8-163-dpfz\"], \"image\": [\"chrome-xenial-20101800-2d400e1627f\"], \"inside_docker\": [\"0\"], \"kvm\": [\"1\"], \"locale\": [\"en_US.UTF-8\"], \"machine_type\": [\"e2-standard-8\"], \"os\": [\"Linux\", \"Ubuntu\", \"Ubuntu-16\", \"Ubuntu-16.04\", \"Ubuntu-16.04.6\"], \"pool\": [\"luci.chromium.ci\"], \"python\": [\"2.7.12\"], \"server_version\": [\"5614-d862eaa\"], \"ssd\": [\"0\"], \"zone\": [\"us\", \"us-central\", \"us-central1\", \"us-central1-b\"]}}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1604069244156987",
"status": "COMPLETED",
"status_changed_ts": "1604071977377519",
"tags": [
"build_address:luci.chromium.ci/Linux Builder (dbg)/177181",
"builder:Linux Builder (dbg)",
"buildset:commit/git/263ace9b190e7b3244e9e989325f3b5e2ac2f751",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/263ace9b190e7b3244e9e989325f3b5e2ac2f751",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9030435268742308320",
"scheduler_job_id:chromium/Linux Builder (dbg)",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8865005206741854672/+/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:4f92cbbf319f8310",
"user_agent:luci-scheduler"
],
"updated_ts": "1604071977396309",
"url": "https://ci.chromium.org/b/8865005206741854672",
"utcnow_ts": "1604071977972236"
}
}
[15:32:57.983] Invocation finished in 45m37.543550103s with status SUCCEEDED