[17:05:02.999] New invocation is queued and will start shortly
[17:05:12.772] Starting the invocation (attempt 1)
[17:05:12.813] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[17:05:12.815] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[17:05:12.815] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9044378537662688544",
"parameters_json": "{\"builder_name\":\"Site Isolation Android\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"92909c3d25f4db2223a370bca4acce53c90108c1\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:Site Isolation Android",
"scheduler_invocation_id:9044378537662688544",
"scheduler_job_id:chromium/Site Isolation Android",
"user_agent:luci-scheduler",
"buildset:commit/git/92909c3d25f4db2223a370bca4acce53c90108c1",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/92909c3d25f4db2223a370bca4acce53c90108c1",
"gitiles_ref:refs/heads/master"
]
}
[17:05:18.623] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1590771913204578",
"id": "8878948466298513216",
"parameters_json": "{\"builder_name\": \"Site Isolation Android\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"92909c3d25f4db2223a370bca4acce53c90108c1\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1590771918376995",
"tags": [
"build_address:luci.chromium.ci/Site Isolation Android/44471",
"builder:Site Isolation Android",
"buildset:commit/git/92909c3d25f4db2223a370bca4acce53c90108c1",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/92909c3d25f4db2223a370bca4acce53c90108c1",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9044378537662688544",
"scheduler_job_id:chromium/Site Isolation Android",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8878948466298513216/+/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": "1590771918377348",
"url": "https://ci.chromium.org/b/8878948466298513216",
"utcnow_ts": "1590771918612240"
}
}
[17:05:18.623] Task URL: https://ci.chromium.org/b/8878948466298513216
[17:05:18.623] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:2:0) after 1m0s
[17:06:18.651] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:2:0)
[17:06:18.651] Timer tick, asking Buildbucket for the build status
[17:06:19.511] Build 8878948466298513216: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[17:06:19.511] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:3:0) after 1m0s
[17:06:26.595] Received PubSub notification, asking Buildbucket for the build status
[17:06:26.683] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:07:19.587] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:3:0)
[17:07:19.587] Timer tick, asking Buildbucket for the build status
[17:07:19.888] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:07:19.888] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:5:0) after 1m0s
[17:08:19.950] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:5:0)
[17:08:19.950] Timer tick, asking Buildbucket for the build status
[17:08:20.411] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:08:20.411] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:6:0) after 1m0s
[17:09:20.504] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:6:0)
[17:09:20.504] Timer tick, asking Buildbucket for the build status
[17:09:21.039] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:09:21.039] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:7:0) after 1m0s
[17:10:21.094] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:7:0)
[17:10:21.094] Timer tick, asking Buildbucket for the build status
[17:10:21.421] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:10:21.421] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:8:0) after 1m0s
[17:11:21.483] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:8:0)
[17:11:21.483] Timer tick, asking Buildbucket for the build status
[17:11:21.821] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:11:21.822] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:9:0) after 1m0s
[17:12:21.845] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:9:0)
[17:12:21.845] Timer tick, asking Buildbucket for the build status
[17:12:21.981] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:12:21.981] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:10:0) after 1m0s
[17:13:22.106] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:10:0)
[17:13:22.106] Timer tick, asking Buildbucket for the build status
[17:13:22.274] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:13:22.274] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:11:0) after 1m0s
[17:14:22.378] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:11:0)
[17:14:22.378] Timer tick, asking Buildbucket for the build status
[17:14:22.535] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:14:22.535] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:12:0) after 1m0s
[17:15:22.682] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:12:0)
[17:15:22.682] Timer tick, asking Buildbucket for the build status
[17:15:22.955] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:15:22.955] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:13:0) after 1m0s
[17:16:22.985] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:13:0)
[17:16:22.985] Timer tick, asking Buildbucket for the build status
[17:16:23.449] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:16:23.449] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:14:0) after 1m0s
[17:17:23.489] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:14:0)
[17:17:23.489] Timer tick, asking Buildbucket for the build status
[17:17:23.866] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:17:23.866] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:15:0) after 1m0s
[17:18:23.966] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:15:0)
[17:18:23.966] Timer tick, asking Buildbucket for the build status
[17:18:24.093] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:18:24.093] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:16:0) after 1m0s
[17:19:24.128] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:16:0)
[17:19:24.128] Timer tick, asking Buildbucket for the build status
[17:19:24.308] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:19:24.308] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:17:0) after 1m0s
[17:20:24.370] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:17:0)
[17:20:24.370] Timer tick, asking Buildbucket for the build status
[17:20:24.495] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:20:24.495] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:18:0) after 1m0s
[17:21:24.517] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:18:0)
[17:21:24.517] Timer tick, asking Buildbucket for the build status
[17:21:24.657] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:21:24.657] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:19:0) after 1m0s
[17:22:24.678] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:19:0)
[17:22:24.678] Timer tick, asking Buildbucket for the build status
[17:22:24.941] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:22:24.941] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:20:0) after 1m0s
[17:23:24.998] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:20:0)
[17:23:24.998] Timer tick, asking Buildbucket for the build status
[17:23:25.114] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:23:25.114] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:21:0) after 1m0s
[17:24:25.156] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:21:0)
[17:24:25.156] Timer tick, asking Buildbucket for the build status
[17:24:25.446] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:24:25.446] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:22:0) after 1m0s
[17:25:25.477] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:22:0)
[17:25:25.477] Timer tick, asking Buildbucket for the build status
[17:25:25.830] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:25:25.830] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:23:0) after 1m0s
[17:26:25.862] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:23:0)
[17:26:25.863] Timer tick, asking Buildbucket for the build status
[17:26:26.436] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:26:26.436] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:24:0) after 1m0s
[17:27:26.706] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:24:0)
[17:27:26.706] Timer tick, asking Buildbucket for the build status
[17:27:27.628] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:27:27.628] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:25:0) after 1m0s
[17:28:27.682] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:25:0)
[17:28:27.682] Timer tick, asking Buildbucket for the build status
[17:28:27.818] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:28:27.818] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:26:0) after 1m0s
[17:29:27.859] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:26:0)
[17:29:27.859] Timer tick, asking Buildbucket for the build status
[17:29:28.084] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:29:28.084] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:27:0) after 1m0s
[17:30:28.193] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:27:0)
[17:30:28.193] Timer tick, asking Buildbucket for the build status
[17:30:28.769] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:30:28.769] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:28:0) after 1m0s
[17:31:28.810] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:28:0)
[17:31:28.810] Timer tick, asking Buildbucket for the build status
[17:31:29.088] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:31:29.089] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:29:0) after 1m0s
[17:32:29.151] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:29:0)
[17:32:29.151] Timer tick, asking Buildbucket for the build status
[17:32:29.589] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:32:29.589] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:30:0) after 1m0s
[17:33:29.659] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:30:0)
[17:33:29.659] Timer tick, asking Buildbucket for the build status
[17:33:29.938] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:33:29.938] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:31:0) after 1m0s
[17:34:29.971] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:31:0)
[17:34:29.971] Timer tick, asking Buildbucket for the build status
[17:34:30.100] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:34:30.100] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:32:0) after 1m0s
[17:35:30.195] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:32:0)
[17:35:30.195] Timer tick, asking Buildbucket for the build status
[17:35:30.369] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:35:30.369] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:33:0) after 1m0s
[17:36:30.376] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:33:0)
[17:36:30.376] Timer tick, asking Buildbucket for the build status
[17:36:30.529] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:36:30.529] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:34:0) after 1m0s
[17:37:30.595] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:34:0)
[17:37:30.595] Timer tick, asking Buildbucket for the build status
[17:37:31.059] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:37:31.059] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:35:0) after 1m0s
[17:38:31.083] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:35:0)
[17:38:31.083] Timer tick, asking Buildbucket for the build status
[17:38:31.159] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:38:31.159] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:36:0) after 1m0s
[17:39:31.184] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:36:0)
[17:39:31.184] Timer tick, asking Buildbucket for the build status
[17:39:31.657] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:39:31.657] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:37:0) after 1m0s
[17:40:31.739] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:37:0)
[17:40:31.739] Timer tick, asking Buildbucket for the build status
[17:40:31.842] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:40:31.842] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:38:0) after 1m0s
[17:41:31.969] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:38:0)
[17:41:31.969] Timer tick, asking Buildbucket for the build status
[17:41:32.127] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:41:32.127] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:39:0) after 1m0s
[17:42:32.139] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:39:0)
[17:42:32.139] Timer tick, asking Buildbucket for the build status
[17:42:32.401] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:42:32.401] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:40:0) after 1m0s
[17:43:32.452] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:40:0)
[17:43:32.452] Timer tick, asking Buildbucket for the build status
[17:43:32.563] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:43:32.563] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:41:0) after 1m0s
[17:44:32.576] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:41:0)
[17:44:32.576] Timer tick, asking Buildbucket for the build status
[17:44:32.749] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:44:32.749] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:42:0) after 1m0s
[17:45:32.823] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:42:0)
[17:45:32.823] Timer tick, asking Buildbucket for the build status
[17:45:32.980] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:45:32.980] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:43:0) after 1m0s
[17:46:32.992] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:43:0)
[17:46:32.992] Timer tick, asking Buildbucket for the build status
[17:46:33.175] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:46:33.175] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:44:0) after 1m0s
[17:47:33.173] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:44:0)
[17:47:33.173] Timer tick, asking Buildbucket for the build status
[17:47:34.198] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:47:34.198] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:45:0) after 1m0s
[17:48:34.281] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:45:0)
[17:48:34.281] Timer tick, asking Buildbucket for the build status
[17:48:34.448] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:48:34.448] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:46:0) after 1m0s
[17:49:34.533] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:46:0)
[17:49:34.533] Timer tick, asking Buildbucket for the build status
[17:49:35.209] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:49:35.209] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:47:0) after 1m0s
[17:50:35.241] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:47:0)
[17:50:35.241] Timer tick, asking Buildbucket for the build status
[17:50:35.615] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:50:35.615] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:48:0) after 1m0s
[17:51:35.707] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:48:0)
[17:51:35.707] Timer tick, asking Buildbucket for the build status
[17:51:36.331] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:51:36.331] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:49:0) after 1m0s
[17:52:36.350] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:49:0)
[17:52:36.350] Timer tick, asking Buildbucket for the build status
[17:52:37.162] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:52:37.162] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:50:0) after 1m0s
[17:53:37.184] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:50:0)
[17:53:37.184] Timer tick, asking Buildbucket for the build status
[17:53:37.508] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:53:37.508] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:51:0) after 1m0s
[17:54:37.530] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:51:0)
[17:54:37.530] Timer tick, asking Buildbucket for the build status
[17:54:38.403] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:54:38.403] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:52:0) after 1m0s
[17:55:38.478] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:52:0)
[17:55:38.478] Timer tick, asking Buildbucket for the build status
[17:55:38.703] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:55:38.703] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:53:0) after 1m0s
[17:56:38.728] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:53:0)
[17:56:38.728] Timer tick, asking Buildbucket for the build status
[17:56:38.863] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:56:38.863] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:54:0) after 1m0s
[17:57:38.908] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:54:0)
[17:57:38.908] Timer tick, asking Buildbucket for the build status
[17:57:39.439] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:57:39.439] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:55:0) after 1m0s
[17:58:39.495] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:55:0)
[17:58:39.495] Timer tick, asking Buildbucket for the build status
[17:58:40.605] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:58:40.605] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:56:0) after 1m0s
[17:59:40.636] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:56:0)
[17:59:40.636] Timer tick, asking Buildbucket for the build status
[17:59:42.079] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:59:42.079] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:57:0) after 1m0s
[18:00:42.107] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:57:0)
[18:00:42.107] Timer tick, asking Buildbucket for the build status
[18:00:42.567] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:00:42.567] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:58:0) after 1m0s
[18:01:42.597] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:58:0)
[18:01:42.597] Timer tick, asking Buildbucket for the build status
[18:01:42.760] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:01:42.760] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:59:0) after 1m0s
[18:02:42.779] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:59:0)
[18:02:42.779] Timer tick, asking Buildbucket for the build status
[18:02:43.147] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:02:43.148] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:60:0) after 1m0s
[18:03:43.217] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:60:0)
[18:03:43.217] Timer tick, asking Buildbucket for the build status
[18:03:43.729] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:03:43.729] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:61:0) after 1m0s
[18:04:43.792] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:61:0)
[18:04:43.792] Timer tick, asking Buildbucket for the build status
[18:04:44.052] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:04:44.052] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:62:0) after 1m0s
[18:05:44.100] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:62:0)
[18:05:44.100] Timer tick, asking Buildbucket for the build status
[18:05:44.395] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:05:44.395] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:63:0) after 1m0s
[18:06:44.460] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:63:0)
[18:06:44.460] Timer tick, asking Buildbucket for the build status
[18:06:44.920] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:06:44.920] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:64:0) after 1m0s
[18:07:44.935] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:64:0)
[18:07:44.935] Timer tick, asking Buildbucket for the build status
[18:07:45.482] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:07:45.482] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:65:0) after 1m0s
[18:08:45.610] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:65:0)
[18:08:45.610] Timer tick, asking Buildbucket for the build status
[18:08:45.751] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:08:45.751] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:66:0) after 1m0s
[18:09:45.814] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:66:0)
[18:09:45.814] Timer tick, asking Buildbucket for the build status
[18:09:46.140] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:09:46.140] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:67:0) after 1m0s
[18:10:46.258] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:67:0)
[18:10:46.258] Timer tick, asking Buildbucket for the build status
[18:10:46.326] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:10:46.326] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:68:0) after 1m0s
[18:11:46.404] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:68:0)
[18:11:46.404] Timer tick, asking Buildbucket for the build status
[18:11:46.969] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:11:46.969] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:69:0) after 1m0s
[18:12:46.981] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:69:0)
[18:12:46.981] Timer tick, asking Buildbucket for the build status
[18:12:47.183] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:12:47.183] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:70:0) after 1m0s
[18:13:47.218] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:70:0)
[18:13:47.218] Timer tick, asking Buildbucket for the build status
[18:13:47.563] Build 8878948466298513216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:13:47.563] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9044378537662688544:71:0) after 1m0s
[18:14:13.355] Received PubSub notification, asking Buildbucket for the build status
[18:14:14.259] Build 8878948466298513216: status "COMPLETED", result "FAILURE", failure_reason "BUILD_FAILURE", cancelation_reason ""
[18:14:14.259] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1590776052816857",
"created_by": "project:chromium",
"created_ts": "1590771913204578",
"failure_reason": "BUILD_FAILURE",
"id": "8878948466298513216",
"parameters_json": "{\"builder_name\": \"Site Isolation Android\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"92909c3d25f4db2223a370bca4acce53c90108c1\"}}",
"project": "chromium",
"result": "FAILURE",
"result_details_json": "{\"error\": {\"message\": \"1 Test Suite(s) failed.\\n\\n**site_per_process_content_browsertests on Android device Nexus 5X** failed because of:\\n\\n- WebBundleFileBrowserTest/WebBundleFileBrowserTest.IframeOutOfBundleNavigation/1\\n\\n- All/BlockedSchemeNavigationBrowserTest.PDF_NavigationFromFrame_TopFrameHasBlockedScheme_Block/1\\n\\n- All/BlockedSchemeNavigationBrowserTest.PDF_NavigationFromFrame_Block/1\\n\\n- SiteIsolation/ForceEnabledOriginTrialsBrowserTest.ForceEnabledOriginTrials_MainPage/1\"}, \"properties\": {\"$build/goma\": {\"enable_ats\": true, \"rpc_extra_params\": \"?prod\", \"server_host\": \"goma.chromium.org\"}, \"$recipe_engine/path\": {\"cache_dir\": \"/b/s/w/ir/cache\", \"temp_dir\": \"/b/s/w/ir/tmp/rt\"}, \"$recipe_engine/runtime\": {\"is_experimental\": false, \"is_luci\": true}, \"bot_id\": \"luci-chromium-ci-xenial-us-central1-b-8-32-65jf\", \"branch\": \"refs/heads/master\", \"buildername\": \"Site Isolation Android\", \"buildnumber\": 44471, \"got_angle_revision\": \"828485852b9ccabdcaa01641579fff209cfcddbd\", \"got_dawn_revision\": \"4c32bd0b7d6b83c74ccc367a2d9c929df88e793e\", \"got_nacl_revision\": \"87616f7ce2ea8383efd3731960c15f4ba5852d93\", \"got_revision\": \"92909c3d25f4db2223a370bca4acce53c90108c1\", \"got_revision_cp\": \"refs/heads/master@{#773225}\", \"got_swarming_client_revision\": \"90c5e17a82612bc898c90ab1530dd1bd5822eae8\", \"got_swiftshader_revision\": \"471c120ac92a584e1007f5a3cf22619647bc90a1\", \"got_v8_revision\": \"f80910170903904782c20bd4f3c0b775d1482bb5\", \"got_v8_revision_cp\": \"refs/heads/8.5.67@{#1}\", \"got_webrtc_revision\": \"2e69660b3e628bb86839cee75c54d9f7cb98cde3\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#31388}\", \"isolate_server\": \"https://isolateserver.appspot.com\", \"mastername\": \"chromium.fyi\", \"path_config\": \"generic\", \"recipe\": \"chromium\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"92909c3d25f4db2223a370bca4acce53c90108c1\", \"swarm_hashes\": {\"android_browsertests\": \"18c9084b2c34ac8283797f6bee9b7926d3fb2aa2\", \"chrome_public_test_apk\": \"ff292eb244e152cecc3e81501f4c1e23c35ef03c\", \"components_browsertests\": \"afcfdd5031e8258b0c5a8bbab09049bd105a91fd\", \"components_unittests\": \"97b4cad4468313764a457045ccf0e0ffa0c209f1\", \"content_browsertests\": \"0704d434ed0946acbbdc475e1f2305ae3ef7dc1c\", \"content_shell_test_apk\": \"985832275d966c5f36f46a838ecd180d709c834f\", \"content_unittests\": \"4d3e7fce6da10a147e3a93f91fe67ef8e205b157\", \"unit_tests\": \"78032119c20e4e914efb321c8d0636876291762b\"}, \"swarm_hashes_refs/heads/master(at){#773225}_without_patch\": {\"android_browsertests\": \"18c9084b2c34ac8283797f6bee9b7926d3fb2aa2\", \"chrome_public_test_apk\": \"ff292eb244e152cecc3e81501f4c1e23c35ef03c\", \"components_browsertests\": \"afcfdd5031e8258b0c5a8bbab09049bd105a91fd\", \"components_unittests\": \"97b4cad4468313764a457045ccf0e0ffa0c209f1\", \"content_browsertests\": \"0704d434ed0946acbbdc475e1f2305ae3ef7dc1c\", \"content_shell_test_apk\": \"985832275d966c5f36f46a838ecd180d709c834f\", \"content_unittests\": \"4d3e7fce6da10a147e3a93f91fe67ef8e205b157\", \"unit_tests\": \"78032119c20e4e914efb321c8d0636876291762b\"}}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_97b15bccca8d35086c1bc50eecf0b53d98289cdc65be75a287efcc384d1f34ed_v2\", \"builder_bdb70a5d31beeee95e43e31d29f49b3af55c56759f7dba469ec655f2f99557ab_v2\", \"builder_c9091f6bc58db7983401393b6dacc93b3db8fae2c2ae9b40177b9e0904c8bc80_v2\", \"builder_e961d9d7e9bca679490a4aaa8599bd975f9b7e0b713a988ed6895a059d04d2ac_v2\", \"builder_ea77881c233ea3bf69e726d0246983b8ccd102085e68c11ae09953780234032d_v2\", \"builder_ebaf7f5c1b2c5a1ddde1ad009750547d17e6a5e2ae1d52bf66b71a2417c7c923_v2\", \"builder_fac2959e29eeee13eb43de2791ff2fcb7aa7ab15952f0beca21f4615b55fa2a2_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-32-65jf\"], \"image\": [\"chrome-xenial-20041200-f56df5dd7ad\"], \"inside_docker\": [\"0\"], \"kvm\": [\"1\"], \"locale\": [\"en_US.UTF-8\"], \"machine_type\": [\"e2-standard-8\"], \"os\": [\"Linux\", \"Ubuntu\", \"Ubuntu-16.04\"], \"pool\": [\"luci.chromium.ci\"], \"python\": [\"2.7.12\"], \"server_version\": [\"5142-e16b32c\"], \"ssd\": [\"0\"], \"zone\": [\"us\", \"us-central\", \"us-central1\", \"us-central1-b\"]}}, \"ui\": {\"info\": \"1 Test Suite(s) failed.\\n\\n**site_per_process_content_browsertests on Android device Nexus 5X** failed because of:\\n\\n- WebBundleFileBrowserTest/WebBundleFileBrowserTest.IframeOutOfBundleNavigation/1\\n\\n- All/BlockedSchemeNavigationBrowserTest.PDF_NavigationFromFrame_TopFrameHasBlockedScheme_Block/1\\n\\n- All/BlockedSchemeNavigationBrowserTest.PDF_NavigationFromFrame_Block/1\\n\\n- SiteIsolation/ForceEnabledOriginTrialsBrowserTest.ForceEnabledOriginTrials_MainPage/1\"}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1590771985463797",
"status": "COMPLETED",
"status_changed_ts": "1590771986134488",
"tags": [
"build_address:luci.chromium.ci/Site Isolation Android/44471",
"builder:Site Isolation Android",
"buildset:commit/git/92909c3d25f4db2223a370bca4acce53c90108c1",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/92909c3d25f4db2223a370bca4acce53c90108c1",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9044378537662688544",
"scheduler_job_id:chromium/Site Isolation Android",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8878948466298513216/+/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:4c7a36af5830b510",
"user_agent:luci-scheduler"
],
"updated_ts": "1590776053009229",
"url": "https://ci.chromium.org/b/8878948466298513216",
"utcnow_ts": "1590776054177163"
}
}
[18:14:14.259] Invocation finished in 1h9m11.275722507s with status FAILED