[16:01:57.234] New invocation is queued and will start shortly
[16:01:57.234] Triggered by user:infra-codesearch@chops-service-accounts.iam.gserviceaccount.com
[16:01:58.532] Starting the invocation (attempt 1)
[16:01:58.572] Ignoring gitiles_ref tag without the buildset tag
[16:01:58.572] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[16:01:58.573] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[16:01:58.573] Buildbucket request:
{
"requestId": "8959130761932576176",
"builder": {
"project": "infra",
"bucket": "codesearch",
"builder": "codesearch-gen-chromium-win"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8959130761932576176",
"job": "infra/codesearch-gen-chromium-win",
"triggers": [
{
"buildbucket": {
"properties": {
"codesearch_mirror_revision": "e66516e3645aae9ac908bb3fc984e069b44c14d9",
"codesearch_mirror_revision_timestamp": 1672063590,
"root_solution_revision": "ed7ba975e5d8e379de166f72fade8a086ff2ee55",
"root_solution_revision_timestamp": 1672062867
},
"tags": [
"parent_buildername:codesearch-gen-chromium-initiator",
"parent_buildnumber:16456",
"user_agent:recipe"
]
},
"id": "e39cf15b-2189-4cb4-b5fa-0a43aa166b4b",
"title": "codesearch-gen-chromium-initiator/16456"
}
]
},
"codesearch_mirror_revision": "e66516e3645aae9ac908bb3fc984e069b44c14d9",
"codesearch_mirror_revision_timestamp": 1672063590,
"root_solution_revision": "ed7ba975e5d8e379de166f72fade8a086ff2ee55",
"root_solution_revision_timestamp": 1672062867
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8959130761932576176"
},
{
"key": "scheduler_job_id",
"value": "infra/codesearch-gen-chromium-win"
},
{
"key": "user_agent",
"value": "luci-scheduler"
},
{
"key": "parent_buildername",
"value": "codesearch-gen-chromium-initiator"
},
{
"key": "parent_buildnumber",
"value": "16456"
},
{
"key": "user_agent",
"value": "recipe"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[16:01:59.433] Scheduled build:
{
"id": "8793700699630629473",
"builder": {
"project": "infra",
"bucket": "codesearch",
"builder": "codesearch-gen-chromium-win"
},
"number": 11130,
"createdBy": "project:infra",
"createTime": "2022-12-26T16:01:58.806503218Z",
"updateTime": "2022-12-26T16:01:58.806503218Z",
"status": "SCHEDULED",
"input": {
}
}
[16:01:59.433] Task URL: https://cr-buildbucket.appspot.com/build/8793700699630629473
[16:01:59.433] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:2:0) after 8m1s
[16:02:48.846] Received PubSub notification, asking Buildbucket for the build status
[16:02:48.875] Build status: STARTED
[16:10:00.566] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:2:0)
[16:10:00.776] Build status: STARTED
[16:10:00.776] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:4:0) after 4m25s
[16:14:25.802] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:4:0)
[16:14:25.827] Build status: STARTED
[16:14:25.827] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:5:0) after 7m55s
[16:22:20.872] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:5:0)
[16:22:20.919] Build status: STARTED
[16:22:20.919] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:6:0) after 9m32s
[16:31:52.942] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:6:0)
[16:31:52.978] Build status: STARTED
[16:31:52.978] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:7:0) after 2m41s
[16:34:33.996] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:7:0)
[16:34:34.019] Build status: STARTED
[16:34:34.019] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:8:0) after 1m1s
[16:35:35.059] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:8:0)
[16:35:35.100] Build status: STARTED
[16:35:35.100] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:9:0) after 8m26s
[16:44:01.175] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:9:0)
[16:44:01.213] Build status: STARTED
[16:44:01.213] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:10:0) after 2m17s
[16:46:18.332] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:10:0)
[16:46:18.356] Build status: STARTED
[16:46:18.356] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:11:0) after 8m34s
[16:54:52.371] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:11:0)
[16:54:52.404] Build status: STARTED
[16:54:52.404] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:12:0) after 5m37s
[17:00:29.560] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:12:0)
[17:00:29.608] Build status: STARTED
[17:00:29.608] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:13:0) after 6m10s
[17:06:39.630] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:13:0)
[17:06:39.656] Build status: STARTED
[17:06:39.656] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:14:0) after 4m38s
[17:11:17.699] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:14:0)
[17:11:17.747] Build status: STARTED
[17:11:17.747] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:15:0) after 5m54s
[17:17:11.795] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:15:0)
[17:17:11.824] Build status: STARTED
[17:17:11.824] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:16:0) after 7m12s
[17:24:23.961] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:16:0)
[17:24:23.986] Build status: STARTED
[17:24:23.986] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:17:0) after 3m16s
[17:27:40.561] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:17:0)
[17:27:40.629] Build status: STARTED
[17:27:40.629] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:18:0) after 3m52s
[17:31:32.839] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:18:0)
[17:31:32.868] Build status: STARTED
[17:31:32.868] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:19:0) after 7m21s
[17:38:54.228] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:19:0)
[17:38:54.259] Build status: STARTED
[17:38:54.259] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:20:0) after 8m21s
[17:47:15.276] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:20:0)
[17:47:15.302] Build status: STARTED
[17:47:15.302] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:21:0) after 9m2s
[17:56:17.343] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:21:0)
[17:56:17.395] Build status: STARTED
[17:56:17.396] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:22:0) after 2m12s
[17:58:29.538] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:22:0)
[17:58:29.577] Build status: STARTED
[17:58:29.577] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:23:0) after 8m50s
[18:07:19.604] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:23:0)
[18:07:19.641] Build status: STARTED
[18:07:19.641] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:24:0) after 6m4s
[18:13:23.705] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:24:0)
[18:13:23.749] Build status: STARTED
[18:13:23.749] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:25:0) after 2m52s
[18:16:15.866] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:25:0)
[18:16:15.909] Build status: STARTED
[18:16:15.909] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:26:0) after 3m16s
[18:19:31.956] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:26:0)
[18:19:31.988] Build status: STARTED
[18:19:31.988] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:27:0) after 9m56s
[18:29:28.199] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:27:0)
[18:29:28.224] Build status: STARTED
[18:29:28.224] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:28:0) after 1m18s
[18:30:46.237] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:28:0)
[18:30:46.280] Build status: STARTED
[18:30:46.280] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:29:0) after 9m48s
[18:40:34.317] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:29:0)
[18:40:34.412] Build status: STARTED
[18:40:34.412] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:30:0) after 8m51s
[18:49:25.613] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:30:0)
[18:49:25.641] Build status: STARTED
[18:49:25.641] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:31:0) after 9m44s
[18:59:09.665] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:31:0)
[18:59:09.689] Build status: STARTED
[18:59:09.690] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:32:0) after 5m46s
[19:04:55.699] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:32:0)
[19:04:55.731] Build status: STARTED
[19:04:55.731] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:33:0) after 9m48s
[19:14:43.947] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:33:0)
[19:14:43.970] Build status: STARTED
[19:14:43.971] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:34:0) after 3m48s
[19:18:31.988] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:34:0)
[19:18:32.039] Build status: STARTED
[19:18:32.039] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:35:0) after 2m58s
[19:21:30.057] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:35:0)
[19:21:30.099] Build status: STARTED
[19:21:30.099] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:36:0) after 5m36s
[19:27:06.125] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:36:0)
[19:27:06.155] Build status: STARTED
[19:27:06.155] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:37:0) after 9m25s
[19:36:31.316] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:37:0)
[19:36:31.361] Build status: STARTED
[19:36:31.361] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:8959130761932576176:38:0) after 3m20s
[19:38:19.612] Received PubSub notification, asking Buildbucket for the build status
[19:38:19.637] Build:
{
"id": "8793700699630629473",
"builder": {
"project": "infra",
"bucket": "codesearch",
"builder": "codesearch-gen-chromium-win"
},
"number": 11130,
"createdBy": "project:infra",
"createTime": "2022-12-26T16:01:58.806503218Z",
"startTime": "2022-12-26T16:02:48.015808Z",
"endTime": "2022-12-26T19:38:18.543588422Z",
"updateTime": "2022-12-26T19:38:18.543588422Z",
"status": "SUCCESS",
"input": {
}
}
[19:38:19.637] Invocation finished in 3h36m22.410345009s with status SUCCEEDED