[16:08:38.328] New invocation is queued and will start shortly
[16:08:39.449] Starting the invocation (attempt 1)
[16:08:39.474] Popped buildset tag "buildset:commit/gitiles/chromium.googlesource.com/emscripten-releases/+/240f28abe128d42a0c74b2da3667aafbf8efc787"
[16:08:39.475] Popped gitiles commit info from properties and tags
[16:08:39.475] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[16:08:39.475] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[16:08:39.475] Buildbucket request:
{
"requestId": "8943185275272244656",
"builder": {
"project": "emscripten-releases",
"bucket": "ci",
"builder": "linux-test-suites"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8943185275272244656",
"job": "emscripten-releases/linux-test-suites",
"triggers": [
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://chromium.googlesource.com/emscripten-releases",
"revision": "240f28abe128d42a0c74b2da3667aafbf8efc787"
},
"id": "https://chromium.googlesource.com/emscripten-releases/+/refs/heads/main@240f28abe128d42a0c74b2da3667aafbf8efc787",
"title": "240f28abe128d42a0c74b2da3667aafbf8efc787",
"url": "https://chromium.googlesource.com/emscripten-releases/+/240f28abe128d42a0c74b2da3667aafbf8efc787"
}
]
}
},
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "emscripten-releases",
"id": "240f28abe128d42a0c74b2da3667aafbf8efc787",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8943185275272244656"
},
{
"key": "scheduler_job_id",
"value": "emscripten-releases/linux-test-suites"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[16:08:39.774] Scheduled build:
{
"id": "8777755213348951569",
"builder": {
"project": "emscripten-releases",
"bucket": "ci",
"builder": "linux-test-suites"
},
"createdBy": "project:emscripten-releases",
"createTime": "2023-06-20T16:08:39.536004976Z",
"updateTime": "2023-06-20T16:08:39.536004976Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "emscripten-releases",
"id": "240f28abe128d42a0c74b2da3667aafbf8efc787",
"ref": "refs/heads/main"
}
}
}
[16:08:39.774] Task URL: https://cr-buildbucket.appspot.com/build/8777755213348951569
[16:08:39.774] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:2:0) after 9m57s
[16:09:14.715] Received PubSub notification, asking Buildbucket for the build status
[16:09:14.731] Build status: STARTED
[16:18:36.757] Handling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:2:0)
[16:18:36.789] Build status: STARTED
[16:18:36.789] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:4:0) after 2m11s
[16:20:47.775] Handling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:4:0)
[16:20:47.845] Build status: STARTED
[16:20:47.845] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:5:0) after 8m22s
[16:29:10.038] Handling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:5:0)
[16:29:10.088] Build status: STARTED
[16:29:10.088] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:6:0) after 5m9s
[16:34:19.184] Handling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:6:0)
[16:34:19.220] Build status: STARTED
[16:34:19.220] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:7:0) after 9m23s
[16:43:42.291] Handling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:7:0)
[16:43:42.320] Build status: STARTED
[16:43:42.320] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:8:0) after 6m14s
[16:49:56.491] Handling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:8:0)
[16:49:56.513] Build status: STARTED
[16:49:56.513] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:9:0) after 1m3s
[16:50:59.547] Handling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:9:0)
[16:50:59.564] Build status: STARTED
[16:50:59.564] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:10:0) after 4m28s
[16:55:27.586] Handling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:10:0)
[16:55:27.658] Build status: STARTED
[16:55:27.658] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:11:0) after 2m46s
[16:58:14.084] Handling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:11:0)
[16:58:14.106] Build status: STARTED
[16:58:14.106] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:12:0) after 6m12s
[17:04:26.328] Handling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:12:0)
[17:04:26.357] Build status: STARTED
[17:04:26.357] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:13:0) after 2m4s
[17:06:30.394] Handling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:13:0)
[17:06:30.419] Build status: STARTED
[17:06:30.419] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:14:0) after 2m6s
[17:08:36.746] Handling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:14:0)
[17:08:36.782] Build status: STARTED
[17:08:36.782] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:15:0) after 2m24s
[17:11:00.943] Handling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:15:0)
[17:11:00.970] Build status: STARTED
[17:11:00.971] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:16:0) after 2m23s
[17:13:24.088] Handling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:16:0)
[17:13:24.109] Build status: STARTED
[17:13:24.109] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:17:0) after 5m19s
[17:18:43.125] Handling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:17:0)
[17:18:43.164] Build status: STARTED
[17:18:43.165] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:18:0) after 6m50s
[17:25:33.397] Handling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:18:0)
[17:25:33.421] Build status: STARTED
[17:25:33.421] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:19:0) after 2m36s
[17:28:09.580] Handling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:19:0)
[17:28:09.620] Build status: STARTED
[17:28:09.620] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:20:0) after 1m34s
[17:29:43.639] Handling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:20:0)
[17:29:43.679] Build status: STARTED
[17:29:43.679] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:21:0) after 9m10s
[17:38:53.842] Handling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:21:0)
[17:38:53.861] Build status: STARTED
[17:38:53.861] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:22:0) after 4m17s
[17:43:11.053] Handling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:22:0)
[17:43:11.086] Build status: STARTED
[17:43:11.086] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:23:0) after 2m2s
[17:45:13.306] Handling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:23:0)
[17:45:13.377] Build status: STARTED
[17:45:13.377] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:24:0) after 2m37s
[17:47:50.394] Handling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:24:0)
[17:47:50.516] Build status: STARTED
[17:47:50.516] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:25:0) after 1m49s
[17:49:39.503] Handling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:25:0)
[17:49:39.535] Build status: STARTED
[17:49:39.535] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:26:0) after 6m9s
[17:55:48.626] Handling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:26:0)
[17:55:48.641] Build status: STARTED
[17:55:48.641] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:27:0) after 6m28s
[18:02:17.435] Handling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:27:0)
[18:02:17.470] Build status: STARTED
[18:02:17.470] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:28:0) after 6m59s
[18:09:16.521] Handling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:28:0)
[18:09:16.545] Build status: STARTED
[18:09:16.545] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:29:0) after 8m46s
[18:18:02.950] Handling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:29:0)
[18:18:02.978] Build status: STARTED
[18:18:02.979] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:30:0) after 7m17s
[18:25:19.997] Handling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:30:0)
[18:25:20.067] Build status: STARTED
[18:25:20.067] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:31:0) after 7m46s
[18:33:06.084] Handling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:31:0)
[18:33:06.120] Build status: STARTED
[18:33:06.120] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:32:0) after 5m23s
[18:38:29.133] Handling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:32:0)
[18:38:29.167] Build status: STARTED
[18:38:29.167] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:33:0) after 3m47s
[18:42:16.199] Handling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:33:0)
[18:42:16.235] Build status: STARTED
[18:42:16.235] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:34:0) after 2m15s
[18:44:31.252] Handling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:34:0)
[18:44:31.372] Build status: STARTED
[18:44:31.372] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/linux-test-suites:8943185275272244656:35:0) after 8m49s
[18:46:32.736] Received PubSub notification, asking Buildbucket for the build status
[18:46:32.793] Build:
{
"id": "8777755213348951569",
"builder": {
"project": "emscripten-releases",
"bucket": "ci",
"builder": "linux-test-suites"
},
"createdBy": "project:emscripten-releases",
"createTime": "2023-06-20T16:08:39.536004976Z",
"startTime": "2023-06-20T16:09:13.763879Z",
"endTime": "2023-06-20T18:46:32.331909540Z",
"updateTime": "2023-06-20T18:46:32.331909540Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "emscripten-releases",
"id": "240f28abe128d42a0c74b2da3667aafbf8efc787",
"ref": "refs/heads/main"
}
}
}
[18:46:32.793] Invocation finished in 2h37m54.475798668s with status SUCCEEDED