[08:00:24.493] New invocation is queued and will start shortly
[08:00:24.493] Triggered by user:infra-codesearch@chops-service-accounts.iam.gserviceaccount.com
[08:00:25.584] Starting the invocation (attempt 1)
[08:00:25.621] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[08:00:25.621] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[08:00:25.621] Buildbucket request:
{
"bucket": "luci.infra.codesearch",
"client_operation_id": "9073766220690022896",
"parameters_json": "{\"builder_name\":\"codesearch-gen-chromium-linux\",\"properties\":{\"$recipe_engine/scheduler\":{\"hostname\":\"luci-scheduler.appspot.com\",\"triggers\":[{\"buildbucket\":{\"properties\":{\"root_solution_revision\":\"5cebbb88944669dfd867d2083413bb2a92430169\",\"root_solution_revision_timestamp\":1562744674},\"tags\":[\"parent_buildername:codesearch-gen-chromium-initiator\",\"parent_buildnumber:8863\",\"user_agent:recipe\"]},\"id\":\"d7d09d41-7ec5-4d41-bdbd-caaeb80f5cda\",\"title\":\"codesearch-gen-chromium-initiator/8863\"}]},\"root_solution_revision\":\"5cebbb88944669dfd867d2083413bb2a92430169\",\"root_solution_revision_timestamp\":1562744674}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:codesearch-gen-chromium-linux",
"scheduler_invocation_id:9073766220690022896",
"scheduler_job_id:infra/codesearch-gen-chromium-linux",
"user_agent:luci-scheduler",
"parent_buildername:codesearch-gen-chromium-initiator",
"parent_buildnumber:8863",
"user_agent:recipe"
]
}
[08:00:26.514] Buildbucket response:
{
"build": {
"bucket": "luci.infra.codesearch",
"canary_preference": "PROD",
"created_by": "project:infra",
"created_ts": "1562745625732928",
"id": "8908336158710937040",
"parameters_json": "{\"builder_name\": \"codesearch-gen-chromium-linux\", \"properties\": {\"$recipe_engine/scheduler\": {\"hostname\": \"luci-scheduler.appspot.com\", \"triggers\": [{\"buildbucket\": {\"properties\": {\"root_solution_revision\": \"5cebbb88944669dfd867d2083413bb2a92430169\", \"root_solution_revision_timestamp\": 1562744674.0}, \"tags\": [\"parent_buildername:codesearch-gen-chromium-initiator\", \"parent_buildnumber:8863\", \"user_agent:recipe\"]}, \"id\": \"d7d09d41-7ec5-4d41-bdbd-caaeb80f5cda\", \"title\": \"codesearch-gen-chromium-initiator/8863\"}]}, \"root_solution_revision\": \"5cebbb88944669dfd867d2083413bb2a92430169\", \"root_solution_revision_timestamp\": 1562744674.0}}",
"project": "infra",
"result_details_json": "{\"properties\": {}}",
"service_account": "infra-codesearch@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1562745626296808",
"tags": [
"build_address:luci.infra.codesearch/codesearch-gen-chromium-linux/6540",
"builder:codesearch-gen-chromium-linux",
"parent_buildername:codesearch-gen-chromium-initiator",
"parent_buildnumber:8863",
"scheduler_invocation_id:9073766220690022896",
"scheduler_job_id:infra/codesearch-gen-chromium-linux",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/infra/buildbucket/cr-buildbucket.appspot.com/8908336158710937040/+/annotations",
"swarming_tag:luci_project:infra",
"swarming_tag:recipe_name:chromium_codesearch",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_task_id:",
"user_agent:luci-scheduler",
"user_agent:recipe"
],
"updated_ts": "1562745626296898",
"url": "https://ci.chromium.org/b/8908336158710937040",
"utcnow_ts": "1562745626502229"
}
}
[08:00:26.514] Task URL: https://ci.chromium.org/b/8908336158710937040
[08:00:26.514] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:2:0) after 1m0s
[08:00:49.165] Received PubSub notification, asking Buildbucket for the build status
[08:00:49.460] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:01:26.667] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:2:0)
[08:01:26.667] Timer tick, asking Buildbucket for the build status
[08:01:27.882] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:01:27.882] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:4:0) after 1m0s
[08:02:28.055] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:4:0)
[08:02:28.055] Timer tick, asking Buildbucket for the build status
[08:02:28.524] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:02:28.524] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:5:0) after 1m0s
[08:03:28.928] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:5:0)
[08:03:28.928] Timer tick, asking Buildbucket for the build status
[08:03:29.265] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:03:29.265] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:6:0) after 1m0s
[08:04:29.385] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:6:0)
[08:04:29.385] Timer tick, asking Buildbucket for the build status
[08:04:30.966] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:04:30.966] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:7:0) after 1m0s
[08:05:31.074] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:7:0)
[08:05:31.074] Timer tick, asking Buildbucket for the build status
[08:05:31.486] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:05:31.486] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:8:0) after 1m0s
[08:06:31.544] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:8:0)
[08:06:31.544] Timer tick, asking Buildbucket for the build status
[08:06:31.638] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:06:31.639] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:9:0) after 1m0s
[08:07:31.669] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:9:0)
[08:07:31.669] Timer tick, asking Buildbucket for the build status
[08:07:31.792] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:07:31.792] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:10:0) after 1m0s
[08:08:31.812] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:10:0)
[08:08:31.812] Timer tick, asking Buildbucket for the build status
[08:08:32.763] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:08:32.763] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:11:0) after 1m0s
[08:09:32.790] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:11:0)
[08:09:32.790] Timer tick, asking Buildbucket for the build status
[08:09:32.899] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:09:32.899] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:12:0) after 1m0s
[08:10:32.894] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:12:0)
[08:10:32.894] Timer tick, asking Buildbucket for the build status
[08:10:33.212] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:10:33.212] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:13:0) after 1m0s
[08:11:33.267] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:13:0)
[08:11:33.267] Timer tick, asking Buildbucket for the build status
[08:11:34.491] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:11:34.491] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:14:0) after 1m0s
[08:12:34.550] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:14:0)
[08:12:34.550] Timer tick, asking Buildbucket for the build status
[08:12:34.850] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:12:34.850] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:15:0) after 1m0s
[08:13:34.909] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:15:0)
[08:13:34.909] Timer tick, asking Buildbucket for the build status
[08:13:35.927] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:13:35.927] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:16:0) after 1m0s
[08:14:35.927] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:16:0)
[08:14:35.927] Timer tick, asking Buildbucket for the build status
[08:14:37.803] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:14:37.803] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:17:0) after 1m0s
[08:15:37.833] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:17:0)
[08:15:37.833] Timer tick, asking Buildbucket for the build status
[08:15:37.963] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:15:37.963] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:18:0) after 1m0s
[08:16:38.055] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:18:0)
[08:16:38.055] Timer tick, asking Buildbucket for the build status
[08:16:38.251] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:16:38.251] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:19:0) after 1m0s
[08:17:38.281] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:19:0)
[08:17:38.281] Timer tick, asking Buildbucket for the build status
[08:17:38.480] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:17:38.480] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:20:0) after 1m0s
[08:18:38.513] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:20:0)
[08:18:38.513] Timer tick, asking Buildbucket for the build status
[08:18:38.715] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:18:38.715] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:21:0) after 1m0s
[08:19:38.744] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:21:0)
[08:19:38.744] Timer tick, asking Buildbucket for the build status
[08:19:38.835] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:19:38.835] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:22:0) after 1m0s
[08:20:38.870] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:22:0)
[08:20:38.870] Timer tick, asking Buildbucket for the build status
[08:20:39.077] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:20:39.077] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:23:0) after 1m0s
[08:21:39.231] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:23:0)
[08:21:39.231] Timer tick, asking Buildbucket for the build status
[08:21:39.867] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:21:39.867] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:24:0) after 1m0s
[08:22:40.072] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:24:0)
[08:22:40.072] Timer tick, asking Buildbucket for the build status
[08:22:40.177] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:22:40.177] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:25:0) after 1m0s
[08:23:40.199] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:25:0)
[08:23:40.199] Timer tick, asking Buildbucket for the build status
[08:23:40.349] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:23:40.349] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:26:0) after 1m0s
[08:24:40.391] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:26:0)
[08:24:40.391] Timer tick, asking Buildbucket for the build status
[08:24:40.538] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:24:40.538] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:27:0) after 1m0s
[08:25:40.569] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:27:0)
[08:25:40.569] Timer tick, asking Buildbucket for the build status
[08:25:43.721] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:25:43.721] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:28:0) after 1m0s
[08:26:43.702] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:28:0)
[08:26:43.702] Timer tick, asking Buildbucket for the build status
[08:26:43.857] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:26:43.857] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:29:0) after 1m0s
[08:27:43.896] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:29:0)
[08:27:43.896] Timer tick, asking Buildbucket for the build status
[08:27:44.185] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:27:44.185] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:30:0) after 1m0s
[08:28:44.194] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:30:0)
[08:28:44.194] Timer tick, asking Buildbucket for the build status
[08:28:44.577] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:28:44.577] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:31:0) after 1m0s
[08:29:44.601] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:31:0)
[08:29:44.601] Timer tick, asking Buildbucket for the build status
[08:29:45.716] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:29:45.716] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:32:0) after 1m0s
[08:30:45.770] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:32:0)
[08:30:45.770] Timer tick, asking Buildbucket for the build status
[08:30:47.340] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:30:47.340] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:33:0) after 1m0s
[08:31:47.365] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:33:0)
[08:31:47.365] Timer tick, asking Buildbucket for the build status
[08:31:48.354] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:31:48.354] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:34:0) after 1m0s
[08:32:48.441] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:34:0)
[08:32:48.441] Timer tick, asking Buildbucket for the build status
[08:32:48.590] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:32:48.590] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:35:0) after 1m0s
[08:33:48.616] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:35:0)
[08:33:48.616] Timer tick, asking Buildbucket for the build status
[08:33:48.866] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:33:48.866] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:36:0) after 1m0s
[08:34:48.907] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:36:0)
[08:34:48.907] Timer tick, asking Buildbucket for the build status
[08:34:49.171] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:34:49.171] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:37:0) after 1m0s
[08:35:49.205] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:37:0)
[08:35:49.205] Timer tick, asking Buildbucket for the build status
[08:35:50.157] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:35:50.157] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:38:0) after 1m0s
[08:36:50.195] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:38:0)
[08:36:50.195] Timer tick, asking Buildbucket for the build status
[08:36:51.011] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:36:51.011] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:39:0) after 1m0s
[08:37:51.052] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:39:0)
[08:37:51.052] Timer tick, asking Buildbucket for the build status
[08:37:52.586] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:37:52.586] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:40:0) after 1m0s
[08:38:52.636] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:40:0)
[08:38:52.636] Timer tick, asking Buildbucket for the build status
[08:38:52.808] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:38:52.808] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:41:0) after 1m0s
[08:39:52.807] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:41:0)
[08:39:52.807] Timer tick, asking Buildbucket for the build status
[08:39:52.965] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:39:52.965] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:42:0) after 1m0s
[08:40:52.988] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:42:0)
[08:40:52.988] Timer tick, asking Buildbucket for the build status
[08:40:53.255] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:40:53.255] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:43:0) after 1m0s
[08:41:53.297] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:43:0)
[08:41:53.297] Timer tick, asking Buildbucket for the build status
[08:41:53.653] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:41:53.653] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:44:0) after 1m0s
[08:42:53.688] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:44:0)
[08:42:53.688] Timer tick, asking Buildbucket for the build status
[08:42:54.685] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:42:54.685] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:45:0) after 1m0s
[08:43:54.719] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:45:0)
[08:43:54.719] Timer tick, asking Buildbucket for the build status
[08:43:54.804] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:43:54.804] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:46:0) after 1m0s
[08:44:54.960] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:46:0)
[08:44:54.960] Timer tick, asking Buildbucket for the build status
[08:44:55.111] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:44:55.111] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:47:0) after 1m0s
[08:45:55.143] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:47:0)
[08:45:55.143] Timer tick, asking Buildbucket for the build status
[08:45:55.417] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:45:55.417] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:48:0) after 1m0s
[08:46:55.477] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:48:0)
[08:46:55.477] Timer tick, asking Buildbucket for the build status
[08:46:55.721] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:46:55.721] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:49:0) after 1m0s
[08:47:55.754] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:49:0)
[08:47:55.754] Timer tick, asking Buildbucket for the build status
[08:47:55.841] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:47:55.841] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:50:0) after 1m0s
[08:48:55.874] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:50:0)
[08:48:55.874] Timer tick, asking Buildbucket for the build status
[08:48:56.002] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:48:56.002] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:51:0) after 1m0s
[08:49:56.030] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:51:0)
[08:49:56.030] Timer tick, asking Buildbucket for the build status
[08:49:56.310] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:49:56.311] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:52:0) after 1m0s
[08:50:56.447] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:52:0)
[08:50:56.447] Timer tick, asking Buildbucket for the build status
[08:50:57.057] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:50:57.057] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:53:0) after 1m0s
[08:51:57.307] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:53:0)
[08:51:57.307] Timer tick, asking Buildbucket for the build status
[08:51:57.382] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:51:57.382] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:54:0) after 1m0s
[08:52:57.672] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:54:0)
[08:52:57.672] Timer tick, asking Buildbucket for the build status
[08:52:58.012] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:52:58.013] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:55:0) after 1m0s
[08:53:58.171] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:55:0)
[08:53:58.171] Timer tick, asking Buildbucket for the build status
[08:53:59.145] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:53:59.145] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:56:0) after 1m0s
[08:54:59.192] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:56:0)
[08:54:59.192] Timer tick, asking Buildbucket for the build status
[08:54:59.287] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:54:59.287] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:57:0) after 1m0s
[08:55:59.350] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:57:0)
[08:55:59.350] Timer tick, asking Buildbucket for the build status
[08:55:59.437] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:55:59.437] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:58:0) after 1m0s
[08:56:59.471] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:58:0)
[08:56:59.471] Timer tick, asking Buildbucket for the build status
[08:56:59.713] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:56:59.713] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:59:0) after 1m0s
[08:57:59.970] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:59:0)
[08:57:59.970] Timer tick, asking Buildbucket for the build status
[08:58:00.057] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:58:00.058] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:60:0) after 1m0s
[08:59:00.275] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:60:0)
[08:59:00.275] Timer tick, asking Buildbucket for the build status
[08:59:02.653] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:59:02.653] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:61:0) after 1m0s
[09:00:02.715] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:61:0)
[09:00:02.716] Timer tick, asking Buildbucket for the build status
[09:00:03.032] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:00:03.032] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:62:0) after 1m0s
[09:01:03.149] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:62:0)
[09:01:03.149] Timer tick, asking Buildbucket for the build status
[09:01:03.553] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:01:03.553] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:63:0) after 1m0s
[09:02:03.571] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:63:0)
[09:02:03.571] Timer tick, asking Buildbucket for the build status
[09:02:03.890] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:02:03.890] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:64:0) after 1m0s
[09:03:03.965] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:64:0)
[09:03:03.965] Timer tick, asking Buildbucket for the build status
[09:03:04.145] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:03:04.145] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:65:0) after 1m0s
[09:04:04.199] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:65:0)
[09:04:04.199] Timer tick, asking Buildbucket for the build status
[09:04:04.842] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:04:04.842] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:66:0) after 1m0s
[09:05:04.873] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:66:0)
[09:05:04.873] Timer tick, asking Buildbucket for the build status
[09:05:05.215] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:05:05.215] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:67:0) after 1m0s
[09:06:05.263] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:67:0)
[09:06:05.263] Timer tick, asking Buildbucket for the build status
[09:06:05.945] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:06:05.945] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:68:0) after 1m0s
[09:07:05.955] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:68:0)
[09:07:05.955] Timer tick, asking Buildbucket for the build status
[09:07:06.093] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:07:06.093] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:69:0) after 1m0s
[09:08:06.121] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:69:0)
[09:08:06.121] Timer tick, asking Buildbucket for the build status
[09:08:06.318] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:08:06.318] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:70:0) after 1m0s
[09:09:06.334] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:70:0)
[09:09:06.334] Timer tick, asking Buildbucket for the build status
[09:09:07.254] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:09:07.254] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:71:0) after 1m0s
[09:10:07.314] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:71:0)
[09:10:07.314] Timer tick, asking Buildbucket for the build status
[09:10:07.453] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:10:07.453] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:72:0) after 1m0s
[09:11:07.472] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:72:0)
[09:11:07.472] Timer tick, asking Buildbucket for the build status
[09:11:07.712] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:11:07.712] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:73:0) after 1m0s
[09:12:07.739] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:73:0)
[09:12:07.739] Timer tick, asking Buildbucket for the build status
[09:12:07.939] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:12:07.939] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:74:0) after 1m0s
[09:13:07.966] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:74:0)
[09:13:07.966] Timer tick, asking Buildbucket for the build status
[09:13:11.622] Build 8908336158710937040: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:13:11.622] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-linux:9073766220690022896:75:0) after 1m0s
[09:13:34.496] Received PubSub notification, asking Buildbucket for the build status
[09:13:36.727] Build 8908336158710937040: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[09:13:36.727] Buildbucket build:
{
"build": {
"bucket": "luci.infra.codesearch",
"canary_preference": "PROD",
"completed_ts": "1562750013039968",
"created_by": "project:infra",
"created_ts": "1562745625732928",
"id": "8908336158710937040",
"parameters_json": "{\"builder_name\": \"codesearch-gen-chromium-linux\", \"properties\": {\"$recipe_engine/scheduler\": {\"hostname\": \"luci-scheduler.appspot.com\", \"triggers\": [{\"buildbucket\": {\"properties\": {\"root_solution_revision\": \"5cebbb88944669dfd867d2083413bb2a92430169\", \"root_solution_revision_timestamp\": 1562744674.0}, \"tags\": [\"parent_buildername:codesearch-gen-chromium-initiator\", \"parent_buildnumber:8863\", \"user_agent:recipe\"]}, \"id\": \"d7d09d41-7ec5-4d41-bdbd-caaeb80f5cda\", \"title\": \"codesearch-gen-chromium-initiator/8863\"}]}, \"root_solution_revision\": \"5cebbb88944669dfd867d2083413bb2a92430169\", \"root_solution_revision_timestamp\": 1562744674.0}}",
"project": "infra",
"result": "SUCCESS",
"result_details_json": "{\"properties\": {\"$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\": [{\"buildbucket\": {\"properties\": {\"root_solution_revision\": \"5cebbb88944669dfd867d2083413bb2a92430169\", \"root_solution_revision_timestamp\": 1562744674.0}, \"tags\": [\"parent_buildername:codesearch-gen-chromium-initiator\", \"parent_buildnumber:8863\", \"user_agent:recipe\"]}, \"id\": \"d7d09d41-7ec5-4d41-bdbd-caaeb80f5cda\", \"title\": \"codesearch-gen-chromium-initiator/8863\"}]}, \"bot_id\": \"luci-infra-codesearch-xenial-1-y2q5\", \"buildername\": \"codesearch-gen-chromium-linux\", \"buildnumber\": 6540, \"got_angle_revision\": \"4e71b2bc254677bdeac521a371402a92f6747776\", \"got_clang_revision\": \"365097-f7e52fbd-1\", \"got_dawn_revision\": \"27e67b5f97191ed448ae5b11885c42845dd4cebc\", \"got_nacl_revision\": \"058a26f57015051953a727add26e7e26348b9558\", \"got_revision\": \"5cebbb88944669dfd867d2083413bb2a92430169\", \"got_revision_cp\": \"refs/heads/master@{#675967}\", \"got_swarming_client_revision\": \"96f125709acfd0b48fc1e5dae7d6ea42291726ac\", \"got_v8_revision\": \"ffcc6abeb7796e08165267d860887e8fe865f233\", \"got_v8_revision_cp\": \"refs/heads/7.7.213@{#1}\", \"got_webrtc_revision\": \"4876cb21c82f3886d67888f75bee2ab522e55a94\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#28519}\", \"mastername\": \"chromium.infra.codesearch\", \"path_config\": \"generic\", \"recipe\": \"chromium_codesearch\", \"root_solution_revision\": \"5cebbb88944669dfd867d2083413bb2a92430169\", \"root_solution_revision_timestamp\": 1562744674.0}, \"swarming\": {\"bot_dimensions\": {\"caches\": [\"builder_14b4f73c8b95a6615516bba597f721e10c68093aeabbb388e9a5697d2f7f84cc_v2\", \"codesearch_git_genfiles_repo\", \"codesearch_update_submodules_mirror\", \"git\", \"goma_v2\", \"vpython\"], \"cores\": [\"8\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Broadwell_GCE\", \"x86-64-avx2\"], \"gce\": [\"1\"], \"gpu\": [\"none\"], \"id\": [\"luci-infra-codesearch-xenial-1-y2q5\"], \"image\": [\"chrome-xenial-19052201-9cb74617499\"], \"inside_docker\": [\"0\"], \"kvm\": [\"1\"], \"locale\": [\"en_US.UTF-8\"], \"machine_type\": [\"n1-standard-8\"], \"os\": [\"Linux\", \"Ubuntu\", \"Ubuntu-16.04\"], \"pool\": [\"luci.infra.codesearch\"], \"python\": [\"2.7.12\"], \"server_version\": [\"4370-0e704a3\"], \"ssd\": [\"0\"], \"zone\": [\"us\", \"us-east\", \"us-east1\", \"us-east1-a\"]}}}",
"service_account": "infra-codesearch@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1562745647439598",
"status": "COMPLETED",
"status_changed_ts": "1562750013607543",
"tags": [
"build_address:luci.infra.codesearch/codesearch-gen-chromium-linux/6540",
"builder:codesearch-gen-chromium-linux",
"parent_buildername:codesearch-gen-chromium-initiator",
"parent_buildnumber:8863",
"scheduler_invocation_id:9073766220690022896",
"scheduler_job_id:infra/codesearch-gen-chromium-linux",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/infra/buildbucket/cr-buildbucket.appspot.com/8908336158710937040/+/annotations",
"swarming_tag:luci_project:infra",
"swarming_tag:os:Linux",
"swarming_tag:recipe_name:chromium_codesearch",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_task_id:45f3b7692153b710",
"user_agent:luci-scheduler",
"user_agent:recipe"
],
"updated_ts": "1562750013796446",
"url": "https://ci.chromium.org/b/8908336158710937040",
"utcnow_ts": "1562750016632850"
}
}
[09:13:36.728] Invocation finished in 1h13m12.26676927s with status SUCCEEDED