[18:32:09.962] New invocation is queued and will start shortly
[18:32:11.152] Starting the invocation (attempt 1)
[18:32:11.201] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[18:32:11.201] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[18:32:11.201] Buildbucket request:
{
"bucket": "luci.webrtc.ci",
"client_operation_id": "9022539187902676528",
"parameters_json": "{\"builder_name\":\"Linux32 Debug\",\"properties\":{\"$recipe_engine/scheduler\":{\"hostname\":\"luci-scheduler.appspot.com\",\"triggers\":[{\"gitiles\":{\"ref\":\"refs/heads/master\",\"repo\":\"https://webrtc.googlesource.com/src\",\"revision\":\"5312a8f532eb6b17cef1a9993699d992d8fe7269\"},\"id\":\"https://webrtc.googlesource.com/src/+/refs/heads/master@5312a8f532eb6b17cef1a9993699d992d8fe7269\",\"title\":\"5312a8f532eb6b17cef1a9993699d992d8fe7269\",\"url\":\"https://webrtc.googlesource.com/src/+/5312a8f532eb6b17cef1a9993699d992d8fe7269\"}]},\"branch\":\"refs/heads/master\",\"repository\":\"https://webrtc.googlesource.com/src\",\"revision\":\"5312a8f532eb6b17cef1a9993699d992d8fe7269\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:Linux32 Debug",
"scheduler_invocation_id:9022539187902676528",
"scheduler_job_id:webrtc/Linux32 Debug",
"user_agent:luci-scheduler",
"buildset:commit/git/5312a8f532eb6b17cef1a9993699d992d8fe7269",
"buildset:commit/gitiles/webrtc.googlesource.com/src/+/5312a8f532eb6b17cef1a9993699d992d8fe7269",
"gitiles_ref:refs/heads/master"
]
}
[18:32:12.186] Buildbucket response:
{
"build": {
"bucket": "luci.webrtc.ci",
"canary_preference": "PROD",
"created_by": "project:webrtc",
"created_ts": "1611599531302630",
"id": "8857109125824203568",
"parameters_json": "{\"builder_name\": \"Linux32 Debug\", \"properties\": {\"$recipe_engine/scheduler\": {\"hostname\": \"luci-scheduler.appspot.com\", \"triggers\": [{\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://webrtc.googlesource.com/src\", \"revision\": \"5312a8f532eb6b17cef1a9993699d992d8fe7269\"}, \"id\": \"https://webrtc.googlesource.com/src/+/refs/heads/master@5312a8f532eb6b17cef1a9993699d992d8fe7269\", \"title\": \"5312a8f532eb6b17cef1a9993699d992d8fe7269\", \"url\": \"https://webrtc.googlesource.com/src/+/5312a8f532eb6b17cef1a9993699d992d8fe7269\"}]}, \"branch\": \"refs/heads/master\", \"repository\": \"https://webrtc.googlesource.com/src\", \"revision\": \"5312a8f532eb6b17cef1a9993699d992d8fe7269\"}}",
"project": "webrtc",
"result_details_json": "{\"properties\": {}}",
"service_account": "webrtc-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1611599531962819",
"tags": [
"build_address:luci.webrtc.ci/Linux32 Debug/26249",
"builder:Linux32 Debug",
"buildset:commit/git/5312a8f532eb6b17cef1a9993699d992d8fe7269",
"buildset:commit/gitiles/webrtc.googlesource.com/src/+/5312a8f532eb6b17cef1a9993699d992d8fe7269",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9022539187902676528",
"scheduler_job_id:webrtc/Linux32 Debug",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/webrtc/buildbucket/cr-buildbucket.appspot.com/8857109125824203568/+/annotations",
"swarming_tag:luci_project:webrtc",
"swarming_tag:recipe_name:webrtc/standalone",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_task_id:",
"user_agent:luci-scheduler"
],
"updated_ts": "1611599531963042",
"url": "https://ci.chromium.org/b/8857109125824203568",
"utcnow_ts": "1611599532168162"
}
}
[18:32:12.186] Task URL: https://ci.chromium.org/b/8857109125824203568
[18:32:12.186] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:2:0) after 1m0s
[18:33:12.538] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:2:0)
[18:33:12.538] Timer tick, asking Buildbucket for the build status
[18:33:12.712] Build 8857109125824203568: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[18:33:12.712] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:3:0) after 1m0s
[18:34:12.757] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:3:0)
[18:34:12.757] Timer tick, asking Buildbucket for the build status
[18:34:12.939] Build 8857109125824203568: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[18:34:12.939] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:4:0) after 1m0s
[18:35:13.071] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:4:0)
[18:35:13.071] Timer tick, asking Buildbucket for the build status
[18:35:13.153] Build 8857109125824203568: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[18:35:13.153] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:5:0) after 1m0s
[18:36:13.189] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:5:0)
[18:36:13.189] Timer tick, asking Buildbucket for the build status
[18:36:14.254] Build 8857109125824203568: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[18:36:14.254] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:6:0) after 1m0s
[18:37:14.423] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:6:0)
[18:37:14.423] Timer tick, asking Buildbucket for the build status
[18:37:14.513] Build 8857109125824203568: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[18:37:14.513] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:7:0) after 1m0s
[18:38:14.565] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:7:0)
[18:38:14.565] Timer tick, asking Buildbucket for the build status
[18:38:14.901] Build 8857109125824203568: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[18:38:14.901] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:8:0) after 1m0s
[18:39:14.925] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:8:0)
[18:39:14.925] Timer tick, asking Buildbucket for the build status
[18:39:14.992] Build 8857109125824203568: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[18:39:14.992] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:9:0) after 1m0s
[18:40:15.023] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:9:0)
[18:40:15.023] Timer tick, asking Buildbucket for the build status
[18:40:15.130] Build 8857109125824203568: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[18:40:15.130] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:10:0) after 1m0s
[18:41:15.233] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:10:0)
[18:41:15.233] Timer tick, asking Buildbucket for the build status
[18:41:16.543] Build 8857109125824203568: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[18:41:16.543] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:11:0) after 1m0s
[18:42:16.627] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:11:0)
[18:42:16.627] Timer tick, asking Buildbucket for the build status
[18:42:16.727] Build 8857109125824203568: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[18:42:16.727] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:12:0) after 1m0s
[18:43:16.784] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:12:0)
[18:43:16.784] Timer tick, asking Buildbucket for the build status
[18:43:17.098] Build 8857109125824203568: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[18:43:17.098] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:13:0) after 1m0s
[18:44:17.254] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:13:0)
[18:44:17.254] Timer tick, asking Buildbucket for the build status
[18:44:17.337] Build 8857109125824203568: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[18:44:17.337] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:14:0) after 1m0s
[18:45:17.392] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:14:0)
[18:45:17.392] Timer tick, asking Buildbucket for the build status
[18:45:17.713] Build 8857109125824203568: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[18:45:17.713] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:15:0) after 1m0s
[18:46:17.886] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:15:0)
[18:46:17.886] Timer tick, asking Buildbucket for the build status
[18:46:18.267] Build 8857109125824203568: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[18:46:18.267] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:16:0) after 1m0s
[18:46:54.300] Received PubSub notification, asking Buildbucket for the build status
[18:46:54.659] Build 8857109125824203568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:47:18.541] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:16:0)
[18:47:18.541] Timer tick, asking Buildbucket for the build status
[18:47:18.673] Build 8857109125824203568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:47:18.673] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:18:0) after 1m0s
[18:48:18.861] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:18:0)
[18:48:18.861] Timer tick, asking Buildbucket for the build status
[18:48:18.989] Build 8857109125824203568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:48:18.989] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:19:0) after 1m0s
[18:49:18.978] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:19:0)
[18:49:18.978] Timer tick, asking Buildbucket for the build status
[18:49:19.127] Build 8857109125824203568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:49:19.127] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:20:0) after 1m0s
[18:50:19.339] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:20:0)
[18:50:19.339] Timer tick, asking Buildbucket for the build status
[18:50:19.428] Build 8857109125824203568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:50:19.428] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:21:0) after 1m0s
[18:51:19.559] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:21:0)
[18:51:19.559] Timer tick, asking Buildbucket for the build status
[18:51:19.746] Build 8857109125824203568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:51:19.746] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:22:0) after 1m0s
[18:52:19.753] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:22:0)
[18:52:19.753] Timer tick, asking Buildbucket for the build status
[18:52:19.853] Build 8857109125824203568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:52:19.853] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:23:0) after 1m0s
[18:53:19.866] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:23:0)
[18:53:19.866] Timer tick, asking Buildbucket for the build status
[18:53:20.568] Build 8857109125824203568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:53:20.568] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:24:0) after 1m0s
[18:54:20.669] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:24:0)
[18:54:20.669] Timer tick, asking Buildbucket for the build status
[18:54:20.827] Build 8857109125824203568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:54:20.827] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:25:0) after 1m0s
[18:55:20.931] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:25:0)
[18:55:20.931] Timer tick, asking Buildbucket for the build status
[18:55:21.353] Build 8857109125824203568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:55:21.353] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:26:0) after 1m0s
[18:56:21.481] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:26:0)
[18:56:21.481] Timer tick, asking Buildbucket for the build status
[18:56:21.584] Build 8857109125824203568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:56:21.584] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:27:0) after 1m0s
[18:57:21.647] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:27:0)
[18:57:21.647] Timer tick, asking Buildbucket for the build status
[18:57:22.176] Build 8857109125824203568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:57:22.176] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:28:0) after 1m0s
[18:58:22.263] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:28:0)
[18:58:22.263] Timer tick, asking Buildbucket for the build status
[18:58:23.597] Build 8857109125824203568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:58:23.597] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:29:0) after 1m0s
[18:59:23.668] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:29:0)
[18:59:23.668] Timer tick, asking Buildbucket for the build status
[18:59:23.759] Build 8857109125824203568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:59:23.759] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:30:0) after 1m0s
[19:00:23.805] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:30:0)
[19:00:23.805] Timer tick, asking Buildbucket for the build status
[19:00:23.903] Build 8857109125824203568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:00:23.903] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:31:0) after 1m0s
[19:01:24.056] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:31:0)
[19:01:24.056] Timer tick, asking Buildbucket for the build status
[19:01:24.183] Build 8857109125824203568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:01:24.183] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:32:0) after 1m0s
[19:02:24.295] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:32:0)
[19:02:24.295] Timer tick, asking Buildbucket for the build status
[19:02:24.481] Build 8857109125824203568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:02:24.481] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:33:0) after 1m0s
[19:03:24.546] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:33:0)
[19:03:24.547] Timer tick, asking Buildbucket for the build status
[19:03:24.621] Build 8857109125824203568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:03:24.621] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:34:0) after 1m0s
[19:04:24.750] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:34:0)
[19:04:24.750] Timer tick, asking Buildbucket for the build status
[19:04:25.026] Build 8857109125824203568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:04:25.026] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:35:0) after 1m0s
[19:05:25.204] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:35:0)
[19:05:25.204] Timer tick, asking Buildbucket for the build status
[19:05:25.338] Build 8857109125824203568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:05:25.338] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:36:0) after 1m0s
[19:06:25.360] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:36:0)
[19:06:25.360] Timer tick, asking Buildbucket for the build status
[19:06:25.566] Build 8857109125824203568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:06:25.566] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:37:0) after 1m0s
[19:07:25.612] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:37:0)
[19:07:25.612] Timer tick, asking Buildbucket for the build status
[19:07:26.203] Build 8857109125824203568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:07:26.203] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:38:0) after 1m0s
[19:08:26.228] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:38:0)
[19:08:26.228] Timer tick, asking Buildbucket for the build status
[19:08:26.525] Build 8857109125824203568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:08:26.525] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:39:0) after 1m0s
[19:09:26.607] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:39:0)
[19:09:26.607] Timer tick, asking Buildbucket for the build status
[19:09:26.803] Build 8857109125824203568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:09:26.803] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:40:0) after 1m0s
[19:10:26.852] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:40:0)
[19:10:26.852] Timer tick, asking Buildbucket for the build status
[19:10:26.941] Build 8857109125824203568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:10:26.941] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:41:0) after 1m0s
[19:11:26.932] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:41:0)
[19:11:26.932] Timer tick, asking Buildbucket for the build status
[19:11:28.504] Build 8857109125824203568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:11:28.504] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:42:0) after 1m0s
[19:12:28.633] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:42:0)
[19:12:28.633] Timer tick, asking Buildbucket for the build status
[19:12:28.793] Build 8857109125824203568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:12:28.793] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:43:0) after 1m0s
[19:13:28.831] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:43:0)
[19:13:28.831] Timer tick, asking Buildbucket for the build status
[19:13:29.107] Build 8857109125824203568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:13:29.107] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:44:0) after 1m0s
[19:14:29.147] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:44:0)
[19:14:29.147] Timer tick, asking Buildbucket for the build status
[19:14:29.232] Build 8857109125824203568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:14:29.232] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:45:0) after 1m0s
[19:15:29.259] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:45:0)
[19:15:29.259] Timer tick, asking Buildbucket for the build status
[19:15:29.334] Build 8857109125824203568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:15:29.334] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:46:0) after 1m0s
[19:16:29.382] Handling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:46:0)
[19:16:29.382] Timer tick, asking Buildbucket for the build status
[19:16:29.507] Build 8857109125824203568: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:16:29.507] Scheduling timer "check-buildbucket-build-status" (webrtc/Linux32 Debug:9022539187902676528:47:0) after 1m0s
[19:16:50.282] Received PubSub notification, asking Buildbucket for the build status
[19:16:50.471] Build 8857109125824203568: status "COMPLETED", result "FAILURE", failure_reason "BUILD_FAILURE", cancelation_reason ""
[19:16:50.471] Buildbucket build:
{
"build": {
"bucket": "luci.webrtc.ci",
"canary_preference": "PROD",
"completed_ts": "1611602209948874",
"created_by": "project:webrtc",
"created_ts": "1611599531302630",
"failure_reason": "BUILD_FAILURE",
"id": "8857109125824203568",
"parameters_json": "{\"builder_name\": \"Linux32 Debug\", \"properties\": {\"$recipe_engine/scheduler\": {\"hostname\": \"luci-scheduler.appspot.com\", \"triggers\": [{\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://webrtc.googlesource.com/src\", \"revision\": \"5312a8f532eb6b17cef1a9993699d992d8fe7269\"}, \"id\": \"https://webrtc.googlesource.com/src/+/refs/heads/master@5312a8f532eb6b17cef1a9993699d992d8fe7269\", \"title\": \"5312a8f532eb6b17cef1a9993699d992d8fe7269\", \"url\": \"https://webrtc.googlesource.com/src/+/5312a8f532eb6b17cef1a9993699d992d8fe7269\"}]}, \"branch\": \"refs/heads/master\", \"repository\": \"https://webrtc.googlesource.com/src\", \"revision\": \"5312a8f532eb6b17cef1a9993699d992d8fe7269\"}}",
"project": "webrtc",
"result": "FAILURE",
"result_details_json": "{\"error\": {\"message\": \"Test target(s) failed: modules_tests\"}, \"properties\": {\"$build/goma\": {\"server_host\": \"goma.chromium.org\", \"use_luci_auth\": true}, \"$recipe_engine/isolated\": {\"server\": \"https://isolateserver.appspot.com\"}, \"$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}, \"$recipe_engine/scheduler\": {\"hostname\": \"luci-scheduler.appspot.com\", \"triggers\": [{\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://webrtc.googlesource.com/src\", \"revision\": \"5312a8f532eb6b17cef1a9993699d992d8fe7269\"}, \"id\": \"https://webrtc.googlesource.com/src/+/refs/heads/master@5312a8f532eb6b17cef1a9993699d992d8fe7269\", \"title\": \"5312a8f532eb6b17cef1a9993699d992d8fe7269\", \"url\": \"https://webrtc.googlesource.com/src/+/5312a8f532eb6b17cef1a9993699d992d8fe7269\"}]}, \"bot_id\": \"luci-webrtc-ci-xenial-6-cgrw\", \"branch\": \"refs/heads/master\", \"builder_group\": \"client.webrtc\", \"buildername\": \"Linux32 Debug\", \"buildnumber\": 26249, \"got_revision\": \"5312a8f532eb6b17cef1a9993699d992d8fe7269\", \"got_revision_cp\": \"refs/heads/master@{#33069}\", \"isolate_server\": \"https://isolateserver.appspot.com\", \"path_config\": \"generic\", \"recipe\": \"webrtc/standalone\", \"repository\": \"https://webrtc.googlesource.com/src\", \"revision\": \"5312a8f532eb6b17cef1a9993699d992d8fe7269\", \"swarm_hashes\": {\"audio_decoder_unittests\": \"11c75023e3fa81d0cc7af4b923fb3dc610947ac7\", \"common_audio_unittests\": \"e188b609bac363371a23fc235f89f808491d952d\", \"common_video_unittests\": \"c79c61882476527a2294dd8ecac2653607087c73\", \"low_bandwidth_audio_test\": \"a959d69e06fe566e1c25867d595e34d05608ff62\", \"modules_tests\": \"599c2cb8f6edf9e577e4e5713781558e49b21574\", \"modules_unittests\": \"d97c169a66c2f3d2a0eeeb8a465a7c16a077e6e2\", \"peerconnection_unittests\": \"d60a8a9ded8f3e52cf8e8d8066c1713896fc5c15\", \"rtc_media_unittests\": \"ac1bb39a58823647c6c4fa4e396b5a796a7a9e62\", \"rtc_pc_unittests\": \"d23eb3fafe682143aa3d2f7b07cb40c7654dadbf\", \"rtc_stats_unittests\": \"073ee6626abb0fb53ffc1826369ba121ae97819b\", \"rtc_unittests\": \"f98e2278bac38e950df1def6bc103d3f39322ea2\", \"slow_tests\": \"c1b08b2562c3a5dcecf419ff8f007f14b44c10ed\", \"system_wrappers_unittests\": \"6939715411d88d8e4ef778180eb89000639fbb01\", \"test_support_unittests\": \"0fa754b9a2d432076ee8ccd6e2f14b17bdfeabdf\", \"tools_unittests\": \"0546dd1e3af1d57566d8a134cd0e4cb9cc290300\", \"video_engine_tests\": \"65eeda7256e1500376d96553b83749840547ad41\", \"voip_unittests\": \"b4cf8f466e67d825eaa840e82038bbb66f5ee50a\", \"webrtc_nonparallel_tests\": \"e99f572b5ee867ecf1ff604f5f451868337b99d0\"}}, \"swarming\": {\"bot_dimensions\": {\"caches\": [\"builder_9e79062e5d3768761821c29cf99044627265ebba18113d0281c5efcb6dd834e3_v2\", \"git\", \"goma_v2\", \"vpython\"], \"cores\": [\"8\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Haswell_GCE\", \"x86-64-avx2\"], \"gce\": [\"1\"], \"gcp\": [\"webrtc-ci\"], \"gpu\": [\"none\"], \"id\": [\"luci-webrtc-ci-xenial-6-cgrw\"], \"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.webrtc.ci\"], \"python\": [\"2.7.12\"], \"server_version\": [\"5672-4713de1\"], \"ssd\": [\"0\"], \"zone\": [\"us\", \"us-central\", \"us-central1\", \"us-central1-b\"]}}, \"ui\": {\"info\": \"Test target(s) failed: modules_tests\"}}",
"service_account": "webrtc-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1611600413410346",
"status": "COMPLETED",
"status_changed_ts": "1611600413926510",
"tags": [
"build_address:luci.webrtc.ci/Linux32 Debug/26249",
"builder:Linux32 Debug",
"buildset:commit/git/5312a8f532eb6b17cef1a9993699d992d8fe7269",
"buildset:commit/gitiles/webrtc.googlesource.com/src/+/5312a8f532eb6b17cef1a9993699d992d8fe7269",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9022539187902676528",
"scheduler_job_id:webrtc/Linux32 Debug",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/webrtc/buildbucket/cr-buildbucket.appspot.com/8857109125824203568/+/annotations",
"swarming_tag:luci_project:webrtc",
"swarming_tag:os:Linux",
"swarming_tag:recipe_name:webrtc/standalone",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_task_id:5153a2e12dbff710",
"user_agent:luci-scheduler"
],
"updated_ts": "1611602210026999",
"url": "https://ci.chromium.org/b/8857109125824203568",
"utcnow_ts": "1611602210454316"
}
}
[19:16:50.471] Invocation finished in 44m40.534518435s with status FAILED