[05:00:02.519] New invocation is queued and will start shortly
[05:00:03.552] Starting the invocation (attempt 1)
[05:00:03.579] Ignoring gitiles_ref tag without the buildset tag
[05:00:03.579] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[05:00:03.581] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[05:00:03.581] Buildbucket request:
{
"requestId": "8903455271494246736",
"builder": {
"project": "dawn",
"bucket": "ci",
"builder": "cts-roller"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8903455271494246736",
"job": "dawn/cts-roller",
"triggers": [
{
"cron": {
"generation": "1152"
},
"id": "cron:v1:1152"
}
]
}
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8903455271494246736"
},
{
"key": "scheduler_job_id",
"value": "dawn/cts-roller"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[05:00:04.565] Scheduled build:
{
"id": "8738025209633750481",
"builder": {
"project": "dawn",
"bucket": "ci",
"builder": "cts-roller"
},
"createdBy": "project:dawn",
"createTime": "2024-09-01T05:00:03.669834016Z",
"updateTime": "2024-09-01T05:00:03.669834016Z",
"status": "SCHEDULED",
"input": {
}
}
[05:00:04.565] Task URL: https://cr-buildbucket.appspot.com/build/8738025209633750481
[05:00:04.565] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:2:0) after 4m20s
[05:00:05.444] Received PubSub notification, asking Buildbucket for the build status
[05:00:05.729] Build status: SCHEDULED
[05:00:17.466] Received PubSub notification, asking Buildbucket for the build status
[05:00:17.493] Build status: STARTED
[05:04:24.675] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:2:0)
[05:04:24.704] Build status: STARTED
[05:04:24.704] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:5:0) after 6m10s
[05:10:34.723] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:5:0)
[05:10:34.749] Build status: STARTED
[05:10:34.749] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:6:0) after 2m32s
[05:13:06.863] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:6:0)
[05:13:06.918] Build status: STARTED
[05:13:06.918] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:7:0) after 1m36s
[05:14:42.931] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:7:0)
[05:14:42.959] Build status: STARTED
[05:14:42.959] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:8:0) after 2m12s
[05:16:55.264] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:8:0)
[05:16:55.292] Build status: STARTED
[05:16:55.293] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:9:0) after 5m57s
[05:22:52.459] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:9:0)
[05:22:52.765] Build status: STARTED
[05:22:52.765] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:10:0) after 9m27s
[05:32:19.949] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:10:0)
[05:32:20.123] Build status: STARTED
[05:32:20.123] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:11:0) after 8m50s
[05:41:10.237] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:11:0)
[05:41:10.271] Build status: STARTED
[05:41:10.271] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:12:0) after 2m12s
[05:43:22.285] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:12:0)
[05:43:22.398] Build status: STARTED
[05:43:22.398] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:13:0) after 4m23s
[05:47:45.432] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:13:0)
[05:47:45.451] Build status: STARTED
[05:47:45.451] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:14:0) after 6m0s
[05:53:45.476] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:14:0)
[05:53:45.556] Build status: STARTED
[05:53:45.556] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:15:0) after 7m59s
[06:01:44.572] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:15:0)
[06:01:44.716] Build status: STARTED
[06:01:44.716] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:16:0) after 9m26s
[06:11:10.740] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:16:0)
[06:11:10.784] Build status: STARTED
[06:11:10.784] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:17:0) after 3m42s
[06:14:52.878] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:17:0)
[06:14:52.915] Build status: STARTED
[06:14:52.915] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:18:0) after 8m19s
[06:23:12.455] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:18:0)
[06:23:12.604] Build status: STARTED
[06:23:12.604] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:19:0) after 7m3s
[06:30:16.096] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:19:0)
[06:30:16.119] Build status: STARTED
[06:30:16.119] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:20:0) after 3m18s
[06:33:34.134] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:20:0)
[06:33:34.166] Build status: STARTED
[06:33:34.166] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:21:0) after 4m44s
[06:38:18.461] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:21:0)
[06:38:18.493] Build status: STARTED
[06:38:18.493] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:22:0) after 3m27s
[06:41:46.633] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:22:0)
[06:41:46.653] Build status: STARTED
[06:41:46.653] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:23:0) after 5m28s
[06:47:14.695] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:23:0)
[06:47:14.720] Build status: STARTED
[06:47:14.720] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:24:0) after 8m31s
[06:55:45.703] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:24:0)
[06:55:45.721] Build status: STARTED
[06:55:45.721] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:25:0) after 9m9s
[07:04:54.735] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:25:0)
[07:04:54.760] Build status: STARTED
[07:04:54.760] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:26:0) after 4m0s
[07:08:54.741] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:26:0)
[07:08:54.763] Build status: STARTED
[07:08:54.763] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:27:0) after 5m54s
[07:14:48.995] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:27:0)
[07:14:49.032] Build status: STARTED
[07:14:49.032] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:28:0) after 8m30s
[07:23:19.225] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:28:0)
[07:23:19.252] Build status: STARTED
[07:23:19.252] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:29:0) after 5m23s
[07:28:42.567] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:29:0)
[07:28:42.659] Build status: STARTED
[07:28:42.659] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:30:0) after 3m32s
[07:32:15.225] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:30:0)
[07:32:15.253] Build status: STARTED
[07:32:15.253] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:31:0) after 3m53s
[07:36:08.427] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:31:0)
[07:36:08.453] Build status: STARTED
[07:36:08.453] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:32:0) after 1m12s
[07:37:20.986] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:32:0)
[07:37:21.031] Build status: STARTED
[07:37:21.031] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:33:0) after 5m13s
[07:42:34.011] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:33:0)
[07:42:34.042] Build status: STARTED
[07:42:34.042] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:34:0) after 1m34s
[07:44:08.140] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:34:0)
[07:44:08.169] Build status: STARTED
[07:44:08.169] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:35:0) after 3m38s
[07:47:46.233] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:35:0)
[07:47:46.289] Build status: STARTED
[07:47:46.289] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:36:0) after 7m59s
[07:55:45.431] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:36:0)
[07:55:45.451] Build status: STARTED
[07:55:45.451] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:37:0) after 1m42s
[07:57:27.523] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:37:0)
[07:57:27.543] Build status: STARTED
[07:57:27.543] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:38:0) after 7m45s
[08:05:12.525] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:38:0)
[08:05:12.592] Build status: STARTED
[08:05:12.592] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:39:0) after 7m12s
[08:12:24.608] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:39:0)
[08:12:24.641] Build status: STARTED
[08:12:24.641] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:40:0) after 1m11s
[08:13:35.657] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:40:0)
[08:13:35.684] Build status: STARTED
[08:13:35.684] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:41:0) after 6m15s
[08:19:50.709] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:41:0)
[08:19:50.737] Build status: STARTED
[08:19:50.737] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:42:0) after 6m19s
[08:26:09.857] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:42:0)
[08:26:09.887] Build status: STARTED
[08:26:09.887] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:43:0) after 7m47s
[08:33:57.068] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:43:0)
[08:33:57.090] Build status: STARTED
[08:33:57.090] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:44:0) after 7m3s
[08:41:00.107] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:44:0)
[08:41:00.139] Build status: STARTED
[08:41:00.139] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:45:0) after 8m55s
[08:49:55.155] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:45:0)
[08:49:55.183] Build status: STARTED
[08:49:55.183] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:46:0) after 3m55s
[08:53:50.294] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:46:0)
[08:53:50.323] Build status: STARTED
[08:53:50.323] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:47:0) after 4m0s
[08:57:50.432] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:47:0)
[08:57:50.455] Build status: STARTED
[08:57:50.455] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:48:0) after 3m7s
[09:00:57.518] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:48:0)
[09:00:57.537] Build status: STARTED
[09:00:57.537] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:49:0) after 8m48s
[09:09:45.673] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:49:0)
[09:09:45.702] Build status: STARTED
[09:09:45.702] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:50:0) after 3m41s
[09:13:26.707] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:50:0)
[09:13:26.733] Build status: STARTED
[09:13:26.733] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:51:0) after 5m16s
[09:18:42.748] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:51:0)
[09:18:42.777] Build status: STARTED
[09:18:42.777] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:52:0) after 4m1s
[09:22:43.825] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:52:0)
[09:22:43.940] Build status: STARTED
[09:22:43.940] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:53:0) after 3m46s
[09:26:30.082] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:53:0)
[09:26:30.125] Build status: STARTED
[09:26:30.125] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:54:0) after 7m1s
[09:33:31.143] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:54:0)
[09:33:31.166] Build status: STARTED
[09:33:31.166] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:55:0) after 9m43s
[09:43:14.279] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:55:0)
[09:43:14.313] Build status: STARTED
[09:43:14.313] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:56:0) after 7m32s
[09:50:46.353] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:56:0)
[09:50:46.368] Build status: STARTED
[09:50:46.368] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:57:0) after 5m6s
[09:55:52.385] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:57:0)
[09:55:52.403] Build status: STARTED
[09:55:52.403] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:58:0) after 5m18s
[10:01:10.436] Handling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:58:0)
[10:01:10.495] Build status: STARTED
[10:01:10.495] Scheduling timer "check-buildbucket-build-status" (dawn/cts-roller:8903455271494246736:59:0) after 7m15s
[10:07:04.415] Received PubSub notification, asking Buildbucket for the build status
[10:07:04.436] Build:
{
"id": "8738025209633750481",
"builder": {
"project": "dawn",
"bucket": "ci",
"builder": "cts-roller"
},
"createdBy": "project:dawn",
"createTime": "2024-09-01T05:00:03.669834016Z",
"startTime": "2024-09-01T05:00:16.457201357Z",
"endTime": "2024-09-01T10:06:59.203387354Z",
"updateTime": "2024-09-01T10:06:59.203387354Z",
"status": "INFRA_FAILURE",
"input": {
}
}
[10:07:04.436] Invocation finished in 5h7m1.924210619s with status FAILED