[14:12:31.432] New invocation is queued and will start shortly
[14:12:32.539] Starting the invocation (attempt 1)
[14:12:32.590] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[14:12:32.590] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[14:12:32.590] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9021830747439537152",
"parameters_json": "{\"builder_name\":\"Linux Builder (dbg)\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"080b2120379ef2f28e1c457c4bd7fcfab48c2164\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:Linux Builder (dbg)",
"scheduler_invocation_id:9021830747439537152",
"scheduler_job_id:chromium/Linux Builder (dbg)",
"user_agent:luci-scheduler",
"buildset:commit/git/080b2120379ef2f28e1c457c4bd7fcfab48c2164",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/080b2120379ef2f28e1c457c4bd7fcfab48c2164",
"gitiles_ref:refs/heads/master"
]
}
[14:12:33.721] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary": true,
"canary_preference": "CANARY",
"created_by": "project:chromium",
"created_ts": "1612275152706870",
"id": "8856400685434491696",
"parameters_json": "{\"builder_name\": \"Linux Builder (dbg)\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"080b2120379ef2f28e1c457c4bd7fcfab48c2164\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1612275153491481",
"tags": [
"build_address:luci.chromium.ci/Linux Builder (dbg)/180201",
"builder:Linux Builder (dbg)",
"buildset:commit/git/080b2120379ef2f28e1c457c4bd7fcfab48c2164",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/080b2120379ef2f28e1c457c4bd7fcfab48c2164",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9021830747439537152",
"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/8856400685434491696/+/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": "1612275153491586",
"url": "https://ci.chromium.org/b/8856400685434491696",
"utcnow_ts": "1612275153713883"
}
}
[14:12:33.721] Task URL: https://ci.chromium.org/b/8856400685434491696
[14:12:33.721] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:2:0) after 1m0s
[14:13:22.507] Received PubSub notification, asking Buildbucket for the build status
[14:13:22.800] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:13:35.390] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:2:0)
[14:13:35.390] Timer tick, asking Buildbucket for the build status
[14:13:35.502] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:13:35.502] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:4:0) after 1m0s
[14:14:35.538] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:4:0)
[14:14:35.538] Timer tick, asking Buildbucket for the build status
[14:14:35.895] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:14:35.895] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:5:0) after 1m0s
[14:15:36.102] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:5:0)
[14:15:36.102] Timer tick, asking Buildbucket for the build status
[14:15:36.417] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:15:36.417] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:6:0) after 1m0s
[14:16:36.494] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:6:0)
[14:16:36.494] Timer tick, asking Buildbucket for the build status
[14:16:36.675] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:16:36.675] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:7:0) after 1m0s
[14:17:36.936] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:7:0)
[14:17:36.936] Timer tick, asking Buildbucket for the build status
[14:17:37.068] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:17:37.068] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:8:0) after 1m0s
[14:18:37.136] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:8:0)
[14:18:37.136] Timer tick, asking Buildbucket for the build status
[14:18:37.203] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:18:37.204] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:9:0) after 1m0s
[14:19:37.430] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:9:0)
[14:19:37.430] Timer tick, asking Buildbucket for the build status
[14:19:37.485] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:19:37.485] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:10:0) after 1m0s
[14:20:37.510] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:10:0)
[14:20:37.510] Timer tick, asking Buildbucket for the build status
[14:20:37.626] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:20:37.626] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:11:0) after 1m0s
[14:21:37.713] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:11:0)
[14:21:37.713] Timer tick, asking Buildbucket for the build status
[14:21:37.859] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:21:37.859] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:12:0) after 1m0s
[14:22:37.853] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:12:0)
[14:22:37.853] Timer tick, asking Buildbucket for the build status
[14:22:37.937] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:22:37.937] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:13:0) after 1m0s
[14:23:38.064] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:13:0)
[14:23:38.064] Timer tick, asking Buildbucket for the build status
[14:23:38.251] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:23:38.251] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:14:0) after 1m0s
[14:24:38.326] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:14:0)
[14:24:38.326] Timer tick, asking Buildbucket for the build status
[14:24:38.389] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:24:38.389] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:15:0) after 1m0s
[14:25:38.448] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:15:0)
[14:25:38.448] Timer tick, asking Buildbucket for the build status
[14:25:38.516] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:25:38.516] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:16:0) after 1m0s
[14:26:38.529] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:16:0)
[14:26:38.529] Timer tick, asking Buildbucket for the build status
[14:26:38.709] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:26:38.709] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:17:0) after 1m0s
[14:27:38.731] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:17:0)
[14:27:38.731] Timer tick, asking Buildbucket for the build status
[14:27:39.067] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:27:39.067] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:18:0) after 1m0s
[14:28:39.202] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:18:0)
[14:28:39.202] Timer tick, asking Buildbucket for the build status
[14:28:39.347] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:28:39.347] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:19:0) after 1m0s
[14:29:39.378] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:19:0)
[14:29:39.378] Timer tick, asking Buildbucket for the build status
[14:29:39.449] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:29:39.449] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:20:0) after 1m0s
[14:30:39.514] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:20:0)
[14:30:39.514] Timer tick, asking Buildbucket for the build status
[14:30:39.681] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:30:39.681] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:21:0) after 1m0s
[14:31:39.692] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:21:0)
[14:31:39.692] Timer tick, asking Buildbucket for the build status
[14:31:39.754] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:31:39.754] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:22:0) after 1m0s
[14:32:39.760] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:22:0)
[14:32:39.760] Timer tick, asking Buildbucket for the build status
[14:32:39.867] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:32:39.867] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:23:0) after 1m0s
[14:33:39.909] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:23:0)
[14:33:39.909] Timer tick, asking Buildbucket for the build status
[14:33:40.122] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:33:40.122] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:24:0) after 1m0s
[14:34:40.173] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:24:0)
[14:34:40.173] Timer tick, asking Buildbucket for the build status
[14:34:40.254] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:34:40.254] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:25:0) after 1m0s
[14:35:40.313] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:25:0)
[14:35:40.313] Timer tick, asking Buildbucket for the build status
[14:35:40.379] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:35:40.379] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:26:0) after 1m0s
[14:36:40.388] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:26:0)
[14:36:40.388] Timer tick, asking Buildbucket for the build status
[14:36:40.546] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:36:40.546] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:27:0) after 1m0s
[14:37:40.622] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:27:0)
[14:37:40.622] Timer tick, asking Buildbucket for the build status
[14:37:40.763] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:37:40.763] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:28:0) after 1m0s
[14:38:40.897] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:28:0)
[14:38:40.897] Timer tick, asking Buildbucket for the build status
[14:38:40.981] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:38:40.982] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:29:0) after 1m0s
[14:39:41.075] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:29:0)
[14:39:41.075] Timer tick, asking Buildbucket for the build status
[14:39:41.148] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:39:41.148] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:30:0) after 1m0s
[14:40:41.270] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:30:0)
[14:40:41.270] Timer tick, asking Buildbucket for the build status
[14:40:41.458] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:40:41.458] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:31:0) after 1m0s
[14:41:41.521] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:31:0)
[14:41:41.521] Timer tick, asking Buildbucket for the build status
[14:41:41.622] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:41:41.622] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:32:0) after 1m0s
[14:42:41.702] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:32:0)
[14:42:41.702] Timer tick, asking Buildbucket for the build status
[14:42:41.832] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:42:41.832] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:33:0) after 1m0s
[14:43:41.924] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:33:0)
[14:43:41.924] Timer tick, asking Buildbucket for the build status
[14:43:42.042] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:43:42.042] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:34:0) after 1m0s
[14:44:42.162] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:34:0)
[14:44:42.162] Timer tick, asking Buildbucket for the build status
[14:44:42.221] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:44:42.221] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:35:0) after 1m0s
[14:45:42.450] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:35:0)
[14:45:42.450] Timer tick, asking Buildbucket for the build status
[14:45:42.622] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:45:42.622] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:36:0) after 1m0s
[14:46:42.784] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:36:0)
[14:46:42.784] Timer tick, asking Buildbucket for the build status
[14:46:42.899] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:46:42.900] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:37:0) after 1m0s
[14:47:43.123] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:37:0)
[14:47:43.123] Timer tick, asking Buildbucket for the build status
[14:47:43.312] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:47:43.312] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:38:0) after 1m0s
[14:48:43.486] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:38:0)
[14:48:43.486] Timer tick, asking Buildbucket for the build status
[14:48:43.542] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:48:43.542] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:39:0) after 1m0s
[14:49:43.659] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:39:0)
[14:49:43.659] Timer tick, asking Buildbucket for the build status
[14:49:43.806] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:49:43.806] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:40:0) after 1m0s
[14:50:43.896] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:40:0)
[14:50:43.896] Timer tick, asking Buildbucket for the build status
[14:50:44.019] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:50:44.019] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:41:0) after 1m0s
[14:51:44.068] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:41:0)
[14:51:44.068] Timer tick, asking Buildbucket for the build status
[14:51:44.241] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:51:44.241] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:42:0) after 1m0s
[14:52:44.380] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:42:0)
[14:52:44.380] Timer tick, asking Buildbucket for the build status
[14:52:44.709] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:52:44.709] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:43:0) after 1m0s
[14:53:44.734] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:43:0)
[14:53:44.734] Timer tick, asking Buildbucket for the build status
[14:53:45.081] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:53:45.081] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:44:0) after 1m0s
[14:54:45.254] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:44:0)
[14:54:45.254] Timer tick, asking Buildbucket for the build status
[14:54:45.345] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:54:45.346] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:45:0) after 1m0s
[14:55:45.414] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:45:0)
[14:55:45.414] Timer tick, asking Buildbucket for the build status
[14:55:45.537] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:55:45.537] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:46:0) after 1m0s
[14:56:45.548] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:46:0)
[14:56:45.548] Timer tick, asking Buildbucket for the build status
[14:56:45.820] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:56:45.820] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:47:0) after 1m0s
[14:57:45.992] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:47:0)
[14:57:45.992] Timer tick, asking Buildbucket for the build status
[14:57:46.622] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:57:46.622] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:48:0) after 1m0s
[14:58:46.621] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:48:0)
[14:58:46.621] Timer tick, asking Buildbucket for the build status
[14:58:47.025] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:58:47.025] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:49:0) after 1m0s
[14:59:47.022] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:49:0)
[14:59:47.022] Timer tick, asking Buildbucket for the build status
[14:59:47.437] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:59:47.437] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:50:0) after 1m0s
[15:00:47.463] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:50:0)
[15:00:47.463] Timer tick, asking Buildbucket for the build status
[15:00:47.722] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:00:47.722] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:51:0) after 1m0s
[15:01:47.816] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:51:0)
[15:01:47.816] Timer tick, asking Buildbucket for the build status
[15:01:48.037] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:01:48.037] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:52:0) after 1m0s
[15:02:48.071] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:52:0)
[15:02:48.071] Timer tick, asking Buildbucket for the build status
[15:02:48.348] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:02:48.348] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:53:0) after 1m0s
[15:03:48.417] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:53:0)
[15:03:48.417] Timer tick, asking Buildbucket for the build status
[15:03:48.828] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:03:48.829] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:54:0) after 1m0s
[15:04:48.823] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:54:0)
[15:04:48.823] Timer tick, asking Buildbucket for the build status
[15:04:48.961] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:04:48.961] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:55:0) after 1m0s
[15:05:49.064] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:55:0)
[15:05:49.064] Timer tick, asking Buildbucket for the build status
[15:05:49.155] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:05:49.155] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:56:0) after 1m0s
[15:06:49.163] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:56:0)
[15:06:49.163] Timer tick, asking Buildbucket for the build status
[15:06:49.240] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:06:49.240] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:57:0) after 1m0s
[15:07:49.287] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:57:0)
[15:07:49.287] Timer tick, asking Buildbucket for the build status
[15:07:49.510] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:07:49.510] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:58:0) after 1m0s
[15:08:49.574] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:58:0)
[15:08:49.574] Timer tick, asking Buildbucket for the build status
[15:08:49.807] Build 8856400685434491696: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:08:49.807] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9021830747439537152:59:0) after 1m0s
[15:08:57.818] Received PubSub notification, asking Buildbucket for the build status
[15:08:58.046] Build 8856400685434491696: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[15:08:58.046] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary": true,
"canary_preference": "CANARY",
"completed_ts": "1612278536811960",
"created_by": "project:chromium",
"created_ts": "1612275152706870",
"id": "8856400685434491696",
"parameters_json": "{\"builder_name\": \"Linux Builder (dbg)\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"080b2120379ef2f28e1c457c4bd7fcfab48c2164\"}}",
"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\": \"080b2120379ef2f28e1c457c4bd7fcfab48c2164\", \"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-159-2xnu\", \"branch\": \"refs/heads/master\", \"builder_group\": \"chromium.linux\", \"buildername\": \"Linux Builder (dbg)\", \"buildnumber\": 180201, \"got_angle_revision\": \"43e39e1e8e387644f22d87c7a846e57172bd1312\", \"got_dawn_revision\": \"199ba447c511fcdc9f06595f85d42bb97f519417\", \"got_nacl_revision\": \"952e81813a66902714b68f34b51073c5d1ba6c94\", \"got_revision\": \"080b2120379ef2f28e1c457c4bd7fcfab48c2164\", \"got_revision_cp\": \"refs/heads/master@{#849573}\", \"got_swarming_client_revision\": \"a32a1607f6093d338f756c7e7c7b4333b0c50c9c\", \"got_swiftshader_revision\": \"51045556acd0fe0a1b687ef00725a57f0f19a91b\", \"got_v8_revision\": \"084201251b83b335e314810dda69e21838233623\", \"got_v8_revision_cp\": \"refs/heads/9.0.110@{#1}\", \"got_webrtc_revision\": \"e7c79fd3d66e0f6c54c027f880a8b1682ebae58a\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#33124}\", \"isolate_server\": \"https://isolateserver.appspot.com\", \"mirrored_builders\": [\"tryserver.chromium.linux:linux-clang-tidy-dbg\", \"tryserver.chromium.linux:linux_chromium_dbg_ng\", \"tryserver.chromium.linux:linux_chromium_compile_dbg_ng\"], \"path_config\": \"generic\", \"recipe\": \"chromium\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"080b2120379ef2f28e1c457c4bd7fcfab48c2164\", \"swarm_hashes_refs/heads/master(at){#849573}_without_patch\": {\"absl_hardening_tests\": \"a4bcd765216c7a03b207772e5692b6bc3b4afd96\", \"accessibility_unittests\": \"e3ccdf14c2b0005dde5d050d9fdf24ab2b6734c7\", \"angle_unittests\": \"deb9c1819769f52abbf888fbe966baeb04a412a8\", \"app_shell_unittests\": \"f4f0562e21a65076fc5e547a419413c134d1f29c\", \"aura_unittests\": \"488cceb17d5d1e41085586681411fd67a883d37a\", \"base_unittests\": \"4efc4f84b1081b0422c2b4cac197eaec2f805623\", \"base_util_unittests\": \"5b7d0fbf0afb003299e798cb603ac87a197153e0\", \"blink_common_unittests\": \"9573f21159bbd491778a6e109754d3833a83c870\", \"blink_fuzzer_unittests\": \"14fc418c05600b4de6fc8db08938166877f872c2\", \"blink_heap_unittests\": \"d158ea7d5f0083919b2c2dd6edae806c637d93b1\", \"blink_platform_unittests\": \"6647c9cfdc4b9c297d3b23230cc931d1988bbb68\", \"blink_python_tests\": \"bc6caec4aa3f28709d561553661c474c768400a8\", \"blink_unittests\": \"0e183d2c8fcc84c779e9654938622db73762dd6c\", \"blink_web_tests\": \"f71a35ac557af25568e10fe8a8329584d223c387\", \"boringssl_crypto_tests\": \"482e1bd88283b3af927d7761951969ae1300ccae\", \"boringssl_ssl_tests\": \"cf7e88bfa27868899b798c3222deed982e8f553b\", \"browser_tests\": \"94900c46fffd416b7978187bb35cd820807795bf\", \"capture_unittests\": \"e37df8e8272a6127bad1eb6cda4442488e4fce91\", \"cast_unittests\": \"8c2811ed46a4f2641c69fdd71d7351a3ce856056\", \"cc_unittests\": \"89098e0a128e5e27c8e8cc9141306cd7111af986\", \"chrome_app_unittests\": \"fa52fa19326b13657defc16e82541d017a3520a3\", \"chromedriver_unittests\": \"4571b938cb4fc0f53e203b75ccf028c547a15d45\", \"components_browsertests\": \"01ffcd15d85ad5975787da8a49fdc6d4f95055ec\", \"components_unittests\": \"54ef0ad108c02dfc58d27625e227f08274b93a29\", \"compositor_unittests\": \"8d0da282992026306b2466e1ea9d7e606d3120bb\", \"content_browsertests\": \"597da649a2c24d1ca12c976b81f3bd7c1f128cfd\", \"content_shell_crash_test\": \"ca31334d1b45729f00c71c6d259e0f39211bfa94\", \"content_unittests\": \"1f70159e80cfc70122ad775d76b091fa5e4892c3\", \"crashpad_tests\": \"837639fcb24e8d98e8c24ec7c1a224e2d37ce866\", \"cronet_tests\": \"f8f7971b645901412a3d9536c3984a532074303b\", \"cronet_unittests\": \"c3b819720fc7848d25347f414ef620400b64e9ab\", \"crypto_unittests\": \"41f378578783a700b3f604dc5f825328f684f292\", \"dbus_unittests\": \"b58d00be780fc06b05a3ff5d83d79f09ca94ee5f\", \"device_unittests\": \"964cbb0d7c0c6c0eabf107ac9ea9342c35f1ee20\", \"display_unittests\": \"d9a5196eeda0126f8f065475cb317308e4424239\", \"events_unittests\": \"7eb084b00946aa4814d20ae6e3f476a18d5f912b\", \"extensions_browsertests\": \"ebe0406386a2e05a46ff3c8ca277fab584bf765c\", \"extensions_unittests\": \"9d103210e30fe722768428838e3f0aa61f4046ac\", \"filesystem_service_unittests\": \"cff67f470ef8288a619e35aea2b28eedff594b42\", \"flatbuffers_unittests\": \"abe7737f42a55ed672142d98ab3b938d8384c781\", \"gcm_unit_tests\": \"5e4127694ad237bda6081a98e00041e638c2ae6b\", \"gfx_unittests\": \"66119b2d473b534448aaff90147562fee067c446\", \"gin_unittests\": \"bbdc2e23b7f083ed4a3318abc7300debec431c7c\", \"google_apis_unittests\": \"544be36d1810fe0b0a1b6e25b9142979f1e4ac6a\", \"gpu_unittests\": \"a1381071005d7b99dd7bbf24bf1190d816fe2dde\", \"grit_python_unittests\": \"0532571aa381198443b89c1ec536d42cf612fc22\", \"gwp_asan_unittests\": \"a81d4df621919748ab5785e6d87e745309f19db6\", \"headless_browsertests\": \"f6f30a5a1cd7b89ed381ff0a12f6a76843f8a60a\", \"headless_unittests\": \"d8bfebb37c487c35d6725eb0863c9c4fed0c7e59\", \"interactive_ui_tests\": \"7586f39cb3b5018d569d024248a5e20da44c213a\", \"ipc_tests\": \"2da5172162354d4714cdf7f002fda9bd2bd97fad\", \"jingle_unittests\": \"1b3da37a6ab2010b31acc0f2aaff11b6139bd0c1\", \"latency_unittests\": \"74f3aae15347e4987d96075b2236dc18390dde6b\", \"libjingle_xmpp_unittests\": \"f068e491bcd1d2846ab47285fd31fca05157be6c\", \"liburlpattern_unittests\": \"872f938ec359ba533b3a6ed3a1d0083047722e97\", \"media_blink_unittests\": \"f7a47131256329ac05a795140a6c2300b52e677e\", \"media_unittests\": \"65038a605479a9a23f10879c39767f1cdb5c2169\", \"message_center_unittests\": \"ca75dc5fb46ff6201b3f27328596f8a122894ce7\", \"metrics_python_tests\": \"c04b3bda50428747524b68b45a38e8d89d39221c\", \"midi_unittests\": \"e85e08e97ba84b54d9bcea3ea31ee6b724254e80\", \"mojo_core_unittests\": \"e52abc603e87fcb2fd425aff25481b554aea3479\", \"mojo_unittests\": \"b6d805281cfccfc60c27b34cfc91715553bef382\", \"nacl_helper_nonsfi_unittests\": \"2445bb42b1c0a85930ff1f57a8f465c3f42a11ff\", \"nacl_loader_unittests\": \"c7cde6bcaf6ef434ec4b7146edc29efaf1b44333\", \"native_theme_unittests\": \"81437f143423bc4b6b09fc0a2413927506ada0d4\", \"net_unittests\": \"a9f8fcffaf485d39b4215762cfd99ab52c7d78ea\", \"openscreen_unittests\": \"7b3893fff8e52ae48e80bc3f369e46a54ecc21db\", \"pdf_unittests\": \"451e3f2ae10539418ea1daa87d6c99991f9cd880\", \"perfetto_unittests\": \"8f220725939816d9e76671d9cdd21bd545efa63c\", \"ppapi_unittests\": \"ebccf886729dd126f9613fa1c79bed76bdc8de03\", \"printing_unittests\": \"d5df3a026186e7051608510d65f3d20280797ff8\", \"remoting_unittests\": \"38179b70c6c5c2a0923c3dd39f059db306bd2ed5\", \"sandbox_linux_unittests\": \"5daaaa805f15841f696c388034ca60d42ce78819\", \"service_manager_unittests\": \"22dd5677f9e60bff9a723d03f6eea443d85892ff\", \"services_unittests\": \"2697c333e8b079f63c3aec68810deef30bebca03\", \"shell_dialogs_unittests\": \"a35672721be18813f0009e198a3a196975f4d85b\", \"skia_unittests\": \"af3d82a1e92a210f9231688ff46ae1eaf6189c53\", \"snapshot_unittests\": \"fb6a8d7f88e852b8a7bf39ce1415a0b588b8e62b\", \"sql_unittests\": \"76862f9ba49d3276e0ea9352d936085dba61c4d2\", \"storage_unittests\": \"917bd3b372adb633a0fa9297c94c2dc04eb941db\", \"sync_integration_tests\": \"a16955374cf8bcfaf72872c799af48a42c2d7336\", \"telemetry_gpu_unittests\": \"fb7493e58e8f49cf40b04befa3ccbb5c9f9e1b00\", \"telemetry_perf_unittests\": \"000ee7b625c355e8dc1610c0a2c671111778bbc9\", \"telemetry_unittests\": \"505553acbda05c0199b67ab4687625afb53997f2\", \"traffic_annotation_auditor_unittests\": \"eb39e83f973b430fc9ce3a2678dda6e871beebb1\", \"ui_base_unittests\": \"0191eb4c826d2fe3b6b33e772744a879b419fb20\", \"ui_touch_selection_unittests\": \"cc3c5ad983cab1b6af588154800eff6a1168b8e8\", \"unit_tests\": \"60e619c0d37873cb3df20ff4438d9a072b7a1d25\", \"url_unittests\": \"ecf4c6ef47f6c610a1e0072a8cddfa882dec6570\", \"views_perftests\": \"6a656f734d438e84a572c3240d51ac450cd60fed\", \"views_unittests\": \"a48b61ab6f2127d7a954e2323eb1a618b91f14db\", \"viz_unittests\": \"1e914663e455f884f121f20309205bd59cc6a152\", \"vr_common_unittests\": \"12685e5a0bd79b6dd81944fae6a305d92e8841ee\", \"vr_pixeltests\": \"381bd1073c00c1a047c1cb2b42808eea15eefc73\", \"webdriver_wpt_tests\": \"6d4866a3fc02c72518dc7a439bd55f70b312c30e\", \"weblayer_browsertests\": \"aaedbafcde74b57f51db8369b4d1002ea3261857\", \"weblayer_unittests\": \"41b00d63fbfd04a563ed6078c5fff289c03ecd0c\", \"wm_unittests\": \"535c72a2f039219d1ecc49d155e54446c76cdbd0\", \"wtf_unittests\": \"09ecb75f4ff08d634335f9f42a7b16c6d5d5bc9e\", \"x11_unittests\": \"8d76a538ce824dbdaa8da805c6da177765b824c9\", \"xr_browser_tests\": \"7c1d6ed76350153dae546d8867c96bb308a74bfa\", \"zlib_unittests\": \"9d1e6e54d1a20ebf8f533928baf31d1abd2a40b1\"}}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_be71ec2e45ff41f29ecdc3611cfb7c276cc0ff3138424d653aa2b7cfb51218d3_v2\", \"builder_d1ade7eeaf5d4bfec46cdcc4260ff7266c5ca5ac9f935f1643683e9e2b66e303_v2\", \"builder_de6b7a4556553e5c716563e6aa155a105cc4f0b63061ff921cc2886efab12e23_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-159-2xnu\"], \"image\": [\"chrome-xenial-21011100-9488e34e558\"], \"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\": [\"5673-2413400\"], \"ssd\": [\"0\"], \"zone\": [\"us\", \"us-central\", \"us-central1\", \"us-central1-b\"]}}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1612275191393168",
"status": "COMPLETED",
"status_changed_ts": "1612278537256327",
"tags": [
"build_address:luci.chromium.ci/Linux Builder (dbg)/180201",
"builder:Linux Builder (dbg)",
"buildset:commit/git/080b2120379ef2f28e1c457c4bd7fcfab48c2164",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/080b2120379ef2f28e1c457c4bd7fcfab48c2164",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9021830747439537152",
"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/8856400685434491696/+/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:517be8057abb1810",
"user_agent:luci-scheduler"
],
"updated_ts": "1612278537260955",
"url": "https://ci.chromium.org/b/8856400685434491696",
"utcnow_ts": "1612278538033177"
}
}
[15:08:58.046] Invocation finished in 56m26.635575678s with status SUCCEEDED