[60.467240] Initializing watchdogs [60.467290] /dev/watchdog0 [60.483465] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics] [60.489333] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [60.491550] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [60.494729] [001/134] (960s left) gem_exec_whisper (basic-queues-priority-all) [60.567879] Starting subtest: basic-queues-priority-all [84.135066] Subtest basic-queues-priority-all: SUCCESS (23.631s) [84.318936] [002/134] (936s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-mmap-wc) [84.412239] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-mmap-wc [88.378403] Subtest fbc-1p-offscreen-pri-shrfb-draw-mmap-wc: SUCCESS (3.966s) [89.560973] [003/134] (931s left) kms_pipe_crc_basic (nonblocking-crc-frame-sequence) [89.656615] Starting subtest: nonblocking-crc-frame-sequence [89.657649] Starting dynamic subtest: pipe-A-eDP-1 [90.433836] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.777s) [90.442559] Starting dynamic subtest: pipe-B-eDP-1 [91.836560] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.402s) [91.843279] Starting dynamic subtest: pipe-C-eDP-1 [93.240732] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.402s) [93.247333] Starting dynamic subtest: pipe-D-eDP-1 [94.572815] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.331s) [94.573769] Subtest nonblocking-crc-frame-sequence: SUCCESS (4.917s) [95.388247] [004/134] (925s left) kms_addfb_basic (unused-modifier) [95.444626] Starting subtest: unused-modifier [95.445741] Subtest unused-modifier: SUCCESS (0.000s) [95.614897] [005/134] (925s left) gem_render_copy (linear-to-vebox-yf-tiled) [95.663774] Starting subtest: linear-to-vebox-yf-tiled [95.665977] Subtest linear-to-vebox-yf-tiled: SKIP (0.000s) [95.861600] [006/134] (925s left) gem_pread (display) [95.913990] Subtest display: SKIP (0.000s) [95.978353] [007/134] (925s left) gem_ctx_persistence (legacy-engines-mixed-process) [96.035601] Starting subtest: legacy-engines-mixed-process [96.036650] Starting dynamic subtest: render [97.859597] Dynamic subtest render: SUCCESS (1.822s) [97.867340] Starting dynamic subtest: bsd1 [99.884399] Dynamic subtest bsd1: SUCCESS (2.025s) [99.892616] Starting dynamic subtest: bsd2 [101.927532] Dynamic subtest bsd2: SUCCESS (2.042s) [101.938116] Starting dynamic subtest: blt [103.879186] Dynamic subtest blt: SUCCESS (1.950s) [103.887078] Starting dynamic subtest: vebox [105.917717] Dynamic subtest vebox: SUCCESS (2.038s) [105.919083] Subtest legacy-engines-mixed-process: SUCCESS (9.881s) [106.000482] [008/134] (915s left) syncobj_wait (invalid-multi-wait-unsubmitted-submitted-signaled) [106.052279] Starting subtest: invalid-multi-wait-unsubmitted-submitted-signaled [106.053307] Subtest invalid-multi-wait-unsubmitted-submitted-signaled: SUCCESS (0.000s) [106.172335] [009/134] (915s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-render) [106.266207] Starting subtest: fbc-rgb101010-draw-render [110.936022] Subtest fbc-rgb101010-draw-render: SUCCESS (4.670s) [112.113612] [010/134] (909s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-0-hflip) [112.212220] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-0-hflip [112.214050] Subtest y-tiled-max-hw-stride-32bpp-rotate-0-hflip: SKIP (0.000s) [112.340760] [011/134] (908s left) kms_frontbuffer_tracking (psr-rgb565-draw-pwrite) [112.442586] Starting subtest: psr-rgb565-draw-pwrite [119.554477] Subtest psr-rgb565-draw-pwrite: SUCCESS (7.112s) [119.681400] [012/134] (901s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-mmap-wc) [119.777307] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-mmap-wc [126.398911] Subtest psr-1p-offscreen-pri-shrfb-draw-mmap-wc: SUCCESS (6.620s) [126.535513] [013/134] (894s left) gem_userptr_blits (usage-restrictions) [126.596964] Starting subtest: usage-restrictions [126.597976] Subtest usage-restrictions: SUCCESS (0.000s) [126.751935] [014/134] (894s left) gem_mmap_wc (write-wc-read-gtt) [126.806246] Subtest write-wc-read-gtt: SKIP (0.000s) [126.862921] [015/134] (894s left) kms_flip (2x-flip-vs-panning) [126.957670] Starting subtest: 2x-flip-vs-panning [126.968106] Subtest 2x-flip-vs-panning: SKIP (0.011s) [127.060153] [016/134] (894s left) perf_pmu (invalid-init) [127.091503] Starting subtest: invalid-init [127.092675] Subtest invalid-init: SUCCESS (0.000s) [127.207994] [017/134] (894s left) kms_flip (2x-flip-vs-dpms) [127.291746] Starting subtest: 2x-flip-vs-dpms [127.301903] Subtest 2x-flip-vs-dpms: SKIP (0.011s) [127.439015] [018/134] (894s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-msflip-blt) [127.528176] Starting subtest: fbc-1p-primscrn-shrfb-msflip-blt [132.091802] Subtest fbc-1p-primscrn-shrfb-msflip-blt: SUCCESS (4.564s) [133.255472] [019/134] (888s left) kms_cursor_crc (cursor-onscreen-512x512) [133.529183] Starting subtest: cursor-onscreen-512x512 [133.531042] Subtest cursor-onscreen-512x512: SKIP (0.001s) [133.689714] [020/134] (887s left) perf (whitelisted-registers-userspace-config) [133.821402] Starting subtest: whitelisted-registers-userspace-config [133.822220] Subtest whitelisted-registers-userspace-config: SUCCESS (0.001s) [133.857332] [021/134] (887s left) kms_psr (pr-dpms) [133.944338] Starting subtest: pr-dpms [133.946158] Subtest pr-dpms: SKIP (0.000s) [134.019115] [022/134] (887s left) sw_sync (sync_merge) [134.045560] Starting subtest: sync_merge [134.046480] Subtest sync_merge: SUCCESS (0.000s) [134.118056] [023/134] (887s left) gem_ctx_freq (sysfs) [134.173946] Starting subtest: sysfs [134.174919] Starting dynamic subtest: gt0 [139.726363] Dynamic subtest gt0: SUCCESS (5.552s) [139.736277] Starting dynamic subtest: gt1 [180.886848] Dynamic subtest gt1: SUCCESS (41.158s) [180.888809] Subtest sysfs: SUCCESS (46.711s) [181.035275] [024/134] (840s left) kms_psr2_sf (pr-primary-plane-update-sf-dmg-area) [186.016810] Starting subtest: pr-primary-plane-update-sf-dmg-area [186.019818] Subtest pr-primary-plane-update-sf-dmg-area: SKIP (0.002s) [186.847376] [025/134] (834s left) gem_create (busy-create) [186.903422] Starting subtest: busy-create [186.904609] Starting dynamic subtest: smem0 [220.927046] Dynamic subtest smem0: SUCCESS (34.020s) [220.928741] Subtest busy-create: SUCCESS (34.021s) [221.118720] [026/134] (800s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-cpu) [221.217723] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-cpu [221.219675] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s) [221.328918] [027/134] (800s left) perf (gen8-unprivileged-single-ctx-counters) [221.425715] Starting subtest: gen8-unprivileged-single-ctx-counters [221.427901] Subtest gen8-unprivileged-single-ctx-counters: SKIP (0.000s) [221.457644] [028/134] (800s left) kms_plane_scaling (invalid-num-scalers) [221.547947] Starting subtest: invalid-num-scalers [221.549111] Starting dynamic subtest: pipe-A-eDP-1-invalid-num-scalers [221.564885] Dynamic subtest pipe-A-eDP-1-invalid-num-scalers: SUCCESS (0.017s) [221.572353] Starting dynamic subtest: pipe-B-eDP-1-invalid-num-scalers [221.594942] Dynamic subtest pipe-B-eDP-1-invalid-num-scalers: SUCCESS (0.029s) [221.602309] Starting dynamic subtest: pipe-C-eDP-1-invalid-num-scalers [221.625597] Dynamic subtest pipe-C-eDP-1-invalid-num-scalers: SUCCESS (0.029s) [221.632155] Starting dynamic subtest: pipe-D-eDP-1-invalid-num-scalers [221.655497] Dynamic subtest pipe-D-eDP-1-invalid-num-scalers: SUCCESS (0.029s) [221.656343] Subtest invalid-num-scalers: SUCCESS (0.109s) [221.772258] [029/134] (800s left) kms_big_fb (linear-32bpp-rotate-180) [221.868684] Starting subtest: linear-32bpp-rotate-180 [223.414453] Subtest linear-32bpp-rotate-180: SUCCESS (1.546s) [223.593661] [030/134] (798s left) kms_psr (fbc-psr2-primary-render) [223.687547] Starting subtest: fbc-psr2-primary-render [223.688536] Starting dynamic subtest: eDP-1 [223.690378] Dynamic subtest eDP-1: SKIP (0.000s) [223.692247] Subtest fbc-psr2-primary-render: SKIP (0.001s) [223.763181] [031/134] (798s left) kms_psr (fbc-pr-cursor-render) [223.851858] Starting subtest: fbc-pr-cursor-render [223.853889] Subtest fbc-pr-cursor-render: SKIP (0.000s) [223.938418] [032/134] (797s left) kms_psr2_sf (pr-overlay-plane-update-continuous-sf) [228.932826] Starting subtest: pr-overlay-plane-update-continuous-sf [228.935977] Subtest pr-overlay-plane-update-continuous-sf: SKIP (0.002s) [229.773673] [033/134] (792s left) gem_softpin (evict-single-offset) [229.837715] Starting subtest: evict-single-offset [253.911954] Subtest evict-single-offset: SUCCESS (24.070s) [254.011447] [034/134] (767s left) gem_exec_balancer (hog) [254.096597] Starting subtest: hog [254.098577] Subtest hog: SKIP (0.000s) [254.413702] [035/134] (767s left) kms_psr (psr2-cursor-blt) [254.511205] Starting subtest: psr2-cursor-blt [254.512188] Starting dynamic subtest: eDP-1 [256.245898] Dynamic subtest eDP-1: SUCCESS (1.734s) [256.246993] Subtest psr2-cursor-blt: SUCCESS (1.734s) [257.046358] [036/134] (764s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-downscaling) [257.134427] Starting subtest: flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-downscaling [257.135356] Starting dynamic subtest: pipe-A-default-mode [257.489359] Dynamic subtest pipe-A-default-mode: SKIP (0.353s) [257.491188] Subtest flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-downscaling: SKIP (0.355s) [258.265323] [037/134] (763s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-render) [258.359464] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-render [258.361771] Subtest fbc-2p-scndscrn-spr-indfb-draw-render: SKIP (0.000s) [258.493497] [038/134] (763s left) kms_3d (basic) [258.545643] Starting subtest: basic [260.498680] Subtest basic: SUCCESS (1.954s) [261.016362] [039/134] (761s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-render) [261.104911] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-render [261.106751] Subtest fbc-2p-primscrn-cur-indfb-draw-render: SKIP (0.000s) [261.221429] [040/134] (760s left) gem_exec_params (invalid-ring2) [261.271263] Starting subtest: invalid-ring2 [261.272207] Subtest invalid-ring2: SUCCESS (0.000s) [261.390257] [041/134] (760s left) perf_pmu (busy-check-all) [261.421604] Starting subtest: busy-check-all [261.422845] Starting dynamic subtest: rcs0 [261.994548] Dynamic subtest rcs0: SUCCESS (0.572s) [262.006112] Starting dynamic subtest: bcs0 [262.544421] Dynamic subtest bcs0: SUCCESS (0.548s) [262.555851] Starting dynamic subtest: vcs0 [263.895808] Dynamic subtest vcs0: SUCCESS (1.347s) [263.906240] Starting dynamic subtest: vcs1 [265.880056] Dynamic subtest vcs1: SUCCESS (1.982s) [265.890924] Starting dynamic subtest: vecs0 [267.927877] Dynamic subtest vecs0: SUCCESS (2.044s) [267.937850] Starting dynamic subtest: ccs0 [268.481110] Dynamic subtest ccs0: SUCCESS (0.553s) [268.482645] Subtest busy-check-all: SUCCESS (7.060s) [268.592812] [042/134] (753s left) syncobj_timeline (etime-multi-wait-all-for-submit-submitted) [268.641053] Starting subtest: etime-multi-wait-all-for-submit-submitted [268.747682] Subtest etime-multi-wait-all-for-submit-submitted: SUCCESS (0.103s) [268.852455] [043/134] (753s left) sysfs_heartbeat_interval (nopreempt) [268.911437] Starting subtest: nopreempt [268.912430] Starting dynamic subtest: vecs0 [278.963284] Dynamic subtest vecs0: SUCCESS (10.050s) [278.975070] Starting dynamic subtest: ccs0 [283.000612] Dynamic subtest ccs0: SUCCESS (4.035s) [283.010887] Starting dynamic subtest: vcs0 [292.917562] Dynamic subtest vcs0: SUCCESS (9.912s) [292.927704] Starting dynamic subtest: bcs0 [296.813586] Dynamic subtest bcs0: SUCCESS (3.895s) [296.826197] Starting dynamic subtest: rcs0 [300.860229] Dynamic subtest rcs0: SUCCESS (4.047s) [300.871859] Starting dynamic subtest: vcs1 [310.956081] Dynamic subtest vcs1: SUCCESS (10.094s) [310.957421] Subtest nopreempt: SUCCESS (42.044s) [311.036852] [044/134] (711s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-180) [311.122769] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-180 [311.124807] Subtest yf-tiled-max-hw-stride-64bpp-rotate-180: SKIP (0.000s) [311.239050] [045/134] (711s left) gem_exec_schedule (preempt-queue-contexts) [311.307915] Subtest preempt-queue-contexts: SKIP (0.000s) [311.601381] [046/134] (710s left) gem_ctx_shared (q-smoketest-all) [311.658712] Starting subtest: Q-smoketest-all [344.009785] Subtest Q-smoketest-all: SUCCESS (32.330s) [345.018564] [047/134] (677s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-indfb-pgflip-blt) [345.116327] Starting subtest: fbcpsr-1p-primscrn-indfb-pgflip-blt [352.414239] Subtest fbcpsr-1p-primscrn-indfb-pgflip-blt: SUCCESS (7.298s) [352.567883] [048/134] (669s left) perf_pmu (render-node-busy) [352.651457] Starting subtest: render-node-busy [352.652733] Starting dynamic subtest: rcs0 [353.250079] Dynamic subtest rcs0: SUCCESS (0.600s) [353.261719] Starting dynamic subtest: bcs0 [353.813884] Dynamic subtest bcs0: SUCCESS (0.562s) [353.825542] Starting dynamic subtest: vcs0 [355.927864] Dynamic subtest vcs0: SUCCESS (2.109s) [355.938615] Starting dynamic subtest: vcs1 [357.911864] Dynamic subtest vcs1: SUCCESS (1.981s) [357.921996] Starting dynamic subtest: vecs0 [359.895883] Dynamic subtest vecs0: SUCCESS (1.981s) [359.906768] Starting dynamic subtest: ccs0 [360.456056] Dynamic subtest ccs0: SUCCESS (0.559s) [360.457379] Subtest render-node-busy: SUCCESS (7.808s) [360.535617] [049/134] (661s left) syncobj_timeline (host-signal-ordered) [360.586420] Starting subtest: host-signal-ordered [360.587782] Subtest host-signal-ordered: SUCCESS (0.000s) [360.692883] [050/134] (661s left) kms_properties (plane-properties-atomic) [360.783108] Starting subtest: plane-properties-atomic [360.784109] Starting dynamic subtest: pipe-A-eDP-1 [361.342999] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.559s) [361.350772] Starting dynamic subtest: pipe-B-eDP-1 [362.628043] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.284s) [362.637373] Starting dynamic subtest: pipe-C-eDP-1 [363.909063] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.279s) [363.917925] Starting dynamic subtest: pipe-D-eDP-1 [365.216796] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.304s) [365.217955] Subtest plane-properties-atomic: SUCCESS (4.434s) [366.100168] [051/134] (656s left) kms_cursor_crc (cursor-sliding-512x512) [366.372459] Starting subtest: cursor-sliding-512x512 [366.377020] Subtest cursor-sliding-512x512: SKIP (0.001s) [366.530244] [052/134] (655s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-mmap-wc) [366.627465] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-mmap-wc [373.591851] Subtest psr-1p-primscrn-pri-shrfb-draw-mmap-wc: SUCCESS (6.966s) [373.739541] [053/134] (648s left) kms_addfb_basic (tile-pitch-mismatch) [373.792140] Starting subtest: tile-pitch-mismatch [373.794054] Subtest tile-pitch-mismatch: SKIP (0.000s) [373.970020] [054/134] (648s left) kms_addfb_basic (bad-pitch-128) [374.016476] Starting subtest: bad-pitch-128 [374.017469] Subtest bad-pitch-128: SUCCESS (0.000s) [374.177188] [055/134] (648s left) gem_pipe_control_store_loop (reused-buffer) [374.231484] Starting subtest: reused-buffer [376.386036] Subtest reused-buffer: SUCCESS (2.152s) [376.518408] [056/134] (646s left) gen9_exec_parse (cmd-crossing-page) [376.578987] Subtest cmd-crossing-page: SKIP (0.000s) [376.658083] [057/134] (645s left) kms_dsc (dsc-with-formats) [376.739067] Starting subtest: dsc-with-formats [376.753544] Subtest dsc-with-formats: SKIP (0.001s) [376.831755] [058/134] (645s left) kms_vblank (wait-forked-hang) [376.945704] Starting subtest: wait-forked-hang [376.966751] Starting dynamic subtest: pipe-A-eDP-1 [404.708471] Dynamic subtest pipe-A-eDP-1: SUCCESS (27.788s) [404.717703] Starting dynamic subtest: pipe-D-eDP-1 [419.676069] Dynamic subtest pipe-D-eDP-1: SUCCESS (14.965s) [419.677025] Subtest wait-forked-hang: SUCCESS (42.757s) [420.484685] [059/134] (602s left) vgem_basic (dmabuf-fence) [420.585960] Starting subtest: dmabuf-fence [420.586877] Subtest dmabuf-fence: SUCCESS (0.001s) [420.648525] [FACT vgem_basic (dmabuf-fence)] new: kernel.kmod_is_loaded.vgem: true [420.650940] [060/134] (602s left) core_debugfs (read-all-entries) [420.709166] Starting subtest: read-all-entries [420.802460] Subtest read-all-entries: SUCCESS (0.095s) [420.882671] [061/134] (601s left) sysfs_preempt_timeout (invalid) [420.944362] Starting subtest: invalid [420.945304] Starting dynamic subtest: vecs0 [420.946212] Dynamic subtest vecs0: SUCCESS (0.000s) [420.954548] Starting dynamic subtest: ccs0 [420.955472] Dynamic subtest ccs0: SUCCESS (0.000s) [420.962778] Starting dynamic subtest: vcs0 [420.963586] Dynamic subtest vcs0: SUCCESS (0.000s) [420.970862] Starting dynamic subtest: bcs0 [420.971695] Dynamic subtest bcs0: SUCCESS (0.000s) [420.978910] Starting dynamic subtest: rcs0 [420.979756] Dynamic subtest rcs0: SUCCESS (0.000s) [420.986812] Starting dynamic subtest: vcs1 [420.987672] Dynamic subtest vcs1: SUCCESS (0.000s) [420.988499] Subtest invalid: SUCCESS (0.005s) [421.101454] [062/134] (601s left) kms_plane_scaling (plane-upscale-20x20-with-pixel-format) [421.187470] Starting subtest: plane-upscale-20x20-with-pixel-format [421.188487] Starting dynamic subtest: pipe-A [422.236970] Dynamic subtest pipe-A: SUCCESS (1.050s) [422.245079] Starting dynamic subtest: pipe-B [424.347086] Dynamic subtest pipe-B: SUCCESS (2.109s) [424.355581] Starting dynamic subtest: pipe-C [425.513166] Dynamic subtest pipe-C: SUCCESS (1.165s) [425.520647] Starting dynamic subtest: pipe-D [426.706680] Dynamic subtest pipe-D: SUCCESS (1.193s) [426.707612] Subtest plane-upscale-20x20-with-pixel-format: SUCCESS (5.520s) [427.896691] [063/134] (594s left) syncobj_timeline (multi-wait-for-submit-signaled) [427.949490] Starting subtest: multi-wait-for-submit-signaled [427.950722] Subtest multi-wait-for-submit-signaled: SUCCESS (0.000s) [428.051843] [064/134] (594s left) i915_hangman (engine-engine-error) [428.113436] Starting subtest: engine-engine-error [428.114345] Starting dynamic subtest: rcs0 [429.877133] Dynamic subtest rcs0: SUCCESS (1.762s) [429.888325] Starting dynamic subtest: bcs0 [431.861692] Dynamic subtest bcs0: SUCCESS (1.982s) [431.872115] Starting dynamic subtest: vcs0 [433.845927] Dynamic subtest vcs0: SUCCESS (1.982s) [433.857033] Starting dynamic subtest: vcs1 [435.894083] Dynamic subtest vcs1: SUCCESS (2.046s) [435.904722] Starting dynamic subtest: vecs0 [437.877806] Dynamic subtest vecs0: SUCCESS (1.981s) [437.888739] Starting dynamic subtest: ccs0 [439.861930] Dynamic subtest ccs0: SUCCESS (1.981s) [439.863706] Subtest engine-engine-error: SUCCESS (11.748s) [439.961111] [065/134] (582s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc) [440.056279] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc [440.058016] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s) [440.174495] [066/134] (582s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-move) [440.266181] Starting subtest: fbc-1p-primscrn-spr-indfb-move [444.510517] Subtest fbc-1p-primscrn-spr-indfb-move: SUCCESS (4.248s) [445.689034] [067/134] (577s left) syncobj_timeline (multi-wait-available-unsubmitted-submitted) [445.730449] Starting subtest: multi-wait-available-unsubmitted-submitted [445.731382] Subtest multi-wait-available-unsubmitted-submitted: SUCCESS (0.000s) [445.866967] [068/134] (577s left) kms_atomic_transition (modeset-transition-nonblocking-fencing) [445.961348] Starting subtest: modeset-transition-nonblocking-fencing [445.962286] Starting dynamic subtest: 1x-outputs [457.043615] Dynamic subtest 1x-outputs: SUCCESS (11.083s) [457.044932] Subtest modeset-transition-nonblocking-fencing: SUCCESS (11.084s) [457.873317] [069/134] (565s left) kms_ccs (crc-primary-rotation-180-4-tiled-mtl-mc-ccs) [457.968292] Starting subtest: crc-primary-rotation-180-4-tiled-mtl-mc-ccs [457.969135] Starting dynamic subtest: pipe-A-eDP-1 [460.130299] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.162s) [460.139433] Starting dynamic subtest: pipe-B-eDP-1 [462.179881] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.048s) [462.188678] Starting dynamic subtest: pipe-C-eDP-1 [464.284094] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.103s) [464.293217] Starting dynamic subtest: pipe-D-eDP-1 [466.249932] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.964s) [466.250926] Subtest crc-primary-rotation-180-4-tiled-mtl-mc-ccs: SUCCESS (8.282s) [467.489558] [070/134] (555s left) core_hotunplug (unbind-rebind) [467.583634] Starting subtest: unbind-rebind [473.697687] Subtest unbind-rebind: SUCCESS (6.116s) [473.729602] [071/134] (549s left) gem_exec_reloc (basic-wc-gtt) [474.881716] Subtest basic-wc-gtt: SKIP (0.000s) [474.958691] [072/134] (548s left) kms_colorop (plane-xr30-xr30-srgb_eotf) [475.088389] Subtest plane-XR30-XR30-srgb_eotf: SKIP (0.000s) [475.164664] [073/134] (548s left) kms_writeback (writeback-invalid-parameters) [475.251251] Subtest writeback-invalid-parameters: SKIP (0.000s) [475.290452] [074/134] (547s left) syncobj_wait (invalid-multi-wait-all-unsubmitted) [475.341201] Starting subtest: invalid-multi-wait-all-unsubmitted [475.342057] Subtest invalid-multi-wait-all-unsubmitted: SUCCESS (0.000s) [475.459647] [075/134] (547s left) kms_plane_scaling (plane-scaler-with-clipping-clamping-modifiers) [475.540287] Starting subtest: plane-scaler-with-clipping-clamping-modifiers [475.541274] Starting dynamic subtest: pipe-A [475.888279] Dynamic subtest pipe-A: SUCCESS (0.349s) [475.897046] Starting dynamic subtest: pipe-B [477.266562] Dynamic subtest pipe-B: SUCCESS (1.377s) [477.275286] Starting dynamic subtest: pipe-C [478.725953] Dynamic subtest pipe-C: SUCCESS (1.459s) [478.733986] Starting dynamic subtest: pipe-D [480.136793] Dynamic subtest pipe-D: SUCCESS (1.410s) [480.137830] Subtest plane-scaler-with-clipping-clamping-modifiers: SUCCESS (4.598s) [481.318800] [076/134] (541s left) prime_vgem (fence-wait) [481.402030] Starting subtest: fence-wait [481.402952] Starting dynamic subtest: rcs0 [482.467992] Dynamic subtest rcs0: SUCCESS (1.063s) [482.477892] Starting dynamic subtest: bcs0 [483.547083] Dynamic subtest bcs0: SUCCESS (1.077s) [483.558402] Starting dynamic subtest: vcs0 [484.591763] Dynamic subtest vcs0: SUCCESS (1.042s) [484.602877] Starting dynamic subtest: vcs1 [485.901029] Dynamic subtest vcs1: SUCCESS (1.306s) [485.911568] Starting dynamic subtest: vecs0 [486.945831] Dynamic subtest vecs0: SUCCESS (1.043s) [486.956321] Starting dynamic subtest: ccs0 [487.990064] Dynamic subtest ccs0: SUCCESS (1.041s) [487.991724] Subtest fence-wait: SUCCESS (6.586s) [488.147860] [077/134] (535s left) gem_exec_reloc (basic-write-wc) [488.192153] Subtest basic-write-wc: SKIP (0.000s) [488.263855] [078/134] (535s left) gem_exec_fence (basic-busy) [488.442133] Starting subtest: basic-busy [488.443087] Starting dynamic subtest: rcs0 [488.549542] Dynamic subtest rcs0: SUCCESS (0.109s) [488.562856] Starting dynamic subtest: bcs0 [488.612744] Dynamic subtest bcs0: SUCCESS (0.060s) [488.623920] Starting dynamic subtest: vcs0 [488.680831] Dynamic subtest vcs0: SUCCESS (0.066s) [488.692765] Starting dynamic subtest: vcs1 [488.744914] Dynamic subtest vcs1: SUCCESS (0.062s) [488.758383] Starting dynamic subtest: vecs0 [488.811944] Dynamic subtest vecs0: SUCCESS (0.064s) [488.823606] Starting dynamic subtest: ccs0 [488.888807] Dynamic subtest ccs0: SUCCESS (0.075s) [488.892154] Subtest basic-busy: SUCCESS (0.450s) [491.028008] [079/134] (532s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-mmap-gtt) [491.136578] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-mmap-gtt [491.138257] Subtest fbc-2p-scndscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s) [491.250924] [080/134] (532s left) kms_chamelium_edid (dp-edid-stress-resolution-4k) [491.636889] Subtest dp-edid-stress-resolution-4k: SKIP (0.000s) [492.403468] [081/134] (531s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-mmap-cpu) [492.486991] Starting subtest: psr-1p-primscrn-cur-indfb-draw-mmap-cpu [498.926505] Subtest psr-1p-primscrn-cur-indfb-draw-mmap-cpu: SUCCESS (6.440s) [499.090022] [082/134] (524s left) kms_busy (extended-modeset-hang-newfb) [499.190302] Starting subtest: extended-modeset-hang-newfb [499.191283] Starting dynamic subtest: pipe-A [533.791892] Dynamic subtest pipe-A: SUCCESS (34.600s) [533.801760] Starting dynamic subtest: pipe-D [556.820410] Dynamic subtest pipe-D: SUCCESS (23.024s) [556.821425] Subtest extended-modeset-hang-newfb: SUCCESS (57.629s) [557.628802] [083/134] (465s left) i915_pm_rc6_residency (rc6-idle) [557.685077] Starting subtest: rc6-idle [557.723560] Starting dynamic subtest: gt0-rcs0 [582.075940] Dynamic subtest gt0-rcs0: SUCCESS (24.350s) [582.085945] Starting dynamic subtest: gt0-bcs0 [606.434589] Dynamic subtest gt0-bcs0: SUCCESS (24.355s) [606.443060] Starting dynamic subtest: gt0-ccs0 [630.840580] Dynamic subtest gt0-ccs0: SUCCESS (24.402s) [630.852685] Starting dynamic subtest: gt1-vcs0 [637.015504] Dynamic subtest gt1-vcs0: SUCCESS (6.169s) [637.025368] Starting dynamic subtest: gt1-vecs0 [643.187880] Dynamic subtest gt1-vecs0: SUCCESS (6.169s) [643.189508] Subtest rc6-idle: SUCCESS (85.497s) [643.272469] [084/134] (380s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-indfb-plflip-blt) [643.367522] Starting subtest: fbcpsr-2p-primscrn-indfb-plflip-blt [643.369333] Subtest fbcpsr-2p-primscrn-indfb-plflip-blt: SKIP (0.000s) [643.482663] [085/134] (380s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-180) [643.568046] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-180 [644.569076] Subtest 4-tiled-max-hw-stride-32bpp-rotate-180: SUCCESS (1.001s) [644.724289] [086/134] (378s left) kms_prop_blob (invalid-get-prop-any) [644.767636] Starting subtest: invalid-get-prop-any [644.768509] Subtest invalid-get-prop-any: SUCCESS (0.000s) [644.880807] [087/134] (378s left) gem_softpin (evict-snoop) [644.926519] Starting subtest: evict-snoop [644.928554] Subtest evict-snoop: SKIP (0.000s) [645.065376] [088/134] (378s left) kms_cursor_crc (cursor-offscreen-128x42) [645.267454] Starting subtest: cursor-offscreen-128x42 [645.306904] Subtest cursor-offscreen-128x42: SKIP (0.037s) [645.546810] [089/134] (378s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-180-async-flip) [645.648194] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-180-async-flip [646.440379] Subtest x-tiled-max-hw-stride-64bpp-rotate-180-async-flip: SUCCESS (0.792s) [646.608805] [090/134] (377s left) gem_userptr_blits (userfault) [646.663193] Starting subtest: userfault [646.667270] Subtest userfault: SUCCESS (0.007s) [646.816059] [091/134] (376s left) kms_cursor_legacy (cursora-vs-flipb-legacy) [646.936614] Starting subtest: cursorA-vs-flipB-legacy [646.938830] Subtest cursorA-vs-flipB-legacy: SKIP (0.001s) [647.084259] [092/134] (376s left) kms_rmfb (rmfb-ioctl) [647.175789] Starting subtest: rmfb-ioctl [647.176813] Starting dynamic subtest: pipe-A-eDP-1 [647.282468] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.106s) [647.293628] Starting dynamic subtest: pipe-B-eDP-1 [648.480439] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.196s) [648.490206] Starting dynamic subtest: pipe-C-eDP-1 [649.608319] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.126s) [649.618834] Starting dynamic subtest: pipe-D-eDP-1 [650.748978] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.139s) [650.751649] Subtest rmfb-ioctl: SUCCESS (3.574s) [651.978567] [093/134] (371s left) kms_ccs (missing-ccs-buffer-y-tiled-gen12-mc-ccs) [652.061157] Starting subtest: missing-ccs-buffer-y-tiled-gen12-mc-ccs [652.061993] Starting dynamic subtest: pipe-A-eDP-1 [652.070255] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [652.078386] Starting dynamic subtest: pipe-B-eDP-1 [652.086918] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [652.095313] Starting dynamic subtest: pipe-C-eDP-1 [652.103206] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [652.111029] Starting dynamic subtest: pipe-D-eDP-1 [652.119417] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [652.121064] Subtest missing-ccs-buffer-y-tiled-gen12-mc-ccs: SKIP (0.004s) [654.242496] [094/134] (369s left) kms_frontbuffer_tracking (basic) [654.342992] Starting subtest: basic [657.503111] Subtest basic: SUCCESS (3.160s) [657.649431] [095/134] (366s left) kms_chamelium_hpd (vga-hpd-fast) [658.034468] Subtest vga-hpd-fast: SKIP (0.000s) [658.836056] [096/134] (365s left) kms_rotation_crc (multiplane-rotation-cropping-bottom) [658.929394] Starting subtest: multiplane-rotation-cropping-bottom [666.155497] Subtest multiplane-rotation-cropping-bottom: SUCCESS (7.226s) [666.289997] [097/134] (357s left) kms_cursor_legacy (single-bo) [666.408534] Starting subtest: single-bo [666.409467] Starting dynamic subtest: pipe-A [671.791363] Dynamic subtest pipe-A: SUCCESS (5.379s) [671.800083] Starting dynamic subtest: pipe-B [677.177693] Dynamic subtest pipe-B: SUCCESS (5.382s) [677.187463] Starting dynamic subtest: pipe-C [682.561483] Dynamic subtest pipe-C: SUCCESS (5.380s) [682.571487] Starting dynamic subtest: pipe-D [687.943310] Dynamic subtest pipe-D: SUCCESS (5.380s) [687.954377] Starting dynamic subtest: all-pipes [693.331939] Dynamic subtest all-pipes: SUCCESS (5.386s) [693.333146] Subtest single-bo: SUCCESS (26.920s) [693.498819] [098/134] (330s left) vgem_basic (sysfs) [693.541841] Starting subtest: sysfs [693.542870] Subtest sysfs: SUCCESS (0.001s) [693.619640] [099/134] (330s left) kms_frontbuffer_tracking (psr-rgb565-draw-mmap-gtt) [693.885140] Starting subtest: psr-rgb565-draw-mmap-gtt [693.887338] Subtest psr-rgb565-draw-mmap-gtt: SKIP (0.000s) [694.159289] [100/134] (329s left) i915_drm_fdinfo (all-busy-idle-check-all) [694.204091] Starting subtest: all-busy-idle-check-all [694.210795] Subtest all-busy-idle-check-all: SKIP (0.006s) [694.308680] [101/134] (329s left) gem_exec_schedule (deep) [694.546743] Starting subtest: deep [694.548291] Starting dynamic subtest: rcs0 [699.708545] Dynamic subtest rcs0: SKIP (5.158s) [699.719041] Starting dynamic subtest: vcs0 [709.904513] Dynamic subtest vcs0: SUCCESS (10.197s) [709.913049] Starting dynamic subtest: vcs1 [721.299088] Dynamic subtest vcs1: SUCCESS (11.392s) [721.312745] Starting dynamic subtest: vecs0 [732.498919] Dynamic subtest vecs0: SUCCESS (11.198s) [732.510285] Starting dynamic subtest: ccs0 [745.266496] Dynamic subtest ccs0: SUCCESS (12.765s) [745.267975] Subtest deep: SUCCESS (50.716s) [747.316552] [102/134] (276s left) kms_pipe_crc_basic (suspend-read-crc) [747.417368] Starting subtest: suspend-read-crc [747.418358] Starting dynamic subtest: pipe-A-eDP-1 [765.792506] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.083s) [765.802154] Starting dynamic subtest: pipe-B-eDP-1 [784.493564] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.174s) [784.502294] Aborting: Kernel badly tainted (0x4244, 0x200) (check dmesg for details): TAINT_WARN: WARN_ON has happened. [784.504161] Starting dynamic subtest: pipe-C-eDP-1 [803.477203] Dynamic subtest pipe-C-eDP-1: SUCCESS (3.845s) [803.478128] Starting dynamic subtest: pipe-D-eDP-1 [821.471352] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.131s) [821.472210] Subtest suspend-read-crc: SUCCESS (13.239s) [822.298859] [FACT kms_pipe_crc_basic (suspend-read-crc)] new: kernel.is_tainted.taint_warn: true [822.299694] Closing watchdogs results: parsing output: 0/ for test: gem_exec_whisper results: parsing output: 1/ for test: kms_frontbuffer_tracking results: parsing output: 2/ for test: kms_pipe_crc_basic results: parsing output: 3/ for test: kms_addfb_basic results: parsing output: 4/ for test: gem_render_copy results: parsing output: 5/ for test: gem_pread results: parsing output: 6/ for test: gem_ctx_persistence results: parsing output: 7/ for test: syncobj_wait results: parsing output: 8/ for test: kms_frontbuffer_tracking results: parsing output: 9/ for test: kms_big_fb results: parsing output: 10/ for test: kms_frontbuffer_tracking results: parsing output: 11/ for test: kms_frontbuffer_tracking results: parsing output: 12/ for test: gem_userptr_blits results: parsing output: 13/ for test: gem_mmap_wc results: parsing output: 14/ for test: kms_flip results: parsing output: 15/ for test: perf_pmu results: parsing output: 16/ for test: kms_flip results: parsing output: 17/ for test: kms_frontbuffer_tracking results: parsing output: 18/ for test: kms_cursor_crc results: parsing output: 19/ for test: perf results: parsing output: 20/ for test: kms_psr results: parsing output: 21/ for test: sw_sync results: parsing output: 22/ for test: gem_ctx_freq results: parsing output: 23/ for test: kms_psr2_sf results: parsing output: 24/ for test: gem_create results: parsing output: 25/ for test: kms_frontbuffer_tracking results: parsing output: 26/ for test: perf results: parsing output: 27/ for test: kms_plane_scaling results: parsing output: 28/ for test: kms_big_fb results: parsing output: 29/ for test: kms_psr results: parsing output: 30/ for test: kms_psr results: parsing output: 31/ for test: kms_psr2_sf results: parsing output: 32/ for test: gem_softpin results: parsing output: 33/ for test: gem_exec_balancer results: parsing output: 34/ for test: kms_psr results: parsing output: 35/ for test: kms_flip_scaled_crc results: parsing output: 36/ for test: kms_frontbuffer_tracking results: parsing output: 37/ for test: kms_3d results: parsing output: 38/ for test: kms_frontbuffer_tracking results: parsing output: 39/ for test: gem_exec_params results: parsing output: 40/ for test: perf_pmu results: parsing output: 41/ for test: syncobj_timeline results: parsing output: 42/ for test: sysfs_heartbeat_interval results: parsing output: 43/ for test: kms_big_fb results: parsing output: 44/ for test: gem_exec_schedule results: parsing output: 45/ for test: gem_ctx_shared results: parsing output: 46/ for test: kms_frontbuffer_tracking results: parsing output: 47/ for test: perf_pmu results: parsing output: 48/ for test: syncobj_timeline results: parsing output: 49/ for test: kms_properties results: parsing output: 50/ for test: kms_cursor_crc results: parsing output: 51/ for test: kms_frontbuffer_tracking results: parsing output: 52/ for test: kms_addfb_basic results: parsing output: 53/ for test: kms_addfb_basic results: parsing output: 54/ for test: gem_pipe_control_store_loop results: parsing output: 55/ for test: gen9_exec_parse results: parsing output: 56/ for test: kms_dsc results: parsing output: 57/ for test: kms_vblank results: parsing output: 58/ for test: vgem_basic results: parsing output: 59/ for test: core_debugfs results: parsing output: 60/ for test: sysfs_preempt_timeout results: parsing output: 61/ for test: kms_plane_scaling results: parsing output: 62/ for test: syncobj_timeline results: parsing output: 63/ for test: i915_hangman results: parsing output: 64/ for test: kms_frontbuffer_tracking results: parsing output: 65/ for test: kms_frontbuffer_tracking results: parsing output: 66/ for test: syncobj_timeline results: parsing output: 67/ for test: kms_atomic_transition results: parsing output: 68/ for test: kms_ccs results: parsing output: 69/ for test: core_hotunplug results: parsing output: 70/ for test: gem_exec_reloc results: parsing output: 71/ for test: kms_colorop results: parsing output: 72/ for test: kms_writeback results: parsing output: 73/ for test: syncobj_wait results: parsing output: 74/ for test: kms_plane_scaling results: parsing output: 75/ for test: prime_vgem results: parsing output: 76/ for test: gem_exec_reloc results: parsing output: 77/ for test: gem_exec_fence results: parsing output: 78/ for test: kms_frontbuffer_tracking results: parsing output: 79/ for test: kms_chamelium_edid results: parsing output: 80/ for test: kms_frontbuffer_tracking results: parsing output: 81/ for test: kms_busy results: parsing output: 82/ for test: i915_pm_rc6_residency results: parsing output: 83/ for test: kms_frontbuffer_tracking results: parsing output: 84/ for test: kms_big_fb results: parsing output: 85/ for test: kms_prop_blob results: parsing output: 86/ for test: gem_softpin results: parsing output: 87/ for test: kms_cursor_crc results: parsing output: 88/ for test: kms_big_fb results: parsing output: 89/ for test: gem_userptr_blits results: parsing output: 90/ for test: kms_cursor_legacy results: parsing output: 91/ for test: kms_rmfb results: parsing output: 92/ for test: kms_ccs results: parsing output: 93/ for test: kms_frontbuffer_tracking results: parsing output: 94/ for test: kms_chamelium_hpd results: parsing output: 95/ for test: kms_rotation_crc results: parsing output: 96/ for test: kms_cursor_legacy results: parsing output: 97/ for test: vgem_basic results: parsing output: 98/ for test: kms_frontbuffer_tracking results: parsing output: 99/ for test: i915_drm_fdinfo results: parsing output: 100/ for test: gem_exec_schedule results: parsing output: 101/ for test: kms_pipe_crc_basic results: parsing output: 102/ for test: kms_frontbuffer_tracking results: no output, setting notrun results: parsing output: 103/ for test: kms_selftest results: no output, setting notrun results: parsing output: 104/ for test: api_intel_bb results: no output, setting notrun results: parsing output: 105/ for test: gem_exec_schedule results: no output, setting notrun results: parsing output: 106/ for test: kms_frontbuffer_tracking results: no output, setting notrun results: parsing output: 107/ for test: kms_flip results: no output, setting notrun results: parsing output: 108/ for test: kms_frontbuffer_tracking results: no output, setting notrun results: parsing output: 109/ for test: kms_flip results: no output, setting notrun results: parsing output: 110/ for test: kms_joiner results: no output, setting notrun results: parsing output: 111/ for test: kms_colorop results: no output, setting notrun results: parsing output: 112/ for test: kms_ccs results: no output, setting notrun results: parsing output: 113/ for test: kms_cursor_legacy results: no output, setting notrun results: parsing output: 114/ for test: gem_bad_reloc results: no output, setting notrun results: parsing output: 115/ for test: kms_debugfs results: no output, setting notrun results: parsing output: 116/ for test: gem_fenced_exec_thrash results: no output, setting notrun results: parsing output: 117/ for test: kms_ccs results: no output, setting notrun results: parsing output: 118/ for test: kms_big_fb results: no output, setting notrun results: parsing output: 119/ for test: kms_frontbuffer_tracking results: no output, setting notrun results: parsing output: 120/ for test: gem_exec_fence results: no output, setting notrun results: parsing output: 121/ for test: i915_query results: no output, setting notrun results: parsing output: 122/ for test: kms_colorop results: no output, setting notrun results: parsing output: 123/ for test: kms_flip results: no output, setting notrun results: parsing output: 124/ for test: tools_test results: no output, setting notrun results: parsing output: 125/ for test: gem_mmap_offset results: no output, setting notrun results: parsing output: 126/ for test: kms_ccs results: no output, setting notrun results: parsing output: 127/ for test: gem_exec_whisper results: no output, setting notrun results: parsing output: 128/ for test: gem_render_copy results: no output, setting notrun results: parsing output: 129/ for test: kms_pm_rpm results: no output, setting notrun results: parsing output: 130/ for test: kms_hdr results: no output, setting notrun results: parsing output: 131/ for test: gem_exec_reloc results: no output, setting notrun results: parsing output: 132/ for test: gem_lmem_swapping results: no output, setting notrun results: parsing output: 133/ for test: kms_flip_scaled_crc results: no output, setting notrun Done.