[23:38:54.066] New invocation is queued and will start shortly
[23:38:55.185] Starting the invocation (attempt 1)
[23:38:55.232] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[23:38:55.232] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[23:38:55.232] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9019983174738227504",
"parameters_json": "{\"builder_name\":\"Linux Builder (dbg)\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"0a0ec55bc1fe07d6f5e862c8705531eef3391ec2\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:Linux Builder (dbg)",
"scheduler_invocation_id:9019983174738227504",
"scheduler_job_id:chromium/Linux Builder (dbg)",
"user_agent:luci-scheduler",
"buildset:commit/git/0a0ec55bc1fe07d6f5e862c8705531eef3391ec2",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/0a0ec55bc1fe07d6f5e862c8705531eef3391ec2",
"gitiles_ref:refs/heads/master"
]
}
[23:38:56.061] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1614037135349247",
"id": "8854553112722250224",
"parameters_json": "{\"builder_name\": \"Linux Builder (dbg)\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"0a0ec55bc1fe07d6f5e862c8705531eef3391ec2\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1614037135890032",
"tags": [
"build_address:luci.chromium.ci/Linux Builder (dbg)/180830",
"builder:Linux Builder (dbg)",
"buildset:commit/git/0a0ec55bc1fe07d6f5e862c8705531eef3391ec2",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/0a0ec55bc1fe07d6f5e862c8705531eef3391ec2",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9019983174738227504",
"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/8854553112722250224/+/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": "1614037135890147",
"url": "https://ci.chromium.org/b/8854553112722250224",
"utcnow_ts": "1614037136053832"
}
}
[23:38:56.061] Task URL: https://ci.chromium.org/b/8854553112722250224
[23:38:56.061] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:2:0) after 1m0s
[23:39:04.096] Received PubSub notification, asking Buildbucket for the build status
[23:39:04.174] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:39:56.085] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:2:0)
[23:39:56.085] Timer tick, asking Buildbucket for the build status
[23:39:56.160] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:39:56.160] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:4:0) after 1m0s
[23:40:56.793] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:4:0)
[23:40:56.793] Timer tick, asking Buildbucket for the build status
[23:40:58.409] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:40:58.409] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:5:0) after 1m0s
[23:41:58.533] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:5:0)
[23:41:58.533] Timer tick, asking Buildbucket for the build status
[23:41:58.609] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:41:58.609] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:6:0) after 1m0s
[23:42:58.780] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:6:0)
[23:42:58.780] Timer tick, asking Buildbucket for the build status
[23:42:58.861] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:42:58.861] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:7:0) after 1m0s
[23:43:58.900] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:7:0)
[23:43:58.900] Timer tick, asking Buildbucket for the build status
[23:43:59.029] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:43:59.029] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:8:0) after 1m0s
[23:44:59.150] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:8:0)
[23:44:59.150] Timer tick, asking Buildbucket for the build status
[23:44:59.366] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:44:59.366] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:9:0) after 1m0s
[23:45:59.586] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:9:0)
[23:45:59.586] Timer tick, asking Buildbucket for the build status
[23:45:59.652] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:45:59.652] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:10:0) after 1m0s
[23:46:59.801] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:10:0)
[23:46:59.801] Timer tick, asking Buildbucket for the build status
[23:46:59.915] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:46:59.915] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:11:0) after 1m0s
[23:47:59.956] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:11:0)
[23:47:59.956] Timer tick, asking Buildbucket for the build status
[23:48:00.178] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:48:00.178] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:12:0) after 1m0s
[23:49:00.204] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:12:0)
[23:49:00.204] Timer tick, asking Buildbucket for the build status
[23:49:00.462] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:49:00.462] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:13:0) after 1m0s
[23:50:00.802] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:13:0)
[23:50:00.802] Timer tick, asking Buildbucket for the build status
[23:50:01.124] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:50:01.124] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:14:0) after 1m0s
[23:51:01.717] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:14:0)
[23:51:01.717] Timer tick, asking Buildbucket for the build status
[23:51:02.011] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:51:02.011] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:15:0) after 1m0s
[23:52:02.028] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:15:0)
[23:52:02.028] Timer tick, asking Buildbucket for the build status
[23:52:02.139] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:52:02.139] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:16:0) after 1m0s
[23:53:02.132] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:16:0)
[23:53:02.132] Timer tick, asking Buildbucket for the build status
[23:53:02.218] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:53:02.218] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:17:0) after 1m0s
[23:54:02.218] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:17:0)
[23:54:02.218] Timer tick, asking Buildbucket for the build status
[23:54:02.636] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:54:02.636] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:18:0) after 1m0s
[23:55:02.717] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:18:0)
[23:55:02.717] Timer tick, asking Buildbucket for the build status
[23:55:02.891] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:55:02.891] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:19:0) after 1m0s
[23:56:02.997] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:19:0)
[23:56:02.997] Timer tick, asking Buildbucket for the build status
[23:56:03.079] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:56:03.079] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:20:0) after 1m0s
[23:57:03.101] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:20:0)
[23:57:03.101] Timer tick, asking Buildbucket for the build status
[23:57:03.223] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:57:03.223] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:21:0) after 1m0s
[23:58:03.232] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:21:0)
[23:58:03.232] Timer tick, asking Buildbucket for the build status
[23:58:03.525] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:58:03.525] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:22:0) after 1m0s
[23:59:03.493] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:22:0)
[23:59:03.493] Timer tick, asking Buildbucket for the build status
[23:59:03.616] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:59:03.616] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:23:0) after 1m0s
[00:00:03.624] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:23:0)
[00:00:03.624] Timer tick, asking Buildbucket for the build status
[00:00:03.699] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:00:03.699] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:24:0) after 1m0s
[00:01:03.713] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:24:0)
[00:01:03.713] Timer tick, asking Buildbucket for the build status
[00:01:04.336] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:01:04.336] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:25:0) after 1m0s
[00:02:04.310] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:25:0)
[00:02:04.310] Timer tick, asking Buildbucket for the build status
[00:02:04.416] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:02:04.416] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:26:0) after 1m0s
[00:03:04.471] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:26:0)
[00:03:04.471] Timer tick, asking Buildbucket for the build status
[00:03:04.692] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:03:04.692] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:27:0) after 1m0s
[00:04:04.793] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:27:0)
[00:04:04.793] Timer tick, asking Buildbucket for the build status
[00:04:05.153] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:04:05.153] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:28:0) after 1m0s
[00:05:05.163] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:28:0)
[00:05:05.164] Timer tick, asking Buildbucket for the build status
[00:05:05.431] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:05:05.431] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:29:0) after 1m0s
[00:06:05.520] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:29:0)
[00:06:05.520] Timer tick, asking Buildbucket for the build status
[00:06:05.602] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:06:05.602] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:30:0) after 1m0s
[00:07:05.612] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:30:0)
[00:07:05.612] Timer tick, asking Buildbucket for the build status
[00:07:05.740] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:07:05.740] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:31:0) after 1m0s
[00:08:05.811] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:31:0)
[00:08:05.811] Timer tick, asking Buildbucket for the build status
[00:08:05.960] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:08:05.960] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:32:0) after 1m0s
[00:09:06.038] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:32:0)
[00:09:06.038] Timer tick, asking Buildbucket for the build status
[00:09:06.199] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:09:06.199] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:33:0) after 1m0s
[00:10:06.315] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:33:0)
[00:10:06.315] Timer tick, asking Buildbucket for the build status
[00:10:06.415] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:10:06.415] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:34:0) after 1m0s
[00:11:06.433] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:34:0)
[00:11:06.433] Timer tick, asking Buildbucket for the build status
[00:11:06.600] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:11:06.600] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:35:0) after 1m0s
[00:12:06.617] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:35:0)
[00:12:06.617] Timer tick, asking Buildbucket for the build status
[00:12:06.689] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:12:06.689] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:36:0) after 1m0s
[00:13:06.712] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:36:0)
[00:13:06.712] Timer tick, asking Buildbucket for the build status
[00:13:06.808] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:13:06.808] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:37:0) after 1m0s
[00:14:06.817] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:37:0)
[00:14:06.817] Timer tick, asking Buildbucket for the build status
[00:14:06.935] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:14:06.935] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:38:0) after 1m0s
[00:15:06.983] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:38:0)
[00:15:06.983] Timer tick, asking Buildbucket for the build status
[00:15:07.203] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:15:07.203] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:39:0) after 1m0s
[00:16:07.259] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:39:0)
[00:16:07.259] Timer tick, asking Buildbucket for the build status
[00:16:07.346] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:16:07.346] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:40:0) after 1m0s
[00:17:07.395] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:40:0)
[00:17:07.395] Timer tick, asking Buildbucket for the build status
[00:17:07.474] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:17:07.474] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:41:0) after 1m0s
[00:18:07.501] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:41:0)
[00:18:07.501] Timer tick, asking Buildbucket for the build status
[00:18:07.604] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:18:07.604] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:42:0) after 1m0s
[00:19:07.653] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:42:0)
[00:19:07.653] Timer tick, asking Buildbucket for the build status
[00:19:07.760] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:19:07.760] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:43:0) after 1m0s
[00:20:07.787] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:43:0)
[00:20:07.787] Timer tick, asking Buildbucket for the build status
[00:20:08.110] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:20:08.110] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:44:0) after 1m0s
[00:21:08.169] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:44:0)
[00:21:08.169] Timer tick, asking Buildbucket for the build status
[00:21:08.266] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:21:08.266] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:45:0) after 1m0s
[00:22:08.299] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:45:0)
[00:22:08.299] Timer tick, asking Buildbucket for the build status
[00:22:08.386] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:22:08.386] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:46:0) after 1m0s
[00:23:08.370] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:46:0)
[00:23:08.370] Timer tick, asking Buildbucket for the build status
[00:23:08.692] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:23:08.692] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:47:0) after 1m0s
[00:24:08.758] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:47:0)
[00:24:08.758] Timer tick, asking Buildbucket for the build status
[00:24:08.992] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:24:08.992] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:48:0) after 1m0s
[00:25:09.028] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:48:0)
[00:25:09.028] Timer tick, asking Buildbucket for the build status
[00:25:09.107] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:25:09.107] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:49:0) after 1m0s
[00:26:09.133] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:49:0)
[00:26:09.133] Timer tick, asking Buildbucket for the build status
[00:26:09.395] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:26:09.395] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:50:0) after 1m0s
[00:27:09.377] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:50:0)
[00:27:09.377] Timer tick, asking Buildbucket for the build status
[00:27:09.550] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:27:09.550] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:51:0) after 1m0s
[00:28:09.543] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:51:0)
[00:28:09.543] Timer tick, asking Buildbucket for the build status
[00:28:09.922] Build 8854553112722250224: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:28:09.922] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9019983174738227504:52:0) after 1m0s
[00:29:01.625] Received PubSub notification, asking Buildbucket for the build status
[00:29:01.701] Build 8854553112722250224: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[00:29:01.701] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1614040140282796",
"created_by": "project:chromium",
"created_ts": "1614037135349247",
"id": "8854553112722250224",
"parameters_json": "{\"builder_name\": \"Linux Builder (dbg)\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"0a0ec55bc1fe07d6f5e862c8705531eef3391ec2\"}}",
"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\": \"0a0ec55bc1fe07d6f5e862c8705531eef3391ec2\", \"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-8-4egf\", \"branch\": \"refs/heads/master\", \"builder_group\": \"chromium.linux\", \"buildername\": \"Linux Builder (dbg)\", \"buildnumber\": 180830, \"got_angle_revision\": \"4a95488c0edfb4590c808ee01079069da5a6b2b1\", \"got_dawn_revision\": \"2d3c2e355337037dfa6873536bfb3e3a558bf9ed\", \"got_nacl_revision\": \"abf3277f295c6c87f0b103f291ed5e3e73933b76\", \"got_revision\": \"0a0ec55bc1fe07d6f5e862c8705531eef3391ec2\", \"got_revision_cp\": \"refs/heads/master@{#856497}\", \"got_swarming_client_revision\": \"a32a1607f6093d338f756c7e7c7b4333b0c50c9c\", \"got_swiftshader_revision\": \"3ffbd62bb3437e4b12fdf8ee1dd7a3eb8a5d27ee\", \"got_v8_revision\": \"47f385bf2cd19da4cb3cebc6ff3186859728a2fd\", \"got_v8_revision_cp\": \"refs/heads/9.0.236@{#1}\", \"got_webrtc_revision\": \"6fe3fa14c6686ba9c51095b97ad2e6833a9b03e5\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#33319}\", \"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\": \"0a0ec55bc1fe07d6f5e862c8705531eef3391ec2\", \"swarm_hashes_refs/heads/master(at){#856497}_without_patch\": {\"absl_hardening_tests\": \"0731fa2c0fc411782465cd23234a6ba5d759b734\", \"accessibility_unittests\": \"888bdb16bacb3b13bd05aa456954171de0ebf45c\", \"angle_unittests\": \"589a94d95606f53f199ec8a33f888a1d1830c79f\", \"app_shell_unittests\": \"a8d65433c556e3c68866bb9ff7d5ba8133e50e6e\", \"aura_unittests\": \"373b096155fd47e473e3423402ed7cd37ff9ea1d\", \"base_unittests\": \"6badadc4e3d0d21c121b9d1a789f6b71af110dfb\", \"base_util_unittests\": \"887c2cb11bfb8328a8a749d90d2653bc3c21e9a4\", \"blink_common_unittests\": \"9e41126fd745efe714da5d2bb3f6cfa7a3234640\", \"blink_fuzzer_unittests\": \"b098afd4a38c7030fb4f7a1758bec7fb80a48c49\", \"blink_heap_unittests\": \"52617bf2d52ec71397146202b87d45878371923f\", \"blink_platform_unittests\": \"e43e5ce1351e3b1caf4009c80c0c17863389faab\", \"blink_python_tests\": \"5c70098189ed7f3a0528188e3aef2f962e00e1dd\", \"blink_unittests\": \"6536dd4c2262d54d3094aa1c57360bf9b5460d7c\", \"blink_web_tests\": \"106eb6b13bb3d5645fde511fecdc6eecb5cb8645\", \"boringssl_crypto_tests\": \"131275928ab93d542d9311c344bf46ae149512d1\", \"boringssl_ssl_tests\": \"68fe75264022a0077374368bb21c4878394e8d0b\", \"browser_tests\": \"4e8fb1e472a92de0f38d66f41cee218042594050\", \"capture_unittests\": \"0fb97a05afd8c2ccf8c42638f0524e5e513d3473\", \"cast_unittests\": \"4161f457a2d36cf77b4d13e1c9eecf6d8eebb953\", \"cc_unittests\": \"63065dc12f7fb04df74f87337d83345b2fcf72a6\", \"chrome_app_unittests\": \"29c672b42489926e2edc5b86c5c1412304d75070\", \"chromedriver_unittests\": \"92ed4cd166f329f8331320a64070b0b09b0daae8\", \"components_browsertests\": \"16d7b690b6327d741bb2af7bb55de4339a850e0f\", \"components_unittests\": \"8a082b0a77f7d6e5490e9466abd1b9758234725e\", \"compositor_unittests\": \"0910ddf05975d81859aa902de64f34b683e665cd\", \"content_browsertests\": \"da96a84b84795549e405c3464b3005654fad21f6\", \"content_shell_crash_test\": \"36cd7b17012d58c1407229dada3252211ce34453\", \"content_unittests\": \"90220eb8903a740ea103d99dcf100944bc0df4e7\", \"crashpad_tests\": \"e358fbdeeb48bda8129c9570cc4ebf4c92fe5400\", \"cronet_tests\": \"9a686897a569fd4a07e1ef21289170660d72387d\", \"cronet_unittests\": \"e5d6b794979994c745a9b806e720202840422a58\", \"crypto_unittests\": \"54684e0db141dfbede29bdd686f906591b154ea2\", \"dbus_unittests\": \"7324e21402e533a8562feadf713bc92a81549336\", \"device_unittests\": \"aafc2897dc236a267277beca84fb910001a581b5\", \"display_unittests\": \"7847d575fd99f28a832822a1bb1b1c681dd9cda5\", \"events_unittests\": \"c3826a849eff26cc0c65b15b79ec1fea7629ee59\", \"extensions_browsertests\": \"fc789d57de4e1ffedd0e0d4049f840b47e28a949\", \"extensions_unittests\": \"58416c77a053403b3dfc9fec47bd993bd69845e1\", \"filesystem_service_unittests\": \"c98602f89a6d9cff90f7670bc853a45bffdf62da\", \"flatbuffers_unittests\": \"698230cd2ee29799b3293b30c69cdc80b3ff243d\", \"gcm_unit_tests\": \"804604641919950e3bd7bba5ad978a97b01e5bc4\", \"gfx_unittests\": \"a4502678254afee608184c1c19ceefcb1ff1c77c\", \"gin_unittests\": \"01c78080798bf75fa14df6cdc8e5289f73c53772\", \"google_apis_unittests\": \"456b4ccb363ecf9ee4310d0dfb875d6d5937f739\", \"gpu_unittests\": \"576d7052feaad17b8cb55794f6708a4bb495cd4d\", \"grit_python_unittests\": \"e9472d6ec31317123f3dfff9be51bd5eb8f9349b\", \"gwp_asan_unittests\": \"7047f5bef776f5d8fc965f3b27ad265effa25a19\", \"headless_browsertests\": \"6b9df523edaf4795aa25c0bcfbee73f0964b16ad\", \"headless_unittests\": \"78b2da62a18dcb7937842fd9f8a81a01d48ef898\", \"interactive_ui_tests\": \"44076a465ae2352f0442f6bea2da4a525754e58c\", \"ipc_tests\": \"ef940fa3bde370afab8a1d20f19d180ed6e63315\", \"jingle_unittests\": \"8fbea7652e8cbf837d775ab5c9f566262b48fa2c\", \"latency_unittests\": \"e44846838136c5d074cffe1efb793f90a7f0e473\", \"libjingle_xmpp_unittests\": \"2b9df2937d12ee7e1ecc9623ccb953503774cc9d\", \"liburlpattern_unittests\": \"bbb5953b05c8c7933006c5eec04624af2cf8e04b\", \"media_blink_unittests\": \"6deef9274c12c9fef4f305f7b32cb3cc57e52e2b\", \"media_unittests\": \"e09b20624e398181cc4d17b8fbd4a84d5a71e07d\", \"message_center_unittests\": \"dc1f29125481f05564dcd42c954ac5860fa7cbdc\", \"metrics_python_tests\": \"9b62b60158d552a36393c091884f83d9123d6600\", \"midi_unittests\": \"3c408258c14b2fd2893dd16d4e07cb96eabcb247\", \"mojo_core_unittests\": \"55ba6e5dd39b0f215229b0aea56c8a3212c9dd2b\", \"mojo_unittests\": \"3ed58deaf45c3433996b8c853a725f61c2e5d6c4\", \"nacl_helper_nonsfi_unittests\": \"fce9d684523d022469205b3919ccf7b7d68946d0\", \"nacl_loader_unittests\": \"942304331d0135243bf57c8cb45e5c977a670517\", \"native_theme_unittests\": \"a37fb1a891475ea62187bb6bf2d9b1baede5fbe8\", \"net_unittests\": \"395bf76233f2985a8f8572e7e53a750ec1b6a733\", \"openscreen_unittests\": \"dcfc356339aed1185155b726cf2dfbc5b2fdf116\", \"pdf_unittests\": \"c8dc85c00a66edf37ce7f227d2a4e18ee40bbdc1\", \"perfetto_unittests\": \"a85a0ba85a9c6df28b9af79d858eea7cc827b713\", \"ppapi_unittests\": \"47628035d3032c6d12b31a087681b771b7b026f0\", \"printing_unittests\": \"efa6a130ca9a5291dfd261ee9b8f50db3beb5042\", \"remoting_unittests\": \"c933258b1dcf5645358c1e008147031784f49f98\", \"sandbox_linux_unittests\": \"29104ebea69a9a1f60035c5e4d34ea464631e239\", \"service_manager_unittests\": \"c5022b8be694bcfa1c80c8145276690d62e859ed\", \"services_unittests\": \"fb7c1f4c50a77f8993c4a250fed7d959e3d3bcac\", \"shell_dialogs_unittests\": \"4ad8611350c12a4c60343c706a1843a22cb6a923\", \"skia_unittests\": \"52ed3eec021c339d9a849d44688e96edc0234510\", \"snapshot_unittests\": \"48f291d9ac3122a3eeeab725bd26bf635a2e6707\", \"sql_unittests\": \"5fce74cd43d4a1c5380b341466c6be36e51a4c28\", \"storage_unittests\": \"e2bfc790b11a79fad857871b862eec52541df686\", \"sync_integration_tests\": \"00302667ef275177cf024b9bf006b4991921ea25\", \"telemetry_gpu_unittests\": \"499fa9e1ccb302aacaaacf2427502b00cbcc81bb\", \"telemetry_perf_unittests\": \"5dd0e1b12c09955d3a2d50d3e180f50b91384752\", \"telemetry_unittests\": \"18f6498bb957282790f910afef907b7cd6e92d99\", \"traffic_annotation_auditor_unittests\": \"d4ff194a6a1f75f26506c10feccda0e310c226ad\", \"ui_base_unittests\": \"44b1ac91a2a15f422948b2003117398f3131ca78\", \"ui_touch_selection_unittests\": \"be959a1ca073439740a56c38288a0868b75b125f\", \"unit_tests\": \"3a044654bca3983e872d4b6c3ac53197499f9220\", \"url_unittests\": \"a0c349458962d687d1c732bc4d6e438362b3a479\", \"views_perftests\": \"968ac84fbc21965a209d575d2dce625b742a3fbb\", \"views_unittests\": \"058f227e5c737bbd859c051d7bd7064fc63f4c3c\", \"viz_unittests\": \"aea65f5932e150146efa3ec08c6af2dc72f396d4\", \"vr_common_unittests\": \"6e3810ae08bcdca02b7e942e43b337d2a28b9af8\", \"vr_pixeltests\": \"d6fc2140cdbf2ae89f4354920efa184d7104632c\", \"webdriver_wpt_tests\": \"7190db489193b84f74af1bf31322e5ade0104286\", \"weblayer_browsertests\": \"688f10df57e893c581ab8f0c44b7b1d9b73db00c\", \"weblayer_unittests\": \"290a58bd9c18dd5c06a3ef209a6438fefcb6f7b0\", \"wm_unittests\": \"44787dc8053695949d671753b18a033eb81bf530\", \"wtf_unittests\": \"ea6bf2e0a31bc6a7c6b20efb819558a04c6460d1\", \"x11_unittests\": \"3f2b4181b08037e514070d059bc6b67a47e902dd\", \"xr_browser_tests\": \"8910c3044d2f9666b15276ea3e11e16eabfb1406\", \"zlib_unittests\": \"43ff2d9f0c29c49d26f793336aecfc23a52292f6\"}}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_093d924ecb526dae9a1dcf9db4725f8944eec2b4c0f2ddc6c2ac4a04802f7f15_v2\", \"builder_361cbaa79261c75a92fc63a8f8c6fc117764238b3277286fa51086e6da3301df_v2\", \"builder_414309451a62452c5fc91088f02bc2b3c7255663a128fe9787a2b8d2a76dca13_v2\", \"builder_8da721b663411a8949c2bab4d98f074519f5dacc98d2381d19d66b38dd85adce_v2\", \"builder_9abb531f9fa28fcfd3ce68b2370bf6d67201ddb083beddbd2671f7c5fe25be9e_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-8-4egf\"], \"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\": [\"5706-397711c\"], \"ssd\": [\"0\"], \"zone\": [\"us\", \"us-central\", \"us-central1\", \"us-central1-b\"]}}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1614037137114569",
"status": "COMPLETED",
"status_changed_ts": "1614040140877654",
"tags": [
"build_address:luci.chromium.ci/Linux Builder (dbg)/180830",
"builder:Linux Builder (dbg)",
"buildset:commit/git/0a0ec55bc1fe07d6f5e862c8705531eef3391ec2",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/0a0ec55bc1fe07d6f5e862c8705531eef3391ec2",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9019983174738227504",
"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/8854553112722250224/+/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:51e4edbb9544f910",
"user_agent:luci-scheduler"
],
"updated_ts": "1614040141013899",
"url": "https://ci.chromium.org/b/8854553112722250224",
"utcnow_ts": "1614040141692491"
}
}
[00:29:01.701] Invocation finished in 50m7.658225774s with status SUCCEEDED