these 12 derivations will be built: /nix/store/vlmrpqfgpvz3jnhl7r08hdab5x8xqggn-processed-postgresql-config-15.drv /nix/store/l517d6r0m4z5i76v6clbiap8p97p9lbd-postgresql-init.drv /nix/store/kj0hv1a1i8bc6xs60sv235grjs8mzgd4-unit-postgresql.service.drv /nix/store/5r0frhfsihidsnriyffp17d751p7lpw1-system-units.drv /nix/store/axgjaih754gjjn2qjvw69h378jd1gnnk-etc.drv /nix/store/xqklj46s6nagiwy8vb4n7vgp4bn60vfv-activate.drv /nix/store/1mybcksx54mrlw6clx9554yndp7c59js-nixos-system-server-test.drv /nix/store/x5cbgswbz8ssciaa8ag7ay31b4j09f03-closure-info.drv /nix/store/1vs31hj3qklydviy2p1390z48nkryamk-run-nixos-vm.drv /nix/store/zwnvclq86gc7v0yg249x9xfnx789khqi-nixos-vm.drv /nix/store/f3d49w8q70w9780nldq28z7pki6nmj5b-nixos-test-driver-timescaledb.drv /nix/store/4c1l688a563h0zc4xrd86vfqfg6m4a7y-vm-test-run-timescaledb.drv building '/nix/store/f3d49w8q70w9780nldq28z7pki6nmj5b-nixos-test-driver-timescaledb.drv' on 'ssh-ng://nixbot-remote-build@78.232.36.247' building '/nix/store/f3d49w8q70w9780nldq28z7pki6nmj5b-nixos-test-driver-timescaledb.drv' nixos-test-driver-timescaledb> Running type check (enable/disable: config.skipTypeCheck) nixos-test-driver-timescaledb> See https://nixos.org/manual/nixos/stable/#test-opt-skipTypeCheck nixos-test-driver-timescaledb> Success: no issues found in 1 source file nixos-test-driver-timescaledb> additionally exposed symbols: nixos-test-driver-timescaledb> , nixos-test-driver-timescaledb> , nixos-test-driver-timescaledb> start_all, test_script, machines, vlans, driver, log, os, create_machine, subtest, run_tests, join_all, retry, serial_stdout_off, serial_stdout_on, polling_condition, Machine, t, debug nixos-test-driver-timescaledb> Linting test script (enable/disable: config.skipLint) nixos-test-driver-timescaledb> See https://nixos.org/manual/nixos/stable/#test-opt-skipLint building '/nix/store/4c1l688a563h0zc4xrd86vfqfg6m4a7y-vm-test-run-timescaledb.drv' on 'ssh-ng://builder@mac-linux-builder' building '/nix/store/4c1l688a563h0zc4xrd86vfqfg6m4a7y-vm-test-run-timescaledb.drv' vm-test-run-timescaledb> Machine state will be reset. To keep it, pass --keep-vm-state vm-test-run-timescaledb> start all VLans vm-test-run-timescaledb> start vlan vm-test-run-timescaledb> running vlan (pid 7; ctl /build/vde1.ctl) vm-test-run-timescaledb> (finished: start all VLans, in 0.00 seconds) vm-test-run-timescaledb> Test will time out and terminate in 3600 seconds vm-test-run-timescaledb> run the VM test script vm-test-run-timescaledb> additionally exposed symbols: vm-test-run-timescaledb> server, vm-test-run-timescaledb> vlan1, vm-test-run-timescaledb> start_all, test_script, machines, vlans, driver, log, os, create_machine, subtest, run_tests, join_all, retry, serial_stdout_off, serial_stdout_on, polling_condition, Machine, t, debug vm-test-run-timescaledb> start all VMs vm-test-run-timescaledb> server: starting vm vm-test-run-timescaledb> mke2fs 1.47.3 (8-Jul-2025) vm-test-run-timescaledb> qemu-system-aarch64: Could not access KVM kernel module: No such file or directory vm-test-run-timescaledb> qemu-system-aarch64: failed to initialize kvm: No such file or directory vm-test-run-timescaledb> qemu-system-aarch64: falling back to tcg vm-test-run-timescaledb> server # Disk image does not exist, creating the virtualisation disk image... vm-test-run-timescaledb> server # Formatting '/build/vm-state-server/tmp.eGexNUg40F', fmt=raw size=1073741824 vm-test-run-timescaledb> server # Discarding device blocks: 0/262144 done vm-test-run-timescaledb> server # Creating filesystem with 262144 4k blocks and 65536 inodes vm-test-run-timescaledb> server # Filesystem UUID: d30b13ff-3692-45e9-a350-37583c1d47fb vm-test-run-timescaledb> server # Superblock backups stored on blocks: vm-test-run-timescaledb> server # 32768, 98304, 163840, 229376 vm-test-run-timescaledb> server # vm-test-run-timescaledb> server # Allocating group tables: 0/8 done vm-test-run-timescaledb> server # Writing inode tables: 0/8 done vm-test-run-timescaledb> server # Creating journal (8192 blocks): done vm-test-run-timescaledb> server # Writing superblocks and filesystem accounting information: 0/8 done vm-test-run-timescaledb> server # vm-test-run-timescaledb> server: QEMU running (pid 9) vm-test-run-timescaledb> server # Virtualisation disk image created. vm-test-run-timescaledb> (finished: start all VMs, in 0.12 seconds) vm-test-run-timescaledb> server: waiting for unit supabase-db-init.service vm-test-run-timescaledb> server: waiting for the VM to finish booting vm-test-run-timescaledb> server # [ 0.000000] Booting Linux on physical CPU 0x0000000000 [0x000f0510] vm-test-run-timescaledb> server # [ 0.000000] Linux version 6.12.63 (nixbld@localhost) (gcc (GCC) 15.2.0, GNU ld (GNU Binutils) 2.44) #1-NixOS SMP Thu Dec 18 12:55:23 UTC 2025 vm-test-run-timescaledb> server # [ 0.000000] KASLR enabled vm-test-run-timescaledb> server # [ 0.000000] random: crng init done vm-test-run-timescaledb> server # [ 0.000000] Machine model: linux,dummy-virt vm-test-run-timescaledb> server # [ 0.000000] efi: UEFI not found. vm-test-run-timescaledb> server # [ 0.000000] OF: reserved mem: Reserved memory: No reserved-memory node in the DT vm-test-run-timescaledb> server # [ 0.000000] NUMA: Faking a node at [mem 0x0000000040000000-0x000000013fffffff] vm-test-run-timescaledb> server # [ 0.000000] NODE_DATA(0) allocated [mem 0x13f602200-0x13f60593f] vm-test-run-timescaledb> server # [ 0.000000] Zone ranges: vm-test-run-timescaledb> server # [ 0.000000] DMA [mem 0x0000000040000000-0x00000000ffffffff] vm-test-run-timescaledb> server # [ 0.000000] DMA32 empty vm-test-run-timescaledb> server # [ 0.000000] Normal [mem 0x0000000100000000-0x000000013fffffff] vm-test-run-timescaledb> server # [ 0.000000] Device empty vm-test-run-timescaledb> server # [ 0.000000] Movable zone start for each node vm-test-run-timescaledb> server # [ 0.000000] Early memory node ranges vm-test-run-timescaledb> server # [ 0.000000] node 0: [mem 0x0000000040000000-0x000000013fffffff] vm-test-run-timescaledb> server # [ 0.000000] Initmem setup node 0 [mem 0x0000000040000000-0x000000013fffffff] vm-test-run-timescaledb> server # [ 0.000000] cma: Reserved 32 MiB at 0x00000000fe000000 on node -1 vm-test-run-timescaledb> server # [ 0.000000] psci: probing for conduit method from DT. vm-test-run-timescaledb> server # [ 0.000000] psci: PSCIv1.1 detected in firmware. vm-test-run-timescaledb> server # [ 0.000000] psci: Using standard PSCI v0.2 function IDs vm-test-run-timescaledb> server # [ 0.000000] psci: Trusted OS migration not required vm-test-run-timescaledb> server # [ 0.000000] psci: SMC Calling Convention v1.0 vm-test-run-timescaledb> server # [ 0.000000] percpu: Embedded 88 pages/cpu s180056 r65536 d114856 u360448 vm-test-run-timescaledb> server # [ 0.000000] Detected PIPT I-cache on CPU0 vm-test-run-timescaledb> server # [ 0.000000] CPU features: detected: Address authentication (IMP DEF algorithm) vm-test-run-timescaledb> server # [ 0.000000] CPU features: detected: GIC system register CPU interface vm-test-run-timescaledb> server # [ 0.000000] CPU features: detected: HCRX_EL2 register vm-test-run-timescaledb> server # [ 0.000000] CPU features: detected: 52-bit Virtual Addressing (LPA2) vm-test-run-timescaledb> server # [ 0.000000] CPU features: detected: Spectre-v4 vm-test-run-timescaledb> server # [ 0.000000] alternatives: applying boot alternatives vm-test-run-timescaledb> server # [ 0.000000] Kernel command line: console=ttyAMA0 console=tty0 panic=1 boot.panic_on_fail clocksource=acpi_pm loglevel=7 net.ifnames=0 lsm=landlock,yama,bpf init=/nix/store/xccjb0p6frzqczkin80yq741hjvpsb6s-nixos-system-server-test/init regInfo=/nix/store/vwg6j0flb8pbxkb8gckzsrj42lp578kw-closure-info/registration console=ttyAMA0,115200n8 console=tty0 vm-test-run-timescaledb> server # [ 0.000000] Unknown kernel command line parameters "regInfo=/nix/store/vwg6j0flb8pbxkb8gckzsrj42lp578kw-closure-info/registration", will be passed to user space. vm-test-run-timescaledb> server # [ 0.000000] Dentry cache hash table entries: 524288 (order: 10, 4194304 bytes, linear) vm-test-run-timescaledb> server # [ 0.000000] Inode-cache hash table entries: 262144 (order: 9, 2097152 bytes, linear) vm-test-run-timescaledb> server # [ 0.000000] Fallback order for Node 0: 0 vm-test-run-timescaledb> server # [ 0.000000] Built 1 zonelists, mobility grouping on. Total pages: 1048576 vm-test-run-timescaledb> server # [ 0.000000] Policy zone: Normal vm-test-run-timescaledb> server # [ 0.000000] mem auto-init: stack:all(zero), heap alloc:on, heap free:off vm-test-run-timescaledb> server # [ 0.000000] software IO TLB: area num 2. vm-test-run-timescaledb> server # [ 0.000000] software IO TLB: mapped [mem 0x00000000fa000000-0x00000000fe000000] (64MB) vm-test-run-timescaledb> server # [ 0.000000] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=2, Nodes=1 vm-test-run-timescaledb> server # [ 0.000000] allocated 8388608 bytes of page_ext vm-test-run-timescaledb> server # [ 0.000000] ftrace: allocating 72257 entries in 283 pages vm-test-run-timescaledb> server # [ 0.000000] ftrace: allocated 283 pages with 5 groups vm-test-run-timescaledb> server # [ 0.000000] rcu: Hierarchical RCU implementation. vm-test-run-timescaledb> server # [ 0.000000] rcu: RCU event tracing is enabled. vm-test-run-timescaledb> server # [ 0.000000] rcu: RCU restricting CPUs from NR_CPUS=384 to nr_cpu_ids=2. vm-test-run-timescaledb> server # [ 0.000000] Rude variant of Tasks RCU enabled. vm-test-run-timescaledb> server # [ 0.000000] Tracing variant of Tasks RCU enabled. vm-test-run-timescaledb> server # [ 0.000000] rcu: RCU calculated value of scheduler-enlistment delay is 25 jiffies. vm-test-run-timescaledb> server # [ 0.000000] rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=2 vm-test-run-timescaledb> server # [ 0.000000] RCU Tasks Rude: Setting shift to 1 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=2. vm-test-run-timescaledb> server # [ 0.000000] RCU Tasks Trace: Setting shift to 1 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=2. vm-test-run-timescaledb> server # [ 0.000000] NR_IRQS: 64, nr_irqs: 64, preallocated irqs: 0 vm-test-run-timescaledb> server # [ 0.000000] GICv3: 256 SPIs implemented vm-test-run-timescaledb> server # [ 0.000000] GICv3: 0 Extended SPIs implemented vm-test-run-timescaledb> server # [ 0.000000] Root IRQ handler: gic_handle_irq vm-test-run-timescaledb> server # [ 0.000000] GICv3: GICv3 features: 16 PPIs vm-test-run-timescaledb> server # [ 0.000000] GICv3: GICD_CTRL.DS=1, SCR_EL3.FIQ=0 vm-test-run-timescaledb> server # [ 0.000000] GICv3: CPU0: found redistributor 0 region 0:0x00000000080a0000 vm-test-run-timescaledb> server # [ 0.000000] ITS [mem 0x08080000-0x0809ffff] vm-test-run-timescaledb> server # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Devices @100ae0000 (indirect, esz 8, psz 64K, shr 1) vm-test-run-timescaledb> server # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Interrupt Collections @100af0000 (flat, esz 8, psz 64K, shr 1) vm-test-run-timescaledb> server # [ 0.000000] GICv3: using LPI property table @0x0000000100b00000 vm-test-run-timescaledb> server # [ 0.000000] GICv3: CPU0: using allocated LPI pending table @0x0000000100b10000 vm-test-run-timescaledb> server # [ 0.000000] rcu: srcu_init: Setting srcu_struct sizes based on contention. vm-test-run-timescaledb> server # [ 0.000000] arch_timer: cp15 timer(s) running at 1000.00MHz (virt). vm-test-run-timescaledb> server # [ 0.000000] clocksource: arch_sys_counter: mask: 0x1fffffffffffffff max_cycles: 0x1cd42e4dffb, max_idle_ns: 881590591483 ns vm-test-run-timescaledb> server # [ 0.000034] sched_clock: 61 bits at 1000MHz, resolution 1ns, wraps every 4398046511103ns vm-test-run-timescaledb> server # [ 0.002872] kfence: initialized - using 2097152 bytes for 255 objects at 0x(____ptrval____)-0x(____ptrval____) vm-test-run-timescaledb> server # [ 0.013156] Console: colour dummy device 80x25 vm-test-run-timescaledb> server # [ 0.015314] printk: legacy console [tty0] enabled vm-test-run-timescaledb> server # [ 0.020320] Calibrating delay loop (skipped), value calculated using timer frequency.. 2000.00 BogoMIPS (lpj=4000000) vm-test-run-timescaledb> server # [ 0.020790] pid_max: default: 32768 minimum: 301 vm-test-run-timescaledb> server # [ 0.022520] LSM: initializing lsm=capability,landlock,yama,bpf vm-test-run-timescaledb> server # [ 0.023578] landlock: Up and running. vm-test-run-timescaledb> server # [ 0.023618] Yama: becoming mindful. vm-test-run-timescaledb> server # [ 0.028549] LSM support for eBPF active vm-test-run-timescaledb> server # [ 0.031917] Mount-cache hash table entries: 8192 (order: 4, 65536 bytes, linear) vm-test-run-timescaledb> server # [ 0.032070] Mountpoint-cache hash table entries: 8192 (order: 4, 65536 bytes, linear) vm-test-run-timescaledb> server # [ 0.058626] cacheinfo: Unable to detect cache hierarchy for CPU 0 vm-test-run-timescaledb> server # [ 0.069268] rcu: Hierarchical SRCU implementation. vm-test-run-timescaledb> server # [ 0.069349] rcu: Max phase no-delay instances is 1000. vm-test-run-timescaledb> server # [ 0.070619] Timer migration: 1 hierarchy levels; 8 children per group; 1 crossnode level vm-test-run-timescaledb> server # [ 0.075584] fsl-mc MSI: its@8080000 domain created vm-test-run-timescaledb> server # [ 0.077172] EFI services will not be available. vm-test-run-timescaledb> server # [ 0.078428] smp: Bringing up secondary CPUs ... vm-test-run-timescaledb> server # [ 0.081720] Detected PIPT I-cache on CPU1 vm-test-run-timescaledb> server # [ 0.082729] GICv3: CPU1: found redistributor 1 region 0:0x00000000080c0000 vm-test-run-timescaledb> server # [ 0.083297] GICv3: CPU1: using allocated LPI pending table @0x0000000100b20000 vm-test-run-timescaledb> server # [ 0.084560] CPU1: Booted secondary processor 0x0000000001 [0x000f0510] vm-test-run-timescaledb> server # [ 0.087246] smp: Brought up 1 node, 2 CPUs vm-test-run-timescaledb> server # [ 0.087349] SMP: Total of 2 processors activated. vm-test-run-timescaledb> server # [ 0.087382] CPU: All CPU(s) started at EL1 vm-test-run-timescaledb> server # [ 0.087506] CPU features: detected: Branch Target Identification vm-test-run-timescaledb> server # [ 0.087569] CPU features: detected: 32-bit EL0 Support vm-test-run-timescaledb> server # [ 0.087593] CPU features: detected: 32-bit EL1 Support vm-test-run-timescaledb> server # [ 0.087613] CPU features: detected: ARMv8.4 Translation Table Level vm-test-run-timescaledb> server # [ 0.087643] CPU features: detected: Instruction cache invalidation not required for I/D coherence vm-test-run-timescaledb> server # [ 0.087674] CPU features: detected: Data cache clean to the PoU not required for I/D coherence vm-test-run-timescaledb> server # [ 0.087724] CPU features: detected: Common not Private translations vm-test-run-timescaledb> server # [ 0.087745] CPU features: detected: CRC32 instructions vm-test-run-timescaledb> server # [ 0.087762] CPU features: detected: Data cache clean to Point of Deep Persistence vm-test-run-timescaledb> server # [ 0.087785] CPU features: detected: Data cache clean to Point of Persistence vm-test-run-timescaledb> server # [ 0.087805] CPU features: detected: Data independent timing control (DIT) vm-test-run-timescaledb> server # [ 0.087825] CPU features: detected: E0PD vm-test-run-timescaledb> server # [ 0.087841] CPU features: detected: Enhanced Counter Virtualization vm-test-run-timescaledb> server # [ 0.087860] CPU features: detected: Enhanced Counter Virtualization (CNTPOFF) vm-test-run-timescaledb> server # [ 0.087881] CPU features: detected: Enhanced Privileged Access Never vm-test-run-timescaledb> server # [ 0.087900] CPU features: detected: Enhanced Virtualization Traps vm-test-run-timescaledb> server # [ 0.087920] CPU features: detected: Fine Grained Traps vm-test-run-timescaledb> server # [ 0.087964] CPU features: detected: Generic authentication (IMP DEF algorithm) vm-test-run-timescaledb> server # [ 0.088030] CPU features: detected: RCpc load-acquire (LDAPR) vm-test-run-timescaledb> server # [ 0.088067] CPU features: detected: 52-bit Virtual Addressing for KVM (LPA2) vm-test-run-timescaledb> server # [ 0.088088] CPU features: detected: LSE atomic instructions vm-test-run-timescaledb> server # [ 0.088106] CPU features: detected: Memory Copy and Memory Set instructions vm-test-run-timescaledb> server # [ 0.088127] CPU features: detected: Privileged Access Never vm-test-run-timescaledb> server # [ 0.088145] CPU features: detected: RAS Extension Support vm-test-run-timescaledb> server # [ 0.088163] CPU features: detected: Random Number Generator vm-test-run-timescaledb> server # [ 0.088182] CPU features: detected: Speculation barrier (SB) vm-test-run-timescaledb> server # [ 0.088200] CPU features: detected: Stage-2 Force Write-Back vm-test-run-timescaledb> server # [ 0.088218] CPU features: detected: Trap EL0 IMPLEMENTATION DEFINED functionality vm-test-run-timescaledb> server # [ 0.088241] CPU features: detected: TLB range maintenance instructions vm-test-run-timescaledb> server # [ 0.088261] CPU features: detected: WFx with timeout vm-test-run-timescaledb> server # [ 0.088296] CPU features: detected: Speculative Store Bypassing Safe (SSBS) vm-test-run-timescaledb> server # [ 0.088321] CPU features: detected: Scalable Vector Extension vm-test-run-timescaledb> server # [ 0.092733] alternatives: applying system-wide alternatives vm-test-run-timescaledb> server # [ 0.107517] CPU features: detected: Hardware dirty bit management on CPU0-1 vm-test-run-timescaledb> server # [ 0.108054] SVE: maximum available vector length 256 bytes per vector vm-test-run-timescaledb> server # [ 0.108125] SVE: default vector length 64 bytes per vector vm-test-run-timescaledb> server # [ 0.117910] Memory: 3922844K/4194304K available (23296K kernel code, 6546K rwdata, 24596K rodata, 4416K init, 1047K bss, 223164K reserved, 32768K cma-reserved) vm-test-run-timescaledb> server # [ 0.135500] devtmpfs: initialized vm-test-run-timescaledb> server # [ 0.156937] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 7645041785100000 ns vm-test-run-timescaledb> server # [ 0.157334] futex hash table entries: 512 (order: 3, 32768 bytes, linear) vm-test-run-timescaledb> server # [ 0.159505] 2G module region forced by RANDOMIZE_MODULE_REGION_FULL vm-test-run-timescaledb> server # [ 0.159723] 0 pages in range for non-PLT usage vm-test-run-timescaledb> server # [ 0.159764] 509248 pages in range for PLT usage vm-test-run-timescaledb> server # [ 0.162448] pinctrl core: initialized pinctrl subsystem vm-test-run-timescaledb> server # [ 0.171922] DMI not present or invalid. vm-test-run-timescaledb> server # [ 0.186129] NET: Registered PF_NETLINK/PF_ROUTE protocol family vm-test-run-timescaledb> server # [ 0.195501] DMA: preallocated 512 KiB GFP_KERNEL pool for atomic allocations vm-test-run-timescaledb> server # [ 0.197058] DMA: preallocated 512 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations vm-test-run-timescaledb> server # [ 0.197843] DMA: preallocated 512 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations vm-test-run-timescaledb> server # [ 0.198083] audit: initializing netlink subsys (disabled) vm-test-run-timescaledb> server # [ 0.199580] audit: type=2000 audit(0.096:1): state=initialized audit_enabled=0 res=1 vm-test-run-timescaledb> server # [ 0.204007] thermal_sys: Registered thermal governor 'fair_share' vm-test-run-timescaledb> server # [ 0.204040] thermal_sys: Registered thermal governor 'bang_bang' vm-test-run-timescaledb> server # [ 0.204074] thermal_sys: Registered thermal governor 'step_wise' vm-test-run-timescaledb> server # [ 0.204096] thermal_sys: Registered thermal governor 'user_space' vm-test-run-timescaledb> server # [ 0.204117] thermal_sys: Registered thermal governor 'power_allocator' vm-test-run-timescaledb> server # [ 0.204550] cpuidle: using governor ladder vm-test-run-timescaledb> server # [ 0.204779] cpuidle: using governor menu vm-test-run-timescaledb> server # [ 0.206311] hw-breakpoint: found 6 breakpoint and 4 watchpoint registers. vm-test-run-timescaledb> server # [ 0.206737] ASID allocator initialised with 65536 entries vm-test-run-timescaledb> server # [ 0.212423] Serial: AMBA PL011 UART driver vm-test-run-timescaledb> server # [ 0.255134] 9000000.pl011: ttyAMA0 at MMIO 0x9000000 (irq = 13, base_baud = 0) is a PL011 rev1 vm-test-run-timescaledb> server # [ 0.256131] printk: legacy console [ttyAMA0] enabled vm-test-run-timescaledb> server # [ 0.295241] HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages vm-test-run-timescaledb> server # [ 0.295419] HugeTLB: 0 KiB vmemmap can be freed for a 1.00 GiB page vm-test-run-timescaledb> server # [ 0.295635] HugeTLB: registered 32.0 MiB page size, pre-allocated 0 pages vm-test-run-timescaledb> server # [ 0.295722] HugeTLB: 0 KiB vmemmap can be freed for a 32.0 MiB page vm-test-run-timescaledb> server # [ 0.295846] HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages vm-test-run-timescaledb> server # [ 0.295932] HugeTLB: 0 KiB vmemmap can be freed for a 2.00 MiB page vm-test-run-timescaledb> server # [ 0.296516] HugeTLB: registered 64.0 KiB page size, pre-allocated 0 pages vm-test-run-timescaledb> server # [ 0.296750] HugeTLB: 0 KiB vmemmap can be freed for a 64.0 KiB page vm-test-run-timescaledb> server # [ 0.307376] fbcon: Taking over console vm-test-run-timescaledb> server # [ 0.308476] ACPI: Interpreter disabled. vm-test-run-timescaledb> server # [ 0.314725] iommu: Default domain type: Translated vm-test-run-timescaledb> server # [ 0.314855] iommu: DMA domain TLB invalidation policy: strict mode vm-test-run-timescaledb> server # [ 0.317280] SCSI subsystem initialized vm-test-run-timescaledb> server # [ 0.319336] usbcore: registered new interface driver usbfs vm-test-run-timescaledb> server # [ 0.319801] usbcore: registered new interface driver hub vm-test-run-timescaledb> server # [ 0.320010] usbcore: registered new device driver usb vm-test-run-timescaledb> server # [ 0.321993] pps_core: LinuxPPS API ver. 1 registered vm-test-run-timescaledb> server # [ 0.322102] pps_core: Software ver. 5.3.6 - Copyright 2005-2007 Rodolfo Giometti vm-test-run-timescaledb> server # [ 0.322288] PTP clock support registered vm-test-run-timescaledb> server # [ 0.323201] EDAC MC: Ver: 3.0.0 vm-test-run-timescaledb> server # [ 0.325131] scmi_core: SCMI protocol bus registered vm-test-run-timescaledb> server # [ 0.328093] FPGA manager framework vm-test-run-timescaledb> server # [ 0.329382] Advanced Linux Sound Architecture Driver Initialized. vm-test-run-timescaledb> server # [ 0.336175] vgaarb: loaded vm-test-run-timescaledb> server # [ 0.341137] clocksource: Switched to clocksource arch_sys_counter vm-test-run-timescaledb> server # [ 0.345073] VFS: Disk quotas dquot_6.6.0 vm-test-run-timescaledb> server # [ 0.345672] VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes) vm-test-run-timescaledb> server # [ 0.347268] netfs: FS-Cache loaded vm-test-run-timescaledb> server # [ 0.348343] pnp: PnP ACPI: disabled vm-test-run-timescaledb> server # [ 0.367333] NET: Registered PF_INET protocol family vm-test-run-timescaledb> server # [ 0.368677] IP idents hash table entries: 65536 (order: 7, 524288 bytes, linear) vm-test-run-timescaledb> server # [ 0.463683] tcp_listen_portaddr_hash hash table entries: 2048 (order: 3, 32768 bytes, linear) vm-test-run-timescaledb> server # [ 0.464011] Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear) vm-test-run-timescaledb> server # [ 0.464264] TCP established hash table entries: 32768 (order: 6, 262144 bytes, linear) vm-test-run-timescaledb> server # [ 0.465136] TCP bind hash table entries: 32768 (order: 8, 1048576 bytes, linear) vm-test-run-timescaledb> server # [ 0.465835] TCP: Hash tables configured (established 32768 bind 32768) vm-test-run-timescaledb> server # [ 0.467039] MPTCP token hash table entries: 4096 (order: 5, 98304 bytes, linear) vm-test-run-timescaledb> server # [ 0.467441] UDP hash table entries: 2048 (order: 4, 65536 bytes, linear) vm-test-run-timescaledb> server # [ 0.467810] UDP-Lite hash table entries: 2048 (order: 4, 65536 bytes, linear) vm-test-run-timescaledb> server # [ 0.469130] NET: Registered PF_UNIX/PF_LOCAL protocol family vm-test-run-timescaledb> server # [ 0.469827] NET: Registered PF_XDP protocol family vm-test-run-timescaledb> server # [ 0.470061] PCI: CLS 0 bytes, default 64 vm-test-run-timescaledb> server # [ 0.471643] kvm [1]: HYP mode not available vm-test-run-timescaledb> server # [ 0.473156] Trying to unpack rootfs image as initramfs... vm-test-run-timescaledb> server # [ 0.570250] Initialise system trusted keyrings vm-test-run-timescaledb> server # [ 0.571596] workingset: timestamp_bits=42 max_order=20 bucket_order=0 vm-test-run-timescaledb> server # [ 0.574508] squashfs: version 4.0 (2009/01/31) Phillip Lougher vm-test-run-timescaledb> server # [ 0.575438] 9p: Installing v9fs 9p2000 file system support vm-test-run-timescaledb> server # [ 0.624787] Key type asymmetric registered vm-test-run-timescaledb> server # [ 0.624988] Asymmetric key parser 'x509' registered vm-test-run-timescaledb> server # [ 0.625734] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 244) vm-test-run-timescaledb> server # [ 0.626653] io scheduler mq-deadline registered vm-test-run-timescaledb> server # [ 0.626855] io scheduler kyber registered vm-test-run-timescaledb> server # [ 0.646072] pl061_gpio 9030000.pl061: PL061 GPIO chip registered vm-test-run-timescaledb> server # [ 0.649582] ledtrig-cpu: registered to indicate activity on CPUs vm-test-run-timescaledb> server # [ 0.652496] pci-host-generic 4010000000.pcie: host bridge /pcie@10000000 ranges: vm-test-run-timescaledb> server # [ 0.653039] pci-host-generic 4010000000.pcie: IO 0x003eff0000..0x003effffff -> 0x0000000000 vm-test-run-timescaledb> server # [ 0.653869] pci-host-generic 4010000000.pcie: MEM 0x0010000000..0x003efeffff -> 0x0010000000 vm-test-run-timescaledb> server # [ 0.654209] pci-host-generic 4010000000.pcie: MEM 0x8000000000..0xffffffffff -> 0x8000000000 vm-test-run-timescaledb> server # [ 0.654706] pci-host-generic 4010000000.pcie: Memory resource size exceeds max for 32 bits vm-test-run-timescaledb> server # [ 0.655309] pci-host-generic 4010000000.pcie: ECAM at [mem 0x4010000000-0x401fffffff] for [bus 00-ff] vm-test-run-timescaledb> server # [ 0.656641] pci-host-generic 4010000000.pcie: PCI host bridge to bus 0000:00 vm-test-run-timescaledb> server # [ 0.657076] pci_bus 0000:00: root bus resource [bus 00-ff] vm-test-run-timescaledb> server # [ 0.658018] pci_bus 0000:00: root bus resource [io 0x0000-0xffff] vm-test-run-timescaledb> server # [ 0.658324] pci_bus 0000:00: root bus resource [mem 0x10000000-0x3efeffff] vm-test-run-timescaledb> server # [ 0.658492] pci_bus 0000:00: root bus resource [mem 0x8000000000-0xffffffffff] vm-test-run-timescaledb> server # [ 0.659589] pci 0000:00:00.0: [1b36:0008] type 00 class 0x060000 conventional PCI endpoint vm-test-run-timescaledb> server # [ 0.661992] pci 0000:00:01.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint vm-test-run-timescaledb> server # [ 0.662267] pci 0000:00:01.0: BAR 0 [io 0x0000-0x001f] vm-test-run-timescaledb> server # [ 0.662379] pci 0000:00:01.0: BAR 1 [mem 0x00000000-0x00000fff] vm-test-run-timescaledb> server # [ 0.663061] pci 0000:00:01.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] vm-test-run-timescaledb> server # [ 0.663445] pci 0000:00:01.0: ROM [mem 0x00000000-0x0003ffff pref] vm-test-run-timescaledb> server # [ 0.664071] pci 0000:00:02.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint vm-test-run-timescaledb> server # [ 0.664229] pci 0000:00:02.0: BAR 0 [io 0x0000-0x001f] vm-test-run-timescaledb> server # [ 0.664313] pci 0000:00:02.0: BAR 1 [mem 0x00000000-0x00000fff] vm-test-run-timescaledb> server # [ 0.664425] pci 0000:00:02.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] vm-test-run-timescaledb> server # [ 0.664948] pci 0000:00:03.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint vm-test-run-timescaledb> server # [ 0.665139] pci 0000:00:03.0: BAR 0 [io 0x0000-0x003f] vm-test-run-timescaledb> server # [ 0.665238] pci 0000:00:03.0: BAR 1 [mem 0x00000000-0x00000fff] vm-test-run-timescaledb> server # [ 0.665332] pci 0000:00:03.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] vm-test-run-timescaledb> server # [ 0.666054] pci 0000:00:04.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint vm-test-run-timescaledb> server # [ 0.666252] pci 0000:00:04.0: BAR 0 [io 0x0000-0x001f] vm-test-run-timescaledb> server # [ 0.666363] pci 0000:00:04.0: BAR 1 [mem 0x00000000-0x00000fff] vm-test-run-timescaledb> server # [ 0.666464] pci 0000:00:04.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] vm-test-run-timescaledb> server # [ 0.666889] pci 0000:00:05.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint vm-test-run-timescaledb> server # [ 0.667029] pci 0000:00:05.0: BAR 0 [io 0x0000-0x001f] vm-test-run-timescaledb> server # [ 0.667238] pci 0000:00:05.0: BAR 1 [mem 0x00000000-0x00000fff] vm-test-run-timescaledb> server # [ 0.667329] pci 0000:00:05.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] vm-test-run-timescaledb> server # [ 0.667885] pci 0000:00:06.0: [1af4:1001] type 00 class 0x010000 conventional PCI endpoint vm-test-run-timescaledb> server # [ 0.668142] pci 0000:00:06.0: BAR 0 [io 0x0000-0x007f] vm-test-run-timescaledb> server # [ 0.668224] pci 0000:00:06.0: BAR 1 [mem 0x00000000-0x00000fff] vm-test-run-timescaledb> server # [ 0.668317] pci 0000:00:06.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] vm-test-run-timescaledb> server # [ 0.668694] pci 0000:00:07.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint vm-test-run-timescaledb> server # [ 0.668986] pci 0000:00:07.0: BAR 0 [io 0x0000-0x001f] vm-test-run-timescaledb> server # [ 0.669070] pci 0000:00:07.0: BAR 1 [mem 0x00000000-0x00000fff] vm-test-run-timescaledb> server # [ 0.669161] pci 0000:00:07.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] vm-test-run-timescaledb> server # [ 0.669400] pci 0000:00:07.0: ROM [mem 0x00000000-0x0003ffff pref] vm-test-run-timescaledb> server # [ 0.670207] pci 0000:00:08.0: [1af4:1052] type 00 class 0x090000 conventional PCI endpoint vm-test-run-timescaledb> server # [ 0.670369] pci 0000:00:08.0: BAR 1 [mem 0x00000000-0x00000fff] vm-test-run-timescaledb> server # [ 0.670480] pci 0000:00:08.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] vm-test-run-timescaledb> server # [ 0.670855] pci 0000:00:09.0: [1af4:1050] type 00 class 0x038000 conventional PCI endpoint vm-test-run-timescaledb> server # [ 0.670996] pci 0000:00:09.0: BAR 1 [mem 0x00000000-0x00000fff] vm-test-run-timescaledb> server # [ 0.671149] pci 0000:00:09.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] vm-test-run-timescaledb> server # [ 0.671797] pci 0000:00:0a.0: [8086:24cd] type 00 class 0x0c0320 conventional PCI endpoint vm-test-run-timescaledb> server # [ 0.672098] pci 0000:00:0a.0: BAR 0 [mem 0x00000000-0x00000fff] vm-test-run-timescaledb> server # [ 0.672499] pci 0000:00:0b.0: [1af4:1003] type 00 class 0x078000 conventional PCI endpoint vm-test-run-timescaledb> server # [ 0.672913] pci 0000:00:0b.0: BAR 0 [io 0x0000-0x003f] vm-test-run-timescaledb> server # [ 0.673692] pci 0000:00:0b.0: BAR 1 [mem 0x00000000-0x00000fff] vm-test-run-timescaledb> server # [ 0.674014] pci 0000:00:0b.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] vm-test-run-timescaledb> server # [ 0.674642] pci 0000:00:0c.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint vm-test-run-timescaledb> server # [ 0.674957] pci 0000:00:0c.0: BAR 0 [io 0x0000-0x001f] vm-test-run-timescaledb> server # [ 0.675076] pci 0000:00:0c.0: BAR 1 [mem 0x00000000-0x00000fff] vm-test-run-timescaledb> server # [ 0.675177] pci 0000:00:0c.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] vm-test-run-timescaledb> server # [ 0.676841] pci 0000:00:01.0: ROM [mem 0x10000000-0x1003ffff pref]: assigned vm-test-run-timescaledb> server # [ 0.677069] pci 0000:00:07.0: ROM [mem 0x10040000-0x1007ffff pref]: assigned vm-test-run-timescaledb> server # [ 0.677231] pci 0000:00:01.0: BAR 4 [mem 0x8000000000-0x8000003fff 64bit pref]: assigned vm-test-run-timescaledb> server # [ 0.677563] pci 0000:00:02.0: BAR 4 [mem 0x8000004000-0x8000007fff 64bit pref]: assigned vm-test-run-timescaledb> server # [ 0.677972] pci 0000:00:03.0: BAR 4 [mem 0x8000008000-0x800000bfff 64bit pref]: assigned vm-test-run-timescaledb> server # [ 0.678194] pci 0000:00:04.0: BAR 4 [mem 0x800000c000-0x800000ffff 64bit pref]: assigned vm-test-run-timescaledb> server # [ 0.678749] pci 0000:00:05.0: BAR 4 [mem 0x8000010000-0x8000013fff 64bit pref]: assigned vm-test-run-timescaledb> server # [ 0.679091] pci 0000:00:06.0: BAR 4 [mem 0x8000014000-0x8000017fff 64bit pref]: assigned vm-test-run-timescaledb> server # [ 0.679357] pci 0000:00:07.0: BAR 4 [mem 0x8000018000-0x800001bfff 64bit pref]: assigned vm-test-run-timescaledb> server # [ 0.679470] pci 0000:00:08.0: BAR 4 [mem 0x800001c000-0x800001ffff 64bit pref]: assigned vm-test-run-timescaledb> server # [ 0.679648] pci 0000:00:09.0: BAR 4 [mem 0x8000020000-0x8000023fff 64bit pref]: assigned vm-test-run-timescaledb> server # [ 0.679775] pci 0000:00:0b.0: BAR 4 [mem 0x8000024000-0x8000027fff 64bit pref]: assigned vm-test-run-timescaledb> server # [ 0.680008] pci 0000:00:0c.0: BAR 4 [mem 0x8000028000-0x800002bfff 64bit pref]: assigned vm-test-run-timescaledb> server # [ 0.680189] pci 0000:00:01.0: BAR 1 [mem 0x10080000-0x10080fff]: assigned vm-test-run-timescaledb> server # [ 0.680719] pci 0000:00:02.0: BAR 1 [mem 0x10081000-0x10081fff]: assigned vm-test-run-timescaledb> server # [ 0.681001] pci 0000:00:03.0: BAR 1 [mem 0x10082000-0x10082fff]: assigned vm-test-run-timescaledb> server # [ 0.681102] pci 0000:00:04.0: BAR 1 [mem 0x10083000-0x10083fff]: assigned vm-test-run-timescaledb> server # [ 0.681195] pci 0000:00:05.0: BAR 1 [mem 0x10084000-0x10084fff]: assigned vm-test-run-timescaledb> server # [ 0.681284] pci 0000:00:06.0: BAR 1 [mem 0x10085000-0x10085fff]: assigned vm-test-run-timescaledb> server # [ 0.681907] pci 0000:00:07.0: BAR 1 [mem 0x10086000-0x10086fff]: assigned vm-test-run-timescaledb> server # [ 0.682202] pci 0000:00:08.0: BAR 1 [mem 0x10087000-0x10087fff]: assigned vm-test-run-timescaledb> server # [ 0.682302] pci 0000:00:09.0: BAR 1 [mem 0x10088000-0x10088fff]: assigned vm-test-run-timescaledb> server # [ 0.682400] pci 0000:00:0a.0: BAR 0 [mem 0x10089000-0x10089fff]: assigned vm-test-run-timescaledb> server # [ 0.682705] pci 0000:00:0b.0: BAR 1 [mem 0x1008a000-0x1008afff]: assigned vm-test-run-timescaledb> server # [ 0.682848] pci 0000:00:0c.0: BAR 1 [mem 0x1008b000-0x1008bfff]: assigned vm-test-run-timescaledb> server # [ 0.682957] pci 0000:00:06.0: BAR 0 [io 0x1000-0x107f]: assigned vm-test-run-timescaledb> server # [ 0.683063] pci 0000:00:03.0: BAR 0 [io 0x1080-0x10bf]: assigned vm-test-run-timescaledb> server # [ 0.683157] pci 0000:00:0b.0: BAR 0 [io 0x10c0-0x10ff]: assigned vm-test-run-timescaledb> server # [ 0.683338] pci 0000:00:01.0: BAR 0 [io 0x1100-0x111f]: assigned vm-test-run-timescaledb> server # [ 0.683425] pci 0000:00:02.0: BAR 0 [io 0x1120-0x113f]: assigned vm-test-run-timescaledb> server # [ 0.683511] pci 0000:00:04.0: BAR 0 [io 0x1140-0x115f]: assigned vm-test-run-timescaledb> server # [ 0.683775] pci 0000:00:05.0: BAR 0 [io 0x1160-0x117f]: assigned vm-test-run-timescaledb> server # [ 0.683862] pci 0000:00:07.0: BAR 0 [io 0x1180-0x119f]: assigned vm-test-run-timescaledb> server # [ 0.683951] pci 0000:00:0c.0: BAR 0 [io 0x11a0-0x11bf]: assigned vm-test-run-timescaledb> server # [ 0.684187] pci_bus 0000:00: resource 4 [io 0x0000-0xffff] vm-test-run-timescaledb> server # [ 0.684372] pci_bus 0000:00: resource 5 [mem 0x10000000-0x3efeffff] vm-test-run-timescaledb> server # [ 0.684463] pci_bus 0000:00: resource 6 [mem 0x8000000000-0xffffffffff] vm-test-run-timescaledb> server # [ 0.685449] pci 0000:00:0a.0: enabling device (0000 -> 0002) vm-test-run-timescaledb> server # [ 0.728911] virtio-pci 0000:00:01.0: enabling device (0000 -> 0003) vm-test-run-timescaledb> server # [ 0.731839] virtio-pci 0000:00:02.0: enabling device (0000 -> 0003) vm-test-run-timescaledb> server # [ 0.733348] virtio-pci 0000:00:03.0: enabling device (0000 -> 0003) vm-test-run-timescaledb> server # [ 0.735395] virtio-pci 0000:00:04.0: enabling device (0000 -> 0003) vm-test-run-timescaledb> server # [ 0.736922] virtio-pci 0000:00:05.0: enabling device (0000 -> 0003) vm-test-run-timescaledb> server # [ 0.738302] virtio-pci 0000:00:06.0: enabling device (0000 -> 0003) vm-test-run-timescaledb> server # [ 0.739420] virtio-pci 0000:00:07.0: enabling device (0000 -> 0003) vm-test-run-timescaledb> server # [ 0.741078] virtio-pci 0000:00:08.0: enabling device (0000 -> 0002) vm-test-run-timescaledb> server # [ 0.742416] virtio-pci 0000:00:09.0: enabling device (0000 -> 0002) vm-test-run-timescaledb> server # [ 0.743819] virtio-pci 0000:00:0b.0: enabling device (0000 -> 0003) vm-test-run-timescaledb> server # [ 0.745575] virtio-pci 0000:00:0c.0: enabling device (0000 -> 0003) vm-test-run-timescaledb> server # [ 0.757745] Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled vm-test-run-timescaledb> server # [ 0.764425] msm_serial: driver initialized vm-test-run-timescaledb> server # [ 0.765105] SuperH (H)SCI(F) driver initialized vm-test-run-timescaledb> server # [ 0.765867] STM32 USART driver initialized vm-test-run-timescaledb> server # [ 0.805407] loop: module loaded vm-test-run-timescaledb> server # [ 0.806399] virtio_blk virtio5: 2/0/0 default/read/poll queues vm-test-run-timescaledb> server # [ 0.809647] virtio_blk virtio5: [vda] 2097152 512-byte logical blocks (1.07 GB/1.00 GiB) vm-test-run-timescaledb> server # [ 0.819417] Freeing initrd memory: 10684K vm-test-run-timescaledb> server # [ 0.820419] megasas: 07.727.03.00-rc1 vm-test-run-timescaledb> server # [ 0.824824] physmap-flash 0.flash: physmap platform flash device: [mem 0x00000000-0x03ffffff] vm-test-run-timescaledb> server # [ 0.827044] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x000000 vm-test-run-timescaledb> server # [ 0.827712] Intel/Sharp Extended Query Table at 0x0031 vm-test-run-timescaledb> server # [ 0.828847] Using buffer write method vm-test-run-timescaledb> server # [ 0.829692] physmap-flash 0.flash: physmap platform flash device: [mem 0x04000000-0x07ffffff] vm-test-run-timescaledb> server # [ 0.830868] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x000000 vm-test-run-timescaledb> server # [ 0.831130] Intel/Sharp Extended Query Table at 0x0031 vm-test-run-timescaledb> server # [ 0.832686] Using buffer write method vm-test-run-timescaledb> server # [ 0.832863] Concatenating MTD devices: vm-test-run-timescaledb> server # [ 0.832943] (0): "0.flash" vm-test-run-timescaledb> server # [ 0.832996] (1): "0.flash" vm-test-run-timescaledb> server # [ 0.833047] into device "0.flash" vm-test-run-timescaledb> server # [ 0.852866] tun: Universal TUN/TAP device driver, 1.6 vm-test-run-timescaledb> server # [ 0.862832] thunder_xcv, ver 1.0 vm-test-run-timescaledb> server # [ 0.863032] thunder_bgx, ver 1.0 vm-test-run-timescaledb> server # [ 0.863186] nicpf, ver 1.0 vm-test-run-timescaledb> server # [ 0.865678] hns3: Hisilicon Ethernet Network Driver for Hip08 Family - version vm-test-run-timescaledb> server # [ 0.865812] hns3: Copyright (c) 2017 Huawei Corporation. vm-test-run-timescaledb> server # [ 0.866367] hclge is initializing vm-test-run-timescaledb> server # [ 0.866769] e1000: Intel(R) PRO/1000 Network Driver vm-test-run-timescaledb> server # [ 0.866864] e1000: Copyright (c) 1999-2006 Intel Corporation. vm-test-run-timescaledb> server # [ 0.867077] e1000e: Intel(R) PRO/1000 Network Driver vm-test-run-timescaledb> server # [ 0.867409] e1000e: Copyright(c) 1999 - 2015 Intel Corporation. vm-test-run-timescaledb> server # [ 0.867701] igb: Intel(R) Gigabit Ethernet Network Driver vm-test-run-timescaledb> server # [ 0.867868] igb: Copyright (c) 2007-2014 Intel Corporation. vm-test-run-timescaledb> server # [ 0.868221] igbvf: Intel(R) Gigabit Virtual Function Network Driver vm-test-run-timescaledb> server # [ 0.868368] igbvf: Copyright (c) 2009 - 2012 Intel Corporation. vm-test-run-timescaledb> server # [ 0.869005] sky2: driver version 1.30 vm-test-run-timescaledb> server # [ 0.875899] ehci-pci 0000:00:0a.0: EHCI Host Controller vm-test-run-timescaledb> server # [ 0.876902] ehci-pci 0000:00:0a.0: new USB bus registered, assigned bus number 1 vm-test-run-timescaledb> server # [ 0.878205] usbcore: registered new interface driver usb-storage vm-test-run-timescaledb> server # [ 0.878681] usbcore: registered new interface driver usbserial_generic vm-test-run-timescaledb> server # [ 0.879231] usbserial: USB Serial support registered for generic vm-test-run-timescaledb> server # [ 0.880168] ehci-pci 0000:00:0a.0: irq 15, io mem 0x10089000 vm-test-run-timescaledb> server # [ 0.887077] rtc-pl031 9010000.pl031: registered as rtc0 vm-test-run-timescaledb> server # [ 0.888023] rtc-pl031 9010000.pl031: setting system clock to 2026-10-23T10:39:41 UTC (1792751981) vm-test-run-timescaledb> server # [ 0.889866] i2c_dev: i2c /dev entries driver vm-test-run-timescaledb> server # [ 0.899941] ehci-pci 0000:00:0a.0: USB 2.0 started, EHCI 1.00 vm-test-run-timescaledb> server # [ 0.901681] sdhci: Secure Digital Host Controller Interface driver vm-test-run-timescaledb> server # [ 0.901891] sdhci: Copyright(c) Pierre Ossman vm-test-run-timescaledb> server # [ 0.903399] Synopsys Designware Multimedia Card Interface Driver vm-test-run-timescaledb> server # [ 0.905011] sdhci-pltfm: SDHCI platform and OF driver helper vm-test-run-timescaledb> server # [ 0.906496] hub 1-0:1.0: USB hub found vm-test-run-timescaledb> server # [ 0.907119] hub 1-0:1.0: 6 ports detected vm-test-run-timescaledb> server # [ 0.911476] hid: raw HID events driver (C) Jiri Kosina vm-test-run-timescaledb> server # [ 0.913210] usbcore: registered new interface driver usbhid vm-test-run-timescaledb> server # [ 0.913324] usbhid: USB HID core driver vm-test-run-timescaledb> server # [ 0.920129] hw perfevents: enabled with armv8_pmuv3 PMU driver, 7 (0,8000003f) counters available vm-test-run-timescaledb> server # [ 0.930523] drop_monitor: Initializing network drop monitor service vm-test-run-timescaledb> server # [ 0.932181] NET: Registered PF_INET6 protocol family vm-test-run-timescaledb> server # [ 0.943073] Segment Routing with IPv6 vm-test-run-timescaledb> server # [ 0.943352] In-situ OAM (IOAM) with IPv6 vm-test-run-timescaledb> server # [ 0.944180] NET: Registered PF_PACKET protocol family vm-test-run-timescaledb> server # [ 0.945152] 9pnet: Installing 9P2000 support vm-test-run-timescaledb> server # [ 0.948620] Key type dns_resolver registered vm-test-run-timescaledb> server # [ 0.979046] registered taskstats version 1 vm-test-run-timescaledb> server # [ 0.981372] Loading compiled-in X.509 certificates vm-test-run-timescaledb> server # [ 1.028910] Demotion targets for Node 0: null vm-test-run-timescaledb> server # [ 1.030980] Key type .fscrypt registered vm-test-run-timescaledb> server # [ 1.031072] Key type fscrypt-provisioning registered vm-test-run-timescaledb> server # [ 1.041003] input: gpio-keys as /devices/platform/gpio-keys/input/input0 vm-test-run-timescaledb> server # [ 1.078752] clk: Disabling unused clocks vm-test-run-timescaledb> server # [ 1.078996] PM: genpd: Disabling unused power domains vm-test-run-timescaledb> server # [ 1.079287] ALSA device list: vm-test-run-timescaledb> server # [ 1.079488] No soundcards found. vm-test-run-timescaledb> server # [ 1.152094] Freeing unused kernel memory: 4416K vm-test-run-timescaledb> server # [ 1.153594] Run /init as init process vm-test-run-timescaledb> server # [ 1.166216] usb 1-1: new high-speed USB device number 2 using ehci-pci vm-test-run-timescaledb> server # [ 1.419952] input: QEMU QEMU USB Keyboard as /devices/platform/4010000000.pcie/pci0000:00/0000:00:0a.0/usb1/1-1/1-1:1.0/0003:0627:0001.0001/input/input1 vm-test-run-timescaledb> server # [ 1.540665] device-mapper: ioctl: 4.48.0-ioctl (2023-03-01) initialised: dm-devel@lists.linux.dev vm-test-run-timescaledb> server # [ 1.599447] hid-generic 0003:0627:0001.0001: input,hidraw0: USB HID v1.11 Keyboard [QEMU QEMU USB Keyboard] on usb-0000:00:0a.0-1/input0 vm-test-run-timescaledb> server # [ 1.639142] [drm] pci: virtio-gpu-pci detected at 0000:00:09.0 vm-test-run-timescaledb> server # [ 1.640778] [drm] features: -virgl +edid -resource_blob -host_visible vm-test-run-timescaledb> server # [ 1.640798] [drm] features: -context_init vm-test-run-timescaledb> server # [ 1.642752] [drm] number of scanouts: 1 vm-test-run-timescaledb> server # [ 1.642912] [drm] number of cap sets: 0 vm-test-run-timescaledb> server # [ 1.651027] [drm] Initialized virtio_gpu 0.1.0 for 0000:00:09.0 on minor 0 vm-test-run-timescaledb> server # [ 1.677069] Console: switching to colour frame buffer device 160x50 vm-test-run-timescaledb> server # [ 1.686057] virtio-pci 0000:00:09.0: [drm] fb0: virtio_gpudrmfb frame buffer device vm-test-run-timescaledb> server # [ 1.725447] usb 1-2: new high-speed USB device number 3 using ehci-pci vm-test-run-timescaledb> server # [ 1.922193] input: QEMU QEMU USB Tablet as /devices/platform/4010000000.pcie/pci0000:00/0000:00:0a.0/usb1/1-2/1-2:1.0/0003:0627:0001.0002/input/input2 vm-test-run-timescaledb> server # [ 1.929949] hid-generic 0003:0627:0001.0002: input,hidraw1: USB HID v0.01 Mouse [QEMU QEMU USB Tablet] on usb-0000:00:0a.0-2/input0 vm-test-run-timescaledb> server # [ 3.699908] EXT4-fs (vda): mounted filesystem d30b13ff-3692-45e9-a350-37583c1d47fb r/w with ordered data mode. Quota mode: none. vm-test-run-timescaledb> server # [ 5.940702] EXT4-fs (vda): re-mounted d30b13ff-3692-45e9-a350-37583c1d47fb. vm-test-run-timescaledb> server # [ 5.959895] booting system configuration /nix/store/xccjb0p6frzqczkin80yq741hjvpsb6s-nixos-system-server-test vm-test-run-timescaledb> server # [ 16.550807] systemd[1]: systemd 258.2 running in system mode (+PAM +AUDIT -SELINUX +APPARMOR +IMA +IPE +SMACK +SECCOMP +GCRYPT -GNUTLS +OPENSSL +ACL +BLKID +CURL +ELFUTILS +FIDO2 +IDN2 -IDN -IPTC +KMOD +LIBCRYPTSETUP +LIBCRYPTSETUP_PLUGINS +LIBFDISK +PCRE2 +PWQUALITY +P11KIT +QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD +BPF_FRAMEWORK -BTF -XKBCOMMON +UTMP -SYSVINIT +LIBARCHIVE) vm-test-run-timescaledb> server # [ 16.560443] systemd[1]: Detected virtualization qemu. vm-test-run-timescaledb> server # [ 16.565517] systemd[1]: Detected architecture arm64. vm-test-run-timescaledb> server # [ 16.569749] systemd[1]: Detected first boot. vm-test-run-timescaledb> server # [ 16.593824] systemd[1]: Initializing machine ID from random generator. vm-test-run-timescaledb> server # [ 16.620770] systemd[1]: Hostname set to . vm-test-run-timescaledb> server # [ 17.808288] systemd[1]: bpf-restrict-fs: LSM BPF program attached vm-test-run-timescaledb> server # [ 18.953462] systemd[1]: Applying preset policy. vm-test-run-timescaledb> server # [ 22.338250] systemd[1]: Populated /etc with preset unit settings. vm-test-run-timescaledb> server # [ 25.682659] systemd[1]: Queued start job for default target Multi-User System. vm-test-run-timescaledb> server # [ 25.896786] systemd[1]: Created slice Slice /system/getty. vm-test-run-timescaledb> server # [ 25.912118] systemd[1]: Created slice Slice /system/modprobe. vm-test-run-timescaledb> server # [ 25.925842] systemd[1]: Created slice User and Session Slice. vm-test-run-timescaledb> server # [ 25.933193] systemd[1]: Started Dispatch Password Requests to Console Directory Watch. vm-test-run-timescaledb> server # [ 25.939194] systemd[1]: Started Forward Password Requests to Wall Directory Watch. vm-test-run-timescaledb> server # [ 25.944998] systemd[1]: Expecting device /dev/hvc0... vm-test-run-timescaledb> server # [ 25.949923] systemd[1]: Expecting device /dev/ttyAMA0... vm-test-run-timescaledb> server # [ 25.954499] systemd[1]: Expecting device /sys/subsystem/net/devices/eth1... vm-test-run-timescaledb> server # [ 25.959473] systemd[1]: Reached target Local Encrypted Volumes. vm-test-run-timescaledb> server # [ 25.964342] systemd[1]: Reached target Virtual Machines and Containers. vm-test-run-timescaledb> server # [ 25.968894] systemd[1]: Reached target Path Units. vm-test-run-timescaledb> server # [ 25.973158] systemd[1]: Reached target Remote File Systems. vm-test-run-timescaledb> server # [ 25.978062] systemd[1]: Reached target Slice Units. vm-test-run-timescaledb> server # [ 25.982581] systemd[1]: Reached target Swaps. vm-test-run-timescaledb> server # [ 26.019180] systemd[1]: Listening on Process Core Dump Socket. vm-test-run-timescaledb> server # [ 26.043721] systemd[1]: Listening on Credential Encryption/Decryption. vm-test-run-timescaledb> server # [ 26.054979] systemd[1]: Listening on Journal Audit Socket. vm-test-run-timescaledb> server # [ 26.060554] systemd[1]: Listening on Journal Socket (/dev/log). vm-test-run-timescaledb> server # [ 26.067625] systemd[1]: Listening on Journal Sockets. vm-test-run-timescaledb> server # [ 26.075268] systemd[1]: Listening on Userspace Out-Of-Memory (OOM) Killer Socket. vm-test-run-timescaledb> server # [ 26.080670] systemd[1]: Make TPM PCR Policy was skipped because of an unmet condition check (ConditionSecurity=measured-uki). vm-test-run-timescaledb> server # [ 26.087125] systemd[1]: Listening on udev Control Socket. vm-test-run-timescaledb> server # [ 26.092701] systemd[1]: Listening on udev Kernel Socket. vm-test-run-timescaledb> server # [ 26.143161] systemd[1]: Mounting Huge Pages File System... vm-test-run-timescaledb> server # [ 26.179831] systemd[1]: Mounting POSIX Message Queue File System... vm-test-run-timescaledb> server # [ 26.228963] systemd[1]: Mounting Kernel Debug File System... vm-test-run-timescaledb> server # [ 26.274732] systemd[1]: Mounting Kernel Trace File System... vm-test-run-timescaledb> server # [ 26.403990] systemd[1]: Starting Create List of Static Device Nodes... vm-test-run-timescaledb> server # [ 26.535867] systemd[1]: Starting Load Kernel Module 9pnet_virtio... vm-test-run-timescaledb> server # [ 26.546337] systemd[1]: Load Kernel Module configfs was skipped because of an unmet condition check (ConditionKernelModuleLoaded=!configfs). vm-test-run-timescaledb> server # [ 26.663081] systemd[1]: Mounting Kernel Configuration File System... vm-test-run-timescaledb> server # [ 26.678053] systemd[1]: Load Kernel Module drm was skipped because of an unmet condition check (ConditionKernelModuleLoaded=!drm). vm-test-run-timescaledb> server # [ 26.686723] systemd[1]: Load Kernel Module efi_pstore was skipped because of an unmet condition check (ConditionKernelModuleLoaded=!efi_pstore). vm-test-run-timescaledb> server # [ 26.810457] systemd[1]: Starting Load Kernel Module fuse... vm-test-run-timescaledb> server # [ 26.819384] systemd[1]: File System Check on Root Device was skipped because of an unmet condition check (ConditionPathIsReadWrite=!/). vm-test-run-timescaledb> server # [ 26.832653] systemd[1]: Clear Stale Hibernate Storage Info was skipped because of an unmet condition check (ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc67). vm-test-run-timescaledb> server # [ 26.962766] systemd[1]: Starting Journal Service... vm-test-run-timescaledb> server # [ 27.007481] systemd[1]: Starting Load Kernel Modules... vm-test-run-timescaledb> server # [ 27.086454] systemd[1]: Starting Userspace Out-Of-Memory (OOM) Killer... vm-test-run-timescaledb> server # [ 27.155753] systemd[1]: Starting Remount Root and Kernel File Systems... vm-test-run-timescaledb> server # [ 27.165205] systemd[1]: Early TPM SRK Setup was skipped because of an unmet condition check (ConditionSecurity=measured-uki). vm-test-run-timescaledb> server # [ 27.228584] systemd[1]: Starting Coldplug All udev Devices... vm-test-run-timescaledb> server # [ 27.335278] systemd[1]: Mounted Huge Pages File System. vm-test-run-timescaledb> server # [ 27.350749] systemd[1]: Mounted POSIX Message Queue File System. vm-test-run-timescaledb> server # [ 27.360397] systemd[1]: Mounted Kernel Debug File System. vm-test-run-timescaledb> server # [ 27.368864] systemd[1]: Mounted Kernel Trace File System. vm-test-run-timescaledb> server # [ 27.398769] systemd[1]: Finished Create List of Static Device Nodes. vm-test-run-timescaledb> server # [ 27.414951] systemd[1]: Mounted Kernel Configuration File System. vm-test-run-timescaledb> server # [ 27.455662] systemd[1]: Starting Create Static Device Nodes in /dev gracefully... vm-test-run-timescaledb> server # [ 27.800335] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully. vm-test-run-timescaledb> server # [ 27.820157] systemd[1]: Finished Load Kernel Module 9pnet_virtio. vm-test-run-timescaledb> server # [ 28.178168] EXT4-fs (vda): re-mounted d30b13ff-3692-45e9-a350-37583c1d47fb. vm-test-run-timescaledb> server # [ 28.196160] fuse: init (API version 7.41) vm-test-run-timescaledb> server # [ 28.276799] systemd[1]: modprobe@fuse.service: Deactivated successfully. vm-test-run-timescaledb> server # [ 28.298690] systemd[1]: Finished Load Kernel Module fuse. vm-test-run-timescaledb> server # [ 28.357066] systemd[1]: Mounting FUSE Control File System... vm-test-run-timescaledb> server # [ 28.383308] systemd[1]: Finished Remount Root and Kernel File Systems. vm-test-run-timescaledb> server # [ 28.400693] systemd[1]: Platform Persistent Storage Archival was skipped because of an unmet condition check (ConditionDirectoryNotEmpty=/sys/fs/pstore). vm-test-run-timescaledb> server # [ 28.459604] systemd[1]: Starting Load/Save OS Random Seed... vm-test-run-timescaledb> server # [ 28.471107] systemd[1]: TPM SRK Setup was skipped because of an unmet condition check (ConditionSecurity=measured-uki). vm-test-run-timescaledb> server # [ 28.489047] systemd[1]: Finished Load Kernel Modules. vm-test-run-timescaledb> server # [ 28.563253] systemd[1]: Starting Firewall... vm-test-run-timescaledb> server # [ 28.636011] systemd[1]: Starting Apply Kernel Variables... vm-test-run-timescaledb> server # [ 28.667491] systemd[1]: Mounted FUSE Control File System. vm-test-run-timescaledb> server # [ 28.835945] systemd-journald[397]: Collecting audit messages is enabled. vm-test-run-timescaledb> server: Guest root shell did not produce any data yet... vm-test-run-timescaledb> server: To debug, enter the VM and run 'systemctl status backdoor.service'. vm-test-run-timescaledb> server # [ 29.573365] systemd[1]: Finished Load/Save OS Random Seed. vm-test-run-timescaledb> server # [ 29.580278] systemd[1]: Reached target First Boot Complete. vm-test-run-timescaledb> server # [ 29.858991] systemd[1]: Finished Create Static Device Nodes in /dev gracefully. vm-test-run-timescaledb> server # [ 29.968166] systemd[1]: Starting Create Static Device Nodes in /dev... vm-test-run-timescaledb> server # [ 30.086981] systemd[1]: Finished Apply Kernel Variables. vm-test-run-timescaledb> server # [ 30.558544] systemd[1]: Started Userspace Out-Of-Memory (OOM) Killer. vm-test-run-timescaledb> server # [ 31.175785] systemd[1]: Finished Create Static Device Nodes in /dev. vm-test-run-timescaledb> server # [ 31.199497] systemd[1]: Reached target Preparation for Local File Systems. vm-test-run-timescaledb> server # [ 31.251466] systemd[1]: Mounting /run/wrappers... vm-test-run-timescaledb> server # [ 31.313210] systemd[1]: Starting Rule-based Manager for Device Events and Files... vm-test-run-timescaledb> server # [ 31.459216] systemd[1]: Started Journal Service. vm-test-run-timescaledb> server # [ 31.313337] systemd-modules-load[398]: Module 'atkbd' is built in vm-test-run-timescaledb> server # [ 31.324980] systemd-modules-load[398]: Module 'loop' is built in vm-test-run-timescaledb> server # [ 31.357251] systemd-oomd[399]: No swap; memory pressure usage will be degraded vm-test-run-timescaledb> server # [ 31.411192] systemd[1]: Starting Flush Journal to Persistent Storage... vm-test-run-timescaledb> server # [ 31.785028] systemd[1]: Mounted /run/wrappers. vm-test-run-timescaledb> server # [ 31.801974] systemd[1]: Reached target Local File Systems. vm-test-run-timescaledb> server # [ 31.845930] systemd[1]: Listening on Boot Entries Service Socket. vm-test-run-timescaledb> server # [ 31.922780] systemd[1]: Starting Create SUID/SGID Wrappers... vm-test-run-timescaledb> server # [ 31.924114] systemd[1]: Update Boot Loader Random Seed was skipped because no trigger condition checks were met. vm-test-run-timescaledb> server # [ 31.961084] systemd[1]: Starting Save Transient machine-id to Disk... vm-test-run-timescaledb> server # [ 32.379721] systemd-journald[397]: Received client request to flush runtime journal. vm-test-run-timescaledb> server # [ 33.014813] systemd[1]: etc-machine\x2did.mount: Deactivated successfully. vm-test-run-timescaledb> server # [ 33.033689] systemd[1]: Finished Save Transient machine-id to Disk. vm-test-run-timescaledb> server # [ 33.129471] systemd[1]: Finished Flush Journal to Persistent Storage. vm-test-run-timescaledb> server # [ 33.143247] systemd-udevd[425]: Using default interface naming scheme 'v258'. vm-test-run-timescaledb> server # [ 33.178298] systemd[1]: Starting Create System Files and Directories... vm-test-run-timescaledb> server # [ 35.318963] systemd[1]: Finished Create System Files and Directories. vm-test-run-timescaledb> server # [ 35.393719] systemd[1]: Starting Rebuild Journal Catalog... vm-test-run-timescaledb> server # [ 35.459801] systemd[1]: Starting Record System Boot/Shutdown in UTMP... vm-test-run-timescaledb> server # [ 36.079500] systemd[1]: Started Rule-based Manager for Device Events and Files. vm-test-run-timescaledb> server # [ 36.728110] systemd[1]: Finished Record System Boot/Shutdown in UTMP. vm-test-run-timescaledb> server # [ 37.899678] systemd[1]: Finished Rebuild Journal Catalog. vm-test-run-timescaledb> server # [ 37.927176] systemd[1]: Starting Update is Completed... vm-test-run-timescaledb> server # [ 38.848736] systemd[1]: Finished Update is Completed. vm-test-run-timescaledb> server # [ 43.280194] systemd[1]: suid-sgid-wrappers.service: Deactivated successfully. vm-test-run-timescaledb> server # [ 43.295370] systemd[1]: Finished Create SUID/SGID Wrappers. vm-test-run-timescaledb> server # [ 43.298754] systemd[1]: suid-sgid-wrappers.service: Consumed 3.116s CPU time, 5.6M memory peak. vm-test-run-timescaledb> server # [ 46.280167] systemd[1]: Finished Firewall. vm-test-run-timescaledb> server # [ 47.511187] systemd[1]: Finished Coldplug All udev Devices. vm-test-run-timescaledb> server # [ 47.522507] systemd[1]: Reached target System Initialization. vm-test-run-timescaledb> server # [ 47.533212] systemd[1]: Started Discard unused filesystem blocks once a week. vm-test-run-timescaledb> server # [ 47.534962] systemd[1]: Started Daily Cleanup of Temporary Directories. vm-test-run-timescaledb> server # [ 47.536286] systemd[1]: Reached target Timer Units. vm-test-run-timescaledb> server # [ 47.547336] systemd[1]: Listening on D-Bus System Message Bus Socket. vm-test-run-timescaledb> server # [ 47.562003] systemd[1]: Listening on Nix Daemon Socket. vm-test-run-timescaledb> server # [ 47.565768] systemd[1]: Listening on Hostname Service Socket. vm-test-run-timescaledb> server # [ 47.566884] systemd[1]: Reached target Socket Units. vm-test-run-timescaledb> server # [ 47.572989] systemd[1]: Reached target Basic System. vm-test-run-timescaledb> server # [ 47.596872] systemd[1]: Starting Import lastlog data into lastlog2 database... vm-test-run-timescaledb> server # [ 47.644967] systemd[1]: Starting Name Service Cache Daemon (nsncd)... vm-test-run-timescaledb> server # [ 47.711653] systemd[1]: Started Reset console on configuration changes. vm-test-run-timescaledb> server # [ 47.771358] systemd[1]: Starting resolvconf update... vm-test-run-timescaledb> server # [ 47.867327] systemd[1]: Starting D-Bus System Message Bus... vm-test-run-timescaledb> server # [ 49.147907] systemd[1]: Finished Import lastlog data into lastlog2 database. vm-test-run-timescaledb> server # [ 49.241275] systemd[1]: Started Name Service Cache Daemon (nsncd). vm-test-run-timescaledb> server # [ 49.269204] systemd[1]: Reached target Host and Network Name Lookups. vm-test-run-timescaledb> server # [ 49.330708] nsncd[628]: Oct 23 10:40:29.979 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket" vm-test-run-timescaledb> server # [ 49.359723] systemd[1]: Reached target User and Group Name Lookups. vm-test-run-timescaledb> server # [ 49.371789] systemd[1]: Starting User Login Management... vm-test-run-timescaledb> server # [ 49.666799] dbus-daemon[631]: dbus[631]: Unknown username "systemd-timesync" in message bus configuration file vm-test-run-timescaledb> server # [ 50.226234] systemd[1]: Started D-Bus System Message Bus. vm-test-run-timescaledb> server # [ 51.129577] systemd[1]: Stopped target Host and Network Name Lookups. vm-test-run-timescaledb> server # [ 51.143063] systemd[1]: Stopping Host and Network Name Lookups... vm-test-run-timescaledb> server # [ 51.162864] systemd[1]: Stopped target User and Group Name Lookups. vm-test-run-timescaledb> server # [ 51.174577] systemd[1]: Stopping User and Group Name Lookups... vm-test-run-timescaledb> server # [ 51.194320] systemd[1]: Stopping Name Service Cache Daemon (nsncd)... vm-test-run-timescaledb> server # [ 51.243554] systemd-logind[648]: New seat seat0. vm-test-run-timescaledb> server # [ 51.290168] systemd[1]: nscd.service: Deactivated successfully. vm-test-run-timescaledb> server # [ 51.302281] systemd[1]: Stopped Name Service Cache Daemon (nsncd). vm-test-run-timescaledb> server # [ 51.328932] systemd[1]: Started User Login Management. vm-test-run-timescaledb> server # [ 51.434658] systemd[1]: Starting linger-users.service... vm-test-run-timescaledb> server # [ 51.490045] systemd[1]: Starting Name Service Cache Daemon (nsncd)... vm-test-run-timescaledb> server # [ 52.070105] systemd[1]: linger-users.service: Deactivated successfully. vm-test-run-timescaledb> server # [ 52.097385] systemd[1]: Finished linger-users.service. vm-test-run-timescaledb> server # [ 52.403975] systemd[1]: Started Name Service Cache Daemon (nsncd). vm-test-run-timescaledb> server # [ 52.446903] nsncd[691]: Oct 23 10:40:33.179 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket" vm-test-run-timescaledb> server # [ 52.458291] systemd[1]: Reached target Host and Network Name Lookups. vm-test-run-timescaledb> server # [ 52.471480] systemd[1]: Reached target User and Group Name Lookups. vm-test-run-timescaledb> server # [ 52.991713] systemd[1]: Finished resolvconf update. vm-test-run-timescaledb> server # [ 53.008989] systemd[1]: Reached target Preparation for Network. vm-test-run-timescaledb> server # [ 53.056569] systemd[1]: Starting DHCP Client... vm-test-run-timescaledb> server # [ 54.791623] dhcpcd[739]: dhcpcd-10.2.4 starting vm-test-run-timescaledb> server # [ 54.893886] dhcpcd[763]: dev: loaded udev vm-test-run-timescaledb> server # [ 55.701880] 8021q: 802.1Q VLAN Support v1.8 vm-test-run-timescaledb> server # [ 55.804018] systemd[1]: Found device /dev/hvc0. vm-test-run-timescaledb> server # [ 56.536720] cfg80211: Loading compiled-in X.509 certificates for regulatory database vm-test-run-timescaledb> server # [ 56.842619] Loaded X.509 cert 'sforshee: 00b28ddf47aef9cea7' vm-test-run-timescaledb> server # [ 56.851080] Loaded X.509 cert 'wens: 61c038651aabdcf94bd0ac7ff06c7248db18c600' vm-test-run-timescaledb> server # [ 56.871782] platform regulatory.0: Direct firmware load for regulatory.db failed with error -2 vm-test-run-timescaledb> server # [ 56.878126] cfg80211: failed to load regulatory.db vm-test-run-timescaledb> server # [ 57.801990] 8021q: adding VLAN 0 to HW filter on device eth0 vm-test-run-timescaledb> server # [ 57.677060] dhcpcd[763]: eth0: waiting for carrier vm-test-run-timescaledb> server # [ 57.709523] dhcpcd[763]: eth0: carrier acquired vm-test-run-timescaledb> server # [ 57.904535] dhcpcd[763]: DUID 00:01:00:01:32:6d:f6:26:52:54:00:12:34:56 vm-test-run-timescaledb> server # [ 57.907357] dhcpcd[763]: eth0: IAID 00:12:34:56 vm-test-run-timescaledb> server # [ 57.923650] dhcpcd[763]: eth0: adding address fe80::5054:ff:fe12:3456 vm-test-run-timescaledb> server # [ 58.139317] systemd[1]: Found device /dev/ttyAMA0. vm-test-run-timescaledb> server # [ 58.179511] systemd[1]: Started backdoor.service. vm-test-run-timescaledb> server # [ 58.807823] dhcpcd[763]: eth0: soliciting a DHCP lease vm-test-run-timescaledb> server # [ 58.839095] dhcpcd[763]: eth0: offered 10.0.2.15 from 10.0.2.2 vm-test-run-timescaledb> server # connecting to host... vm-test-run-timescaledb> server # [ 58.870502] dhcpcd[763]: eth0: probing address 10.0.2.15/24 vm-test-run-timescaledb> server: Guest shell says: b'Spawning backdoor root shell...\n' vm-test-run-timescaledb> server: connected to guest root shell vm-test-run-timescaledb> server: (connecting took 60.00 seconds) vm-test-run-timescaledb> server: (finished: waiting for the VM to finish booting, in 60.00 seconds) vm-test-run-timescaledb> server # [ 59.171827] (udev-worker)[779]: eth1: Config file /etc/systemd/network/40-eth1.link is applied to device based on potentially unpredictable interface name. vm-test-run-timescaledb> server # [ 59.179198] (udev-worker)[779]: Network interface NamePolicy= disabled on kernel command line. vm-test-run-timescaledb> server # [ 59.210529] (udev-worker)[787]: Network interface NamePolicy= disabled on kernel command line. vm-test-run-timescaledb> server # [ 59.990265] dhcpcd[763]: eth0: IAID 00:12:34:56 vm-test-run-timescaledb> server # [ 60.193756] systemd[1]: Found device Virtio network device. vm-test-run-timescaledb> server # [ 60.260915] systemd[1]: Starting Address configuration of eth1... vm-test-run-timescaledb> server # [ 60.925528] dhcpcd[763]: eth0: soliciting an IPv6 router vm-test-run-timescaledb> server # [ 60.941832] dhcpcd[763]: eth0: Router Advertisement from fe80::2 vm-test-run-timescaledb> server # [ 60.943748] dhcpcd[763]: eth0: adding address fec0::5054:ff:fe12:3456/64 vm-test-run-timescaledb> server # [ 60.953097] dhcpcd[763]: eth0: adding route to fec0::/64 vm-test-run-timescaledb> server # [ 60.963939] dhcpcd[763]: eth0: adding default route via fe80::2 vm-test-run-timescaledb> server # [ 61.418344] 8021q: adding VLAN 0 to HW filter on device eth1 vm-test-run-timescaledb> server # [ 61.517880] network-addresses-eth1-start[811]: adding address 192.168.1.1/24... done vm-test-run-timescaledb> server # [ 61.598928] dhcpcd[763]: eth0: soliciting a DHCP lease vm-test-run-timescaledb> server # [ 61.604097] dhcpcd[763]: eth0: offered 10.0.2.15 from 10.0.2.2 vm-test-run-timescaledb> server # [ 61.606886] dhcpcd[763]: eth0: probing address 10.0.2.15/24 vm-test-run-timescaledb> server # [ 61.695325] network-addresses-eth1-start[811]: adding address 2001:db8:1::1/64... done vm-test-run-timescaledb> server # [ 61.947619] systemd[1]: Finished Address configuration of eth1. vm-test-run-timescaledb> server # [ 61.979836] systemd[1]: Starting Networking Setup... vm-test-run-timescaledb> server # [ 66.597890] dhcpcd[763]: eth0: leased 10.0.2.15 for 86400 seconds vm-test-run-timescaledb> server # [ 66.599197] dhcpcd[763]: eth0: adding route to 10.0.2.0/24 vm-test-run-timescaledb> server # [ 66.599607] dhcpcd[763]: eth0: adding default route via 10.0.2.2 vm-test-run-timescaledb> server # [ 66.625160] systemd[1]: Finished Networking Setup. vm-test-run-timescaledb> server # [ 66.637766] systemd[1]: Reached target Network. vm-test-run-timescaledb> server # [ 66.671187] systemd[1]: Starting PostgreSQL Database Server... vm-test-run-timescaledb> server # [ 66.729006] systemd[1]: Starting Permit User Sessions... vm-test-run-timescaledb> server # [ 67.331384] systemd[1]: Finished Permit User Sessions. vm-test-run-timescaledb> server # [ 67.405423] systemd[1]: Started Getty on tty1. vm-test-run-timescaledb> server # [ 67.415202] systemd[1]: Reached target Login Prompts. vm-test-run-timescaledb> server # [ 68.536120] l6yd4rrp0smxa1b2if617bpa9fjcfvi1-postgresql-init[956]: Initializing database at /var/lib/postgresql/data vm-test-run-timescaledb> server # [ 70.846049] l6yd4rrp0smxa1b2if617bpa9fjcfvi1-postgresql-init[974]: The files belonging to this database system will be owned by user "postgres". vm-test-run-timescaledb> server # [ 70.865500] l6yd4rrp0smxa1b2if617bpa9fjcfvi1-postgresql-init[974]: This user must also own the server process. vm-test-run-timescaledb> server # [ 70.986406] systemd[1]: Started DHCP Client. vm-test-run-timescaledb> server # [ 70.992060] l6yd4rrp0smxa1b2if617bpa9fjcfvi1-postgresql-init[974]: The database cluster will be initialized with locale "en_US.UTF-8". vm-test-run-timescaledb> server # [ 71.001392] l6yd4rrp0smxa1b2if617bpa9fjcfvi1-postgresql-init[974]: The default database encoding has accordingly been set to "UTF8". vm-test-run-timescaledb> server # [ 71.002218] l6yd4rrp0smxa1b2if617bpa9fjcfvi1-postgresql-init[974]: The default text search configuration will be set to "english". vm-test-run-timescaledb> server # [ 71.003053] l6yd4rrp0smxa1b2if617bpa9fjcfvi1-postgresql-init[974]: Data page checksums are enabled. vm-test-run-timescaledb> server # [ 71.003411] l6yd4rrp0smxa1b2if617bpa9fjcfvi1-postgresql-init[974]: fixing permissions on existing directory /var/lib/postgresql/data ... ok vm-test-run-timescaledb> server # [ 71.009110] l6yd4rrp0smxa1b2if617bpa9fjcfvi1-postgresql-init[974]: creating subdirectories ... ok vm-test-run-timescaledb> server # [ 71.016026] l6yd4rrp0smxa1b2if617bpa9fjcfvi1-postgresql-init[974]: selecting dynamic shared memory implementation ... posix vm-test-run-timescaledb> server # [ 72.395344] l6yd4rrp0smxa1b2if617bpa9fjcfvi1-postgresql-init[974]: selecting default max_connections ... 100 vm-test-run-timescaledb> server # [ 73.429974] l6yd4rrp0smxa1b2if617bpa9fjcfvi1-postgresql-init[974]: selecting default shared_buffers ... 128MB vm-test-run-timescaledb> server # [ 73.842435] systemd-logind[648]: Watching system buttons on /dev/input/event0 (gpio-keys) vm-test-run-timescaledb> server # [ 84.457662] mousedev: PS/2 mouse device common for all mice vm-test-run-timescaledb> server # [ 84.942792] l6yd4rrp0smxa1b2if617bpa9fjcfvi1-postgresql-init[974]: selecting default time zone ... UTC vm-test-run-timescaledb> server # [ 84.978673] l6yd4rrp0smxa1b2if617bpa9fjcfvi1-postgresql-init[974]: creating configuration files ... ok vm-test-run-timescaledb> server # [ 88.261769] systemd-logind[648]: Watching system buttons on /dev/input/event1 (QEMU QEMU USB Keyboard) vm-test-run-timescaledb> server # [ 90.494510] l6yd4rrp0smxa1b2if617bpa9fjcfvi1-postgresql-init[974]: running bootstrap script ... ok vm-test-run-timescaledb> server # [ 103.994038] l6yd4rrp0smxa1b2if617bpa9fjcfvi1-postgresql-init[974]: performing post-bootstrap initialization ... ok vm-test-run-timescaledb> server # [ 107.272091] l6yd4rrp0smxa1b2if617bpa9fjcfvi1-postgresql-init[974]: syncing data to disk ... ok vm-test-run-timescaledb> server # [ 107.277728] l6yd4rrp0smxa1b2if617bpa9fjcfvi1-postgresql-init[974]: initdb: warning: enabling "trust" authentication for local connections vm-test-run-timescaledb> server # [ 107.279024] l6yd4rrp0smxa1b2if617bpa9fjcfvi1-postgresql-init[974]: initdb: hint: You can change this by editing pg_hba.conf or using the option -A, or --auth-local and --auth-host, the next time you run initdb. vm-test-run-timescaledb> server # [ 107.280090] l6yd4rrp0smxa1b2if617bpa9fjcfvi1-postgresql-init[974]: Success. You can now start the database server using: vm-test-run-timescaledb> server # [ 107.290267] l6yd4rrp0smxa1b2if617bpa9fjcfvi1-postgresql-init[974]: /nix/store/i45yhjwwac2d5ygyv0s5gbg2cgdjclf9-postgresql-and-plugins-15.19/bin/pg_ctl -D /var/lib/postgresql/data -l logfile start vm-test-run-timescaledb> server # [ 109.070781] l6yd4rrp0smxa1b2if617bpa9fjcfvi1-postgresql-init[956]: Validating PostgreSQL configuration... vm-test-run-timescaledb> server # [ 109.742911] l6yd4rrp0smxa1b2if617bpa9fjcfvi1-postgresql-init[1384]: pg_stat_statements, pgaudit, plpgsql, plpgsql_check, pg_cron, pg_net, pgsodium, timescaledb, auto_explain, pg_tle, plan_filter, supabase_vault vm-test-run-timescaledb> server # [ 111.277884] postgres[1398]: 2026-10-23 10:41:32.054 UTC [1398] LOG: pgaudit extension initialized vm-test-run-timescaledb> server # [ 111.933200] postgres[1398]: 2026-10-23 10:41:32.717 UTC [1398] LOG: pgsodium primary server secret key loaded vm-test-run-timescaledb> server # [ 112.485246] postgres[1398]: 2026-10-23 10:41:33.214 UTC [1398] LOG: vault primary server secret key loaded vm-test-run-timescaledb> server # [ 113.457748] postgres[1398]: 2026-10-23 10:41:34.226 UTC [1398] LOG: starting PostgreSQL 15.19 on aarch64-unknown-linux-gnu, compiled by gcc (GCC) 15.2.0, 64-bit vm-test-run-timescaledb> server # [ 113.461335] postgres[1398]: 2026-10-23 10:41:34.237 UTC [1398] LOG: listening on IPv4 address "0.0.0.0", port 5432 vm-test-run-timescaledb> server # [ 113.475962] postgres[1398]: 2026-10-23 10:41:34.243 UTC [1398] LOG: listening on IPv6 address "::", port 5432 vm-test-run-timescaledb> server # [ 113.482494] postgres[1398]: 2026-10-23 10:41:34.267 UTC [1398] LOG: listening on Unix socket "/run/postgresql/.s.PGSQL.5432" vm-test-run-timescaledb> server # [ 113.702019] postgres[1444]: 2026-10-23 10:41:34.479 UTC [1444] LOG: database system was shut down at 2026-10-23 10:41:24 UTC vm-test-run-timescaledb> server # [ 114.062238] postgres[1398]: 2026-10-23 10:41:34.843 UTC [1398] LOG: database system is ready to accept connections vm-test-run-timescaledb> server # [ 114.116297] postgres[1450]: 2026-10-23 10:41:34.869 UTC [1450] FATAL: role "postgres" does not exist vm-test-run-timescaledb> server # [ 114.162442] postgres[1449]: 2026-10-23 10:41:34.892 UTC [1449] LOG: TimescaleDB background worker launcher connected to shared catalogs vm-test-run-timescaledb> server # [ 114.273271] systemd[1]: Started PostgreSQL Database Server. vm-test-run-timescaledb> server # [ 114.317947] systemd[1]: Starting Supabase Database Initialization... vm-test-run-timescaledb> server # [ 114.504115] postgres[1398]: 2026-10-23 10:41:35.273 UTC [1398] LOG: background worker "pg_net 0.20.4 worker" (PID 1450) exited with exit code 1 vm-test-run-timescaledb> server # [ 114.590530] postgres[1452]: 2026-10-23 10:41:35.363 UTC [1452] LOG: pg_cron scheduler started vm-test-run-timescaledb> server # [ 114.808195] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Waiting for PostgreSQL to be ready... vm-test-run-timescaledb> server # [ 115.317957] postgres[1460]: ::1 2026-10-23 10:41:36.069 UTC [1460] root@root FATAL: role "root" does not exist vm-test-run-timescaledb> server # [ 115.348427] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: PostgreSQL is ready vm-test-run-timescaledb> server # [ 115.352764] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Creating postgres role... vm-test-run-timescaledb> server # [ 115.506971] postgres[1462]: 2026-10-23 10:41:36.275 UTC [1462] FATAL: role "postgres" does not exist vm-test-run-timescaledb> server # [ 115.578798] postgres[1398]: 2026-10-23 10:41:36.335 UTC [1398] LOG: background worker "pg_net 0.20.4 worker" (PID 1462) exited with exit code 1 vm-test-run-timescaledb> server # [ 115.949508] postgres[1466]: ::1 2026-10-23 10:41:36.703 UTC [1466] supabase_admin@postgres LOG: statement: CREATE ROLE postgres SUPERUSER LOGIN; vm-test-run-timescaledb> server # [ 115.999270] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1461]: CREATE ROLE vm-test-run-timescaledb> server # [ 116.606711] postgres[1475]: ::1 2026-10-23 10:41:37.371 UTC [1475] supabase_admin@postgres LOG: statement: ALTER DATABASE postgres OWNER TO postgres; vm-test-run-timescaledb> server # [ 116.670832] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1470]: ALTER DATABASE vm-test-run-timescaledb> server # [ 116.753830] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running init-script: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/init-scripts/00000000000000-initial-schema.sql vm-test-run-timescaledb> server # [ 117.242285] postgres[1487]: ::1 2026-10-23 10:41:38.003 UTC [1487] postgres@postgres LOG: statement: create publication supabase_realtime; vm-test-run-timescaledb> server # [ 117.299462] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1481]: CREATE PUBLICATION vm-test-run-timescaledb> server # [ 117.301894] postgres[1487]: ::1 2026-10-23 10:41:38.065 UTC [1487] postgres@postgres LOG: statement: alter user supabase_admin with superuser createdb createrole replication bypassrls; vm-test-run-timescaledb> server # [ 117.313500] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1481]: ALTER ROLE vm-test-run-timescaledb> server # [ 117.320897] postgres[1487]: ::1 2026-10-23 10:41:38.102 UTC [1487] postgres@postgres LOG: statement: create user supabase_replication_admin with login replication; vm-test-run-timescaledb> server # [ 117.337009] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1481]: CREATE ROLE vm-test-run-timescaledb> server # [ 117.349305] postgres[1487]: ::1 2026-10-23 10:41:38.127 UTC [1487] postgres@postgres LOG: statement: create user supabase_etl_admin with login replication bypassrls; vm-test-run-timescaledb> server # [ 117.365826] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1481]: CREATE ROLE vm-test-run-timescaledb> server # [ 117.378005] postgres[1487]: ::1 2026-10-23 10:41:38.154 UTC [1487] postgres@postgres LOG: statement: grant pg_read_all_data to supabase_etl_admin; vm-test-run-timescaledb> server # [ 117.413470] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1481]: GRANT ROLE vm-test-run-timescaledb> server # [ 117.434490] postgres[1487]: ::1 2026-10-23 10:41:38.196 UTC [1487] postgres@postgres LOG: statement: grant create on database postgres to supabase_etl_admin; vm-test-run-timescaledb> server # [ 117.448198] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1481]: GRANT vm-test-run-timescaledb> server # [ 117.451300] postgres[1487]: ::1 2026-10-23 10:41:38.232 UTC [1487] postgres@postgres LOG: statement: create role supabase_read_only_user with login bypassrls; vm-test-run-timescaledb> server # [ 117.457437] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1481]: CREATE ROLE vm-test-run-timescaledb> server # [ 117.458263] postgres[1487]: ::1 2026-10-23 10:41:38.243 UTC [1487] postgres@postgres LOG: statement: grant pg_read_all_data to supabase_read_only_user; vm-test-run-timescaledb> server # [ 117.467193] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1481]: GRANT ROLE vm-test-run-timescaledb> server # [ 117.468001] postgres[1487]: ::1 2026-10-23 10:41:38.253 UTC [1487] postgres@postgres LOG: statement: create schema if not exists extensions; vm-test-run-timescaledb> server # [ 117.482303] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1481]: CREATE SCHEMA vm-test-run-timescaledb> server # [ 117.484625] postgres[1487]: ::1 2026-10-23 10:41:38.264 UTC [1487] postgres@postgres LOG: statement: create extension if not exists "uuid-ossp" with schema extensions; vm-test-run-timescaledb> server # [ 120.251871] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1481]: CREATE EXTENSION vm-test-run-timescaledb> server # [ 120.275219] postgres[1487]: ::1 2026-10-23 10:41:41.023 UTC [1487] postgres@postgres LOG: statement: create extension if not exists pgcrypto with schema extensions; vm-test-run-timescaledb> server # [ 121.359902] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1481]: CREATE EXTENSION vm-test-run-timescaledb> server # [ 121.366511] postgres[1487]: ::1 2026-10-23 10:41:42.141 UTC [1487] postgres@postgres LOG: statement: create role anon nologin noinherit; vm-test-run-timescaledb> server # [ 121.371186] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1481]: CREATE ROLE vm-test-run-timescaledb> server # [ 121.374702] postgres[1487]: ::1 2026-10-23 10:41:42.159 UTC [1487] postgres@postgres LOG: statement: create role authenticated nologin noinherit; vm-test-run-timescaledb> server # [ 121.385788] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1481]: CREATE ROLE vm-test-run-timescaledb> server # [ 121.387476] postgres[1487]: ::1 2026-10-23 10:41:42.169 UTC [1487] postgres@postgres LOG: statement: create role service_role nologin noinherit bypassrls; vm-test-run-timescaledb> server # [ 121.393822] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1481]: CREATE ROLE vm-test-run-timescaledb> server # [ 121.397938] postgres[1487]: ::1 2026-10-23 10:41:42.181 UTC [1487] postgres@postgres LOG: statement: create user authenticator noinherit; vm-test-run-timescaledb> server # [ 121.410910] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1481]: CREATE ROLE vm-test-run-timescaledb> server # [ 121.414729] postgres[1487]: ::1 2026-10-23 10:41:42.195 UTC [1487] postgres@postgres LOG: statement: grant anon to authenticator; vm-test-run-timescaledb> server # [ 121.420992] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1481]: GRANT ROLE vm-test-run-timescaledb> server # [ 121.426384] postgres[1487]: ::1 2026-10-23 10:41:42.207 UTC [1487] postgres@postgres LOG: statement: grant authenticated to authenticator; vm-test-run-timescaledb> server # [ 121.434296] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1481]: GRANT ROLE vm-test-run-timescaledb> server # [ 121.435325] postgres[1487]: ::1 2026-10-23 10:41:42.218 UTC [1487] postgres@postgres LOG: statement: grant service_role to authenticator; vm-test-run-timescaledb> server # [ 121.442414] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1481]: GRANT ROLE vm-test-run-timescaledb> server # [ 121.448798] postgres[1487]: ::1 2026-10-23 10:41:42.231 UTC [1487] postgres@postgres LOG: statement: grant supabase_admin to authenticator; vm-test-run-timescaledb> server # [ 121.455303] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1481]: GRANT ROLE vm-test-run-timescaledb> server # [ 121.457591] postgres[1487]: ::1 2026-10-23 10:41:42.241 UTC [1487] postgres@postgres LOG: statement: grant usage on schema public to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 121.470256] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1481]: GRANT vm-test-run-timescaledb> server # [ 121.471961] postgres[1487]: ::1 2026-10-23 10:41:42.253 UTC [1487] postgres@postgres LOG: statement: alter default privileges in schema public grant all on tables to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 121.486466] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1481]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 121.495471] postgres[1487]: ::1 2026-10-23 10:41:42.274 UTC [1487] postgres@postgres LOG: statement: alter default privileges in schema public grant all on functions to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 121.498440] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1481]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 121.503286] postgres[1487]: ::1 2026-10-23 10:41:42.285 UTC [1487] postgres@postgres LOG: statement: alter default privileges in schema public grant all on sequences to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 121.514331] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1481]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 121.518026] postgres[1487]: ::1 2026-10-23 10:41:42.301 UTC [1487] postgres@postgres LOG: statement: grant usage on schema extensions to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 121.529896] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1481]: GRANT vm-test-run-timescaledb> server # [ 121.533093] postgres[1487]: ::1 2026-10-23 10:41:42.317 UTC [1487] postgres@postgres LOG: statement: alter user supabase_admin SET search_path TO public, extensions; vm-test-run-timescaledb> server # [ 121.543638] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1481]: ALTER ROLE vm-test-run-timescaledb> server # [ 121.548372] postgres[1487]: ::1 2026-10-23 10:41:42.331 UTC [1487] postgres@postgres LOG: statement: alter default privileges for user supabase_admin in schema public grant all vm-test-run-timescaledb> server # [ 121.551074] postgres[1487]: on sequences to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 121.556844] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1481]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 121.561231] postgres[1487]: ::1 2026-10-23 10:41:42.344 UTC [1487] postgres@postgres LOG: statement: alter default privileges for user supabase_admin in schema public grant all vm-test-run-timescaledb> server # [ 121.562367] postgres[1487]: on tables to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 121.568465] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1481]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 121.570345] postgres[1487]: ::1 2026-10-23 10:41:42.355 UTC [1487] postgres@postgres LOG: statement: alter default privileges for user supabase_admin in schema public grant all vm-test-run-timescaledb> server # [ 121.571271] postgres[1487]: on functions to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 121.581472] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1481]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 121.583925] postgres[1487]: ::1 2026-10-23 10:41:42.369 UTC [1487] postgres@postgres LOG: statement: alter role anon set statement_timeout = '3s'; vm-test-run-timescaledb> server # [ 121.596105] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1481]: ALTER ROLE vm-test-run-timescaledb> server # [ 121.601139] postgres[1487]: ::1 2026-10-23 10:41:42.383 UTC [1487] postgres@postgres LOG: statement: alter role authenticated set statement_timeout = '8s'; vm-test-run-timescaledb> server # [ 121.609682] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1481]: ALTER ROLE vm-test-run-timescaledb> server # [ 121.659528] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running init-script: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/init-scripts/00000000000001-auth-schema.sql vm-test-run-timescaledb> server # [ 121.904270] postgres[1522]: ::1 2026-10-23 10:41:42.680 UTC [1522] postgres@postgres LOG: statement: CREATE SCHEMA IF NOT EXISTS auth AUTHORIZATION supabase_admin; vm-test-run-timescaledb> server # [ 121.943738] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: CREATE SCHEMA vm-test-run-timescaledb> server # [ 121.953945] postgres[1522]: ::1 2026-10-23 10:41:42.725 UTC [1522] postgres@postgres LOG: statement: CREATE TABLE auth.users ( vm-test-run-timescaledb> server # [ 121.955150] postgres[1522]: instance_id uuid NULL, vm-test-run-timescaledb> server # [ 121.956031] postgres[1522]: id uuid NOT NULL UNIQUE, vm-test-run-timescaledb> server # [ 121.956344] postgres[1522]: aud varchar(255) NULL, vm-test-run-timescaledb> server # [ 121.956786] postgres[1522]: "role" varchar(255) NULL, vm-test-run-timescaledb> server # [ 121.962563] postgres[1522]: email varchar(255) NULL UNIQUE, vm-test-run-timescaledb> server # [ 121.973153] postgres[1522]: encrypted_password varchar(255) NULL, vm-test-run-timescaledb> server # [ 121.973875] postgres[1522]: confirmed_at timestamptz NULL, vm-test-run-timescaledb> server # [ 121.974924] postgres[1522]: invited_at timestamptz NULL, vm-test-run-timescaledb> server # [ 121.975720] postgres[1522]: confirmation_token varchar(255) NULL, vm-test-run-timescaledb> server # [ 121.976097] postgres[1522]: confirmation_sent_at timestamptz NULL, vm-test-run-timescaledb> server # [ 121.976490] postgres[1522]: recovery_token varchar(255) NULL, vm-test-run-timescaledb> server # [ 121.977179] postgres[1522]: recovery_sent_at timestamptz NULL, vm-test-run-timescaledb> server # [ 121.991139] postgres[1522]: email_change_token varchar(255) NULL, vm-test-run-timescaledb> server # [ 121.998337] postgres[1522]: email_change varchar(255) NULL, vm-test-run-timescaledb> server # [ 121.999771] postgres[1522]: email_change_sent_at timestamptz NULL, vm-test-run-timescaledb> server # [ 122.002747] postgres[1522]: last_sign_in_at timestamptz NULL, vm-test-run-timescaledb> server # [ 122.006341] postgres[1522]: raw_app_meta_data jsonb NULL, vm-test-run-timescaledb> server # [ 122.007685] postgres[1522]: raw_user_meta_data jsonb NULL, vm-test-run-timescaledb> server # [ 122.013232] postgres[1522]: is_super_admin bool NULL, vm-test-run-timescaledb> server # [ 122.014442] postgres[1522]: created_at timestamptz NULL, vm-test-run-timescaledb> server # [ 122.015474] postgres[1522]: updated_at timestamptz NULL, vm-test-run-timescaledb> server # [ 122.015942] postgres[1522]: CONSTRAINT users_pkey PRIMARY KEY (id) vm-test-run-timescaledb> server # [ 122.023439] postgres[1522]: ); vm-test-run-timescaledb> server # [ 122.182576] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: CREATE TABLE vm-test-run-timescaledb> server # [ 122.189558] postgres[1522]: ::1 2026-10-23 10:41:42.973 UTC [1522] postgres@postgres LOG: statement: CREATE INDEX users_instance_id_email_idx ON auth.users USING btree (instance_id, email); vm-test-run-timescaledb> server # [ 122.232805] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: CREATE INDEX vm-test-run-timescaledb> server # [ 122.233835] postgres[1522]: ::1 2026-10-23 10:41:43.018 UTC [1522] postgres@postgres LOG: statement: CREATE INDEX users_instance_id_idx ON auth.users USING btree (instance_id); vm-test-run-timescaledb> server # [ 122.270898] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: CREATE INDEX vm-test-run-timescaledb> server # [ 122.277457] postgres[1522]: ::1 2026-10-23 10:41:43.060 UTC [1522] postgres@postgres LOG: statement: comment on table auth.users is 'Auth: Stores user login data within a secure schema.'; vm-test-run-timescaledb> server # [ 122.289236] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: COMMENT vm-test-run-timescaledb> server # [ 122.296029] postgres[1522]: ::1 2026-10-23 10:41:43.077 UTC [1522] postgres@postgres LOG: statement: CREATE TABLE auth.refresh_tokens ( vm-test-run-timescaledb> server # [ 122.299642] postgres[1522]: instance_id uuid NULL, vm-test-run-timescaledb> server # [ 122.300480] postgres[1522]: id bigserial NOT NULL, vm-test-run-timescaledb> server # [ 122.300958] postgres[1522]: "token" varchar(255) NULL, vm-test-run-timescaledb> server # [ 122.303091] postgres[1522]: user_id varchar(255) NULL, vm-test-run-timescaledb> server # [ 122.304226] postgres[1522]: revoked bool NULL, vm-test-run-timescaledb> server # [ 122.305526] postgres[1522]: created_at timestamptz NULL, vm-test-run-timescaledb> server # [ 122.305974] postgres[1522]: updated_at timestamptz NULL, vm-test-run-timescaledb> server # [ 122.306839] postgres[1522]: CONSTRAINT refresh_tokens_pkey PRIMARY KEY (id) vm-test-run-timescaledb> server # [ 122.307493] postgres[1522]: ); vm-test-run-timescaledb> server # [ 122.409819] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: CREATE TABLE vm-test-run-timescaledb> server # [ 122.414112] postgres[1522]: ::1 2026-10-23 10:41:43.198 UTC [1522] postgres@postgres LOG: statement: CREATE INDEX refresh_tokens_instance_id_idx ON auth.refresh_tokens USING btree (instance_id); vm-test-run-timescaledb> server # [ 122.461638] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: CREATE INDEX vm-test-run-timescaledb> server # [ 122.463056] postgres[1522]: ::1 2026-10-23 10:41:43.245 UTC [1522] postgres@postgres LOG: statement: CREATE INDEX refresh_tokens_instance_id_user_id_idx ON auth.refresh_tokens USING btree (instance_id, user_id); vm-test-run-timescaledb> server # [ 122.537534] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: CREATE INDEX vm-test-run-timescaledb> server # [ 122.539289] postgres[1522]: ::1 2026-10-23 10:41:43.318 UTC [1522] postgres@postgres LOG: statement: CREATE INDEX refresh_tokens_token_idx ON auth.refresh_tokens USING btree (token); vm-test-run-timescaledb> server # [ 122.605125] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: CREATE INDEX vm-test-run-timescaledb> server # [ 122.629112] postgres[1522]: ::1 2026-10-23 10:41:43.399 UTC [1522] postgres@postgres LOG: statement: comment on table auth.refresh_tokens is 'Auth: Store of tokens used to refresh JWT tokens once they expire.'; vm-test-run-timescaledb> server # [ 122.646419] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: COMMENT vm-test-run-timescaledb> server # [ 122.653374] postgres[1522]: ::1 2026-10-23 10:41:43.433 UTC [1522] postgres@postgres LOG: statement: CREATE TABLE auth.instances ( vm-test-run-timescaledb> server # [ 122.654064] postgres[1522]: id uuid NOT NULL, vm-test-run-timescaledb> server # [ 122.655042] postgres[1522]: uuid uuid NULL, vm-test-run-timescaledb> server # [ 122.655760] postgres[1522]: raw_base_config text NULL, vm-test-run-timescaledb> server # [ 122.665278] postgres[1522]: created_at timestamptz NULL, vm-test-run-timescaledb> server # [ 122.665970] postgres[1522]: updated_at timestamptz NULL, vm-test-run-timescaledb> server # [ 122.666267] postgres[1522]: CONSTRAINT instances_pkey PRIMARY KEY (id) vm-test-run-timescaledb> server # [ 122.666528] postgres[1522]: ); vm-test-run-timescaledb> server # [ 122.741395] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: CREATE TABLE vm-test-run-timescaledb> server # [ 122.743067] postgres[1522]: ::1 2026-10-23 10:41:43.524 UTC [1522] postgres@postgres LOG: statement: comment on table auth.instances is 'Auth: Manages users across multiple sites.'; vm-test-run-timescaledb> server # [ 122.763033] postgres[1522]: ::1 2026-10-23 10:41:43.532 UTC [1522] postgres@postgres LOG: statement: CREATE TABLE auth.audit_log_entries ( vm-test-run-timescaledb> server # [ 122.763708] postgres[1522]: instance_id uuid NULL, vm-test-run-timescaledb> server # [ 122.763998] postgres[1522]: id uuid NOT NULL, vm-test-run-timescaledb> server # [ 122.765561] postgres[1522]: payload json NULL, vm-test-run-timescaledb> server # [ 122.766174] postgres[1522]: created_at timestamptz NULL, vm-test-run-timescaledb> server # [ 122.771160] postgres[1522]: CONSTRAINT audit_log_entries_pkey PRIMARY KEY (id) vm-test-run-timescaledb> server # [ 122.783692] postgres[1522]: ); vm-test-run-timescaledb> server # [ 122.801441] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: COMMENT vm-test-run-timescaledb> server # [ 122.825616] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: CREATE TABLE vm-test-run-timescaledb> server # [ 122.826589] postgres[1522]: ::1 2026-10-23 10:41:43.611 UTC [1522] postgres@postgres LOG: statement: CREATE INDEX audit_logs_instance_id_idx ON auth.audit_log_entries USING btree (instance_id); vm-test-run-timescaledb> server # [ 122.865324] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: CREATE INDEX vm-test-run-timescaledb> server # [ 122.873088] postgres[1522]: ::1 2026-10-23 10:41:43.654 UTC [1522] postgres@postgres LOG: statement: comment on table auth.audit_log_entries is 'Auth: Audit trail for user actions.'; vm-test-run-timescaledb> server # [ 122.886252] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: COMMENT vm-test-run-timescaledb> server # [ 122.887213] postgres[1522]: ::1 2026-10-23 10:41:43.672 UTC [1522] postgres@postgres LOG: statement: CREATE TABLE auth.schema_migrations ( vm-test-run-timescaledb> server # [ 122.887637] postgres[1522]: "version" varchar(255) NOT NULL, vm-test-run-timescaledb> server # [ 122.887918] postgres[1522]: CONSTRAINT schema_migrations_pkey PRIMARY KEY ("version") vm-test-run-timescaledb> server # [ 122.892819] postgres[1522]: ); vm-test-run-timescaledb> server # [ 122.954100] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: CREATE TABLE vm-test-run-timescaledb> server # [ 122.955395] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: COMMENT vm-test-run-timescaledb> server # [ 122.958775] postgres[1522]: ::1 2026-10-23 10:41:43.730 UTC [1522] postgres@postgres LOG: statement: comment on table auth.schema_migrations is 'Auth: Manages updates to the auth system.'; vm-test-run-timescaledb> server # [ 122.997641] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: INSERT 0 7 vm-test-run-timescaledb> server # [ 123.001239] postgres[1522]: ::1 2026-10-23 10:41:43.784 UTC [1522] postgres@postgres LOG: statement: create or replace function auth.uid() returns uuid as $$ vm-test-run-timescaledb> server # [ 123.016164] postgres[1522]: select nullif(current_setting('request.jwt.claim.sub', true), '')::uuid; vm-test-run-timescaledb> server # [ 123.021744] postgres[1522]: $$ language sql stable; vm-test-run-timescaledb> server # [ 123.035487] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 123.044917] postgres[1522]: ::1 2026-10-23 10:41:43.824 UTC [1522] postgres@postgres LOG: statement: create or replace function auth.role() returns text as $$ vm-test-run-timescaledb> server # [ 123.046472] postgres[1522]: select nullif(current_setting('request.jwt.claim.role', true), '')::text; vm-test-run-timescaledb> server # [ 123.047642] postgres[1522]: $$ language sql stable; vm-test-run-timescaledb> server # [ 123.078839] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 123.082481] postgres[1522]: ::1 2026-10-23 10:41:43.867 UTC [1522] postgres@postgres LOG: statement: create or replace function auth.email() returns text as $$ vm-test-run-timescaledb> server # [ 123.084624] postgres[1522]: select nullif(current_setting('request.jwt.claim.email', true), '')::text; vm-test-run-timescaledb> server # [ 123.085125] postgres[1522]: $$ language sql stable; vm-test-run-timescaledb> server # [ 123.099500] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 123.101363] postgres[1522]: ::1 2026-10-23 10:41:43.885 UTC [1522] postgres@postgres LOG: statement: GRANT USAGE ON SCHEMA auth TO anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 123.111675] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: GRANT vm-test-run-timescaledb> server # [ 123.113931] postgres[1522]: ::1 2026-10-23 10:41:43.898 UTC [1522] postgres@postgres LOG: statement: CREATE USER supabase_auth_admin NOINHERIT CREATEROLE LOGIN NOREPLICATION; vm-test-run-timescaledb> server # [ 123.125359] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: CREATE ROLE vm-test-run-timescaledb> server # [ 123.127692] postgres[1522]: ::1 2026-10-23 10:41:43.909 UTC [1522] postgres@postgres LOG: statement: GRANT ALL PRIVILEGES ON SCHEMA auth TO supabase_auth_admin; vm-test-run-timescaledb> server # [ 123.134325] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: GRANT vm-test-run-timescaledb> server # [ 123.141849] postgres[1522]: ::1 2026-10-23 10:41:43.923 UTC [1522] postgres@postgres LOG: statement: GRANT ALL PRIVILEGES ON ALL TABLES IN SCHEMA auth TO supabase_auth_admin; vm-test-run-timescaledb> server # [ 123.175502] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: GRANT vm-test-run-timescaledb> server # [ 123.183345] postgres[1522]: ::1 2026-10-23 10:41:43.964 UTC [1522] postgres@postgres LOG: statement: GRANT ALL PRIVILEGES ON ALL SEQUENCES IN SCHEMA auth TO supabase_auth_admin; vm-test-run-timescaledb> server # [ 123.210775] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: GRANT vm-test-run-timescaledb> server # [ 123.224123] postgres[1522]: ::1 2026-10-23 10:41:44.000 UTC [1522] postgres@postgres LOG: statement: ALTER USER supabase_auth_admin SET search_path = "auth"; vm-test-run-timescaledb> server # [ 123.241097] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: ALTER ROLE vm-test-run-timescaledb> server # [ 123.249010] postgres[1522]: ::1 2026-10-23 10:41:44.028 UTC [1522] postgres@postgres LOG: statement: ALTER table "auth".users OWNER TO supabase_auth_admin; vm-test-run-timescaledb> server # [ 123.311986] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: ALTER TABLE vm-test-run-timescaledb> server # [ 123.317516] postgres[1522]: ::1 2026-10-23 10:41:44.100 UTC [1522] postgres@postgres LOG: statement: ALTER table "auth".refresh_tokens OWNER TO supabase_auth_admin; vm-test-run-timescaledb> server # [ 123.346673] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: ALTER TABLE vm-test-run-timescaledb> server # [ 123.363376] postgres[1522]: ::1 2026-10-23 10:41:44.135 UTC [1522] postgres@postgres LOG: statement: ALTER table "auth".audit_log_entries OWNER TO supabase_auth_admin; vm-test-run-timescaledb> server # [ 123.395233] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: ALTER TABLE vm-test-run-timescaledb> server # [ 123.402824] postgres[1522]: ::1 2026-10-23 10:41:44.185 UTC [1522] postgres@postgres LOG: statement: ALTER table "auth".instances OWNER TO supabase_auth_admin; vm-test-run-timescaledb> server # [ 123.413300] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: ALTER TABLE vm-test-run-timescaledb> server # [ 123.421214] postgres[1522]: ::1 2026-10-23 10:41:44.202 UTC [1522] postgres@postgres LOG: statement: ALTER table "auth".schema_migrations OWNER TO supabase_auth_admin; vm-test-run-timescaledb> server # [ 123.430474] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: ALTER TABLE vm-test-run-timescaledb> server # [ 123.498219] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running init-script: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/init-scripts/00000000000002-storage-schema.sql vm-test-run-timescaledb> server # [ 123.831641] postgres[1548]: ::1 2026-10-23 10:41:44.604 UTC [1548] postgres@postgres LOG: statement: CREATE SCHEMA IF NOT EXISTS storage AUTHORIZATION supabase_admin; vm-test-run-timescaledb> server # [ 123.843897] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1543]: CREATE SCHEMA vm-test-run-timescaledb> server # [ 123.858578] postgres[1548]: ::1 2026-10-23 10:41:44.624 UTC [1548] postgres@postgres LOG: statement: CREATE USER supabase_storage_admin NOINHERIT CREATEROLE LOGIN NOREPLICATION; vm-test-run-timescaledb> server # [ 123.860174] postgres[1548]: ::1 2026-10-23 10:41:44.639 UTC [1548] postgres@postgres LOG: statement: ALTER USER supabase_storage_admin SET search_path = "storage"; vm-test-run-timescaledb> server # [ 123.861750] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1543]: CREATE ROLE vm-test-run-timescaledb> server # [ 123.869981] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1543]: ALTER ROLE vm-test-run-timescaledb> server # [ 123.871318] postgres[1548]: ::1 2026-10-23 10:41:44.650 UTC [1548] postgres@postgres LOG: statement: GRANT CREATE ON DATABASE postgres TO supabase_storage_admin; vm-test-run-timescaledb> server # [ 123.877679] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1543]: GRANT vm-test-run-timescaledb> server # [ 123.977785] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1543]: DO vm-test-run-timescaledb> server # [ 124.027766] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running init-script: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/init-scripts/00000000000003-post-setup.sql vm-test-run-timescaledb> server # [ 124.401994] postgres[1554]: ::1 2026-10-23 10:41:45.179 UTC [1554] postgres@postgres LOG: statement: ALTER ROLE supabase_admin SET search_path TO "\$user",public,auth,extensions; vm-test-run-timescaledb> server # [ 124.450165] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1552]: ALTER ROLE vm-test-run-timescaledb> server # [ 124.454526] postgres[1554]: ::1 2026-10-23 10:41:45.209 UTC [1554] postgres@postgres LOG: statement: ALTER ROLE postgres SET search_path TO "\$user",public,extensions; vm-test-run-timescaledb> server # [ 124.455624] postgres[1554]: ::1 2026-10-23 10:41:45.231 UTC [1554] postgres@postgres LOG: statement: CREATE OR REPLACE FUNCTION extensions.grant_pg_cron_access() vm-test-run-timescaledb> server # [ 124.456149] postgres[1554]: RETURNS event_trigger vm-test-run-timescaledb> server # [ 124.456456] postgres[1554]: LANGUAGE plpgsql vm-test-run-timescaledb> server # [ 124.460918] postgres[1554]: AS $$ vm-test-run-timescaledb> server # [ 124.462114] postgres[1554]: DECLARE vm-test-run-timescaledb> server # [ 124.463319] postgres[1554]: schema_is_cron bool; vm-test-run-timescaledb> server # [ 124.463942] postgres[1554]: BEGIN vm-test-run-timescaledb> server # [ 124.465903] postgres[1554]: schema_is_cron = ( vm-test-run-timescaledb> server # [ 124.466737] postgres[1554]: SELECT n.nspname = 'cron' vm-test-run-timescaledb> server # [ 124.467489] postgres[1554]: FROM pg_event_trigger_ddl_commands() AS ev vm-test-run-timescaledb> server # [ 124.473636] postgres[1554]: LEFT JOIN pg_catalog.pg_namespace AS n vm-test-run-timescaledb> server # [ 124.474383] postgres[1554]: ON ev.objid = n.oid vm-test-run-timescaledb> server # [ 124.474900] postgres[1554]: ); vm-test-run-timescaledb> server # [ 124.475949] postgres[1554]: vm-test-run-timescaledb> server # [ 124.479499] postgres[1554]: IF schema_is_cron vm-test-run-timescaledb> server # [ 124.485493] postgres[1554]: THEN vm-test-run-timescaledb> server # [ 124.486078] postgres[1554]: grant usage on schema cron to postgres with grant option; vm-test-run-timescaledb> server # [ 124.486375] postgres[1554]: vm-test-run-timescaledb> server # [ 124.486586] postgres[1554]: alter default privileges in schema cron grant all on tables to postgres with grant option; vm-test-run-timescaledb> server # [ 124.487331] postgres[1554]: alter default privileges in schema cron grant all on functions to postgres with grant option; vm-test-run-timescaledb> server # [ 124.488074] postgres[1554]: alter default privileges in schema cron grant all on sequences to postgres with grant option; vm-test-run-timescaledb> server # [ 124.489907] postgres[1554]: vm-test-run-timescaledb> server # [ 124.490349] postgres[1554]: alter default privileges for user supabase_admin in schema cron grant all vm-test-run-timescaledb> server # [ 124.491147] postgres[1554]: on sequences to postgres with grant option; vm-test-run-timescaledb> server # [ 124.491469] postgres[1554]: alter default privileges for user supabase_admin in schema cron grant all vm-test-run-timescaledb> server # [ 124.491877] postgres[1554]: on tables to postgres with grant option; vm-test-run-timescaledb> server # [ 124.498314] postgres[1554]: alter default privileges for user supabase_admin in schema cron grant all vm-test-run-timescaledb> server # [ 124.498785] postgres[1554]: on functions to postgres with grant option; vm-test-run-timescaledb> server # [ 124.499540] postgres[1554]: vm-test-run-timescaledb> server # [ 124.506114] postgres[1554]: grant all privileges on all tables in schema cron to postgres with grant option; vm-test-run-timescaledb> server # [ 124.506981] postgres[1554]: vm-test-run-timescaledb> server # [ 124.507303] postgres[1554]: END IF; vm-test-run-timescaledb> server # [ 124.507546] postgres[1554]: vm-test-run-timescaledb> server # [ 124.508295] postgres[1554]: END; vm-test-run-timescaledb> server # [ 124.518460] postgres[1554]: $$; vm-test-run-timescaledb> server # [ 124.521341] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1552]: ALTER ROLE vm-test-run-timescaledb> server # [ 124.545504] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1552]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 124.556953] postgres[1554]: ::1 2026-10-23 10:41:45.338 UTC [1554] postgres@postgres LOG: statement: CREATE EVENT TRIGGER issue_pg_cron_access ON ddl_command_end WHEN TAG in ('CREATE SCHEMA') vm-test-run-timescaledb> server # [ 124.558885] postgres[1554]: EXECUTE PROCEDURE extensions.grant_pg_cron_access(); vm-test-run-timescaledb> server # [ 124.585780] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1552]: CREATE EVENT TRIGGER vm-test-run-timescaledb> server # [ 124.589930] postgres[1554]: ::1 2026-10-23 10:41:45.373 UTC [1554] postgres@postgres LOG: statement: COMMENT ON FUNCTION extensions.grant_pg_cron_access IS 'Grants access to pg_cron'; vm-test-run-timescaledb> server # [ 124.604225] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1552]: COMMENT vm-test-run-timescaledb> server # [ 124.614503] postgres[1554]: ::1 2026-10-23 10:41:45.391 UTC [1554] postgres@postgres LOG: statement: CREATE OR REPLACE FUNCTION extensions.grant_pg_net_access() vm-test-run-timescaledb> server # [ 124.615557] postgres[1554]: RETURNS event_trigger vm-test-run-timescaledb> server # [ 124.615844] postgres[1554]: LANGUAGE plpgsql vm-test-run-timescaledb> server # [ 124.616066] postgres[1554]: AS $$ vm-test-run-timescaledb> server # [ 124.616263] postgres[1554]: BEGIN vm-test-run-timescaledb> server # [ 124.619985] postgres[1554]: IF EXISTS ( vm-test-run-timescaledb> server # [ 124.625001] postgres[1554]: SELECT 1 vm-test-run-timescaledb> server # [ 124.626089] postgres[1554]: FROM pg_event_trigger_ddl_commands() AS ev vm-test-run-timescaledb> server # [ 124.626477] postgres[1554]: JOIN pg_extension AS ext vm-test-run-timescaledb> server # [ 124.627191] postgres[1554]: ON ev.objid = ext.oid vm-test-run-timescaledb> server # [ 124.627472] postgres[1554]: WHERE ext.extname = 'pg_net' vm-test-run-timescaledb> server # [ 124.627928] postgres[1554]: ) vm-test-run-timescaledb> server # [ 124.628179] postgres[1554]: THEN vm-test-run-timescaledb> server # [ 124.638762] postgres[1554]: IF NOT EXISTS ( vm-test-run-timescaledb> server # [ 124.643414] postgres[1554]: SELECT 1 vm-test-run-timescaledb> server # [ 124.644068] postgres[1554]: FROM pg_roles vm-test-run-timescaledb> server # [ 124.647035] postgres[1554]: WHERE rolname = 'supabase_functions_admin' vm-test-run-timescaledb> server # [ 124.656112] postgres[1554]: ) vm-test-run-timescaledb> server # [ 124.663532] postgres[1554]: THEN vm-test-run-timescaledb> server # [ 124.669895] postgres[1554]: CREATE USER supabase_functions_admin NOINHERIT CREATEROLE LOGIN NOREPLICATION; vm-test-run-timescaledb> server # [ 124.671777] postgres[1554]: END IF; vm-test-run-timescaledb> server # [ 124.677074] postgres[1554]: vm-test-run-timescaledb> server # [ 124.677584] postgres[1554]: GRANT USAGE ON SCHEMA net TO supabase_functions_admin, postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 124.678326] postgres[1554]: vm-test-run-timescaledb> server # [ 124.679788] postgres[1554]: ALTER function net.http_get(url text, params jsonb, headers jsonb, timeout_milliseconds integer) SECURITY DEFINER; vm-test-run-timescaledb> server # [ 124.687050] postgres[1554]: ALTER function net.http_post(url text, body jsonb, params jsonb, headers jsonb, timeout_milliseconds integer) SECURITY DEFINER; vm-test-run-timescaledb> server # [ 124.690659] postgres[1554]: vm-test-run-timescaledb> server # [ 124.692127] postgres[1554]: ALTER function net.http_get(url text, params jsonb, headers jsonb, timeout_milliseconds integer) SET search_path = net; vm-test-run-timescaledb> server # [ 124.694837] postgres[1554]: ALTER function net.http_post(url text, body jsonb, params jsonb, headers jsonb, timeout_milliseconds integer) SET search_path = net; vm-test-run-timescaledb> server # [ 124.696108] postgres[1554]: vm-test-run-timescaledb> server # [ 124.702553] postgres[1554]: REVOKE ALL ON FUNCTION net.http_get(url text, params jsonb, headers jsonb, timeout_milliseconds integer) FROM PUBLIC; vm-test-run-timescaledb> server # [ 124.704058] postgres[1554]: REVOKE ALL ON FUNCTION net.http_post(url text, body jsonb, params jsonb, headers jsonb, timeout_milliseconds integer) FROM PUBLIC; vm-test-run-timescaledb> server # [ 124.707626] postgres[1554]: vm-test-run-timescaledb> server # [ 124.709928] postgres[1554]: GRANT EXECUTE ON FUNCTION net.http_get(url text, params jsonb, headers jsonb, timeout_milliseconds integer) TO supabase_functions_admin, postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 124.710973] postgres[1554]: GRANT EXECUTE ON FUNCTION net.http_post(url text, body jsonb, params jsonb, headers jsonb, timeout_milliseconds integer) TO supabase_functions_admin, postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 124.723629] postgres[1554]: END IF; vm-test-run-timescaledb> server # [ 124.729183] postgres[1554]: END; vm-test-run-timescaledb> server # [ 124.730736] postgres[1554]: $$; vm-test-run-timescaledb> server # [ 124.732333] postgres[1554]: ::1 2026-10-23 10:41:45.421 UTC [1554] postgres@postgres LOG: statement: COMMENT ON FUNCTION extensions.grant_pg_net_access IS 'Grants access to pg_net'; vm-test-run-timescaledb> server # [ 124.734471] postgres[1554]: ::1 2026-10-23 10:41:45.503 UTC [1554] postgres@postgres LOG: statement: CREATE ROLE dashboard_user NOSUPERUSER CREATEDB CREATEROLE REPLICATION; vm-test-run-timescaledb> server # [ 124.736359] postgres[1554]: ::1 2026-10-23 10:41:45.516 UTC [1554] postgres@postgres LOG: statement: GRANT ALL ON DATABASE postgres TO dashboard_user; vm-test-run-timescaledb> server # [ 124.748342] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1552]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 124.754469] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1552]: COMMENT vm-test-run-timescaledb> server # [ 124.755050] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1552]: DO vm-test-run-timescaledb> server # [ 124.755997] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1552]: CREATE ROLE vm-test-run-timescaledb> server # [ 124.757222] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1552]: GRANT vm-test-run-timescaledb> server # [ 124.758084] postgres[1554]: ::1 2026-10-23 10:41:45.526 UTC [1554] postgres@postgres LOG: statement: GRANT ALL ON SCHEMA auth TO dashboard_user; vm-test-run-timescaledb> server # [ 124.761056] postgres[1554]: ::1 2026-10-23 10:41:45.538 UTC [1554] postgres@postgres LOG: statement: GRANT ALL ON SCHEMA extensions TO dashboard_user; vm-test-run-timescaledb> server # [ 124.762322] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1552]: GRANT vm-test-run-timescaledb> server # [ 124.765717] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1552]: GRANT vm-test-run-timescaledb> server # [ 124.768732] postgres[1554]: ::1 2026-10-23 10:41:45.551 UTC [1554] postgres@postgres LOG: statement: GRANT ALL ON ALL TABLES IN SCHEMA auth TO dashboard_user; vm-test-run-timescaledb> server # [ 124.777922] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1552]: GRANT vm-test-run-timescaledb> server # [ 124.781715] postgres[1554]: ::1 2026-10-23 10:41:45.565 UTC [1554] postgres@postgres LOG: statement: GRANT ALL ON ALL TABLES IN SCHEMA extensions TO dashboard_user; vm-test-run-timescaledb> server # [ 124.786525] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1552]: GRANT vm-test-run-timescaledb> server # [ 124.788876] postgres[1554]: ::1 2026-10-23 10:41:45.571 UTC [1554] postgres@postgres LOG: statement: GRANT ALL ON ALL SEQUENCES IN SCHEMA auth TO dashboard_user; vm-test-run-timescaledb> server # [ 124.799193] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1552]: GRANT vm-test-run-timescaledb> server # [ 124.805405] postgres[1554]: ::1 2026-10-23 10:41:45.582 UTC [1554] postgres@postgres LOG: statement: GRANT ALL ON ALL SEQUENCES IN SCHEMA extensions TO dashboard_user; vm-test-run-timescaledb> server # [ 124.807034] postgres[1554]: ::1 2026-10-23 10:41:45.587 UTC [1554] postgres@postgres LOG: statement: GRANT ALL ON ALL ROUTINES IN SCHEMA auth TO dashboard_user; vm-test-run-timescaledb> server # [ 124.812690] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1552]: GRANT vm-test-run-timescaledb> server # [ 124.822190] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1552]: GRANT vm-test-run-timescaledb> server # [ 124.829540] postgres[1554]: ::1 2026-10-23 10:41:45.609 UTC [1554] postgres@postgres LOG: statement: GRANT ALL ON ALL ROUTINES IN SCHEMA extensions TO dashboard_user; vm-test-run-timescaledb> server # [ 124.858782] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1552]: GRANT vm-test-run-timescaledb> server # [ 124.880118] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1552]: DO vm-test-run-timescaledb> server # [ 124.931864] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running pgbouncer auth schema... vm-test-run-timescaledb> server # [ 125.187966] postgres[1556]: ::1 2026-10-23 10:41:45.968 UTC [1556] postgres@postgres LOG: statement: CREATE USER pgbouncer; vm-test-run-timescaledb> server # [ 125.203401] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1555]: CREATE ROLE vm-test-run-timescaledb> server # [ 125.204411] postgres[1556]: ::1 2026-10-23 10:41:45.980 UTC [1556] postgres@postgres LOG: statement: REVOKE ALL PRIVILEGES ON SCHEMA public FROM pgbouncer; vm-test-run-timescaledb> server # [ 125.209678] postgres[1556]: ::1 2026-10-23 10:41:45.995 UTC [1556] postgres@postgres LOG: statement: CREATE SCHEMA pgbouncer AUTHORIZATION pgbouncer; vm-test-run-timescaledb> server # [ 125.211455] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1555]: REVOKE vm-test-run-timescaledb> server # [ 125.249962] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1555]: CREATE SCHEMA vm-test-run-timescaledb> server # [ 125.252618] postgres[1556]: ::1 2026-10-23 10:41:46.037 UTC [1556] postgres@postgres LOG: statement: CREATE OR REPLACE FUNCTION pgbouncer.get_auth(p_usename TEXT) vm-test-run-timescaledb> server # [ 125.254576] postgres[1556]: RETURNS TABLE(username TEXT, password TEXT) AS vm-test-run-timescaledb> server # [ 125.255213] postgres[1556]: $$ vm-test-run-timescaledb> server # [ 125.255628] postgres[1556]: BEGIN vm-test-run-timescaledb> server # [ 125.256106] postgres[1556]: RAISE WARNING 'PgBouncer auth request: %', p_usename; vm-test-run-timescaledb> server # [ 125.256414] postgres[1556]: vm-test-run-timescaledb> server # [ 125.256651] postgres[1556]: RETURN QUERY vm-test-run-timescaledb> server # [ 125.256875] postgres[1556]: SELECT usename::TEXT, passwd::TEXT FROM pg_catalog.pg_shadow vm-test-run-timescaledb> server # [ 125.261895] postgres[1556]: WHERE usename = p_usename; vm-test-run-timescaledb> server # [ 125.263734] postgres[1556]: END; vm-test-run-timescaledb> server # [ 125.264977] postgres[1556]: $$ LANGUAGE plpgsql vm-test-run-timescaledb> server # [ 125.265425] postgres[1556]: SET search_path = '' vm-test-run-timescaledb> server # [ 125.265709] postgres[1556]: SECURITY DEFINER; vm-test-run-timescaledb> server # [ 125.279210] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1555]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 125.286236] postgres[1556]: ::1 2026-10-23 10:41:46.068 UTC [1556] postgres@postgres LOG: statement: REVOKE ALL ON FUNCTION pgbouncer.get_auth(p_usename TEXT) FROM PUBLIC; vm-test-run-timescaledb> server # [ 125.291833] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1555]: REVOKE vm-test-run-timescaledb> server # [ 125.298310] postgres[1556]: ::1 2026-10-23 10:41:46.079 UTC [1556] postgres@postgres LOG: statement: GRANT EXECUTE ON FUNCTION pgbouncer.get_auth(p_usename TEXT) TO pgbouncer; vm-test-run-timescaledb> server # [ 125.303139] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1555]: GRANT vm-test-run-timescaledb> server # [ 125.336103] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running stat extension... vm-test-run-timescaledb> server # [ 125.679584] postgres[1558]: ::1 2026-10-23 10:41:46.446 UTC [1558] postgres@postgres LOG: statement: CREATE SCHEMA IF NOT exists extensions; vm-test-run-timescaledb> server # [ 125.706992] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1557]: psql:/nix/store/vgajqkksdcv2cbrba1cgngx3rrkdykp1-stat-extension.sql:1: NOTICE: schema "extensions" already exists, skipping vm-test-run-timescaledb> server # [ 125.718432] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1557]: CREATE SCHEMA vm-test-run-timescaledb> server # [ 125.719454] postgres[1558]: ::1 2026-10-23 10:41:46.488 UTC [1558] postgres@postgres LOG: statement: CREATE EXTENSION IF NOT EXISTS pg_stat_statements with schema extensions; vm-test-run-timescaledb> server # [ 127.525821] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1557]: CREATE EXTENSION vm-test-run-timescaledb> server # [ 127.609456] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/10000000000000_demote-postgres.sql vm-test-run-timescaledb> server # [ 128.002117] postgres[1584]: ::1 2026-10-23 10:41:48.780 UTC [1584] supabase_admin@postgres LOG: statement: GRANT ALL ON DATABASE postgres TO postgres; vm-test-run-timescaledb> server # [ 128.031104] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1583]: GRANT vm-test-run-timescaledb> server # [ 128.032161] postgres[1584]: ::1 2026-10-23 10:41:48.804 UTC [1584] supabase_admin@postgres LOG: statement: GRANT ALL ON SCHEMA auth TO postgres; vm-test-run-timescaledb> server # [ 128.040390] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1583]: GRANT vm-test-run-timescaledb> server # [ 128.047106] postgres[1584]: ::1 2026-10-23 10:41:48.820 UTC [1584] supabase_admin@postgres LOG: statement: GRANT ALL ON SCHEMA extensions TO postgres; vm-test-run-timescaledb> server # [ 128.061720] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1583]: GRANT vm-test-run-timescaledb> server # [ 128.063173] postgres[1584]: ::1 2026-10-23 10:41:48.848 UTC [1584] supabase_admin@postgres LOG: statement: GRANT ALL ON ALL TABLES IN SCHEMA auth TO postgres; vm-test-run-timescaledb> server # [ 128.105788] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1583]: GRANT vm-test-run-timescaledb> server # [ 128.110208] postgres[1584]: ::1 2026-10-23 10:41:48.893 UTC [1584] supabase_admin@postgres LOG: statement: GRANT ALL ON ALL TABLES IN SCHEMA extensions TO postgres; vm-test-run-timescaledb> server # [ 128.122462] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1583]: GRANT vm-test-run-timescaledb> server # [ 128.127546] postgres[1584]: ::1 2026-10-23 10:41:48.910 UTC [1584] supabase_admin@postgres LOG: statement: GRANT ALL ON ALL SEQUENCES IN SCHEMA auth TO postgres; vm-test-run-timescaledb> server # [ 128.139676] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1583]: GRANT vm-test-run-timescaledb> server # [ 128.142205] postgres[1584]: ::1 2026-10-23 10:41:48.927 UTC [1584] supabase_admin@postgres LOG: statement: GRANT ALL ON ALL SEQUENCES IN SCHEMA extensions TO postgres; vm-test-run-timescaledb> server # [ 128.154150] postgres[1584]: ::1 2026-10-23 10:41:48.933 UTC [1584] supabase_admin@postgres LOG: statement: GRANT ALL ON ALL ROUTINES IN SCHEMA auth TO postgres; vm-test-run-timescaledb> server # [ 128.155555] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1583]: GRANT vm-test-run-timescaledb> server # [ 128.168763] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1583]: GRANT vm-test-run-timescaledb> server # [ 128.177736] postgres[1584]: ::1 2026-10-23 10:41:48.959 UTC [1584] supabase_admin@postgres LOG: statement: GRANT ALL ON ALL ROUTINES IN SCHEMA extensions TO postgres; vm-test-run-timescaledb> server # [ 128.214404] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1583]: GRANT vm-test-run-timescaledb> server # [ 128.261950] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1583]: DO vm-test-run-timescaledb> server # [ 128.273584] postgres[1584]: ::1 2026-10-23 10:41:49.051 UTC [1584] supabase_admin@postgres LOG: statement: ALTER ROLE postgres NOSUPERUSER CREATEDB CREATEROLE LOGIN REPLICATION BYPASSRLS; vm-test-run-timescaledb> server # [ 128.279134] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1583]: ALTER ROLE vm-test-run-timescaledb> server # [ 128.312568] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20211115181400_update-auth-permissions.sql vm-test-run-timescaledb> server # [ 128.663607] postgres[1590]: ::1 2026-10-23 10:41:49.444 UTC [1590] supabase_admin@postgres LOG: statement: GRANT ALL PRIVILEGES ON SCHEMA auth TO supabase_auth_admin; vm-test-run-timescaledb> server # [ 128.702365] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1589]: GRANT vm-test-run-timescaledb> server # [ 128.703978] postgres[1590]: ::1 2026-10-23 10:41:49.483 UTC [1590] supabase_admin@postgres LOG: statement: GRANT ALL PRIVILEGES ON ALL TABLES IN SCHEMA auth TO supabase_auth_admin; vm-test-run-timescaledb> server # [ 128.722357] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1589]: GRANT vm-test-run-timescaledb> server # [ 128.729019] postgres[1590]: ::1 2026-10-23 10:41:49.510 UTC [1590] supabase_admin@postgres LOG: statement: GRANT ALL PRIVILEGES ON ALL SEQUENCES IN SCHEMA auth TO supabase_auth_admin; vm-test-run-timescaledb> server # [ 128.738279] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1589]: GRANT vm-test-run-timescaledb> server # [ 128.739943] postgres[1590]: ::1 2026-10-23 10:41:49.525 UTC [1590] supabase_admin@postgres LOG: statement: ALTER table IF EXISTS "auth".users OWNER TO supabase_auth_admin; vm-test-run-timescaledb> server # [ 128.751762] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1589]: ALTER TABLE vm-test-run-timescaledb> server # [ 128.758039] postgres[1590]: ::1 2026-10-23 10:41:49.540 UTC [1590] supabase_admin@postgres LOG: statement: ALTER table IF EXISTS "auth".refresh_tokens OWNER TO supabase_auth_admin; vm-test-run-timescaledb> server # [ 128.765029] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1589]: ALTER TABLE vm-test-run-timescaledb> server # [ 128.767709] postgres[1590]: ::1 2026-10-23 10:41:49.553 UTC [1590] supabase_admin@postgres LOG: statement: ALTER table IF EXISTS "auth".audit_log_entries OWNER TO supabase_auth_admin; vm-test-run-timescaledb> server # [ 128.778769] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1589]: ALTER TABLE vm-test-run-timescaledb> server # [ 128.779707] postgres[1590]: ::1 2026-10-23 10:41:49.564 UTC [1590] supabase_admin@postgres LOG: statement: ALTER table IF EXISTS "auth".instances OWNER TO supabase_auth_admin; vm-test-run-timescaledb> server # [ 128.787800] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1589]: ALTER TABLE vm-test-run-timescaledb> server # [ 128.789774] postgres[1590]: ::1 2026-10-23 10:41:49.573 UTC [1590] supabase_admin@postgres LOG: statement: ALTER table IF EXISTS "auth".schema_migrations OWNER TO supabase_auth_admin; vm-test-run-timescaledb> server # [ 128.797194] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1589]: ALTER TABLE vm-test-run-timescaledb> server # [ 128.801090] postgres[1590]: ::1 2026-10-23 10:41:49.584 UTC [1590] supabase_admin@postgres LOG: statement: GRANT USAGE ON SCHEMA auth TO postgres; vm-test-run-timescaledb> server # [ 128.809014] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1589]: GRANT vm-test-run-timescaledb> server # [ 128.813443] postgres[1590]: ::1 2026-10-23 10:41:49.595 UTC [1590] supabase_admin@postgres LOG: statement: GRANT ALL ON ALL TABLES IN SCHEMA auth TO postgres, dashboard_user; vm-test-run-timescaledb> server # [ 128.824139] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1589]: GRANT vm-test-run-timescaledb> server # [ 128.827553] postgres[1590]: ::1 2026-10-23 10:41:49.611 UTC [1590] supabase_admin@postgres LOG: statement: GRANT ALL ON ALL SEQUENCES IN SCHEMA auth TO postgres, dashboard_user; vm-test-run-timescaledb> server # [ 128.841456] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1589]: GRANT vm-test-run-timescaledb> server # [ 128.842813] postgres[1590]: ::1 2026-10-23 10:41:49.626 UTC [1590] supabase_admin@postgres LOG: statement: GRANT ALL ON ALL ROUTINES IN SCHEMA auth TO postgres, dashboard_user; vm-test-run-timescaledb> server # [ 128.857286] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1589]: GRANT vm-test-run-timescaledb> server # [ 128.858399] postgres[1590]: ::1 2026-10-23 10:41:49.640 UTC [1590] supabase_admin@postgres LOG: statement: ALTER DEFAULT PRIVILEGES FOR ROLE supabase_auth_admin IN SCHEMA auth GRANT ALL ON TABLES TO postgres, dashboard_user; vm-test-run-timescaledb> server # [ 128.866862] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1589]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 128.867996] postgres[1590]: ::1 2026-10-23 10:41:49.652 UTC [1590] supabase_admin@postgres LOG: statement: ALTER DEFAULT PRIVILEGES FOR ROLE supabase_auth_admin IN SCHEMA auth GRANT ALL ON SEQUENCES TO postgres, dashboard_user; vm-test-run-timescaledb> server # [ 128.875989] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1589]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 128.881719] postgres[1590]: ::1 2026-10-23 10:41:49.663 UTC [1590] supabase_admin@postgres LOG: statement: ALTER DEFAULT PRIVILEGES FOR ROLE supabase_auth_admin IN SCHEMA auth GRANT ALL ON ROUTINES TO postgres, dashboard_user; vm-test-run-timescaledb> server # [ 128.892084] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1589]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 128.940281] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20211118015519_create-realtime-schema.sql vm-test-run-timescaledb> server # [ 129.206733] postgres[1592]: ::1 2026-10-23 10:41:49.985 UTC [1592] supabase_admin@postgres LOG: statement: CREATE SCHEMA IF NOT EXISTS realtime; vm-test-run-timescaledb> server # [ 129.230006] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1591]: CREATE SCHEMA vm-test-run-timescaledb> server # [ 129.276640] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20211122051245_update-realtime-permissions.sql vm-test-run-timescaledb> server # [ 129.711338] postgres[1600]: ::1 2026-10-23 10:41:50.459 UTC [1600] supabase_admin@postgres LOG: statement: GRANT USAGE ON SCHEMA realtime TO postgres; vm-test-run-timescaledb> server # [ 129.768007] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1593]: GRANT vm-test-run-timescaledb> server # [ 129.771969] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1593]: GRANT vm-test-run-timescaledb> server # [ 129.782120] postgres[1600]: ::1 2026-10-23 10:41:50.518 UTC [1600] supabase_admin@postgres LOG: statement: GRANT ALL ON ALL TABLES IN SCHEMA realtime TO postgres, dashboard_user; vm-test-run-timescaledb> server # [ 129.783592] postgres[1600]: ::1 2026-10-23 10:41:50.539 UTC [1600] supabase_admin@postgres LOG: statement: GRANT ALL ON ALL SEQUENCES IN SCHEMA realtime TO postgres, dashboard_user; vm-test-run-timescaledb> server # [ 129.788947] postgres[1600]: ::1 2026-10-23 10:41:50.561 UTC [1600] supabase_admin@postgres LOG: statement: GRANT ALL ON ALL ROUTINES IN SCHEMA realtime TO postgres, dashboard_user; vm-test-run-timescaledb> server # [ 129.791242] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1593]: GRANT vm-test-run-timescaledb> server # [ 129.795185] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1593]: GRANT vm-test-run-timescaledb> server # [ 129.842709] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20211124212715_update-auth-owner.sql vm-test-run-timescaledb> server # [ 130.565833] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1607]: DO vm-test-run-timescaledb> server # [ 130.567704] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1607]: DO vm-test-run-timescaledb> server # [ 130.621579] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1607]: DO vm-test-run-timescaledb> server # [ 130.674237] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20211130151719_update-realtime-permissions.sql vm-test-run-timescaledb> server # [ 131.072082] postgres[1622]: ::1 2026-10-23 10:41:51.853 UTC [1622] supabase_admin@postgres LOG: statement: ALTER DEFAULT PRIVILEGES FOR ROLE supabase_admin IN SCHEMA realtime GRANT ALL ON TABLES TO postgres, dashboard_user; vm-test-run-timescaledb> server # [ 131.098409] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1620]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 131.099799] postgres[1622]: ::1 2026-10-23 10:41:51.877 UTC [1622] supabase_admin@postgres LOG: statement: ALTER DEFAULT PRIVILEGES FOR ROLE supabase_admin IN SCHEMA realtime GRANT ALL ON SEQUENCES TO postgres, dashboard_user; vm-test-run-timescaledb> server # [ 131.104880] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1620]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 131.105735] postgres[1622]: ::1 2026-10-23 10:41:51.891 UTC [1622] supabase_admin@postgres LOG: statement: ALTER DEFAULT PRIVILEGES FOR ROLE supabase_admin IN SCHEMA realtime GRANT ALL ON ROUTINES TO postgres, dashboard_user; vm-test-run-timescaledb> server # [ 131.112581] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1620]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 131.169040] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220118070449_enable-safeupdate-postgrest.sql vm-test-run-timescaledb> server # [ 131.457387] postgres[1624]: ::1 2026-10-23 10:41:52.235 UTC [1624] supabase_admin@postgres LOG: statement: ALTER ROLE authenticator SET session_preload_libraries = 'safeupdate'; vm-test-run-timescaledb> server # [ 131.478681] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1623]: ALTER ROLE vm-test-run-timescaledb> server # [ 131.511171] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220126121436_finer-postgrest-triggers.sql vm-test-run-timescaledb> server # [ 131.776046] postgres[1626]: ::1 2026-10-23 10:41:52.555 UTC [1626] supabase_admin@postgres LOG: statement: drop event trigger if exists api_restart; vm-test-run-timescaledb> server # [ 131.781844] postgres[1626]: ::1 2026-10-23 10:41:52.564 UTC [1626] supabase_admin@postgres LOG: statement: drop function if exists extensions.notify_api_restart(); vm-test-run-timescaledb> server # [ 131.787431] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1625]: psql:/nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220126121436_finer-postgrest-triggers.sql:3: NOTICE: event trigger "api_restart" does not exist, skipping vm-test-run-timescaledb> server # [ 131.789852] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1625]: DROP EVENT TRIGGER vm-test-run-timescaledb> server # [ 131.795503] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1625]: psql:/nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220126121436_finer-postgrest-triggers.sql:4: NOTICE: function extensions.notify_api_restart() does not exist, skipping vm-test-run-timescaledb> server # [ 131.796702] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1625]: DROP FUNCTION vm-test-run-timescaledb> server # [ 131.803469] postgres[1626]: ::1 2026-10-23 10:41:52.581 UTC [1626] supabase_admin@postgres LOG: statement: CREATE OR REPLACE FUNCTION extensions.pgrst_ddl_watch() RETURNS event_trigger AS $$ vm-test-run-timescaledb> server # [ 131.806764] postgres[1626]: DECLARE vm-test-run-timescaledb> server # [ 131.807239] postgres[1626]: cmd record; vm-test-run-timescaledb> server # [ 131.810180] postgres[1626]: BEGIN vm-test-run-timescaledb> server # [ 131.811450] postgres[1626]: FOR cmd IN SELECT * FROM pg_event_trigger_ddl_commands() vm-test-run-timescaledb> server # [ 131.811976] postgres[1626]: LOOP vm-test-run-timescaledb> server # [ 131.813537] postgres[1626]: IF cmd.command_tag IN ( vm-test-run-timescaledb> server # [ 131.814393] postgres[1626]: 'CREATE SCHEMA', 'ALTER SCHEMA' vm-test-run-timescaledb> server # [ 131.815975] postgres[1626]: , 'CREATE TABLE', 'CREATE TABLE AS', 'SELECT INTO', 'ALTER TABLE' vm-test-run-timescaledb> server # [ 131.817750] postgres[1626]: , 'CREATE FOREIGN TABLE', 'ALTER FOREIGN TABLE' vm-test-run-timescaledb> server # [ 131.818919] postgres[1626]: , 'CREATE VIEW', 'ALTER VIEW' vm-test-run-timescaledb> server # [ 131.820363] postgres[1626]: , 'CREATE MATERIALIZED VIEW', 'ALTER MATERIALIZED VIEW' vm-test-run-timescaledb> server # [ 131.822495] postgres[1626]: , 'CREATE FUNCTION', 'ALTER FUNCTION' vm-test-run-timescaledb> server # [ 131.823001] postgres[1626]: , 'CREATE TRIGGER' vm-test-run-timescaledb> server # [ 131.825198] postgres[1626]: , 'CREATE TYPE' vm-test-run-timescaledb> server # [ 131.826303] postgres[1626]: , 'CREATE RULE' vm-test-run-timescaledb> server # [ 131.828691] postgres[1626]: , 'COMMENT' vm-test-run-timescaledb> server # [ 131.829816] postgres[1626]: ) vm-test-run-timescaledb> server # [ 131.831498] postgres[1626]: -- don't notify in case of CREATE TEMP table or other objects created on pg_temp vm-test-run-timescaledb> server # [ 131.834015] postgres[1626]: AND cmd.schema_name is distinct from 'pg_temp' vm-test-run-timescaledb> server # [ 131.834518] postgres[1626]: THEN vm-test-run-timescaledb> server # [ 131.835303] postgres[1626]: NOTIFY pgrst, 'reload schema'; vm-test-run-timescaledb> server # [ 131.835982] postgres[1626]: END IF; vm-test-run-timescaledb> server # [ 131.836260] postgres[1626]: END LOOP; vm-test-run-timescaledb> server # [ 131.837482] postgres[1626]: END; $$ LANGUAGE plpgsql; vm-test-run-timescaledb> server # [ 131.848991] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1625]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 131.861863] postgres[1626]: ::1 2026-10-23 10:41:52.642 UTC [1626] supabase_admin@postgres LOG: statement: CREATE OR REPLACE FUNCTION extensions.pgrst_drop_watch() RETURNS event_trigger AS $$ vm-test-run-timescaledb> server # [ 131.863441] postgres[1626]: DECLARE vm-test-run-timescaledb> server # [ 131.871941] postgres[1626]: obj record; vm-test-run-timescaledb> server # [ 131.877518] postgres[1626]: BEGIN vm-test-run-timescaledb> server # [ 131.878227] postgres[1626]: FOR obj IN SELECT * FROM pg_event_trigger_dropped_objects() vm-test-run-timescaledb> server # [ 131.889537] postgres[1626]: LOOP vm-test-run-timescaledb> server # [ 131.890464] postgres[1626]: IF obj.object_type IN ( vm-test-run-timescaledb> server # [ 131.890956] postgres[1626]: 'schema' vm-test-run-timescaledb> server # [ 131.891268] postgres[1626]: , 'table' vm-test-run-timescaledb> server # [ 131.891533] postgres[1626]: , 'foreign table' vm-test-run-timescaledb> server # [ 131.891946] postgres[1626]: , 'view' vm-test-run-timescaledb> server # [ 131.892824] postgres[1626]: , 'materialized view' vm-test-run-timescaledb> server # [ 131.898040] postgres[1626]: , 'function' vm-test-run-timescaledb> server # [ 131.899025] postgres[1626]: , 'trigger' vm-test-run-timescaledb> server # [ 131.901495] postgres[1626]: , 'type' vm-test-run-timescaledb> server # [ 131.906304] postgres[1626]: , 'rule' vm-test-run-timescaledb> server # [ 131.910856] postgres[1626]: ) vm-test-run-timescaledb> server # [ 131.911359] postgres[1626]: AND obj.is_temporary IS false -- no pg_temp objects vm-test-run-timescaledb> server # [ 131.912231] postgres[1626]: THEN vm-test-run-timescaledb> server # [ 131.917837] postgres[1626]: NOTIFY pgrst, 'reload schema'; vm-test-run-timescaledb> server # [ 131.918983] postgres[1626]: END IF; vm-test-run-timescaledb> server # [ 131.919303] postgres[1626]: END LOOP; vm-test-run-timescaledb> server # [ 131.919984] postgres[1626]: END; $$ LANGUAGE plpgsql; vm-test-run-timescaledb> server # [ 131.924832] postgres[1626]: ::1 2026-10-23 10:41:52.679 UTC [1626] supabase_admin@postgres LOG: statement: DROP EVENT TRIGGER IF EXISTS pgrst_ddl_watch; vm-test-run-timescaledb> server # [ 131.926279] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1625]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 131.926897] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1625]: psql:/nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220126121436_finer-postgrest-triggers.sql:59: NOTICE: event trigger "pgrst_ddl_watch" does not exist, skipping vm-test-run-timescaledb> server # [ 131.927906] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1625]: DROP EVENT TRIGGER vm-test-run-timescaledb> server # [ 131.931717] postgres[1626]: ::1 2026-10-23 10:41:52.713 UTC [1626] supabase_admin@postgres LOG: statement: CREATE EVENT TRIGGER pgrst_ddl_watch vm-test-run-timescaledb> server # [ 131.934962] postgres[1626]: ON ddl_command_end vm-test-run-timescaledb> server # [ 131.940109] postgres[1626]: EXECUTE PROCEDURE extensions.pgrst_ddl_watch(); vm-test-run-timescaledb> server # [ 131.948824] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1625]: CREATE EVENT TRIGGER vm-test-run-timescaledb> server # [ 131.950270] postgres[1626]: ::1 2026-10-23 10:41:52.733 UTC [1626] supabase_admin@postgres LOG: statement: DROP EVENT TRIGGER IF EXISTS pgrst_drop_watch; vm-test-run-timescaledb> server # [ 131.955995] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1625]: psql:/nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220126121436_finer-postgrest-triggers.sql:64: NOTICE: event trigger "pgrst_drop_watch" does not exist, skipping vm-test-run-timescaledb> server # [ 131.964806] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1625]: DROP EVENT TRIGGER vm-test-run-timescaledb> server # [ 131.965977] postgres[1626]: ::1 2026-10-23 10:41:52.746 UTC [1626] supabase_admin@postgres LOG: statement: CREATE EVENT TRIGGER pgrst_drop_watch vm-test-run-timescaledb> server # [ 131.967805] postgres[1626]: ON sql_drop vm-test-run-timescaledb> server # [ 131.978201] postgres[1626]: EXECUTE PROCEDURE extensions.pgrst_drop_watch(); vm-test-run-timescaledb> server # [ 131.991524] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1625]: CREATE EVENT TRIGGER vm-test-run-timescaledb> server # [ 132.057245] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220224211803_fix-postgrest-supautils.sql vm-test-run-timescaledb> server # [ 133.314871] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1630]: DO vm-test-run-timescaledb> server # [ 133.371133] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220317095840_pg_graphql.sql vm-test-run-timescaledb> server # [ 133.813977] postgres[1651]: ::1 2026-10-23 10:41:54.576 UTC [1651] supabase_admin@postgres LOG: statement: create schema if not exists graphql_public; vm-test-run-timescaledb> server # [ 133.902972] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1645]: CREATE SCHEMA vm-test-run-timescaledb> server # [ 133.911890] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1645]: psql:/nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220317095840_pg_graphql.sql:5: NOTICE: function graphql_public.graphql(text,text,jsonb) does not exist, skipping vm-test-run-timescaledb> server # [ 133.915777] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1645]: DROP FUNCTION vm-test-run-timescaledb> server # [ 133.919961] postgres[1651]: ::1 2026-10-23 10:41:54.675 UTC [1651] supabase_admin@postgres LOG: statement: drop function if exists graphql_public.graphql(text, text, jsonb); vm-test-run-timescaledb> server # [ 133.927572] postgres[1651]: ::1 2026-10-23 10:41:54.693 UTC [1651] supabase_admin@postgres LOG: statement: create or replace function graphql_public.graphql( vm-test-run-timescaledb> server # [ 133.941092] postgres[1651]: "operationName" text default null, vm-test-run-timescaledb> server # [ 133.942010] postgres[1651]: query text default null, vm-test-run-timescaledb> server # [ 133.942852] postgres[1651]: variables jsonb default null, vm-test-run-timescaledb> server # [ 133.943233] postgres[1651]: extensions jsonb default null vm-test-run-timescaledb> server # [ 133.943506] postgres[1651]: ) vm-test-run-timescaledb> server # [ 133.943915] postgres[1651]: returns jsonb vm-test-run-timescaledb> server # [ 133.949219] postgres[1651]: language plpgsql vm-test-run-timescaledb> server # [ 133.951149] postgres[1651]: as $$ vm-test-run-timescaledb> server # [ 133.951643] postgres[1651]: DECLARE vm-test-run-timescaledb> server # [ 133.952254] postgres[1651]: server_version float; vm-test-run-timescaledb> server # [ 133.952512] postgres[1651]: BEGIN vm-test-run-timescaledb> server # [ 133.957263] postgres[1651]: server_version = (SELECT (SPLIT_PART((select version()), ' ', 2))::float); vm-test-run-timescaledb> server # [ 133.961758] postgres[1651]: vm-test-run-timescaledb> server # [ 133.962366] postgres[1651]: IF server_version >= 14 THEN vm-test-run-timescaledb> server # [ 133.963375] postgres[1651]: RETURN jsonb_build_object( vm-test-run-timescaledb> server # [ 133.972821] postgres[1651]: 'data', null::jsonb, vm-test-run-timescaledb> server # [ 133.974206] postgres[1651]: 'errors', array['pg_graphql extension is not enabled.'] vm-test-run-timescaledb> server # [ 133.975962] postgres[1651]: ); vm-test-run-timescaledb> server # [ 133.981310] postgres[1651]: ELSE vm-test-run-timescaledb> server # [ 133.982052] postgres[1651]: RETURN jsonb_build_object( vm-test-run-timescaledb> server # [ 133.983113] postgres[1651]: 'data', null::jsonb, vm-test-run-timescaledb> server # [ 133.984390] postgres[1651]: 'errors', array['pg_graphql is only available on projects running Postgres 14 onwards.'] vm-test-run-timescaledb> server # [ 133.984799] postgres[1651]: ); vm-test-run-timescaledb> server # [ 133.985031] postgres[1651]: END IF; vm-test-run-timescaledb> server # [ 133.985247] postgres[1651]: END; vm-test-run-timescaledb> server # [ 133.985456] postgres[1651]: $$; vm-test-run-timescaledb> server # [ 133.997373] postgres[1651]: ::1 2026-10-23 10:41:54.737 UTC [1651] supabase_admin@postgres LOG: statement: grant usage on schema graphql_public to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 134.006439] postgres[1651]: ::1 2026-10-23 10:41:54.762 UTC [1651] supabase_admin@postgres LOG: statement: alter default privileges in schema graphql_public grant all on tables to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 134.008308] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1645]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 134.008910] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1645]: GRANT vm-test-run-timescaledb> server # [ 134.019077] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1645]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 134.025999] postgres[1651]: ::1 2026-10-23 10:41:54.792 UTC [1651] supabase_admin@postgres LOG: statement: alter default privileges in schema graphql_public grant all on functions to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 134.037468] postgres[1651]: ::1 2026-10-23 10:41:54.822 UTC [1651] supabase_admin@postgres LOG: statement: alter default privileges in schema graphql_public grant all on sequences to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 134.038429] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1645]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 134.057851] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1645]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 134.059093] postgres[1651]: ::1 2026-10-23 10:41:54.839 UTC [1651] supabase_admin@postgres LOG: statement: alter default privileges for user supabase_admin in schema graphql_public grant all vm-test-run-timescaledb> server # [ 134.061352] postgres[1651]: on sequences to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 134.067878] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1645]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 134.073489] postgres[1651]: ::1 2026-10-23 10:41:54.855 UTC [1651] supabase_admin@postgres LOG: statement: alter default privileges for user supabase_admin in schema graphql_public grant all vm-test-run-timescaledb> server # [ 134.075753] postgres[1651]: on tables to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 134.088153] postgres[1651]: ::1 2026-10-23 10:41:54.867 UTC [1651] supabase_admin@postgres LOG: statement: alter default privileges for user supabase_admin in schema graphql_public grant all vm-test-run-timescaledb> server # [ 134.093727] postgres[1651]: on functions to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 134.103835] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1645]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 134.107331] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1645]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 134.114523] postgres[1651]: ::1 2026-10-23 10:41:54.889 UTC [1651] supabase_admin@postgres LOG: statement: CREATE OR REPLACE FUNCTION extensions.grant_pg_graphql_access() vm-test-run-timescaledb> server # [ 134.127433] postgres[1651]: RETURNS event_trigger vm-test-run-timescaledb> server # [ 134.134010] postgres[1651]: LANGUAGE plpgsql vm-test-run-timescaledb> server # [ 134.134393] postgres[1651]: AS $func$ vm-test-run-timescaledb> server # [ 134.134800] postgres[1651]: DECLARE vm-test-run-timescaledb> server # [ 134.139370] postgres[1651]: func_is_graphql_resolve bool; vm-test-run-timescaledb> server # [ 134.146903] postgres[1651]: BEGIN vm-test-run-timescaledb> server # [ 134.147379] postgres[1651]: func_is_graphql_resolve = ( vm-test-run-timescaledb> server # [ 134.151530] postgres[1651]: SELECT n.proname = 'resolve' vm-test-run-timescaledb> server # [ 134.157356] postgres[1651]: FROM pg_event_trigger_ddl_commands() AS ev vm-test-run-timescaledb> server # [ 134.159928] postgres[1651]: LEFT JOIN pg_catalog.pg_proc AS n vm-test-run-timescaledb> server # [ 134.174532] postgres[1651]: ON ev.objid = n.oid vm-test-run-timescaledb> server # [ 134.177726] postgres[1651]: ); vm-test-run-timescaledb> server # [ 134.185656] postgres[1651]: vm-test-run-timescaledb> server # [ 134.186768] postgres[1651]: IF func_is_graphql_resolve vm-test-run-timescaledb> server # [ 134.187855] postgres[1651]: THEN vm-test-run-timescaledb> server # [ 134.188198] postgres[1651]: grant usage on schema graphql to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 134.198545] postgres[1651]: grant all on function graphql.resolve to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 134.199388] postgres[1651]: vm-test-run-timescaledb> server # [ 134.199693] postgres[1651]: alter default privileges in schema graphql grant all on tables to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 134.200011] postgres[1651]: alter default privileges in schema graphql grant all on functions to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 134.200316] postgres[1651]: alter default privileges in schema graphql grant all on sequences to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 134.210289] postgres[1651]: vm-test-run-timescaledb> server # [ 134.213512] postgres[1651]: DROP FUNCTION IF EXISTS graphql_public.graphql; vm-test-run-timescaledb> server # [ 134.218882] postgres[1651]: create or replace function graphql_public.graphql( vm-test-run-timescaledb> server # [ 134.219459] postgres[1651]: "operationName" text default null, vm-test-run-timescaledb> server # [ 134.220488] postgres[1651]: query text default null, vm-test-run-timescaledb> server # [ 134.227967] postgres[1651]: variables jsonb default null, vm-test-run-timescaledb> server # [ 134.229050] postgres[1651]: extensions jsonb default null vm-test-run-timescaledb> server # [ 134.229960] postgres[1651]: ) vm-test-run-timescaledb> server # [ 134.237452] postgres[1651]: returns jsonb vm-test-run-timescaledb> server # [ 134.237929] postgres[1651]: language sql vm-test-run-timescaledb> server # [ 134.238703] postgres[1651]: as $$ vm-test-run-timescaledb> server # [ 134.240655] postgres[1651]: SELECT graphql.resolve(query, coalesce(variables, '{}')); vm-test-run-timescaledb> server # [ 134.242741] postgres[1651]: $$; vm-test-run-timescaledb> server # [ 134.250392] postgres[1651]: vm-test-run-timescaledb> server # [ 134.253935] postgres[1651]: grant execute on function graphql.resolve to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 134.260590] postgres[1651]: END IF; vm-test-run-timescaledb> server # [ 134.267975] postgres[1651]: vm-test-run-timescaledb> server # [ 134.269027] postgres[1651]: END; vm-test-run-timescaledb> server # [ 134.269771] postgres[1651]: $func$; vm-test-run-timescaledb> server # [ 134.270531] postgres[1651]: ::1 2026-10-23 10:41:54.909 UTC [1651] supabase_admin@postgres LOG: statement: DROP EVENT TRIGGER IF EXISTS issue_pg_graphql_access; vm-test-run-timescaledb> server # [ 134.271538] postgres[1651]: ::1 2026-10-23 10:41:54.919 UTC [1651] supabase_admin@postgres LOG: statement: CREATE EVENT TRIGGER issue_pg_graphql_access ON ddl_command_end WHEN TAG in ('CREATE FUNCTION') vm-test-run-timescaledb> server # [ 134.280160] postgres[1651]: EXECUTE PROCEDURE extensions.grant_pg_graphql_access(); vm-test-run-timescaledb> server # [ 134.293179] postgres[1651]: ::1 2026-10-23 10:41:54.936 UTC [1651] supabase_admin@postgres LOG: statement: COMMENT ON FUNCTION extensions.grant_pg_graphql_access IS 'Grants access to pg_graphql'; vm-test-run-timescaledb> server # [ 134.295082] postgres[1651]: ::1 2026-10-23 10:41:54.967 UTC [1651] supabase_admin@postgres LOG: statement: CREATE OR REPLACE FUNCTION extensions.set_graphql_placeholder() vm-test-run-timescaledb> server # [ 134.298305] postgres[1651]: RETURNS event_trigger vm-test-run-timescaledb> server # [ 134.311147] postgres[1651]: LANGUAGE plpgsql vm-test-run-timescaledb> server # [ 134.317469] postgres[1651]: AS $func$ vm-test-run-timescaledb> server # [ 134.318849] postgres[1651]: DECLARE vm-test-run-timescaledb> server # [ 134.329160] postgres[1651]: graphql_is_dropped bool; vm-test-run-timescaledb> server # [ 134.331325] postgres[1651]: BEGIN vm-test-run-timescaledb> server # [ 134.333284] postgres[1651]: graphql_is_dropped = ( vm-test-run-timescaledb> server # [ 134.337733] postgres[1651]: SELECT ev.schema_name = 'graphql_public' vm-test-run-timescaledb> server # [ 134.346152] postgres[1651]: FROM pg_event_trigger_dropped_objects() AS ev vm-test-run-timescaledb> server # [ 134.357453] postgres[1651]: WHERE ev.schema_name = 'graphql_public' vm-test-run-timescaledb> server # [ 134.374939] postgres[1651]: ); vm-test-run-timescaledb> server # [ 134.379517] postgres[1651]: vm-test-run-timescaledb> server # [ 134.380763] postgres[1651]: IF graphql_is_dropped vm-test-run-timescaledb> server # [ 134.381095] postgres[1651]: THEN vm-test-run-timescaledb> server # [ 134.381344] postgres[1651]: create or replace function graphql_public.graphql( vm-test-run-timescaledb> server # [ 134.381612] postgres[1651]: "operationName" text default null, vm-test-run-timescaledb> server # [ 134.381861] postgres[1651]: query text default null, vm-test-run-timescaledb> server # [ 134.382300] postgres[1651]: variables jsonb default null, vm-test-run-timescaledb> server # [ 134.389544] postgres[1651]: extensions jsonb default null vm-test-run-timescaledb> server # [ 134.390889] postgres[1651]: ) vm-test-run-timescaledb> server # [ 134.395799] postgres[1651]: returns jsonb vm-test-run-timescaledb> server # [ 134.402939] postgres[1651]: language plpgsql vm-test-run-timescaledb> server # [ 134.403882] postgres[1651]: as $$ vm-test-run-timescaledb> server # [ 134.409750] postgres[1651]: DECLARE vm-test-run-timescaledb> server # [ 134.411021] postgres[1651]: server_version float; vm-test-run-timescaledb> server # [ 134.414050] postgres[1651]: BEGIN vm-test-run-timescaledb> server # [ 134.421090] postgres[1651]: server_version = (SELECT (SPLIT_PART((select version()), ' ', 2))::float); vm-test-run-timescaledb> server # [ 134.421728] postgres[1651]: vm-test-run-timescaledb> server # [ 134.422020] postgres[1651]: IF server_version >= 14 THEN vm-test-run-timescaledb> server # [ 134.423128] postgres[1651]: RETURN jsonb_build_object( vm-test-run-timescaledb> server # [ 134.424236] postgres[1651]: 'data', null::jsonb, vm-test-run-timescaledb> server # [ 134.429678] postgres[1651]: 'errors', array['pg_graphql extension is not enabled.'] vm-test-run-timescaledb> server # [ 134.434789] postgres[1651]: ); vm-test-run-timescaledb> server # [ 134.435835] postgres[1651]: ELSE vm-test-run-timescaledb> server # [ 134.436274] postgres[1651]: RETURN jsonb_build_object( vm-test-run-timescaledb> server # [ 134.436616] postgres[1651]: 'data', null::jsonb, vm-test-run-timescaledb> server # [ 134.446231] postgres[1651]: 'errors', array['pg_graphql is only available on projects running Postgres 14 onwards.'] vm-test-run-timescaledb> server # [ 134.447752] postgres[1651]: ); vm-test-run-timescaledb> server # [ 134.450529] postgres[1651]: END IF; vm-test-run-timescaledb> server # [ 134.453845] postgres[1651]: END; vm-test-run-timescaledb> server # [ 134.462474] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1645]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 134.469422] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1645]: psql:/nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220317095840_pg_graphql.sql:90: NOTICE: event trigger "issue_pg_graphql_access" does not exist, skipping vm-test-run-timescaledb> server # [ 134.471604] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1645]: DROP EVENT TRIGGER vm-test-run-timescaledb> server # [ 134.474884] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1645]: CREATE EVENT TRIGGER vm-test-run-timescaledb> server # [ 134.477912] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1645]: COMMENT vm-test-run-timescaledb> server # [ 134.486752] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1645]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 134.493534] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1645]: psql:/nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220317095840_pg_graphql.sql:143: NOTICE: event trigger "issue_graphql_placeholder" does not exist, skipping vm-test-run-timescaledb> server # [ 134.495988] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1645]: DROP EVENT TRIGGER vm-test-run-timescaledb> server # [ 134.505817] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1645]: CREATE EVENT TRIGGER vm-test-run-timescaledb> server # [ 134.506356] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1645]: COMMENT vm-test-run-timescaledb> server # [ 134.513627] postgres[1651]: $$; vm-test-run-timescaledb> server # [ 134.514904] postgres[1651]: END IF; vm-test-run-timescaledb> server # [ 134.518196] postgres[1651]: vm-test-run-timescaledb> server # [ 134.519792] postgres[1651]: END; vm-test-run-timescaledb> server # [ 134.521862] postgres[1651]: $func$; vm-test-run-timescaledb> server # [ 134.523155] postgres[1651]: ::1 2026-10-23 10:41:55.056 UTC [1651] supabase_admin@postgres LOG: statement: DROP EVENT TRIGGER IF EXISTS issue_graphql_placeholder; vm-test-run-timescaledb> server # [ 134.523919] postgres[1651]: ::1 2026-10-23 10:41:55.064 UTC [1651] supabase_admin@postgres LOG: statement: CREATE EVENT TRIGGER issue_graphql_placeholder ON sql_drop WHEN TAG in ('DROP EXTENSION') vm-test-run-timescaledb> server # [ 134.526972] postgres[1651]: EXECUTE PROCEDURE extensions.set_graphql_placeholder(); vm-test-run-timescaledb> server # [ 134.527962] postgres[1651]: ::1 2026-10-23 10:41:55.076 UTC [1651] supabase_admin@postgres LOG: statement: COMMENT ON FUNCTION extensions.set_graphql_placeholder IS 'Reintroduces placeholder function for graphql_public.graphql'; vm-test-run-timescaledb> server # [ 134.535408] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220321174452_fix-postgrest-alter-type-event-trigger.sql vm-test-run-timescaledb> server # [ 134.833760] postgres[1660]: ::1 2026-10-23 10:41:55.613 UTC [1660] supabase_admin@postgres LOG: statement: drop event trigger if exists api_restart; vm-test-run-timescaledb> server # [ 134.847006] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1659]: psql:/nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220321174452_fix-postgrest-alter-type-event-trigger.sql:3: NOTICE: event trigger "api_restart" does not exist, skipping vm-test-run-timescaledb> server # [ 134.848323] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1659]: DROP EVENT TRIGGER vm-test-run-timescaledb> server # [ 134.853182] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1659]: psql:/nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220321174452_fix-postgrest-alter-type-event-trigger.sql:4: NOTICE: function extensions.notify_api_restart() does not exist, skipping vm-test-run-timescaledb> server # [ 134.855455] postgres[1660]: ::1 2026-10-23 10:41:55.624 UTC [1660] supabase_admin@postgres LOG: statement: drop function if exists extensions.notify_api_restart(); vm-test-run-timescaledb> server # [ 134.864442] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1659]: DROP FUNCTION vm-test-run-timescaledb> server # [ 134.866062] postgres[1660]: ::1 2026-10-23 10:41:55.650 UTC [1660] supabase_admin@postgres LOG: statement: CREATE OR REPLACE FUNCTION extensions.pgrst_ddl_watch() RETURNS event_trigger AS $$ vm-test-run-timescaledb> server # [ 134.874313] postgres[1660]: DECLARE vm-test-run-timescaledb> server # [ 134.875897] postgres[1660]: cmd record; vm-test-run-timescaledb> server # [ 134.878359] postgres[1660]: BEGIN vm-test-run-timescaledb> server # [ 134.878878] postgres[1660]: FOR cmd IN SELECT * FROM pg_event_trigger_ddl_commands() vm-test-run-timescaledb> server # [ 134.879718] postgres[1660]: LOOP vm-test-run-timescaledb> server # [ 134.880174] postgres[1660]: IF cmd.command_tag IN ( vm-test-run-timescaledb> server # [ 134.881070] postgres[1660]: 'CREATE SCHEMA', 'ALTER SCHEMA' vm-test-run-timescaledb> server # [ 134.881381] postgres[1660]: , 'CREATE TABLE', 'CREATE TABLE AS', 'SELECT INTO', 'ALTER TABLE' vm-test-run-timescaledb> server # [ 134.882540] postgres[1660]: , 'CREATE FOREIGN TABLE', 'ALTER FOREIGN TABLE' vm-test-run-timescaledb> server # [ 134.883068] postgres[1660]: , 'CREATE VIEW', 'ALTER VIEW' vm-test-run-timescaledb> server # [ 134.883559] postgres[1660]: , 'CREATE MATERIALIZED VIEW', 'ALTER MATERIALIZED VIEW' vm-test-run-timescaledb> server # [ 134.883849] postgres[1660]: , 'CREATE FUNCTION', 'ALTER FUNCTION' vm-test-run-timescaledb> server # [ 134.885765] postgres[1660]: , 'CREATE TRIGGER' vm-test-run-timescaledb> server # [ 134.886109] postgres[1660]: , 'CREATE TYPE', 'ALTER TYPE' vm-test-run-timescaledb> server # [ 134.886375] postgres[1660]: , 'CREATE RULE' vm-test-run-timescaledb> server # [ 134.887841] postgres[1660]: , 'COMMENT' vm-test-run-timescaledb> server # [ 134.888115] postgres[1660]: ) vm-test-run-timescaledb> server # [ 134.889139] postgres[1660]: -- don't notify in case of CREATE TEMP table or other objects created on pg_temp vm-test-run-timescaledb> server # [ 134.890664] postgres[1660]: AND cmd.schema_name is distinct from 'pg_temp' vm-test-run-timescaledb> server # [ 134.891272] postgres[1660]: THEN vm-test-run-timescaledb> server # [ 134.891554] postgres[1660]: NOTIFY pgrst, 'reload schema'; vm-test-run-timescaledb> server # [ 134.892133] postgres[1660]: END IF; vm-test-run-timescaledb> server # [ 134.893475] postgres[1660]: END LOOP; vm-test-run-timescaledb> server # [ 134.895209] postgres[1660]: END; $$ LANGUAGE plpgsql; vm-test-run-timescaledb> server # [ 134.925004] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1659]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 134.926232] postgres[1660]: ::1 2026-10-23 10:41:55.709 UTC [1660] supabase_admin@postgres LOG: statement: CREATE OR REPLACE FUNCTION extensions.pgrst_drop_watch() RETURNS event_trigger AS $$ vm-test-run-timescaledb> server # [ 134.927305] postgres[1660]: DECLARE vm-test-run-timescaledb> server # [ 134.932982] postgres[1660]: obj record; vm-test-run-timescaledb> server # [ 134.933966] postgres[1660]: BEGIN vm-test-run-timescaledb> server # [ 134.934286] postgres[1660]: FOR obj IN SELECT * FROM pg_event_trigger_dropped_objects() vm-test-run-timescaledb> server # [ 134.934914] postgres[1660]: LOOP vm-test-run-timescaledb> server # [ 134.935445] postgres[1660]: IF obj.object_type IN ( vm-test-run-timescaledb> server # [ 134.941210] postgres[1660]: 'schema' vm-test-run-timescaledb> server # [ 134.943113] postgres[1660]: , 'table' vm-test-run-timescaledb> server # [ 134.945231] postgres[1660]: , 'foreign table' vm-test-run-timescaledb> server # [ 134.945620] postgres[1660]: , 'view' vm-test-run-timescaledb> server # [ 134.945860] postgres[1660]: , 'materialized view' vm-test-run-timescaledb> server # [ 134.946084] postgres[1660]: , 'function' vm-test-run-timescaledb> server # [ 134.946291] postgres[1660]: , 'trigger' vm-test-run-timescaledb> server # [ 134.946512] postgres[1660]: , 'type' vm-test-run-timescaledb> server # [ 134.946915] postgres[1660]: , 'rule' vm-test-run-timescaledb> server # [ 134.947413] postgres[1660]: ) vm-test-run-timescaledb> server # [ 134.947680] postgres[1660]: AND obj.is_temporary IS false -- no pg_temp objects vm-test-run-timescaledb> server # [ 134.948243] postgres[1660]: THEN vm-test-run-timescaledb> server # [ 134.948692] postgres[1660]: NOTIFY pgrst, 'reload schema'; vm-test-run-timescaledb> server # [ 134.949280] postgres[1660]: END IF; vm-test-run-timescaledb> server # [ 134.949725] postgres[1660]: END LOOP; vm-test-run-timescaledb> server # [ 134.949970] postgres[1660]: END; $$ LANGUAGE plpgsql; vm-test-run-timescaledb> server # [ 134.967008] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1659]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 134.969358] postgres[1660]: ::1 2026-10-23 10:41:55.746 UTC [1660] supabase_admin@postgres LOG: statement: DROP EVENT TRIGGER IF EXISTS pgrst_ddl_watch; vm-test-run-timescaledb> server # [ 134.974810] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1659]: DROP EVENT TRIGGER vm-test-run-timescaledb> server # [ 134.976642] postgres[1660]: ::1 2026-10-23 10:41:55.762 UTC [1660] supabase_admin@postgres LOG: statement: CREATE EVENT TRIGGER pgrst_ddl_watch vm-test-run-timescaledb> server # [ 134.978208] postgres[1660]: ON ddl_command_end vm-test-run-timescaledb> server # [ 134.978800] postgres[1660]: EXECUTE PROCEDURE extensions.pgrst_ddl_watch(); vm-test-run-timescaledb> server # [ 134.986399] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1659]: CREATE EVENT TRIGGER vm-test-run-timescaledb> server # [ 134.989794] postgres[1660]: ::1 2026-10-23 10:41:55.773 UTC [1660] supabase_admin@postgres LOG: statement: DROP EVENT TRIGGER IF EXISTS pgrst_drop_watch; vm-test-run-timescaledb> server # [ 134.998808] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1659]: DROP EVENT TRIGGER vm-test-run-timescaledb> server # [ 135.005026] postgres[1660]: ::1 2026-10-23 10:41:55.788 UTC [1660] supabase_admin@postgres LOG: statement: CREATE EVENT TRIGGER pgrst_drop_watch vm-test-run-timescaledb> server # [ 135.005851] postgres[1660]: ON sql_drop vm-test-run-timescaledb> server # [ 135.006971] postgres[1660]: EXECUTE PROCEDURE extensions.pgrst_drop_watch(); vm-test-run-timescaledb> server # [ 135.013216] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1659]: CREATE EVENT TRIGGER vm-test-run-timescaledb> server # [ 135.059109] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220322085208_gotrue-session-limit.sql vm-test-run-timescaledb> server # [ 135.313771] postgres[1662]: ::1 2026-10-23 10:41:56.087 UTC [1662] supabase_admin@postgres LOG: statement: ALTER ROLE supabase_auth_admin SET idle_in_transaction_session_timeout TO 60000; vm-test-run-timescaledb> server # [ 135.330769] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1661]: ALTER ROLE vm-test-run-timescaledb> server # [ 135.368389] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220404205710_pg_graphql-on-by-default.sql vm-test-run-timescaledb> server # [ 135.683904] postgres[1664]: ::1 2026-10-23 10:41:56.462 UTC [1664] supabase_admin@postgres LOG: statement: create or replace function extensions.grant_pg_graphql_access() vm-test-run-timescaledb> server # [ 135.687467] postgres[1664]: returns event_trigger vm-test-run-timescaledb> server # [ 135.689379] postgres[1664]: language plpgsql vm-test-run-timescaledb> server # [ 135.691033] postgres[1664]: AS $func$ vm-test-run-timescaledb> server # [ 135.693441] postgres[1664]: DECLARE vm-test-run-timescaledb> server # [ 135.694021] postgres[1664]: func_is_graphql_resolve bool; vm-test-run-timescaledb> server # [ 135.694896] postgres[1664]: BEGIN vm-test-run-timescaledb> server # [ 135.695401] postgres[1664]: func_is_graphql_resolve = ( vm-test-run-timescaledb> server # [ 135.695937] postgres[1664]: SELECT n.proname = 'resolve' vm-test-run-timescaledb> server # [ 135.696250] postgres[1664]: FROM pg_event_trigger_ddl_commands() AS ev vm-test-run-timescaledb> server # [ 135.696523] postgres[1664]: LEFT JOIN pg_catalog.pg_proc AS n vm-test-run-timescaledb> server # [ 135.698102] postgres[1664]: ON ev.objid = n.oid vm-test-run-timescaledb> server # [ 135.699689] postgres[1664]: ); vm-test-run-timescaledb> server # [ 135.700547] postgres[1664]: vm-test-run-timescaledb> server # [ 135.701454] postgres[1664]: IF func_is_graphql_resolve vm-test-run-timescaledb> server # [ 135.702917] postgres[1664]: THEN vm-test-run-timescaledb> server # [ 135.705150] postgres[1664]: grant usage on schema graphql to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 135.709608] postgres[1664]: grant all on function graphql.resolve to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 135.711349] postgres[1664]: vm-test-run-timescaledb> server # [ 135.712723] postgres[1664]: alter default privileges in schema graphql grant all on tables to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 135.715226] postgres[1664]: alter default privileges in schema graphql grant all on functions to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 135.718284] postgres[1664]: alter default privileges in schema graphql grant all on sequences to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 135.720506] postgres[1664]: vm-test-run-timescaledb> server # [ 135.721145] postgres[1664]: -- Update public wrapper to pass all arguments through to the pg_graphql resolve func vm-test-run-timescaledb> server # [ 135.723651] postgres[1664]: DROP FUNCTION IF EXISTS graphql_public.graphql; vm-test-run-timescaledb> server # [ 135.725859] postgres[1664]: create or replace function graphql_public.graphql( vm-test-run-timescaledb> server # [ 135.726559] postgres[1664]: "operationName" text default null, vm-test-run-timescaledb> server # [ 135.727024] postgres[1664]: query text default null, vm-test-run-timescaledb> server # [ 135.727632] postgres[1664]: variables jsonb default null, vm-test-run-timescaledb> server # [ 135.728115] postgres[1664]: extensions jsonb default null vm-test-run-timescaledb> server # [ 135.729774] postgres[1664]: ) vm-test-run-timescaledb> server # [ 135.730555] postgres[1664]: returns jsonb vm-test-run-timescaledb> server # [ 135.733186] postgres[1664]: language sql vm-test-run-timescaledb> server # [ 135.734488] postgres[1664]: as $$ vm-test-run-timescaledb> server # [ 135.735005] postgres[1664]: -- This changed vm-test-run-timescaledb> server # [ 135.735598] postgres[1664]: select graphql.resolve( vm-test-run-timescaledb> server # [ 135.736242] postgres[1664]: query := query, vm-test-run-timescaledb> server # [ 135.737823] postgres[1664]: variables := coalesce(variables, '{}'), vm-test-run-timescaledb> server # [ 135.738447] postgres[1664]: "operationName" := "operationName", vm-test-run-timescaledb> server # [ 135.739211] postgres[1664]: extensions := extensions vm-test-run-timescaledb> server # [ 135.739541] postgres[1664]: ); vm-test-run-timescaledb> server # [ 135.739962] postgres[1664]: $$; vm-test-run-timescaledb> server # [ 135.740217] postgres[1664]: vm-test-run-timescaledb> server # [ 135.740431] postgres[1664]: grant execute on function graphql.resolve to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 135.741202] postgres[1664]: END IF; vm-test-run-timescaledb> server # [ 135.742322] postgres[1664]: vm-test-run-timescaledb> server # [ 135.743179] postgres[1664]: END; vm-test-run-timescaledb> server # [ 135.743589] postgres[1664]: $func$; vm-test-run-timescaledb> server # [ 135.787215] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1663]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 135.788200] postgres[1664]: ::1 2026-10-23 10:41:56.566 UTC [1664] supabase_admin@postgres LOG: statement: CREATE OR REPLACE FUNCTION extensions.set_graphql_placeholder() vm-test-run-timescaledb> server # [ 135.799254] postgres[1664]: RETURNS event_trigger vm-test-run-timescaledb> server # [ 135.811716] postgres[1664]: LANGUAGE plpgsql vm-test-run-timescaledb> server # [ 135.812334] postgres[1664]: AS $func$ vm-test-run-timescaledb> server # [ 135.819474] postgres[1664]: DECLARE vm-test-run-timescaledb> server # [ 135.827884] postgres[1664]: graphql_is_dropped bool; vm-test-run-timescaledb> server # [ 135.833610] postgres[1664]: BEGIN vm-test-run-timescaledb> server # [ 135.834909] postgres[1664]: graphql_is_dropped = ( vm-test-run-timescaledb> server # [ 135.835326] postgres[1664]: SELECT ev.schema_name = 'graphql_public' vm-test-run-timescaledb> server # [ 135.835925] postgres[1664]: FROM pg_event_trigger_dropped_objects() AS ev vm-test-run-timescaledb> server # [ 135.842865] postgres[1664]: WHERE ev.schema_name = 'graphql_public' vm-test-run-timescaledb> server # [ 135.846823] postgres[1664]: ); vm-test-run-timescaledb> server # [ 135.847442] postgres[1664]: vm-test-run-timescaledb> server # [ 135.854147] postgres[1664]: IF graphql_is_dropped vm-test-run-timescaledb> server # [ 135.855014] postgres[1664]: THEN vm-test-run-timescaledb> server # [ 135.855363] postgres[1664]: create or replace function graphql_public.graphql( vm-test-run-timescaledb> server # [ 135.855841] postgres[1664]: "operationName" text default null, vm-test-run-timescaledb> server # [ 135.857634] postgres[1664]: query text default null, vm-test-run-timescaledb> server # [ 135.865151] postgres[1664]: variables jsonb default null, vm-test-run-timescaledb> server # [ 135.866042] postgres[1664]: extensions jsonb default null vm-test-run-timescaledb> server # [ 135.866778] postgres[1664]: ) vm-test-run-timescaledb> server # [ 135.867709] postgres[1664]: returns jsonb vm-test-run-timescaledb> server # [ 135.868047] postgres[1664]: language plpgsql vm-test-run-timescaledb> server # [ 135.875032] postgres[1664]: as $$ vm-test-run-timescaledb> server # [ 135.889211] postgres[1664]: DECLARE vm-test-run-timescaledb> server # [ 135.890363] postgres[1664]: server_version float; vm-test-run-timescaledb> server # [ 135.891921] postgres[1664]: BEGIN vm-test-run-timescaledb> server # [ 135.905063] postgres[1664]: server_version = (SELECT (SPLIT_PART((select version()), ' ', 2))::float); vm-test-run-timescaledb> server # [ 135.905884] postgres[1664]: vm-test-run-timescaledb> server # [ 135.906232] postgres[1664]: IF server_version >= 14 THEN vm-test-run-timescaledb> server # [ 135.906509] postgres[1664]: RETURN jsonb_build_object( vm-test-run-timescaledb> server # [ 135.912415] postgres[1664]: 'errors', jsonb_build_array( vm-test-run-timescaledb> server # [ 135.914753] postgres[1664]: jsonb_build_object( vm-test-run-timescaledb> server # [ 135.915577] postgres[1664]: 'message', 'pg_graphql extension is not enabled.' vm-test-run-timescaledb> server # [ 135.915885] postgres[1664]: ) vm-test-run-timescaledb> server # [ 135.923389] postgres[1664]: ) vm-test-run-timescaledb> server # [ 135.931508] postgres[1664]: ); vm-test-run-timescaledb> server # [ 135.932107] postgres[1664]: ELSE vm-test-run-timescaledb> server # [ 135.932651] postgres[1664]: RETURN jsonb_build_object( vm-test-run-timescaledb> server # [ 135.932991] postgres[1664]: 'errors', jsonb_build_array( vm-test-run-timescaledb> server # [ 135.933297] postgres[1664]: jsonb_build_object( vm-test-run-timescaledb> server # [ 135.942396] postgres[1664]: 'message', 'pg_graphql is only available on projects running Postgres 14 onwards.' vm-test-run-timescaledb> server # [ 135.943801] postgres[1664]: ) vm-test-run-timescaledb> server # [ 135.956793] postgres[1664]: ) vm-test-run-timescaledb> server # [ 135.957502] postgres[1664]: ); vm-test-run-timescaledb> server # [ 135.957850] postgres[1664]: END IF; vm-test-run-timescaledb> server # [ 135.958485] postgres[1664]: END; vm-test-run-timescaledb> server # [ 135.958921] postgres[1664]: $$; vm-test-run-timescaledb> server # [ 135.959190] postgres[1664]: END IF; vm-test-run-timescaledb> server # [ 135.960157] postgres[1664]: vm-test-run-timescaledb> server # [ 135.963406] postgres[1664]: END; vm-test-run-timescaledb> server # [ 135.969498] postgres[1664]: $func$; vm-test-run-timescaledb> server # [ 135.971826] postgres[1664]: ::1 2026-10-23 10:41:56.591 UTC [1664] supabase_admin@postgres LOG: statement: create or replace function graphql_public.graphql( vm-test-run-timescaledb> server # [ 135.982196] postgres[1664]: "operationName" text default null, vm-test-run-timescaledb> server # [ 135.983655] postgres[1664]: query text default null, vm-test-run-timescaledb> server # [ 135.989973] postgres[1664]: variables jsonb default null, vm-test-run-timescaledb> server # [ 135.992417] postgres[1664]: extensions jsonb default null vm-test-run-timescaledb> server # [ 135.999150] postgres[1664]: ) vm-test-run-timescaledb> server # [ 136.004814] postgres[1664]: returns jsonb vm-test-run-timescaledb> server # [ 136.006459] postgres[1664]: language plpgsql vm-test-run-timescaledb> server # [ 136.014770] postgres[1664]: as $$ vm-test-run-timescaledb> server # [ 136.018080] postgres[1664]: DECLARE vm-test-run-timescaledb> server # [ 136.033174] postgres[1664]: server_version float; vm-test-run-timescaledb> server # [ 136.034969] postgres[1664]: BEGIN vm-test-run-timescaledb> server # [ 136.035891] postgres[1664]: server_version = (SELECT (SPLIT_PART((select version()), ' ', 2))::float); vm-test-run-timescaledb> server # [ 136.042948] postgres[1664]: vm-test-run-timescaledb> server # [ 136.047489] postgres[1664]: IF server_version >= 14 THEN vm-test-run-timescaledb> server # [ 136.051254] postgres[1664]: RETURN jsonb_build_object( vm-test-run-timescaledb> server # [ 136.055607] postgres[1664]: 'errors', jsonb_build_array( vm-test-run-timescaledb> server # [ 136.060933] postgres[1664]: jsonb_build_object( vm-test-run-timescaledb> server # [ 136.062082] postgres[1664]: 'message', 'pg_graphql extension is not enabled.' vm-test-run-timescaledb> server # [ 136.063846] postgres[1664]: ) vm-test-run-timescaledb> server # [ 136.073530] postgres[1664]: ) vm-test-run-timescaledb> server # [ 136.075130] postgres[1664]: ); vm-test-run-timescaledb> server # [ 136.078686] postgres[1664]: ELSE vm-test-run-timescaledb> server # [ 136.080289] postgres[1664]: RETURN jsonb_build_object( vm-test-run-timescaledb> server # [ 136.097988] postgres[1664]: 'errors', jsonb_build_array( vm-test-run-timescaledb> server # [ 136.099183] postgres[1664]: jsonb_build_object( vm-test-run-timescaledb> server # [ 136.099499] postgres[1664]: 'message', 'pg_graphql is only available on projects running Postgres 14 onwards.' vm-test-run-timescaledb> server # [ 136.099810] postgres[1664]: ) vm-test-run-timescaledb> server # [ 136.107119] postgres[1664]: ) vm-test-run-timescaledb> server # [ 136.113775] postgres[1664]: ); vm-test-run-timescaledb> server # [ 136.114293] postgres[1664]: END IF; vm-test-run-timescaledb> server # [ 136.115778] postgres[1664]: END; vm-test-run-timescaledb> server # [ 136.117267] postgres[1664]: $$; vm-test-run-timescaledb> server # [ 136.120241] postgres[1664]: ::1 2026-10-23 10:41:56.656 UTC [1664] supabase_admin@postgres LOG: statement: drop extension if exists pg_graphql; vm-test-run-timescaledb> server # [ 136.131277] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1663]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 136.139256] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1663]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 136.147083] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1663]: psql:/nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220404205710_pg_graphql-on-by-default.sql:142: NOTICE: extension "pg_graphql" does not exist, skipping vm-test-run-timescaledb> server # [ 136.153407] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1663]: DROP EXTENSION vm-test-run-timescaledb> server # [ 137.926963] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1663]: DO vm-test-run-timescaledb> server # [ 138.003212] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220609081115_grant-supabase-auth-admin-and-supabase-storage-admin-to-postgres.sql vm-test-run-timescaledb> server # [ 138.358142] postgres[1694]: ::1 2026-10-23 10:41:59.136 UTC [1694] supabase_admin@postgres LOG: statement: grant supabase_auth_admin, supabase_storage_admin to postgres; vm-test-run-timescaledb> server # [ 138.411765] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1692]: GRANT ROLE vm-test-run-timescaledb> server # [ 138.438316] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220613123923_pg_graphql-pg-dump-perms.sql vm-test-run-timescaledb> server # [ 138.819329] postgres[1696]: ::1 2026-10-23 10:41:59.576 UTC [1696] supabase_admin@postgres LOG: statement: create or replace function extensions.grant_pg_graphql_access() vm-test-run-timescaledb> server # [ 138.829576] postgres[1696]: returns event_trigger vm-test-run-timescaledb> server # [ 138.835550] postgres[1696]: language plpgsql vm-test-run-timescaledb> server # [ 138.838598] postgres[1696]: AS $func$ vm-test-run-timescaledb> server # [ 138.839391] postgres[1696]: DECLARE vm-test-run-timescaledb> server # [ 138.839920] postgres[1696]: func_is_graphql_resolve bool; vm-test-run-timescaledb> server # [ 138.845388] postgres[1696]: BEGIN vm-test-run-timescaledb> server # [ 138.846152] postgres[1696]: func_is_graphql_resolve = ( vm-test-run-timescaledb> server # [ 138.846585] postgres[1696]: SELECT n.proname = 'resolve' vm-test-run-timescaledb> server # [ 138.847404] postgres[1696]: FROM pg_event_trigger_ddl_commands() AS ev vm-test-run-timescaledb> server # [ 138.847833] postgres[1696]: LEFT JOIN pg_catalog.pg_proc AS n vm-test-run-timescaledb> server # [ 138.848086] postgres[1696]: ON ev.objid = n.oid vm-test-run-timescaledb> server # [ 138.848474] postgres[1696]: ); vm-test-run-timescaledb> server # [ 138.848750] postgres[1696]: vm-test-run-timescaledb> server # [ 138.853377] postgres[1696]: IF func_is_graphql_resolve vm-test-run-timescaledb> server # [ 138.853962] postgres[1696]: THEN vm-test-run-timescaledb> server # [ 138.854468] postgres[1696]: -- Update public wrapper to pass all arguments through to the pg_graphql resolve func vm-test-run-timescaledb> server # [ 138.855271] postgres[1696]: DROP FUNCTION IF EXISTS graphql_public.graphql; vm-test-run-timescaledb> server # [ 138.855964] postgres[1696]: create or replace function graphql_public.graphql( vm-test-run-timescaledb> server # [ 138.856278] postgres[1696]: "operationName" text default null, vm-test-run-timescaledb> server # [ 138.863034] postgres[1696]: query text default null, vm-test-run-timescaledb> server # [ 138.864253] postgres[1696]: variables jsonb default null, vm-test-run-timescaledb> server # [ 138.870033] postgres[1696]: extensions jsonb default null vm-test-run-timescaledb> server # [ 138.870503] postgres[1696]: ) vm-test-run-timescaledb> server # [ 138.871107] postgres[1696]: returns jsonb vm-test-run-timescaledb> server # [ 138.871738] postgres[1696]: language sql vm-test-run-timescaledb> server # [ 138.872313] postgres[1696]: as $$ vm-test-run-timescaledb> server # [ 138.879201] postgres[1696]: select graphql.resolve( vm-test-run-timescaledb> server # [ 138.883257] postgres[1696]: query := query, vm-test-run-timescaledb> server # [ 138.883613] postgres[1696]: variables := coalesce(variables, '{}'), vm-test-run-timescaledb> server # [ 138.883874] postgres[1696]: "operationName" := "operationName", vm-test-run-timescaledb> server # [ 138.889537] postgres[1696]: extensions := extensions vm-test-run-timescaledb> server # [ 138.890525] postgres[1696]: ); vm-test-run-timescaledb> server # [ 138.891304] postgres[1696]: $$; vm-test-run-timescaledb> server # [ 138.892045] postgres[1696]: vm-test-run-timescaledb> server # [ 138.894872] postgres[1696]: -- This hook executes when `graphql.resolve` is created. That is not necessarily the last vm-test-run-timescaledb> server # [ 138.900651] postgres[1696]: -- function in the extension so we need to grant permissions on existing entities AND vm-test-run-timescaledb> server # [ 138.901952] postgres[1696]: -- update default permissions to any others that are created after `graphql.resolve` vm-test-run-timescaledb> server # [ 138.902924] postgres[1696]: grant usage on schema graphql to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 138.904021] postgres[1696]: grant select on all tables in schema graphql to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 138.914375] postgres[1696]: grant execute on all functions in schema graphql to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 138.915477] postgres[1696]: grant all on all sequences in schema graphql to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 138.923102] postgres[1696]: alter default privileges in schema graphql grant all on tables to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 138.926451] postgres[1696]: alter default privileges in schema graphql grant all on functions to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 138.932669] postgres[1696]: alter default privileges in schema graphql grant all on sequences to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 138.933571] postgres[1696]: END IF; vm-test-run-timescaledb> server # [ 138.934463] postgres[1696]: vm-test-run-timescaledb> server # [ 138.935074] postgres[1696]: END; vm-test-run-timescaledb> server # [ 138.935961] postgres[1696]: $func$; vm-test-run-timescaledb> server # [ 138.937166] postgres[1696]: ::1 2026-10-23 10:41:59.679 UTC [1696] supabase_admin@postgres LOG: statement: drop extension if exists pg_graphql; vm-test-run-timescaledb> server # [ 138.942335] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1695]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 138.944277] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1695]: DROP EXTENSION vm-test-run-timescaledb> server # [ 141.052054] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1695]: DO vm-test-run-timescaledb> server # [ 141.083122] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220713082019_pg_cron-pg_net-temp-perms-fix.sql vm-test-run-timescaledb> server # [ 142.069232] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1721]: DO vm-test-run-timescaledb> server # [ 142.924680] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1721]: DO vm-test-run-timescaledb> server # [ 142.994586] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20221028101028_set_authenticator_timeout.sql vm-test-run-timescaledb> server # [ 143.427970] postgres[1737]: ::1 2026-10-23 10:42:04.200 UTC [1737] supabase_admin@postgres LOG: statement: alter role authenticator set statement_timeout = '8s'; vm-test-run-timescaledb> server # [ 143.476758] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1732]: ALTER ROLE vm-test-run-timescaledb> server # [ 143.499689] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20221103090837_revoke_admin.sql vm-test-run-timescaledb> server # [ 144.002962] postgres[1748]: ::1 2026-10-23 10:42:04.762 UTC [1748] supabase_admin@postgres LOG: statement: revoke supabase_admin from authenticator; vm-test-run-timescaledb> server # [ 144.033186] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1743]: REVOKE ROLE vm-test-run-timescaledb> server # [ 144.082758] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20221207154255_create_pgsodium_and_vault.sql vm-test-run-timescaledb> server # [ 146.738869] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1754]: DO vm-test-run-timescaledb> server # [ 146.806916] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20230201083204_grant_auth_roles_to_postgres.sql vm-test-run-timescaledb> server # [ 147.246089] postgres[1780]: ::1 2026-10-23 10:42:08.020 UTC [1780] supabase_admin@postgres LOG: statement: grant anon, authenticated, service_role to postgres; vm-test-run-timescaledb> server # [ 147.274802] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1775]: GRANT ROLE vm-test-run-timescaledb> server # [ 147.309526] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20230224042246_grant_extensions_perms_for_postgres.sql vm-test-run-timescaledb> server # [ 147.594499] postgres[1784]: ::1 2026-10-23 10:42:08.367 UTC [1784] supabase_admin@postgres LOG: statement: grant all privileges on all tables in schema extensions to postgres with grant option; vm-test-run-timescaledb> server # [ 147.637312] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1783]: GRANT vm-test-run-timescaledb> server # [ 147.639746] postgres[1784]: ::1 2026-10-23 10:42:08.413 UTC [1784] supabase_admin@postgres LOG: statement: grant all privileges on all routines in schema extensions to postgres with grant option; vm-test-run-timescaledb> server # [ 147.713830] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1783]: GRANT vm-test-run-timescaledb> server # [ 147.716986] postgres[1784]: ::1 2026-10-23 10:42:08.500 UTC [1784] supabase_admin@postgres LOG: statement: grant all privileges on all sequences in schema extensions to postgres with grant option; vm-test-run-timescaledb> server # [ 147.746086] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1783]: GRANT vm-test-run-timescaledb> server # [ 147.747428] postgres[1784]: ::1 2026-10-23 10:42:08.528 UTC [1784] supabase_admin@postgres LOG: statement: alter default privileges in schema extensions grant all on tables to postgres with grant option; vm-test-run-timescaledb> server # [ 147.777703] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1783]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 147.787400] postgres[1784]: ::1 2026-10-23 10:42:08.569 UTC [1784] supabase_admin@postgres LOG: statement: alter default privileges in schema extensions grant all on routines to postgres with grant option; vm-test-run-timescaledb> server # [ 147.797868] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1783]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 147.810896] postgres[1784]: ::1 2026-10-23 10:42:08.580 UTC [1784] supabase_admin@postgres LOG: statement: alter default privileges in schema extensions grant all on sequences to postgres with grant option; vm-test-run-timescaledb> server # [ 147.822879] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1783]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 147.876174] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20230306081037_grant_pg_monitor_to_postgres.sql vm-test-run-timescaledb> server # [ 148.200755] postgres[1790]: ::1 2026-10-23 10:42:08.975 UTC [1790] supabase_admin@postgres LOG: statement: grant pg_monitor to postgres; vm-test-run-timescaledb> server # [ 148.223030] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1789]: GRANT ROLE vm-test-run-timescaledb> server # [ 148.263590] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20230327032006_grant_auth_roles_to_supabase_storage_admin.sql vm-test-run-timescaledb> server # [ 148.589485] postgres[1792]: ::1 2026-10-23 10:42:09.365 UTC [1792] supabase_admin@postgres LOG: statement: grant anon, authenticated, service_role to supabase_storage_admin; vm-test-run-timescaledb> server # [ 148.616984] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1791]: GRANT ROLE vm-test-run-timescaledb> server # [ 148.651877] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20230529180330_alter_api_roles_for_inherit.sql vm-test-run-timescaledb> server # [ 148.933011] postgres[1794]: ::1 2026-10-23 10:42:09.709 UTC [1794] supabase_admin@postgres LOG: statement: ALTER ROLE authenticated inherit; vm-test-run-timescaledb> server # [ 148.979924] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1793]: ALTER ROLE vm-test-run-timescaledb> server # [ 148.982960] postgres[1794]: ::1 2026-10-23 10:42:09.735 UTC [1794] supabase_admin@postgres LOG: statement: ALTER ROLE anon inherit; vm-test-run-timescaledb> server # [ 148.986348] postgres[1794]: ::1 2026-10-23 10:42:09.761 UTC [1794] supabase_admin@postgres LOG: statement: ALTER ROLE service_role inherit; vm-test-run-timescaledb> server # [ 148.998160] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1793]: ALTER ROLE vm-test-run-timescaledb> server # [ 149.003247] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1793]: ALTER ROLE vm-test-run-timescaledb> server # [ 149.056983] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1793]: DO vm-test-run-timescaledb> server # [ 149.161560] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20231013070755_grant_authenticator_to_supabase_storage_admin.sql vm-test-run-timescaledb> server # [ 149.585132] postgres[1805]: ::1 2026-10-23 10:42:10.312 UTC [1805] supabase_admin@postgres LOG: statement: grant authenticator to supabase_storage_admin; vm-test-run-timescaledb> server # [ 149.603318] postgres[1805]: ::1 2026-10-23 10:42:10.335 UTC [1805] supabase_admin@postgres LOG: statement: revoke anon, authenticated, service_role from supabase_storage_admin; vm-test-run-timescaledb> server # [ 149.645776] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1800]: GRANT ROLE vm-test-run-timescaledb> server # [ 149.655057] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1800]: REVOKE ROLE vm-test-run-timescaledb> server # [ 149.656019] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20231017062225_grant_pg_graphql_permissions_for_custom_roles.sql vm-test-run-timescaledb> server # [ 150.295203] postgres[1818]: ::1 2026-10-23 10:42:11.061 UTC [1818] supabase_admin@postgres LOG: statement: create or replace function extensions.grant_pg_graphql_access() vm-test-run-timescaledb> server # [ 150.309950] postgres[1818]: returns event_trigger vm-test-run-timescaledb> server # [ 150.312350] postgres[1818]: language plpgsql vm-test-run-timescaledb> server # [ 150.318095] postgres[1818]: AS $func$ vm-test-run-timescaledb> server # [ 150.336864] postgres[1818]: DECLARE vm-test-run-timescaledb> server # [ 150.339696] postgres[1818]: func_is_graphql_resolve bool; vm-test-run-timescaledb> server # [ 150.343458] postgres[1818]: BEGIN vm-test-run-timescaledb> server # [ 150.344078] postgres[1818]: func_is_graphql_resolve = ( vm-test-run-timescaledb> server # [ 150.350177] postgres[1818]: SELECT n.proname = 'resolve' vm-test-run-timescaledb> server # [ 150.350881] postgres[1818]: FROM pg_event_trigger_ddl_commands() AS ev vm-test-run-timescaledb> server # [ 150.351320] postgres[1818]: LEFT JOIN pg_catalog.pg_proc AS n vm-test-run-timescaledb> server # [ 150.351572] postgres[1818]: ON ev.objid = n.oid vm-test-run-timescaledb> server # [ 150.351787] postgres[1818]: ); vm-test-run-timescaledb> server # [ 150.352059] postgres[1818]: vm-test-run-timescaledb> server # [ 150.352381] postgres[1818]: IF func_is_graphql_resolve vm-test-run-timescaledb> server # [ 150.357578] postgres[1818]: THEN vm-test-run-timescaledb> server # [ 150.368317] postgres[1818]: -- Update public wrapper to pass all arguments through to the pg_graphql resolve func vm-test-run-timescaledb> server # [ 150.370494] postgres[1818]: DROP FUNCTION IF EXISTS graphql_public.graphql; vm-test-run-timescaledb> server # [ 150.376750] postgres[1818]: create or replace function graphql_public.graphql( vm-test-run-timescaledb> server # [ 150.389794] postgres[1818]: "operationName" text default null, vm-test-run-timescaledb> server # [ 150.390574] postgres[1818]: query text default null, vm-test-run-timescaledb> server # [ 150.396833] postgres[1818]: variables jsonb default null, vm-test-run-timescaledb> server # [ 150.398432] postgres[1818]: extensions jsonb default null vm-test-run-timescaledb> server # [ 150.398953] postgres[1818]: ) vm-test-run-timescaledb> server # [ 150.408580] postgres[1818]: returns jsonb vm-test-run-timescaledb> server # [ 150.409589] postgres[1818]: language sql vm-test-run-timescaledb> server # [ 150.410229] postgres[1818]: as $$ vm-test-run-timescaledb> server # [ 150.410950] postgres[1818]: select graphql.resolve( vm-test-run-timescaledb> server # [ 150.411499] postgres[1818]: query := query, vm-test-run-timescaledb> server # [ 150.411813] postgres[1818]: variables := coalesce(variables, '{}'), vm-test-run-timescaledb> server # [ 150.421430] postgres[1818]: "operationName" := "operationName", vm-test-run-timescaledb> server # [ 150.422420] postgres[1818]: extensions := extensions vm-test-run-timescaledb> server # [ 150.422904] postgres[1818]: ); vm-test-run-timescaledb> server # [ 150.424007] postgres[1818]: $$; vm-test-run-timescaledb> server # [ 150.433016] postgres[1818]: vm-test-run-timescaledb> server # [ 150.433706] postgres[1818]: -- This hook executes when `graphql.resolve` is created. That is not necessarily the last vm-test-run-timescaledb> server # [ 150.434871] postgres[1818]: -- function in the extension so we need to grant permissions on existing entities AND vm-test-run-timescaledb> server # [ 150.435292] postgres[1818]: -- update default permissions to any others that are created after `graphql.resolve` vm-test-run-timescaledb> server # [ 150.436094] postgres[1818]: grant usage on schema graphql to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 150.444120] postgres[1818]: grant select on all tables in schema graphql to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 150.445423] postgres[1818]: grant execute on all functions in schema graphql to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 150.446302] postgres[1818]: grant all on all sequences in schema graphql to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 150.446694] postgres[1818]: alter default privileges in schema graphql grant all on tables to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 150.447217] postgres[1818]: alter default privileges in schema graphql grant all on functions to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 150.448013] postgres[1818]: alter default privileges in schema graphql grant all on sequences to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 150.458015] postgres[1818]: vm-test-run-timescaledb> server # [ 150.473139] postgres[1818]: -- Allow postgres role to allow granting usage on graphql and graphql_public schemas to custom roles vm-test-run-timescaledb> server # [ 150.475090] postgres[1818]: grant usage on schema graphql_public to postgres with grant option; vm-test-run-timescaledb> server # [ 150.476238] postgres[1818]: grant usage on schema graphql to postgres with grant option; vm-test-run-timescaledb> server # [ 150.478140] postgres[1818]: END IF; vm-test-run-timescaledb> server # [ 150.478720] postgres[1818]: vm-test-run-timescaledb> server # [ 150.479117] postgres[1818]: END; vm-test-run-timescaledb> server # [ 150.493623] postgres[1818]: $func$; vm-test-run-timescaledb> server # [ 150.501966] postgres[1818]: ::1 2026-10-23 10:42:11.237 UTC [1818] supabase_admin@postgres LOG: statement: drop extension if exists pg_graphql; vm-test-run-timescaledb> server # [ 150.553516] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1811]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 150.617263] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1811]: DROP EXTENSION vm-test-run-timescaledb> server # [ 152.246419] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1811]: DO vm-test-run-timescaledb> server # [ 152.329687] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20231020085357_revoke_writes_on_cron_job_from_postgres.sql vm-test-run-timescaledb> server # [ 152.796808] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1830]: DO vm-test-run-timescaledb> server # [ 152.816161] postgres[1835]: ::1 2026-10-23 10:42:13.581 UTC [1835] supabase_admin@postgres LOG: statement: CREATE OR REPLACE FUNCTION extensions.grant_pg_cron_access() RETURNS event_trigger vm-test-run-timescaledb> server # [ 152.822558] postgres[1835]: LANGUAGE plpgsql vm-test-run-timescaledb> server # [ 152.824014] postgres[1835]: AS $$ vm-test-run-timescaledb> server # [ 152.825046] postgres[1835]: BEGIN vm-test-run-timescaledb> server # [ 152.825506] postgres[1835]: IF EXISTS ( vm-test-run-timescaledb> server # [ 152.826038] postgres[1835]: SELECT vm-test-run-timescaledb> server # [ 152.826353] postgres[1835]: FROM pg_event_trigger_ddl_commands() AS ev vm-test-run-timescaledb> server # [ 152.827054] postgres[1835]: JOIN pg_extension AS ext vm-test-run-timescaledb> server # [ 152.827646] postgres[1835]: ON ev.objid = ext.oid vm-test-run-timescaledb> server # [ 152.827909] postgres[1835]: WHERE ext.extname = 'pg_cron' vm-test-run-timescaledb> server # [ 152.836345] postgres[1835]: ) vm-test-run-timescaledb> server # [ 152.837876] postgres[1835]: THEN vm-test-run-timescaledb> server # [ 152.838458] postgres[1835]: grant usage on schema cron to postgres with grant option; vm-test-run-timescaledb> server # [ 152.838921] postgres[1835]: vm-test-run-timescaledb> server # [ 152.839756] postgres[1835]: alter default privileges in schema cron grant all on tables to postgres with grant option; vm-test-run-timescaledb> server # [ 152.845377] postgres[1835]: alter default privileges in schema cron grant all on functions to postgres with grant option; vm-test-run-timescaledb> server # [ 152.846097] postgres[1835]: alter default privileges in schema cron grant all on sequences to postgres with grant option; vm-test-run-timescaledb> server # [ 152.846472] postgres[1835]: vm-test-run-timescaledb> server # [ 152.847020] postgres[1835]: alter default privileges for user supabase_admin in schema cron grant all vm-test-run-timescaledb> server # [ 152.847305] postgres[1835]: on sequences to postgres with grant option; vm-test-run-timescaledb> server # [ 152.847738] postgres[1835]: alter default privileges for user supabase_admin in schema cron grant all vm-test-run-timescaledb> server # [ 152.848165] postgres[1835]: on tables to postgres with grant option; vm-test-run-timescaledb> server # [ 152.853560] postgres[1835]: alter default privileges for user supabase_admin in schema cron grant all vm-test-run-timescaledb> server # [ 152.854055] postgres[1835]: on functions to postgres with grant option; vm-test-run-timescaledb> server # [ 152.854682] postgres[1835]: vm-test-run-timescaledb> server # [ 152.855646] postgres[1835]: grant all privileges on all tables in schema cron to postgres with grant option; vm-test-run-timescaledb> server # [ 152.855977] postgres[1835]: revoke all on table cron.job from postgres; vm-test-run-timescaledb> server # [ 152.856249] postgres[1835]: grant select on table cron.job to postgres with grant option; vm-test-run-timescaledb> server # [ 152.861891] postgres[1835]: END IF; vm-test-run-timescaledb> server # [ 152.862769] postgres[1835]: END; vm-test-run-timescaledb> server # [ 152.863097] postgres[1835]: $$; vm-test-run-timescaledb> server # [ 152.881163] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1830]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 152.883138] postgres[1835]: ::1 2026-10-23 10:42:13.667 UTC [1835] supabase_admin@postgres LOG: statement: drop event trigger if exists issue_pg_cron_access; vm-test-run-timescaledb> server # [ 152.899512] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1830]: DROP EVENT TRIGGER vm-test-run-timescaledb> server # [ 152.901530] postgres[1835]: ::1 2026-10-23 10:42:13.685 UTC [1835] supabase_admin@postgres LOG: statement: alter function extensions.grant_pg_cron_access owner to supabase_admin; vm-test-run-timescaledb> server # [ 152.921509] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1830]: ALTER FUNCTION vm-test-run-timescaledb> server # [ 152.922811] postgres[1835]: ::1 2026-10-23 10:42:13.707 UTC [1835] supabase_admin@postgres LOG: statement: CREATE EVENT TRIGGER issue_pg_cron_access ON ddl_command_end vm-test-run-timescaledb> server # [ 152.923852] postgres[1835]: WHEN TAG IN ('CREATE EXTENSION') vm-test-run-timescaledb> server # [ 152.929358] postgres[1835]: EXECUTE FUNCTION extensions.grant_pg_cron_access(); vm-test-run-timescaledb> server # [ 152.937647] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1830]: CREATE EVENT TRIGGER vm-test-run-timescaledb> server # [ 152.990164] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20231130133139_set_lock_timeout_to_authenticator_role.sql vm-test-run-timescaledb> server # [ 153.452361] postgres[1846]: ::1 2026-10-23 10:42:14.233 UTC [1846] supabase_admin@postgres LOG: statement: ALTER ROLE authenticator set lock_timeout to '8s'; vm-test-run-timescaledb> server # [ 153.463795] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1841]: ALTER ROLE vm-test-run-timescaledb> server # [ 153.511778] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20240124080435_alter_lo_export_lo_import_owner.sql vm-test-run-timescaledb> server # [ 153.955478] postgres[1855]: ::1 2026-10-23 10:42:14.714 UTC [1855] supabase_admin@postgres LOG: statement: alter function pg_catalog.lo_export owner to supabase_admin; vm-test-run-timescaledb> server # [ 153.999520] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1851]: ALTER FUNCTION vm-test-run-timescaledb> server # [ 154.014006] postgres[1855]: ::1 2026-10-23 10:42:14.787 UTC [1855] supabase_admin@postgres LOG: statement: alter function pg_catalog.lo_import(text) owner to supabase_admin; vm-test-run-timescaledb> server # [ 154.021150] postgres[1855]: ::1 2026-10-23 10:42:14.803 UTC [1855] supabase_admin@postgres LOG: statement: alter function pg_catalog.lo_import(text, oid) owner to supabase_admin; vm-test-run-timescaledb> server # [ 154.022846] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1851]: ALTER FUNCTION vm-test-run-timescaledb> server # [ 154.033407] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1851]: ALTER FUNCTION vm-test-run-timescaledb> server # [ 154.062799] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20240606060239_grant_predefined_roles_to_postgres.sql vm-test-run-timescaledb> server # [ 154.423861] postgres[1858]: ::1 2026-10-23 10:42:15.204 UTC [1858] supabase_admin@postgres LOG: statement: grant pg_read_all_data, pg_signal_backend to postgres; vm-test-run-timescaledb> server # [ 154.440044] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1857]: GRANT ROLE vm-test-run-timescaledb> server # [ 154.495924] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20241031003909_create_orioledb.sql vm-test-run-timescaledb> server # [ 155.432238] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1859]: DO vm-test-run-timescaledb> server # [ 155.481311] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20241215003910_backfill_pgmq_metadata.sql vm-test-run-timescaledb> server # [ 156.085196] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1864]: DO vm-test-run-timescaledb> server # [ 156.095202] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1864]: DO vm-test-run-timescaledb> server # [ 156.163681] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20250205060043_disable_log_statement_on_internal_roles.sql vm-test-run-timescaledb> server # [ 156.625278] postgres[1879]: ::1 2026-10-23 10:42:17.377 UTC [1879] supabase_admin@postgres LOG: statement: alter role supabase_admin set log_statement = none; vm-test-run-timescaledb> server # [ 156.644541] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1877]: ALTER ROLE vm-test-run-timescaledb> server # [ 156.655027] postgres[1879]: ::1 2026-10-23 10:42:17.418 UTC [1879] supabase_admin@postgres LOG: statement: alter role supabase_auth_admin set log_statement = none; vm-test-run-timescaledb> server # [ 156.665168] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1877]: ALTER ROLE vm-test-run-timescaledb> server # [ 156.677180] postgres[1879]: ::1 2026-10-23 10:42:17.448 UTC [1879] supabase_admin@postgres LOG: statement: alter role supabase_storage_admin set log_statement = none; vm-test-run-timescaledb> server # [ 156.687305] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1877]: ALTER ROLE vm-test-run-timescaledb> server # [ 156.751334] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20250205144616_move_orioledb_to_extensions_schema.sql vm-test-run-timescaledb> server # [ 157.181188] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1884]: DO vm-test-run-timescaledb> server # [ 157.203434] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20250218031949_pgsodium_mask_role.sql vm-test-run-timescaledb> server # [ 157.563193] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1891]: DO vm-test-run-timescaledb> server # [ 157.589089] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20250220051611_pg_net_perms_fix.sql vm-test-run-timescaledb> server # [ 158.118510] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1896]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 158.129139] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1896]: DO vm-test-run-timescaledb> server # [ 158.179954] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20250312095419_pgbouncer_ownership.sql vm-test-run-timescaledb> server # [ 158.490103] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1899]: ALTER FUNCTION vm-test-run-timescaledb> server # [ 158.497646] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1899]: GRANT vm-test-run-timescaledb> server # [ 158.539693] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20250402065937_alter_internal_event_triggers_owner_to_supabase_admin.sql vm-test-run-timescaledb> server # [ 158.906830] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1901]: DROP EVENT TRIGGER vm-test-run-timescaledb> server # [ 158.983169] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1901]: ALTER FUNCTION vm-test-run-timescaledb> server # [ 159.025336] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1901]: CREATE EVENT TRIGGER vm-test-run-timescaledb> server # [ 159.074310] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20250402093753_grant_subscription_to_postgres_16_and_above.sql vm-test-run-timescaledb> server # [ 159.593745] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1911]: DO vm-test-run-timescaledb> server # [ 159.631607] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20250417190610_update_pgbouncer_get_auth.sql vm-test-run-timescaledb> server # [ 160.190177] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1922]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 160.209189] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1922]: GRANT vm-test-run-timescaledb> server # [ 160.237556] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20250421084701_revoke_admin_roles_from_postgres.sql vm-test-run-timescaledb> server # [ 160.598044] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1931]: REVOKE ROLE vm-test-run-timescaledb> server # [ 160.635136] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1931]: DO vm-test-run-timescaledb> server # [ 160.645584] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1931]: DO vm-test-run-timescaledb> server # [ 160.656174] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1931]: REVOKE ROLE vm-test-run-timescaledb> server # [ 160.673389] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1931]: REVOKE vm-test-run-timescaledb> server # [ 160.702789] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1931]: DO vm-test-run-timescaledb> server # [ 160.766870] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20250605172253_grant_with_admin_to_postgres_16_and_above.sql vm-test-run-timescaledb> server # [ 161.032246] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1933]: DO vm-test-run-timescaledb> server # [ 161.070024] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20250623125453_tmp_grant_storage_tables_to_postgres_with_grant_option.sql vm-test-run-timescaledb> server # [ 161.364055] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1935]: DO vm-test-run-timescaledb> server # [ 161.419637] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20250709135250_grant_storage_schema_to_postgres_with_grant_option.sql vm-test-run-timescaledb> server # [ 161.930771] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1939]: DO vm-test-run-timescaledb> server # [ 162.004319] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20250710151649_supabase_read_only_user_default_transaction_read_only.sql vm-test-run-timescaledb> server # [ 162.439070] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1943]: ALTER ROLE vm-test-run-timescaledb> server # [ 162.497063] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20251001204436_predefined_role_grants.sql vm-test-run-timescaledb> server # [ 162.923931] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1952]: GRANT ROLE vm-test-run-timescaledb> server # [ 162.954840] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1952]: DO vm-test-run-timescaledb> server # [ 163.026035] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20251105172723_grant_pg_reload_conf_to_postgres.sql vm-test-run-timescaledb> server # [ 163.506784] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1962]: GRANT vm-test-run-timescaledb> server # [ 163.555743] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20251121132723_correct_search_path_pgbouncer.sql vm-test-run-timescaledb> server # [ 164.061179] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1972]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 164.102360] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1972]: REVOKE vm-test-run-timescaledb> server # [ 164.117339] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1972]: REVOKE vm-test-run-timescaledb> server # [ 164.126772] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1972]: GRANT vm-test-run-timescaledb> server # [ 164.195401] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20260211120934_supabase_privileged_role.sql vm-test-run-timescaledb> server # [ 164.490276] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1975]: DO vm-test-run-timescaledb> server # [ 164.510258] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20260413000000_fix-authenticator-session-preload-libraries.sql vm-test-run-timescaledb> server # [ 164.778714] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1977]: ALTER ROLE vm-test-run-timescaledb> server # [ 164.804899] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20260421000000_pg_graphql-off-by-default.sql vm-test-run-timescaledb> server # [ 165.291827] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1979]: DROP EXTENSION vm-test-run-timescaledb> server # [ 165.330467] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20260421000001_rescope_pg_graphql_access_trigger.sql vm-test-run-timescaledb> server # [ 165.909581] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1984]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 165.910537] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1984]: DROP EVENT TRIGGER vm-test-run-timescaledb> server # [ 165.932876] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1984]: CREATE EVENT TRIGGER vm-test-run-timescaledb> server # [ 166.000800] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20260730000000_revoke_trigger_on_cron_tables_from_postgres.sql vm-test-run-timescaledb> server # [ 166.546455] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1995]: DO vm-test-run-timescaledb> server # [ 166.600402] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1995]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 166.671996] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20260923021047_update_pgrst_watch_triggers.sql vm-test-run-timescaledb> server # [ 167.114308] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[2007]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 167.125049] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[2007]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 167.158337] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20261016000001_search_path_for_supa_functions.sql vm-test-run-timescaledb> server # [ 167.628000] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[2011]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 167.660854] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[2011]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 167.690174] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[2011]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 167.733057] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[2011]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 167.759066] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[2011]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 167.787676] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[2011]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 167.843915] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Running postgresql schema... vm-test-run-timescaledb> server # [ 168.181039] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[2017]: ALTER DATABASE vm-test-run-timescaledb> server # [ 168.187045] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[2017]: ALTER DATABASE vm-test-run-timescaledb> server # [ 168.263335] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[2017]: ALTER ROLE vm-test-run-timescaledb> server # [ 168.341050] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[2017]: ALTER ROLE vm-test-run-timescaledb> server # [ 168.398593] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[2017]: ALTER ROLE vm-test-run-timescaledb> server # [ 168.457471] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[2017]: ALTER ROLE vm-test-run-timescaledb> server # [ 168.572029] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[2017]: ALTER ROLE vm-test-run-timescaledb> server # [ 168.721132] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[2017]: ALTER ROLE vm-test-run-timescaledb> server # [ 168.869471] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[2017]: ALTER ROLE vm-test-run-timescaledb> server # [ 169.018155] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[2017]: ALTER ROLE vm-test-run-timescaledb> server # [ 169.156633] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[2017]: ALTER ROLE vm-test-run-timescaledb> server # [ 169.178839] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[2017]: ALTER ROLE vm-test-run-timescaledb> server # [ 169.242495] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1456]: Database initialization complete vm-test-run-timescaledb> server # [ 169.305839] systemd[1]: Finished Supabase Database Initialization. vm-test-run-timescaledb> server # [ 169.338273] systemd[1]: Reached target Multi-User System. vm-test-run-timescaledb> server # [ 169.351831] systemd[1]: Startup finished in 15.818s (kernel) + 2min 33.481s (userspace) = 2min 49.299s. vm-test-run-timescaledb> server: (finished: waiting for unit supabase-db-init.service, in 170.85 seconds) vm-test-run-timescaledb> subtest: Check upgrade path with postgresql 15 vm-test-run-timescaledb> server: must succeed: psql -U supabase_admin -d postgres -t -A -F"," -c "DROP EXTENSION IF EXISTS timescaledb;" vm-test-run-timescaledb> server # NOTICE: extension "timescaledb" does not exist, skipping vm-test-run-timescaledb> server: (finished: must succeed: psql -U supabase_admin -d postgres -t -A -F"," -c "DROP EXTENSION IF EXISTS timescaledb;" , in 0.55 seconds) vm-test-run-timescaledb> server: must succeed: psql -U supabase_admin -d postgres -t -A -F"," -c "CREATE EXTENSION timescaledb WITH VERSION '2.9.1' CASCADE;" vm-test-run-timescaledb> server # WARNING: vm-test-run-timescaledb> server # WELCOME TO vm-test-run-timescaledb> server # _____ _ _ ____________ vm-test-run-timescaledb> server # |_ _(_) | | | _ \ ___ \ vm-test-run-timescaledb> server # | | _ _ __ ___ ___ ___ ___ __ _| | ___| | | | |_/ / vm-test-run-timescaledb> server # | | | | _ ` _ \ / _ \/ __|/ __/ _` | |/ _ \ | | | ___ \ vm-test-run-timescaledb> server # | | | | | | | | | __/\__ \ (_| (_| | | __/ |/ /| |_/ / vm-test-run-timescaledb> server # |_| |_|_| |_| |_|\___||___/\___\__,_|_|\___|___/ \____/ vm-test-run-timescaledb> server # Running version 2.9.1 vm-test-run-timescaledb> server # For more information on TimescaleDB, please visit the following links: vm-test-run-timescaledb> server # vm-test-run-timescaledb> server # 1. Getting started: https://docs.timescale.com/timescaledb/latest/getting-started vm-test-run-timescaledb> server # 2. API reference documentation: https://docs.timescale.com/api/latest vm-test-run-timescaledb> server # 3. How TimescaleDB is designed: https://docs.timescale.com/timescaledb/latest/overview/core-concepts vm-test-run-timescaledb> server # vm-test-run-timescaledb> server # Note: Please enable telemetry to help us improve our product by running: ALTER DATABASE "postgres" SET timescaledb.telemetry_level = 'basic'; vm-test-run-timescaledb> server # vm-test-run-timescaledb> server # [ 177.123371] postgres[2051]: [local] 2026-10-23 10:42:37.904 UTC [2051] supabase_admin@postgres WARNING: vm-test-run-timescaledb> server # [ 177.149525] postgres[2051]: WELCOME TO vm-test-run-timescaledb> server # [ 177.150363] postgres[2051]: _____ _ _ ____________ vm-test-run-timescaledb> server # [ 177.150992] postgres[2051]: |_ _(_) | | | _ \ ___ \ vm-test-run-timescaledb> server # [ 177.151609] postgres[2051]: | | _ _ __ ___ ___ ___ ___ __ _| | ___| | | | |_/ / vm-test-run-timescaledb> server # [ 177.161375] postgres[2051]: | | | | _ ` _ \ / _ \/ __|/ __/ _` | |/ _ \ | | | ___ \ vm-test-run-timescaledb> server # [ 177.161917] postgres[2051]: | | | | | | | | | __/\__ \ (_| (_| | | __/ |/ /| |_/ / vm-test-run-timescaledb> server # [ 177.164042] postgres[2051]: |_| |_|_| |_| |_|\___||___/\___\__,_|_|\___|___/ \____/ vm-test-run-timescaledb> server # [ 177.170514] postgres[2051]: Running version 2.9.1 vm-test-run-timescaledb> server # [ 177.171565] postgres[2051]: For more information on TimescaleDB, please visit the following links: vm-test-run-timescaledb> server # [ 177.171999] postgres[2051]: vm-test-run-timescaledb> server # [ 177.178048] postgres[2051]: 1. Getting started: https://docs.timescale.com/timescaledb/latest/getting-started vm-test-run-timescaledb> server # [ 177.179527] postgres[2051]: 2. API reference documentation: https://docs.timescale.com/api/latest vm-test-run-timescaledb> server # [ 177.186911] postgres[2051]: 3. How TimescaleDB is designed: https://docs.timescale.com/timescaledb/latest/overview/core-concepts vm-test-run-timescaledb> server # [ 177.192844] postgres[2051]: vm-test-run-timescaledb> server # [ 177.193887] postgres[2051]: Note: Please enable telemetry to help us improve our product by running: ALTER DATABASE "postgres" SET timescaledb.telemetry_level = 'basic'; vm-test-run-timescaledb> server # [ 177.194499] postgres[2051]: vm-test-run-timescaledb> server # [ 177.195036] postgres[2051]: [local] 2026-10-23 10:42:37.904 UTC [2051] supabase_admin@postgres CONTEXT: PL/pgSQL function inline_code_block line 16 at RAISE vm-test-run-timescaledb> server: (finished: must succeed: psql -U supabase_admin -d postgres -t -A -F"," -c "CREATE EXTENSION timescaledb WITH VERSION '2.9.1' CASCADE;" , in 6.80 seconds) vm-test-run-timescaledb> server: must succeed: psql -U supabase_admin -d postgres -t -A -F"," -c "SELECT extversion FROM pg_extension WHERE extname = 'timescaledb';" vm-test-run-timescaledb> server # [ 178.013693] postgres[2109]: 2026-10-23 10:42:38.775 UTC [2109] LOG: job 2 threw an error vm-test-run-timescaledb> server # [ 178.033755] postgres[2109]: 2026-10-23 10:42:38.789 UTC [2109] ERROR: functionality not supported under the current "apache" license vm-test-run-timescaledb> server # [ 178.035794] postgres[2109]: 2026-10-23 10:42:38.789 UTC [2109] HINT: Upgrade your license to 'timescale' to use this free community feature. vm-test-run-timescaledb> server # [ 178.075667] postgres[1398]: 2026-10-23 10:42:38.836 UTC [1398] LOG: background worker "Error Log Retention Policy [2]" (PID 2109) exited with exit code 1 vm-test-run-timescaledb> server: (finished: must succeed: psql -U supabase_admin -d postgres -t -A -F"," -c "SELECT extversion FROM pg_extension WHERE extname = 'timescaledb';" , in 1.13 seconds) vm-test-run-timescaledb> server: must succeed: psql -U supabase_admin -d postgres -t -A -F"," -c "ALTER EXTENSION timescaledb UPDATE TO '2.16.1';" vm-test-run-timescaledb> server # [ 179.442207] postgres[2096]: 2026-10-23 10:42:40.224 UTC [2096] FATAL: terminating background worker "TimescaleDB Background Worker Scheduler" due to administrator command vm-test-run-timescaledb> server # [ 179.502234] postgres[1398]: 2026-10-23 10:42:40.260 UTC [1398] LOG: background worker "TimescaleDB Background Worker Scheduler" (PID 2096) exited with exit code 1 vm-test-run-timescaledb> server # [ 186.769374] input: QEMU Virtio Keyboard as /devices/platform/4010000000.pcie/pci0000:00/0000:00:08.0/virtio7/input/input3 vm-test-run-timescaledb> server # [ 187.088689] postgres[2123]: 2026-10-23 10:42:47.856 UTC [2123] FATAL: terminating background worker "TimescaleDB Background Worker Scheduler" due to administrator command vm-test-run-timescaledb> server # [ 187.106713] postgres[1398]: 2026-10-23 10:42:47.883 UTC [1398] LOG: background worker "TimescaleDB Background Worker Scheduler" (PID 2123) exited with exit code 1 vm-test-run-timescaledb> server: (finished: must succeed: psql -U supabase_admin -d postgres -t -A -F"," -c "ALTER EXTENSION timescaledb UPDATE TO '2.16.1';" , in 9.10 seconds) vm-test-run-timescaledb> server: must succeed: psql -U supabase_admin -d postgres -t -A -F"," -c "SELECT extversion FROM pg_extension WHERE extname = 'timescaledb';" vm-test-run-timescaledb> server # [ 187.751177] postgres[2187]: 2026-10-23 10:42:48.530 UTC [2187] LOG: job 3 threw an error vm-test-run-timescaledb> server # [ 187.761860] postgres[2187]: 2026-10-23 10:42:48.535 UTC [2187] ERROR: functionality not supported under the current "apache" license. Learn more at https://timescale.com/. vm-test-run-timescaledb> server # [ 187.763794] postgres[2187]: 2026-10-23 10:42:48.535 UTC [2187] HINT: To access all features and the best time-series experience, try out Timescale Cloud. vm-test-run-timescaledb> server # [ 187.790440] postgres[1398]: 2026-10-23 10:42:48.572 UTC [1398] LOG: background worker "Job History Log Retention Policy [3]" (PID 2187) exited with exit code 1 vm-test-run-timescaledb> server: (finished: must succeed: psql -U supabase_admin -d postgres -t -A -F"," -c "SELECT extversion FROM pg_extension WHERE extname = 'timescaledb';" , in 0.59 seconds) vm-test-run-timescaledb> (finished: subtest: Check upgrade path with postgresql 15, in 18.18 seconds) vm-test-run-timescaledb> subtest: Check the install of the last version of the extension vm-test-run-timescaledb> server: must succeed: psql -U supabase_admin -d postgres -t -A -F"," -c "DROP EXTENSION IF EXISTS timescaledb;" vm-test-run-timescaledb> server # [ 188.639678] postgres[2185]: 2026-10-23 10:42:49.416 UTC [2185] FATAL: terminating background worker "TimescaleDB Background Worker Scheduler" due to administrator command vm-test-run-timescaledb> server # [ 188.675824] postgres[1398]: 2026-10-23 10:42:49.451 UTC [1398] LOG: background worker "TimescaleDB Background Worker Scheduler" (PID 2185) exited with exit code 1 vm-test-run-timescaledb> server: (finished: must succeed: psql -U supabase_admin -d postgres -t -A -F"," -c "DROP EXTENSION IF EXISTS timescaledb;" , in 1.39 seconds) vm-test-run-timescaledb> server: must succeed: psql -U supabase_admin -d postgres -t -A -F"," -c "CREATE EXTENSION timescaledb WITH VERSION '2.16.1' CASCADE;" vm-test-run-timescaledb> server # [ 191.246772] systemd[1]: Starting Virtual Console Setup... vm-test-run-timescaledb> server # [ 191.392713] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully. vm-test-run-timescaledb> server # [ 191.394337] systemd[1]: Stopped Virtual Console Setup. vm-test-run-timescaledb> server # [ 191.422925] systemd[1]: Starting Virtual Console Setup... vm-test-run-timescaledb> server # [ 193.549613] systemd[1]: Listening on Load/Save RF Kill Switch Status /dev/rfkill Watch. vm-test-run-timescaledb> server # [ 194.813070] systemd-logind[648]: Watching system buttons on /dev/input/event3 (QEMU Virtio Keyboard) vm-test-run-timescaledb> server # [ 194.855826] systemd[1]: Finished Virtual Console Setup. vm-test-run-timescaledb> server: (finished: must succeed: psql -U supabase_admin -d postgres -t -A -F"," -c "CREATE EXTENSION timescaledb WITH VERSION '2.16.1' CASCADE;" , in 5.94 seconds) vm-test-run-timescaledb> server: must succeed: psql -U supabase_admin -d postgres -t -A -F"," -c "SELECT extversion FROM pg_extension WHERE extname = 'timescaledb';" vm-test-run-timescaledb> server # [ 195.809364] postgres[2253]: 2026-10-23 10:42:56.589 UTC [2253] LOG: job 3 threw an error vm-test-run-timescaledb> server # [ 195.820081] postgres[2253]: 2026-10-23 10:42:56.600 UTC [2253] ERROR: functionality not supported under the current "apache" license. Learn more at https://timescale.com/. vm-test-run-timescaledb> server # [ 195.827982] postgres[2253]: 2026-10-23 10:42:56.600 UTC [2253] HINT: To access all features and the best time-series experience, try out Timescale Cloud. vm-test-run-timescaledb> server # [ 195.862205] postgres[1398]: 2026-10-23 10:42:56.636 UTC [1398] LOG: background worker "Job History Log Retention Policy [3]" (PID 2253) exited with exit code 1 vm-test-run-timescaledb> server: (finished: must succeed: psql -U supabase_admin -d postgres -t -A -F"," -c "SELECT extversion FROM pg_extension WHERE extname = 'timescaledb';" , in 0.73 seconds) vm-test-run-timescaledb> (finished: subtest: Check the install of the last version of the extension, in 8.06 seconds) vm-test-run-timescaledb> (finished: run the VM test script, in 197.20 seconds) vm-test-run-timescaledb> test script finished in 197.56s vm-test-run-timescaledb> cleanup vm-test-run-timescaledb> kill machine (pid 9) vm-test-run-timescaledb> qemu-system-aarch64: terminating on signal 15 from pid 6 (/nix/store/y88crn50yx35fiiwcjx6xqwi6ahk7mlq-python3-3.13.11/bin/python3.13) vm-test-run-timescaledb> vde_switch: EOF data port: Interrupted system call vm-test-run-timescaledb> kill vlan (pid 7) vm-test-run-timescaledb> (finished: cleanup, in 0.01 seconds) vm-test-run-timescaledb> vde_switch: Caught signal 15, cleaning up and exiting