[02:42:35.520] New invocation is queued and will start shortly
[02:42:36.625] Starting the invocation (attempt 1)
[02:42:36.655] Popped buildset tag "buildset:commit/gitiles/fuchsia.googlesource.com/integration/+/e0164ff17b7ccdb69352a3b8cca7da19936fbc51"
[02:42:36.655] Popped gitiles commit info from properties and tags
[02:42:36.655] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[02:42:36.655] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[02:42:36.656] Buildbucket request:
{
"requestId": "8921402118453247728",
"builder": {
"project": "fuchsia",
"bucket": "global.ci",
"builder": "firebase-docs"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8921402118453247728",
"job": "fuchsia/firebase-docs-e5a0ec7f",
"triggers": [
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "3c27a3c1d67ef3b69030bc90157e46691dbc7cce"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@3c27a3c1d67ef3b69030bc90157e46691dbc7cce",
"title": "3c27a3c1d67ef3b69030bc90157e46691dbc7cce",
"url": "https://fuchsia.googlesource.com/integration/+/3c27a3c1d67ef3b69030bc90157e46691dbc7cce"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "289d193491b554446423fa1accc24a71074294ff"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@289d193491b554446423fa1accc24a71074294ff",
"title": "289d193491b554446423fa1accc24a71074294ff",
"url": "https://fuchsia.googlesource.com/integration/+/289d193491b554446423fa1accc24a71074294ff"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "69098132cbfb6dba9502b090007145585bcbd9c0"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@69098132cbfb6dba9502b090007145585bcbd9c0",
"title": "69098132cbfb6dba9502b090007145585bcbd9c0",
"url": "https://fuchsia.googlesource.com/integration/+/69098132cbfb6dba9502b090007145585bcbd9c0"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "c5359a1f2a9b88d69913dbab89ed1b3d356ef64b"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@c5359a1f2a9b88d69913dbab89ed1b3d356ef64b",
"title": "c5359a1f2a9b88d69913dbab89ed1b3d356ef64b",
"url": "https://fuchsia.googlesource.com/integration/+/c5359a1f2a9b88d69913dbab89ed1b3d356ef64b"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "8edb6c4bc15cedf2ba44d2a25e54ca486199041d"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@8edb6c4bc15cedf2ba44d2a25e54ca486199041d",
"title": "8edb6c4bc15cedf2ba44d2a25e54ca486199041d",
"url": "https://fuchsia.googlesource.com/integration/+/8edb6c4bc15cedf2ba44d2a25e54ca486199041d"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "c7d4b92607b27179d58ac71197e6df343ac72bad"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@c7d4b92607b27179d58ac71197e6df343ac72bad",
"title": "c7d4b92607b27179d58ac71197e6df343ac72bad",
"url": "https://fuchsia.googlesource.com/integration/+/c7d4b92607b27179d58ac71197e6df343ac72bad"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "71bbab8d15f8d3a8f07b69d03cf69539346f0dc5"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@71bbab8d15f8d3a8f07b69d03cf69539346f0dc5",
"title": "71bbab8d15f8d3a8f07b69d03cf69539346f0dc5",
"url": "https://fuchsia.googlesource.com/integration/+/71bbab8d15f8d3a8f07b69d03cf69539346f0dc5"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "8198ae524a46aa9ccdb1a2c3a7aa05323dc65588"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@8198ae524a46aa9ccdb1a2c3a7aa05323dc65588",
"title": "8198ae524a46aa9ccdb1a2c3a7aa05323dc65588",
"url": "https://fuchsia.googlesource.com/integration/+/8198ae524a46aa9ccdb1a2c3a7aa05323dc65588"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "9003c7cfa11f38b2c3ea011e9a4537150d1822fc"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@9003c7cfa11f38b2c3ea011e9a4537150d1822fc",
"title": "9003c7cfa11f38b2c3ea011e9a4537150d1822fc",
"url": "https://fuchsia.googlesource.com/integration/+/9003c7cfa11f38b2c3ea011e9a4537150d1822fc"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "cfd1e54a2f2222724e3c35ca9db34229583cd264"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@cfd1e54a2f2222724e3c35ca9db34229583cd264",
"title": "cfd1e54a2f2222724e3c35ca9db34229583cd264",
"url": "https://fuchsia.googlesource.com/integration/+/cfd1e54a2f2222724e3c35ca9db34229583cd264"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "d8955d963ed888718f3e0e87dd4d4799d2cd3ee7"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@d8955d963ed888718f3e0e87dd4d4799d2cd3ee7",
"title": "d8955d963ed888718f3e0e87dd4d4799d2cd3ee7",
"url": "https://fuchsia.googlesource.com/integration/+/d8955d963ed888718f3e0e87dd4d4799d2cd3ee7"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "4b4bd60e52c2c2440c954c6d0e70fd3c17265601"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@4b4bd60e52c2c2440c954c6d0e70fd3c17265601",
"title": "4b4bd60e52c2c2440c954c6d0e70fd3c17265601",
"url": "https://fuchsia.googlesource.com/integration/+/4b4bd60e52c2c2440c954c6d0e70fd3c17265601"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "669abcf1b6684b9d5f9f66f1399191733d6268d6"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@669abcf1b6684b9d5f9f66f1399191733d6268d6",
"title": "669abcf1b6684b9d5f9f66f1399191733d6268d6",
"url": "https://fuchsia.googlesource.com/integration/+/669abcf1b6684b9d5f9f66f1399191733d6268d6"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "e0164ff17b7ccdb69352a3b8cca7da19936fbc51"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@e0164ff17b7ccdb69352a3b8cca7da19936fbc51",
"title": "e0164ff17b7ccdb69352a3b8cca7da19936fbc51",
"url": "https://fuchsia.googlesource.com/integration/+/e0164ff17b7ccdb69352a3b8cca7da19936fbc51"
}
]
}
},
"gitilesCommit": {
"host": "fuchsia.googlesource.com",
"project": "integration",
"id": "e0164ff17b7ccdb69352a3b8cca7da19936fbc51",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8921402118453247728"
},
{
"key": "scheduler_job_id",
"value": "fuchsia/firebase-docs-e5a0ec7f"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[02:42:37.041] Scheduled build:
{
"id": "8755972056538657297",
"builder": {
"project": "fuchsia",
"bucket": "global.ci",
"builder": "firebase-docs"
},
"createdBy": "project:fuchsia",
"createTime": "2024-02-16T02:42:36.716947557Z",
"updateTime": "2024-02-16T02:42:36.716947557Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "fuchsia.googlesource.com",
"project": "integration",
"id": "e0164ff17b7ccdb69352a3b8cca7da19936fbc51",
"ref": "refs/heads/main"
}
}
}
[02:42:37.041] Task URL: https://cr-buildbucket.appspot.com/build/8755972056538657297
[02:42:37.041] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:2:0) after 9m19s
[02:42:37.131] Received PubSub notification, asking Buildbucket for the build status
[02:42:37.153] Build status: SCHEDULED
[02:42:37.952] Received PubSub notification, asking Buildbucket for the build status
[02:42:37.986] Build status: STARTED
[02:51:56.229] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:2:0)
[02:51:56.257] Build status: STARTED
[02:51:56.257] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:5:0) after 2m40s
[02:54:36.276] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:5:0)
[02:54:36.295] Build status: STARTED
[02:54:36.296] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:6:0) after 6m16s
[03:00:52.335] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:6:0)
[03:00:52.354] Build status: STARTED
[03:00:52.354] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:7:0) after 2m2s
[03:02:54.394] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:7:0)
[03:02:54.419] Build status: STARTED
[03:02:54.419] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:8:0) after 6m32s
[03:09:26.536] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:8:0)
[03:09:26.563] Build status: STARTED
[03:09:26.563] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:9:0) after 9m17s
[03:18:43.800] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:9:0)
[03:18:43.833] Build status: STARTED
[03:18:43.833] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:10:0) after 1m46s
[03:20:29.976] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:10:0)
[03:20:29.993] Build status: STARTED
[03:20:29.993] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:11:0) after 5m5s
[03:25:35.022] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:11:0)
[03:25:35.046] Build status: STARTED
[03:25:35.046] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:12:0) after 8m12s
[03:33:47.108] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:12:0)
[03:33:47.130] Build status: STARTED
[03:33:47.130] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:13:0) after 4m50s
[03:38:37.419] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:13:0)
[03:38:37.445] Build status: STARTED
[03:38:37.445] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:14:0) after 8m44s
[03:47:21.791] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:14:0)
[03:47:21.810] Build status: STARTED
[03:47:21.810] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:15:0) after 5m2s
[03:52:23.827] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:15:0)
[03:52:23.844] Build status: STARTED
[03:52:23.844] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:16:0) after 8m9s
[04:00:32.933] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:16:0)
[04:00:32.951] Build status: STARTED
[04:00:32.951] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:17:0) after 6m36s
[04:07:09.473] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:17:0)
[04:07:09.599] Build status: STARTED
[04:07:09.599] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:18:0) after 4m6s
[04:11:15.621] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:18:0)
[04:11:15.644] Build status: STARTED
[04:11:15.644] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:19:0) after 2m15s
[04:13:30.738] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:19:0)
[04:13:30.766] Build status: STARTED
[04:13:30.766] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:20:0) after 8m3s
[04:21:34.095] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:20:0)
[04:21:34.116] Build status: STARTED
[04:21:34.116] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:21:0) after 7m36s
[04:29:10.134] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:21:0)
[04:29:10.152] Build status: STARTED
[04:29:10.152] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:22:0) after 5m35s
[04:34:45.159] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:22:0)
[04:34:45.180] Build status: STARTED
[04:34:45.180] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:23:0) after 3m19s
[04:38:04.525] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:23:0)
[04:38:04.544] Build status: STARTED
[04:38:04.544] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:24:0) after 2m13s
[04:40:17.562] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:24:0)
[04:40:17.578] Build status: STARTED
[04:40:17.578] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:25:0) after 8m59s
[04:49:16.680] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:25:0)
[04:49:16.700] Build status: STARTED
[04:49:16.700] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8921402118453247728:26:0) after 1m19s
[04:49:53.577] Received PubSub notification, asking Buildbucket for the build status
[04:49:53.642] Build:
{
"id": "8755972056538657297",
"builder": {
"project": "fuchsia",
"bucket": "global.ci",
"builder": "firebase-docs"
},
"createdBy": "project:fuchsia",
"createTime": "2024-02-16T02:42:36.716947557Z",
"startTime": "2024-02-16T02:42:37.442386Z",
"endTime": "2024-02-16T04:49:52.095095Z",
"updateTime": "2024-02-16T04:49:52.095095Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "fuchsia.googlesource.com",
"project": "integration",
"id": "e0164ff17b7ccdb69352a3b8cca7da19936fbc51",
"ref": "refs/heads/main"
}
}
}
[04:49:53.642] Invocation finished in 2h7m18.136156929s with status SUCCEEDED