[18:09:02.909] New invocation is queued and will start shortly
[18:09:04.003] Starting the invocation (attempt 1)
[18:09:04.029] Popped buildset tag "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/82762459a2cd5b83aac9b6088d141e0eb37c8bac"
[18:09:04.029] Popped gitiles commit info from properties and tags
[18:09:04.029] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[18:09:04.029] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[18:09:04.030] Buildbucket request:
{
"requestId": "8863361772348683152",
"builder": {
"project": "openscreen",
"bucket": "ci",
"builder": "chromium_linux_x64"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8863361772348683152",
"job": "openscreen/chromium_linux_x64",
"triggers": [
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "ff71ada2c432b116bfa1d656557d80e7a8ad3c39"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/heads/main@ff71ada2c432b116bfa1d656557d80e7a8ad3c39",
"title": "ff71ada2c432b116bfa1d656557d80e7a8ad3c39",
"url": "https://chromium.googlesource.com/chromium/src/+/ff71ada2c432b116bfa1d656557d80e7a8ad3c39"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "ff2f481d859df2ed1e26c1cfa98f0452e3dfe83a"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/heads/main@ff2f481d859df2ed1e26c1cfa98f0452e3dfe83a",
"title": "ff2f481d859df2ed1e26c1cfa98f0452e3dfe83a",
"url": "https://chromium.googlesource.com/chromium/src/+/ff2f481d859df2ed1e26c1cfa98f0452e3dfe83a"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "0877c970bfb874ff6760a033d6b81ecae2ad80fa"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/heads/main@0877c970bfb874ff6760a033d6b81ecae2ad80fa",
"title": "0877c970bfb874ff6760a033d6b81ecae2ad80fa",
"url": "https://chromium.googlesource.com/chromium/src/+/0877c970bfb874ff6760a033d6b81ecae2ad80fa"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "683514a3e63cad04e6360dbd46d819f59c9a326f"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/heads/main@683514a3e63cad04e6360dbd46d819f59c9a326f",
"title": "683514a3e63cad04e6360dbd46d819f59c9a326f",
"url": "https://chromium.googlesource.com/chromium/src/+/683514a3e63cad04e6360dbd46d819f59c9a326f"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "d04281e33f563605ce9522646059e2173aec7baa"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/heads/main@d04281e33f563605ce9522646059e2173aec7baa",
"title": "d04281e33f563605ce9522646059e2173aec7baa",
"url": "https://chromium.googlesource.com/chromium/src/+/d04281e33f563605ce9522646059e2173aec7baa"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "27e494818ced3f830b8099cfd39baa1c0da840b0"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/heads/main@27e494818ced3f830b8099cfd39baa1c0da840b0",
"title": "27e494818ced3f830b8099cfd39baa1c0da840b0",
"url": "https://chromium.googlesource.com/chromium/src/+/27e494818ced3f830b8099cfd39baa1c0da840b0"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "b0679bc05e03aba52aedd3abedae8a56c26242e4"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/heads/main@b0679bc05e03aba52aedd3abedae8a56c26242e4",
"title": "b0679bc05e03aba52aedd3abedae8a56c26242e4",
"url": "https://chromium.googlesource.com/chromium/src/+/b0679bc05e03aba52aedd3abedae8a56c26242e4"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "9789e2217c9c1fb2e07aff77199a3f231ef5ed6d"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/heads/main@9789e2217c9c1fb2e07aff77199a3f231ef5ed6d",
"title": "9789e2217c9c1fb2e07aff77199a3f231ef5ed6d",
"url": "https://chromium.googlesource.com/chromium/src/+/9789e2217c9c1fb2e07aff77199a3f231ef5ed6d"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "82762459a2cd5b83aac9b6088d141e0eb37c8bac"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/heads/main@82762459a2cd5b83aac9b6088d141e0eb37c8bac",
"title": "82762459a2cd5b83aac9b6088d141e0eb37c8bac",
"url": "https://chromium.googlesource.com/chromium/src/+/82762459a2cd5b83aac9b6088d141e0eb37c8bac"
}
]
}
},
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "82762459a2cd5b83aac9b6088d141e0eb37c8bac",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8863361772348683152"
},
{
"key": "scheduler_job_id",
"value": "openscreen/chromium_linux_x64"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[18:09:04.376] Scheduled build:
{
"id": "8697931710460427873",
"builder": {
"project": "openscreen",
"bucket": "ci",
"builder": "chromium_linux_x64"
},
"createdBy": "project:openscreen",
"createTime": "2025-11-17T18:09:04.086307003Z",
"updateTime": "2025-11-17T18:09:04.086307003Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "82762459a2cd5b83aac9b6088d141e0eb37c8bac",
"ref": "refs/heads/main"
}
}
}
[18:09:04.376] Task URL: https://cr-buildbucket.appspot.com/build/8697931710460427873
[18:09:04.376] Scheduling timer "check-buildbucket-build-status" (openscreen/chromium_linux_x64:8863361772348683152:2:0) after 1m49s
[18:09:05.360] Received PubSub notification, asking Buildbucket for the build status
[18:09:05.498] Build status: SCHEDULED
[18:09:09.019] Received PubSub notification, asking Buildbucket for the build status
[18:09:09.061] Build status: STARTED
[18:10:53.427] Handling timer "check-buildbucket-build-status" (openscreen/chromium_linux_x64:8863361772348683152:2:0)
[18:10:53.446] Build status: STARTED
[18:10:53.446] Scheduling timer "check-buildbucket-build-status" (openscreen/chromium_linux_x64:8863361772348683152:5:0) after 9m37s
[18:20:30.507] Handling timer "check-buildbucket-build-status" (openscreen/chromium_linux_x64:8863361772348683152:5:0)
[18:20:30.529] Build status: STARTED
[18:20:30.529] Scheduling timer "check-buildbucket-build-status" (openscreen/chromium_linux_x64:8863361772348683152:6:0) after 3m29s
[18:23:59.543] Handling timer "check-buildbucket-build-status" (openscreen/chromium_linux_x64:8863361772348683152:6:0)
[18:23:59.571] Build status: STARTED
[18:23:59.571] Scheduling timer "check-buildbucket-build-status" (openscreen/chromium_linux_x64:8863361772348683152:7:0) after 5m39s
[18:29:38.588] Handling timer "check-buildbucket-build-status" (openscreen/chromium_linux_x64:8863361772348683152:7:0)
[18:29:38.642] Build status: STARTED
[18:29:38.642] Scheduling timer "check-buildbucket-build-status" (openscreen/chromium_linux_x64:8863361772348683152:8:0) after 2m43s
[18:32:21.642] Handling timer "check-buildbucket-build-status" (openscreen/chromium_linux_x64:8863361772348683152:8:0)
[18:32:21.675] Build status: STARTED
[18:32:21.675] Scheduling timer "check-buildbucket-build-status" (openscreen/chromium_linux_x64:8863361772348683152:9:0) after 1m0s
[18:32:26.192] Received PubSub notification, asking Buildbucket for the build status
[18:32:26.229] Build:
{
"id": "8697931710460427873",
"builder": {
"project": "openscreen",
"bucket": "ci",
"builder": "chromium_linux_x64"
},
"createdBy": "project:openscreen",
"createTime": "2025-11-17T18:09:04.086307003Z",
"startTime": "2025-11-17T18:09:08.595334797Z",
"endTime": "2025-11-17T18:32:25.983464224Z",
"updateTime": "2025-11-17T18:32:25.983464224Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "82762459a2cd5b83aac9b6088d141e0eb37c8bac",
"ref": "refs/heads/main"
}
}
}
[18:32:26.229] Invocation finished in 23m23.327330666s with status SUCCEEDED