[15:59:04.196] New invocation is queued and will start shortly
[15:59:05.372] Starting the invocation (attempt 1)
[15:59:05.399] Popped buildset tag "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/1e148d11b30c7f8a940462df464bbf6f27e9e799"
[15:59:05.399] Popped gitiles commit info from properties and tags
[15:59:05.399] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[15:59:05.399] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[15:59:05.400] Buildbucket request:
{
"requestId": "8868443380014469968",
"builder": {
"project": "openscreen",
"bucket": "ci",
"builder": "chromium_win_x64"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8868443380014469968",
"job": "openscreen/chromium_win_x64",
"triggers": [
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "a596a5c2bd350d06fe32ac686c44e26fdc47aad2"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/heads/main@a596a5c2bd350d06fe32ac686c44e26fdc47aad2",
"title": "a596a5c2bd350d06fe32ac686c44e26fdc47aad2",
"url": "https://chromium.googlesource.com/chromium/src/+/a596a5c2bd350d06fe32ac686c44e26fdc47aad2"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "442bb5e7ce35506fb06191c1e3fea4dfe818eaaf"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/heads/main@442bb5e7ce35506fb06191c1e3fea4dfe818eaaf",
"title": "442bb5e7ce35506fb06191c1e3fea4dfe818eaaf",
"url": "https://chromium.googlesource.com/chromium/src/+/442bb5e7ce35506fb06191c1e3fea4dfe818eaaf"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "8fa1a63b2f9e75029e5797040e3d7dffbc480f3c"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/heads/main@8fa1a63b2f9e75029e5797040e3d7dffbc480f3c",
"title": "8fa1a63b2f9e75029e5797040e3d7dffbc480f3c",
"url": "https://chromium.googlesource.com/chromium/src/+/8fa1a63b2f9e75029e5797040e3d7dffbc480f3c"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "e7c56d0551e78b8c70d4dbd97f96d7cd23c68b0b"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/heads/main@e7c56d0551e78b8c70d4dbd97f96d7cd23c68b0b",
"title": "e7c56d0551e78b8c70d4dbd97f96d7cd23c68b0b",
"url": "https://chromium.googlesource.com/chromium/src/+/e7c56d0551e78b8c70d4dbd97f96d7cd23c68b0b"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "aafe6988605f0348abc91e7c5ea985ea365032cd"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/heads/main@aafe6988605f0348abc91e7c5ea985ea365032cd",
"title": "aafe6988605f0348abc91e7c5ea985ea365032cd",
"url": "https://chromium.googlesource.com/chromium/src/+/aafe6988605f0348abc91e7c5ea985ea365032cd"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "06085254284f856d3fb62dcf324210f1d262ec95"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/heads/main@06085254284f856d3fb62dcf324210f1d262ec95",
"title": "06085254284f856d3fb62dcf324210f1d262ec95",
"url": "https://chromium.googlesource.com/chromium/src/+/06085254284f856d3fb62dcf324210f1d262ec95"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "d63631b7752d182c2a22b5851319e922b725f859"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/heads/main@d63631b7752d182c2a22b5851319e922b725f859",
"title": "d63631b7752d182c2a22b5851319e922b725f859",
"url": "https://chromium.googlesource.com/chromium/src/+/d63631b7752d182c2a22b5851319e922b725f859"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "01fed1a3aa0a5e9bce3653e616f761f4ee21f8c7"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/heads/main@01fed1a3aa0a5e9bce3653e616f761f4ee21f8c7",
"title": "01fed1a3aa0a5e9bce3653e616f761f4ee21f8c7",
"url": "https://chromium.googlesource.com/chromium/src/+/01fed1a3aa0a5e9bce3653e616f761f4ee21f8c7"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "14775f0245876b6326e84fb8e61d093f50d3493b"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/heads/main@14775f0245876b6326e84fb8e61d093f50d3493b",
"title": "14775f0245876b6326e84fb8e61d093f50d3493b",
"url": "https://chromium.googlesource.com/chromium/src/+/14775f0245876b6326e84fb8e61d093f50d3493b"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "b2a36ca2c6860a4dd08b9291080e71fa6e2c7feb"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/heads/main@b2a36ca2c6860a4dd08b9291080e71fa6e2c7feb",
"title": "b2a36ca2c6860a4dd08b9291080e71fa6e2c7feb",
"url": "https://chromium.googlesource.com/chromium/src/+/b2a36ca2c6860a4dd08b9291080e71fa6e2c7feb"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "be985e288c00a5b06263c7b7232ea47509324842"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/heads/main@be985e288c00a5b06263c7b7232ea47509324842",
"title": "be985e288c00a5b06263c7b7232ea47509324842",
"url": "https://chromium.googlesource.com/chromium/src/+/be985e288c00a5b06263c7b7232ea47509324842"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "43505b487f0c4275055f32d6096bcfdc97d43dd0"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/heads/main@43505b487f0c4275055f32d6096bcfdc97d43dd0",
"title": "43505b487f0c4275055f32d6096bcfdc97d43dd0",
"url": "https://chromium.googlesource.com/chromium/src/+/43505b487f0c4275055f32d6096bcfdc97d43dd0"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "1e148d11b30c7f8a940462df464bbf6f27e9e799"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/heads/main@1e148d11b30c7f8a940462df464bbf6f27e9e799",
"title": "1e148d11b30c7f8a940462df464bbf6f27e9e799",
"url": "https://chromium.googlesource.com/chromium/src/+/1e148d11b30c7f8a940462df464bbf6f27e9e799"
}
]
}
},
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "1e148d11b30c7f8a940462df464bbf6f27e9e799",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8868443380014469968"
},
{
"key": "scheduler_job_id",
"value": "openscreen/chromium_win_x64"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[15:59:05.835] Scheduled build:
{
"id": "8703013318035287553",
"builder": {
"project": "openscreen",
"bucket": "ci",
"builder": "chromium_win_x64"
},
"createdBy": "project:openscreen",
"createTime": "2025-09-22T15:59:05.456018449Z",
"updateTime": "2025-09-22T15:59:05.456018449Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "1e148d11b30c7f8a940462df464bbf6f27e9e799",
"ref": "refs/heads/main"
}
}
}
[15:59:05.835] Task URL: https://cr-buildbucket.appspot.com/build/8703013318035287553
[15:59:05.835] Scheduling timer "check-buildbucket-build-status" (openscreen/chromium_win_x64:8868443380014469968:2:0) after 2m8s
[15:59:06.855] Received PubSub notification, asking Buildbucket for the build status
[15:59:06.884] Build status: SCHEDULED
[16:01:13.857] Handling timer "check-buildbucket-build-status" (openscreen/chromium_win_x64:8868443380014469968:2:0)
[16:01:13.890] Build status: SCHEDULED
[16:01:13.890] Scheduling timer "check-buildbucket-build-status" (openscreen/chromium_win_x64:8868443380014469968:4:0) after 8m32s
[16:03:14.115] Received PubSub notification, asking Buildbucket for the build status
[16:03:14.163] Build status: STARTED
[16:09:46.175] Handling timer "check-buildbucket-build-status" (openscreen/chromium_win_x64:8868443380014469968:4:0)
[16:09:46.200] Build status: STARTED
[16:09:46.200] Scheduling timer "check-buildbucket-build-status" (openscreen/chromium_win_x64:8868443380014469968:6:0) after 9m40s
[16:19:26.283] Handling timer "check-buildbucket-build-status" (openscreen/chromium_win_x64:8868443380014469968:6:0)
[16:19:26.309] Build status: STARTED
[16:19:26.309] Scheduling timer "check-buildbucket-build-status" (openscreen/chromium_win_x64:8868443380014469968:7:0) after 2m47s
[16:22:13.360] Handling timer "check-buildbucket-build-status" (openscreen/chromium_win_x64:8868443380014469968:7:0)
[16:22:13.393] Build status: STARTED
[16:22:13.393] Scheduling timer "check-buildbucket-build-status" (openscreen/chromium_win_x64:8868443380014469968:8:0) after 3m28s
[16:25:41.554] Handling timer "check-buildbucket-build-status" (openscreen/chromium_win_x64:8868443380014469968:8:0)
[16:25:41.786] Build status: STARTED
[16:25:41.786] Scheduling timer "check-buildbucket-build-status" (openscreen/chromium_win_x64:8868443380014469968:9:0) after 8m25s
[16:34:06.813] Handling timer "check-buildbucket-build-status" (openscreen/chromium_win_x64:8868443380014469968:9:0)
[16:34:06.865] Build status: STARTED
[16:34:06.865] Scheduling timer "check-buildbucket-build-status" (openscreen/chromium_win_x64:8868443380014469968:10:0) after 1m15s
[16:35:21.902] Handling timer "check-buildbucket-build-status" (openscreen/chromium_win_x64:8868443380014469968:10:0)
[16:35:21.950] Build status: STARTED
[16:35:21.950] Scheduling timer "check-buildbucket-build-status" (openscreen/chromium_win_x64:8868443380014469968:11:0) after 1m15s
[16:36:36.967] Handling timer "check-buildbucket-build-status" (openscreen/chromium_win_x64:8868443380014469968:11:0)
[16:36:37.396] Build status: STARTED
[16:36:37.396] Scheduling timer "check-buildbucket-build-status" (openscreen/chromium_win_x64:8868443380014469968:12:0) after 8m14s
[16:44:51.454] Handling timer "check-buildbucket-build-status" (openscreen/chromium_win_x64:8868443380014469968:12:0)
[16:44:51.481] Build status: STARTED
[16:44:51.482] Scheduling timer "check-buildbucket-build-status" (openscreen/chromium_win_x64:8868443380014469968:13:0) after 1m8s
[16:45:59.465] Handling timer "check-buildbucket-build-status" (openscreen/chromium_win_x64:8868443380014469968:13:0)
[16:45:59.546] Build status: STARTED
[16:45:59.546] Scheduling timer "check-buildbucket-build-status" (openscreen/chromium_win_x64:8868443380014469968:14:0) after 4m6s
[16:50:05.842] Handling timer "check-buildbucket-build-status" (openscreen/chromium_win_x64:8868443380014469968:14:0)
[16:50:05.865] Build status: STARTED
[16:50:05.865] Scheduling timer "check-buildbucket-build-status" (openscreen/chromium_win_x64:8868443380014469968:15:0) after 3m3s
[16:51:59.625] Received PubSub notification, asking Buildbucket for the build status
[16:51:59.653] Build:
{
"id": "8703013318035287553",
"builder": {
"project": "openscreen",
"bucket": "ci",
"builder": "chromium_win_x64"
},
"createdBy": "project:openscreen",
"createTime": "2025-09-22T15:59:05.456018449Z",
"startTime": "2025-09-22T16:03:13.884446461Z",
"endTime": "2025-09-22T16:51:59.431917222Z",
"updateTime": "2025-09-22T16:51:59.431917222Z",
"status": "FAILURE",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "1e148d11b30c7f8a940462df464bbf6f27e9e799",
"ref": "refs/heads/main"
}
}
}
[16:51:59.653] Invocation finished in 52m55.468456127s with status FAILED