[56.789480] Initializing watchdogs [56.789558] /dev/watchdog0 [56.809647] [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] [56.814186] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [56.816541] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [56.819979] [001/131] (960s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-pwrite) [56.943088] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-pwrite [56.947236] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-pwrite: SKIP (0.000s) [57.056676] [002/131] (960s left) prime_busy (after-wait) [57.123811] Starting subtest: after-wait [57.128577] Starting dynamic subtest: rcs0 [57.161448] Dynamic subtest rcs0: SUCCESS (0.035s) [57.170276] Starting dynamic subtest: bcs0 [57.219393] Dynamic subtest bcs0: SUCCESS (0.057s) [57.228626] Starting dynamic subtest: vcs0 [57.259148] Dynamic subtest vcs0: SUCCESS (0.039s) [57.265578] Starting dynamic subtest: vcs1 [57.297324] Dynamic subtest vcs1: SUCCESS (0.038s) [57.303804] Starting dynamic subtest: vecs0 [57.337060] Dynamic subtest vecs0: SUCCESS (0.039s) [57.343378] Starting dynamic subtest: ccs0 [57.376092] Dynamic subtest ccs0: SUCCESS (0.038s) [57.485532] Subtest after-wait: SUCCESS (0.358s) [57.567217] [003/131] (959s left) api_intel_bb (simple-bb) [57.628151] Starting subtest: simple-bb [57.633058] Subtest simple-bb: SUCCESS (0.006s) [57.770685] [004/131] (959s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-move) [57.877283] Starting subtest: fbc-2p-scndscrn-spr-indfb-move [57.881341] Subtest fbc-2p-scndscrn-spr-indfb-move: SKIP (0.000s) [57.986321] [005/131] (959s left) gem_exec_whisper (basic-queues) [58.054410] Starting subtest: basic-queues [63.861820] Subtest basic-queues: SUCCESS (5.785s) [64.070847] [006/131] (953s left) i915_pm_rps (thresholds-idle) [64.122955] Starting subtest: thresholds-idle [64.127497] Subtest thresholds-idle: SKIP (0.001s) [64.207956] [007/131] (953s left) kms_psr (fbc-psr-sprite-blt) [64.306995] Starting subtest: fbc-psr-sprite-blt [64.309386] Starting dynamic subtest: eDP-1 [64.313897] Dynamic subtest eDP-1: SKIP (0.000s) [64.318686] Subtest fbc-psr-sprite-blt: SKIP (0.000s) [64.389941] [008/131] (953s left) syncobj_basic (bad-pad-handle-to-fd) [64.442570] Starting subtest: bad-pad-handle-to-fd [64.444784] Subtest bad-pad-handle-to-fd: SUCCESS (0.000s) [64.550642] [009/131] (953s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-blt) [64.647476] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-blt [68.457725] Subtest fbc-1p-primscrn-spr-indfb-draw-blt: SUCCESS (3.808s) [69.631990] [010/131] (948s left) syncobj_timeline (multi-wait-all-signaled) [69.685811] Starting subtest: multi-wait-all-signaled [69.688148] Subtest multi-wait-all-signaled: SUCCESS (0.001s) [69.825743] [011/131] (947s left) gem_mmap_wc (bad-object) [69.885735] Subtest bad-object: SKIP (0.000s) [69.947682] [012/131] (947s left) kms_addfb_basic (basic) [69.988771] Starting subtest: basic [69.990648] Subtest basic: SUCCESS (0.000s) [70.142199] [013/131] (947s left) gem_exec_balancer (full-late) [70.195571] Starting subtest: full-late [74.758366] Subtest full-late: SUCCESS (4.560s) [75.094919] [014/131] (942s left) perf_pmu (semaphore-wait) [75.133209] Starting subtest: semaphore-wait [75.135495] Starting dynamic subtest: rcs0 [75.649433] Dynamic subtest rcs0: SUCCESS (0.515s) [75.660801] Starting dynamic subtest: bcs0 [76.165075] Dynamic subtest bcs0: SUCCESS (0.514s) [76.176532] Starting dynamic subtest: vcs0 [76.679510] Dynamic subtest vcs0: SUCCESS (0.513s) [76.690448] Starting dynamic subtest: vcs1 [77.192754] Dynamic subtest vcs1: SUCCESS (0.512s) [77.204333] Starting dynamic subtest: vecs0 [77.707437] Dynamic subtest vecs0: SUCCESS (0.513s) [77.718883] Starting dynamic subtest: ccs0 [78.223656] Dynamic subtest ccs0: SUCCESS (0.514s) [78.226482] Subtest semaphore-wait: SUCCESS (3.089s) [78.364715] [015/131] (939s left) core_getversion (basic) [78.398071] Starting subtest: basic [78.402701] Subtest basic: SUCCESS (0.000s) [78.482821] [016/131] (939s left) kms_big_fb (y-tiled-8bpp-rotate-0) [78.593755] Starting subtest: y-tiled-8bpp-rotate-0 [78.598097] Subtest y-tiled-8bpp-rotate-0: SKIP (0.000s) [78.725782] [017/131] (939s left) kms_plane_multiple (2x-tiling-4) [78.812981] Starting subtest: 2x-tiling-4 [78.817470] Subtest 2x-tiling-4: SKIP (0.000s) [78.908700] [018/131] (939s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-blt) [79.014837] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-blt [79.019224] Subtest fbc-2p-primscrn-cur-indfb-draw-blt: SKIP (0.000s) [79.139241] [019/131] (938s left) kms_psr2_sf (psr2-cursor-plane-move-continuous-exceed-sf) [84.169222] Starting subtest: psr2-cursor-plane-move-continuous-exceed-sf [84.171692] Starting dynamic subtest: pipe-A-eDP-1 [95.597124] Dynamic subtest pipe-A-eDP-1: SUCCESS (11.423s) [95.607048] Starting dynamic subtest: pipe-B-eDP-1 [107.033623] Dynamic subtest pipe-B-eDP-1: SUCCESS (11.435s) [107.036238] Subtest psr2-cursor-plane-move-continuous-exceed-sf: SUCCESS (22.861s) [107.907864] [020/131] (910s left) kms_ccs (crc-primary-rotation-180-4-tiled-mtl-rc-ccs-cc) [108.010317] Starting subtest: crc-primary-rotation-180-4-tiled-mtl-rc-ccs-cc [108.012610] Starting dynamic subtest: pipe-A-eDP-1 [108.806799] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.785s) [108.816691] Starting dynamic subtest: pipe-B-eDP-1 [110.339078] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.532s) [110.348775] Starting dynamic subtest: pipe-C-eDP-1 [111.821829] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.482s) [111.831904] Starting dynamic subtest: pipe-D-eDP-1 [113.351401] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.528s) [113.353608] Subtest crc-primary-rotation-180-4-tiled-mtl-rc-ccs-cc: SUCCESS (5.331s) [114.555892] [021/131] (903s left) kms_frontbuffer_tracking (psr-rgb565-draw-blt) [114.666775] Starting subtest: psr-rgb565-draw-blt [121.600806] Subtest psr-rgb565-draw-blt: SUCCESS (6.937s) [121.747740] [022/131] (896s left) gem_exec_reloc (basic-cpu-read-active) [121.803052] Subtest basic-cpu-read-active: SKIP (0.000s) [121.877926] [023/131] (896s left) perf_pmu (all-busy-check-all) [121.915927] Starting subtest: all-busy-check-all [123.925231] Subtest all-busy-check-all: SUCCESS (2.008s) [124.045600] [024/131] (894s left) kms_psr (psr2-sprite-blt) [124.137084] Starting subtest: psr2-sprite-blt [124.139452] Starting dynamic subtest: eDP-1 [125.867962] Dynamic subtest eDP-1: SUCCESS (1.729s) [125.870193] Subtest psr2-sprite-blt: SUCCESS (1.730s) [126.764214] [025/131] (891s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-msflip-blt) [126.860597] Starting subtest: fbc-1p-primscrn-shrfb-msflip-blt [131.353766] Subtest fbc-1p-primscrn-shrfb-msflip-blt: SUCCESS (4.496s) [132.577544] [026/131] (885s left) kms_color (deep-color) [132.689674] Starting subtest: deep-color [133.718519] Starting dynamic subtest: pipe-A-eDP-1-gamma [134.409696] Dynamic subtest pipe-A-eDP-1-gamma: SUCCESS (0.693s) [134.418469] Starting dynamic subtest: pipe-A-eDP-1-degamma [135.811091] Dynamic subtest pipe-A-eDP-1-degamma: SUCCESS (1.398s) [135.821032] Starting dynamic subtest: pipe-A-eDP-1-ctm [137.243559] Dynamic subtest pipe-A-eDP-1-ctm: SUCCESS (1.433s) [138.018117] Starting dynamic subtest: pipe-B-eDP-1-gamma [138.690939] Dynamic subtest pipe-B-eDP-1-gamma: SUCCESS (0.679s) [138.700355] Starting dynamic subtest: pipe-B-eDP-1-degamma [140.085818] Dynamic subtest pipe-B-eDP-1-degamma: SUCCESS (1.397s) [140.095790] Starting dynamic subtest: pipe-B-eDP-1-ctm [141.495995] Dynamic subtest pipe-B-eDP-1-ctm: SUCCESS (1.410s) [142.315871] Starting dynamic subtest: pipe-C-eDP-1-gamma [142.969202] Dynamic subtest pipe-C-eDP-1-gamma: SUCCESS (0.659s) [142.977477] Starting dynamic subtest: pipe-C-eDP-1-degamma [144.340799] Dynamic subtest pipe-C-eDP-1-degamma: SUCCESS (1.371s) [144.349749] Starting dynamic subtest: pipe-C-eDP-1-ctm [145.709754] Dynamic subtest pipe-C-eDP-1-ctm: SUCCESS (1.368s) [146.520336] Starting dynamic subtest: pipe-D-eDP-1-gamma [147.176534] Dynamic subtest pipe-D-eDP-1-gamma: SUCCESS (0.662s) [147.185773] Starting dynamic subtest: pipe-D-eDP-1-degamma [148.538741] Dynamic subtest pipe-D-eDP-1-degamma: SUCCESS (1.360s) [148.546844] Starting dynamic subtest: pipe-D-eDP-1-ctm [149.851644] Dynamic subtest pipe-D-eDP-1-ctm: SUCCESS (1.311s) [149.853615] Subtest deep-color: SUCCESS (17.161s) [150.695314] [027/131] (867s left) kms_joiner (basic-big-joiner) [150.797111] Starting subtest: basic-big-joiner [150.801511] Subtest basic-big-joiner: SKIP (0.000s) [150.871806] [028/131] (867s left) fbdev (unaligned-write) [150.911617] Starting subtest: unaligned-write [151.012701] Subtest unaligned-write: SUCCESS (0.100s) [151.082362] [029/131] (867s left) gem_spin_batch (user-each) [151.144749] Starting subtest: user-each [154.416383] Subtest user-each: SUCCESS (3.263s) [154.940884] [030/131] (863s left) gem_exec_fence (submit) [155.112653] Starting subtest: submit [155.117348] Subtest submit: SKIP (0.000s) [156.970549] [FACT gem_exec_fence (submit)] new: kernel.kmod_is_loaded.vgem: true [156.974659] [031/131] (861s left) kms_flip (2x-flip-vs-modeset-vs-hang) [157.060140] Starting subtest: 2x-flip-vs-modeset-vs-hang [157.071586] Subtest 2x-flip-vs-modeset-vs-hang: SKIP (0.011s) [157.159951] [032/131] (861s left) gem_render_copy_redux (interruptible) [157.209629] Starting subtest: interruptible [157.470023] Subtest interruptible: SUCCESS (0.261s) [157.610020] [033/131] (860s left) gem_exec_whisper (basic-fds-priority) [157.666851] Starting subtest: basic-fds-priority [181.395992] Subtest basic-fds-priority: SUCCESS (23.725s) [181.589982] [034/131] (837s left) kms_busy (extended-modeset-hang-oldfb-with-reset) [181.703146] Starting subtest: extended-modeset-hang-oldfb-with-reset [181.705891] Starting dynamic subtest: pipe-A [193.445581] Dynamic subtest pipe-A: SUCCESS (11.741s) [193.455996] Starting dynamic subtest: pipe-D [205.723795] Dynamic subtest pipe-D: SUCCESS (12.276s) [205.726173] Subtest extended-modeset-hang-oldfb-with-reset: SUCCESS (24.021s) [206.548409] [035/131] (812s left) kms_big_fb (x-tiled-64bpp-rotate-180) [206.666391] Starting subtest: x-tiled-64bpp-rotate-180 [208.264413] Subtest x-tiled-64bpp-rotate-180: SUCCESS (1.599s) [208.454736] [036/131] (810s left) gem_pxp (protected-encrypted-src-copy-not-readible) [208.588127] Starting subtest: protected-encrypted-src-copy-not-readible [208.702622] Subtest protected-encrypted-src-copy-not-readible: SUCCESS (0.115s) [208.861042] [037/131] (809s left) kms_cursor_legacy (2x-cursor-vs-flip-legacy) [208.968461] Starting subtest: 2x-cursor-vs-flip-legacy [208.973059] Subtest 2x-cursor-vs-flip-legacy: SKIP (0.001s) [209.140580] [038/131] (809s left) gem_exec_params (no-blt) [209.195149] Starting subtest: no-blt [209.197524] Subtest no-blt: SUCCESS (0.002s) [209.340254] [039/131] (809s left) gem_render_copy (y-tiled-ccs-to-y-tiled-ccs) [209.402587] Starting subtest: y-tiled-ccs-to-y-tiled-ccs [209.407280] Subtest y-tiled-ccs-to-y-tiled-ccs: SKIP (0.000s) [209.608691] [040/131] (809s left) kms_flip (basic-plain-flip) [209.691716] Starting subtest: basic-plain-flip [209.694137] Starting dynamic subtest: A-eDP1 [211.323900] Dynamic subtest A-eDP1: SUCCESS (1.631s) [211.335071] Starting dynamic subtest: B-eDP1 [212.970468] Dynamic subtest B-eDP1: SUCCESS (1.645s) [212.980405] Starting dynamic subtest: C-eDP1 [214.596829] Dynamic subtest C-eDP1: SUCCESS (1.625s) [214.606780] Starting dynamic subtest: D-eDP1 [216.239302] Dynamic subtest D-eDP1: SUCCESS (1.641s) [216.244845] Subtest basic-plain-flip: SUCCESS (6.552s) [217.426585] [041/131] (801s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-cpu) [217.533358] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-cpu [217.537669] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s) [217.676068] [042/131] (801s left) kms_atomic_interruptible (atomic-setmode) [217.775066] Starting subtest: atomic-setmode [217.777205] Starting dynamic subtest: pipe-A-eDP-1 [224.653436] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.878s) [224.655772] Subtest atomic-setmode: SUCCESS (6.879s) [225.469574] [043/131] (793s left) kms_ccs (random-ccs-data-4-tiled-dg2-rc-ccs) [225.557343] Starting subtest: random-ccs-data-4-tiled-dg2-rc-ccs [225.559727] Starting dynamic subtest: pipe-A-eDP-1 [225.586436] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [225.596470] Starting dynamic subtest: pipe-B-eDP-1 [225.620856] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [225.630310] Starting dynamic subtest: pipe-C-eDP-1 [225.654937] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [225.663518] Starting dynamic subtest: pipe-D-eDP-1 [225.687353] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [225.691587] Subtest random-ccs-data-4-tiled-dg2-rc-ccs: SKIP (0.004s) [227.760895] [044/131] (791s left) kms_big_fb (4-tiled-64bpp-rotate-90) [227.861371] Starting subtest: 4-tiled-64bpp-rotate-90 [227.880814] Subtest 4-tiled-64bpp-rotate-90: SKIP (0.019s) [228.029500] [045/131] (791s left) gem_exec_basic (basic) [228.097108] Starting subtest: basic [228.099433] Starting dynamic subtest: rcs0-smem [228.101795] Dynamic subtest rcs0-smem: SUCCESS (0.003s) [228.112483] Starting dynamic subtest: bcs0-smem [228.114378] Dynamic subtest bcs0-smem: SUCCESS (0.001s) [228.122976] Starting dynamic subtest: vcs0-smem [228.124891] Dynamic subtest vcs0-smem: SUCCESS (0.001s) [228.133308] Starting dynamic subtest: vcs1-smem [228.135204] Dynamic subtest vcs1-smem: SUCCESS (0.002s) [228.143457] Starting dynamic subtest: vecs0-smem [228.145388] Dynamic subtest vecs0-smem: SUCCESS (0.002s) [228.153906] Starting dynamic subtest: ccs0-smem [228.155861] Dynamic subtest ccs0-smem: SUCCESS (0.002s) [228.157810] Subtest basic: SUCCESS (0.014s) [229.975374] [046/131] (789s left) gem_render_copy (y-tiled-ccs-to-y-tiled) [230.028903] Starting subtest: y-tiled-ccs-to-y-tiled [230.033651] Subtest y-tiled-ccs-to-y-tiled: SKIP (0.000s) [230.223074] [047/131] (788s left) kms_joiner (invalid-modeset-ultra-joiner) [230.318677] Starting subtest: invalid-modeset-ultra-joiner [230.322857] Subtest invalid-modeset-ultra-joiner: SKIP (0.000s) [230.397660] [048/131] (788s left) kms_atomic_transition (plane-primary-toggle-with-vblank-wait) [230.482963] Starting subtest: plane-primary-toggle-with-vblank-wait [230.485175] Starting dynamic subtest: pipe-A-eDP-1 [230.656669] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.175s) [230.960088] Starting dynamic subtest: pipe-B-eDP-1 [231.841685] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.892s) [232.141993] Subtest plane-primary-toggle-with-vblank-wait: SUCCESS (1.661s) [233.018712] [049/131] (786s left) kms_addfb_basic (addfb25-framebuffer-vs-set-tiling) [233.124556] Subtest addfb25-framebuffer-vs-set-tiling: SKIP (0.000s) [233.261839] [050/131] (785s left) syncobj_wait (wait-all-for-submit-complex) [233.325422] Starting subtest: wait-all-for-submit-complex [233.539977] Subtest wait-all-for-submit-complex: SUCCESS (0.213s) [233.638443] [051/131] (785s left) tools_test (sysfs_l3_parity) [233.686332] Starting subtest: sysfs_l3_parity [233.766293] Subtest sysfs_l3_parity: SKIP (0.090s) [233.830785] [052/131] (785s left) i915_pm_rpm (gem-execbuf-stress-pc8) [236.062734] Starting subtest: gem-execbuf-stress-pc8 [236.103479] Subtest gem-execbuf-stress-pc8: SKIP (0.042s) [236.460917] [053/131] (782s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-mmap-cpu) [236.564834] Starting subtest: psr-2p-primscrn-spr-indfb-draw-mmap-cpu [236.569418] Subtest psr-2p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s) [236.707767] [054/131] (782s left) kms_psr2_su (frontbuffer-xrgb8888) [236.771565] Subtest frontbuffer-XRGB8888: SKIP (0.000s) [236.828850] [055/131] (782s left) kms_frontbuffer_tracking (fbc-2p-primscrn-shrfb-msflip-blt) [236.919847] Starting subtest: fbc-2p-primscrn-shrfb-msflip-blt [236.924073] Subtest fbc-2p-primscrn-shrfb-msflip-blt: SKIP (0.000s) [237.031950] [056/131] (782s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-mmap-wc) [237.129153] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-mmap-wc [241.148673] Subtest fbc-1p-offscreen-pri-indfb-draw-mmap-wc: SUCCESS (4.022s) [242.352318] [057/131] (777s left) i915_drm_fdinfo (busy-idle-check-all) [242.388963] Starting subtest: busy-idle-check-all [242.391227] Starting dynamic subtest: rcs0 [242.398126] Dynamic subtest rcs0: SKIP (0.006s) [242.409677] Starting dynamic subtest: bcs0 [242.413803] Dynamic subtest bcs0: SKIP (0.000s) [242.422685] Starting dynamic subtest: vcs0 [242.427194] Dynamic subtest vcs0: SKIP (0.000s) [242.435769] Starting dynamic subtest: vcs1 [242.440177] Dynamic subtest vcs1: SKIP (0.000s) [242.448941] Starting dynamic subtest: vecs0 [242.453419] Dynamic subtest vecs0: SKIP (0.000s) [242.462350] Starting dynamic subtest: ccs0 [242.466767] Dynamic subtest ccs0: SKIP (0.000s) [242.471245] Subtest busy-idle-check-all: SKIP (0.012s) [242.510125] [058/131] (777s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-pwrite) [242.631479] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-pwrite [251.945992] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-pwrite: SUCCESS (9.315s) [252.096284] [059/131] (767s left) i915_getparams_basic (basic-subslice-total) [252.147853] Starting subtest: basic-subslice-total [252.152156] Subtest basic-subslice-total: SUCCESS (0.000s) [252.252046] [060/131] (767s left) perf (gen12-unprivileged-single-ctx-counters) [252.396544] Starting subtest: gen12-unprivileged-single-ctx-counters [252.398432] Starting dynamic subtest: rcs0 [252.468324] Dynamic subtest rcs0: SUCCESS (0.073s) [252.470638] Subtest gen12-unprivileged-single-ctx-counters: SUCCESS (0.074s) [252.519992] [061/131] (767s left) kms_setmode (invalid-clone-single-crtc) [252.597184] Starting subtest: invalid-clone-single-crtc [252.603886] Subtest invalid-clone-single-crtc: SKIP (0.000s) [252.719457] [062/131] (767s left) syncobj_timeline (device-signal-unordered) [252.776720] Starting subtest: device-signal-unordered [252.778974] Subtest device-signal-unordered: SUCCESS (0.000s) [252.898588] [063/131] (766s left) gem_exec_schedule (submit-golden-slice) [252.955687] Starting subtest: submit-golden-slice [252.958148] Starting dynamic subtest: rcs0 [252.989300] Dynamic subtest rcs0: SUCCESS (0.037s) [253.000506] Starting dynamic subtest: bcs0 [253.023381] Dynamic subtest bcs0: SUCCESS (0.033s) [253.033142] Starting dynamic subtest: vcs0 [253.060672] Dynamic subtest vcs0: SUCCESS (0.037s) [253.069614] Starting dynamic subtest: vcs1 [253.092351] Dynamic subtest vcs1: SUCCESS (0.031s) [253.101564] Starting dynamic subtest: vecs0 [253.138522] Dynamic subtest vecs0: SUCCESS (0.045s) [253.148977] Starting dynamic subtest: ccs0 [253.174913] Dynamic subtest ccs0: SUCCESS (0.035s) [253.176946] Subtest submit-golden-slice: SUCCESS (0.223s) [255.025316] [064/131] (764s left) kms_async_flips (crc-atomic) [255.140865] Starting subtest: crc-atomic [255.526418] Starting dynamic subtest: pipe-A-eDP-1 [258.409978] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.883s) [258.797091] Starting dynamic subtest: pipe-B-eDP-1 [261.736680] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.951s) [262.116925] Starting dynamic subtest: pipe-C-eDP-1 [264.959909] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.854s) [265.323752] Starting dynamic subtest: pipe-D-eDP-1 [268.191267] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.879s) [268.193600] Subtest crc-atomic: SUCCESS (13.051s) [269.370524] [065/131] (750s left) kms_async_flips (async-flip-with-page-flip-events-tiled) [269.465043] Starting subtest: async-flip-with-page-flip-events-tiled [269.839365] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs [272.627763] Dynamic subtest pipe-A-eDP-1-4-rc-ccs: SUCCESS (2.788s) [272.638992] Starting dynamic subtest: pipe-A-eDP-1-4 [274.813979] Dynamic subtest pipe-A-eDP-1-4: SUCCESS (2.185s) [274.827864] Starting dynamic subtest: pipe-A-eDP-1-4 [276.824043] Dynamic subtest pipe-A-eDP-1-4: SUCCESS (2.008s) [276.833548] Starting dynamic subtest: pipe-A-eDP-1-x [279.014026] Dynamic subtest pipe-A-eDP-1-x: SUCCESS (2.189s) [279.380545] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs [282.152405] Dynamic subtest pipe-B-eDP-1-4-rc-ccs: SUCCESS (2.778s) [282.162223] Starting dynamic subtest: pipe-B-eDP-1-4 [284.350661] Dynamic subtest pipe-B-eDP-1-4: SUCCESS (2.196s) [284.360124] Starting dynamic subtest: pipe-B-eDP-1-4 [286.360055] Dynamic subtest pipe-B-eDP-1-4: SUCCESS (2.008s) [286.371025] Starting dynamic subtest: pipe-B-eDP-1-x [288.549802] Dynamic subtest pipe-B-eDP-1-x: SUCCESS (2.189s) [288.944260] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs [291.683361] Dynamic subtest pipe-C-eDP-1-4-rc-ccs: SUCCESS (2.748s) [291.692801] Starting dynamic subtest: pipe-C-eDP-1-4 [293.859420] Dynamic subtest pipe-C-eDP-1-4: SUCCESS (2.174s) [293.871666] Starting dynamic subtest: pipe-C-eDP-1-4 [295.869281] Dynamic subtest pipe-C-eDP-1-4: SUCCESS (2.009s) [295.879191] Starting dynamic subtest: pipe-C-eDP-1-x [298.047719] Dynamic subtest pipe-C-eDP-1-x: SUCCESS (2.177s) [298.411963] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs [301.210756] Dynamic subtest pipe-D-eDP-1-4-rc-ccs: SUCCESS (2.805s) [301.220687] Starting dynamic subtest: pipe-D-eDP-1-4 [303.385818] Dynamic subtest pipe-D-eDP-1-4: SUCCESS (2.174s) [303.395140] Starting dynamic subtest: pipe-D-eDP-1-4 [305.396366] Dynamic subtest pipe-D-eDP-1-4: SUCCESS (2.009s) [305.408835] Starting dynamic subtest: pipe-D-eDP-1-x [307.574569] Dynamic subtest pipe-D-eDP-1-x: SUCCESS (2.177s) [307.577195] Subtest async-flip-with-page-flip-events-tiled: SUCCESS (38.109s) [308.820369] [066/131] (711s left) kms_cursor_crc (cursor-onscreen-64x64) [308.999677] Starting subtest: cursor-onscreen-64x64 [309.004611] Starting dynamic subtest: pipe-A-eDP-1 [311.108581] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.105s) [311.138452] Starting dynamic subtest: pipe-D-eDP-1 [313.862246] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.732s) [313.864799] Subtest cursor-onscreen-64x64: SUCCESS (4.862s) [314.675451] [067/131] (705s left) gem_lmem_swapping (verify-random-ccs) [314.720063] Subtest verify-random-ccs: SKIP (0.000s) [314.761497] [068/131] (705s left) gem_mmap_wc (read-write) [314.813262] Subtest read-write: SKIP (0.000s) [314.880032] [069/131] (705s left) kms_psr2_sf (fbc-pr-primary-plane-update-sf-dmg-area) [319.863053] Starting subtest: fbc-pr-primary-plane-update-sf-dmg-area [319.867875] Subtest fbc-pr-primary-plane-update-sf-dmg-area: SKIP (0.002s) [320.745415] [070/131] (699s left) gen9_exec_parse (allowed-single) [320.813966] Subtest allowed-single: SKIP (0.000s) [320.898816] [071/131] (699s left) kms_fbcon_fbt (psr) [320.953813] Starting subtest: psr [328.233991] Subtest psr: SUCCESS (7.276s) [328.308175] [072/131] (691s left) kms_cursor_crc (cursor-onscreen-256x256) [328.554812] Starting subtest: cursor-onscreen-256x256 [328.560250] Starting dynamic subtest: pipe-A-eDP-1 [330.669917] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.109s) [330.697110] Starting dynamic subtest: pipe-D-eDP-1 [333.420540] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.731s) [333.422481] Subtest cursor-onscreen-256x256: SUCCESS (4.864s) [334.229061] [073/131] (685s left) kms_chamelium_edid (dp-mode-timings) [334.613241] Subtest dp-mode-timings: SKIP (0.000s) [335.439233] [074/131] (684s left) gem_ctx_persistence (legacy-engines-queued) [335.504729] Starting subtest: legacy-engines-queued [335.507270] Starting dynamic subtest: render [335.625528] Dynamic subtest render: SUCCESS (0.120s) [335.640491] Starting dynamic subtest: bsd1 [336.885589] Dynamic subtest bsd1: SUCCESS (1.255s) [336.898384] Starting dynamic subtest: bsd2 [338.866760] Dynamic subtest bsd2: SUCCESS (1.978s) [338.878043] Starting dynamic subtest: blt [338.950917] Dynamic subtest blt: SUCCESS (0.083s) [338.961761] Starting dynamic subtest: vebox [340.915326] Dynamic subtest vebox: SUCCESS (1.960s) [340.918424] Subtest legacy-engines-queued: SUCCESS (5.411s) [341.021182] [075/131] (679s left) kms_dp_linktrain_fallback (dsc-fallback) [341.117776] Starting subtest: dsc-fallback [341.124126] Subtest dsc-fallback: SKIP (0.000s) [341.202444] [076/131] (679s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-mmap-gtt) [341.293753] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-mmap-gtt [341.298179] Subtest psr-1p-offscreen-pri-shrfb-draw-mmap-gtt: SKIP (0.000s) [341.397902] [077/131] (678s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-blt) [341.499636] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-blt [341.503725] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-blt: SKIP (0.000s) [341.634975] [078/131] (678s left) gem_userptr_blits (unsync-unmap-after-close) [341.704084] Subtest unsync-unmap-after-close: SKIP (0.000s) [341.851946] [079/131] (678s left) gem_readwrite (read-write) [341.902584] Subtest read-write: SKIP (0.000s) [341.968227] [080/131] (678s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-0-async-flip) [342.071812] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-0-async-flip [342.075721] Subtest yf-tiled-max-hw-stride-64bpp-rotate-0-async-flip: SKIP (0.000s) [342.197405] [081/131] (678s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-mmap-wc) [342.297483] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-mmap-wc [348.767373] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-mmap-wc: SUCCESS (6.471s) [348.914238] [082/131] (671s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-64bpp-ytile-downscaling) [349.007149] Starting subtest: flip-32bpp-ytile-to-64bpp-ytile-downscaling [349.009425] Starting dynamic subtest: pipe-A-default-mode [349.296459] Dynamic subtest pipe-A-default-mode: SKIP (0.287s) [349.301172] Subtest flip-32bpp-ytile-to-64bpp-ytile-downscaling: SKIP (0.289s) [350.162574] [083/131] (670s left) kms_sequence (get-forked-busy) [350.264152] Starting subtest: get-forked-busy [350.266453] Starting dynamic subtest: pipe-A-eDP-1 [352.207080] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.943s) [352.218612] Starting dynamic subtest: pipe-B-eDP-1 [354.833325] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.623s) [354.845335] Starting dynamic subtest: pipe-C-eDP-1 [357.448227] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.615s) [357.461990] Starting dynamic subtest: pipe-D-eDP-1 [360.075278] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.626s) [360.077748] Subtest get-forked-busy: SUCCESS (9.813s) [360.969697] [084/131] (659s left) kms_dsc (dsc-fractional-bpp-with-bpc) [361.063155] Starting subtest: dsc-fractional-bpp-with-bpc [361.093636] Subtest dsc-fractional-bpp-with-bpc: SKIP (0.001s) [361.144265] [085/131] (659s left) kms_prop_blob (blob-prop-core) [361.204449] Starting subtest: blob-prop-core [361.206805] Subtest blob-prop-core: SUCCESS (0.000s) [361.335198] [086/131] (659s left) prime_vgem (coherency-gtt) [361.401461] Starting subtest: coherency-gtt [361.405894] Subtest coherency-gtt: SKIP (0.000s) [361.522048] [087/131] (659s left) gem_mmap_gtt (flink-race) [361.576875] Subtest flink-race: SKIP (0.000s) [361.644201] [088/131] (659s left) kms_cursor_edge_walk (64x64-right-edge) [361.739160] Starting subtest: 64x64-right-edge [361.741409] Starting dynamic subtest: pipe-A-eDP-1 [365.235551] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.497s) [365.245489] Starting dynamic subtest: pipe-D-eDP-1 [368.365914] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.127s) [368.368248] Subtest 64x64-right-edge: SUCCESS (6.627s) [369.190685] [089/131] (651s left) kms_flip_scaled_crc (flip-32bpp-4tile-to-64bpp-4tile-upscaling) [369.293103] Starting subtest: flip-32bpp-4tile-to-64bpp-4tile-upscaling [369.295328] Starting dynamic subtest: pipe-A-default-mode [372.026220] Dynamic subtest pipe-A-default-mode: SUCCESS (2.731s) [372.028663] Subtest flip-32bpp-4tile-to-64bpp-4tile-upscaling: SUCCESS (2.732s) [372.916429] [090/131] (648s left) kms_selftest (drm_plane_helper) [372.954247] Starting subtest: drm_plane_helper [373.013345] Starting dynamic subtest: drm_test_check_plane_state [373.246728] Dynamic subtest drm_test_check_plane_state: FAIL (0.158s) [373.256535] Starting dynamic subtest: drm_test_check_invalid_plane_state [373.404129] Dynamic subtest drm_test_check_invalid_plane_state: FAIL (0.153s) [373.406496] Subtest drm_plane_helper: FAIL (0.371s) [373.543522] [091/131] (647s left) kms_pm_rpm (dpms-mode-unset-non-lpsp) [375.061050] Starting subtest: dpms-mode-unset-non-lpsp [376.206603] Subtest dpms-mode-unset-non-lpsp: SKIP (1.145s) [376.593666] [092/131] (644s left) gem_partial_pwrite_pread (writes-after-reads) [376.664204] Subtest writes-after-reads: SKIP (0.000s) [376.753041] [093/131] (644s left) gem_userptr_blits (forbidden-operations) [376.814040] Starting subtest: forbidden-operations [376.818370] Subtest forbidden-operations: SKIP (0.000s) [376.976444] [094/131] (644s left) kms_cursor_legacy (cursorb-vs-flipa-legacy) [377.094504] Starting subtest: cursorB-vs-flipA-legacy [377.099044] Subtest cursorB-vs-flipA-legacy: SKIP (0.001s) [377.264116] [095/131] (643s left) gem_mmap_gtt (hang) [377.325997] Subtest hang: SKIP (0.000s) [377.395478] [096/131] (643s left) kms_ccs (crc-primary-basic-4-tiled-mtl-mc-ccs) [377.485072] Starting subtest: crc-primary-basic-4-tiled-mtl-mc-ccs [377.487309] Starting dynamic subtest: pipe-A-eDP-1 [379.558460] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.071s) [379.567966] Starting dynamic subtest: pipe-B-eDP-1 [381.608763] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.051s) [381.618444] Starting dynamic subtest: pipe-C-eDP-1 [383.613094] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.004s) [383.623263] Starting dynamic subtest: pipe-D-eDP-1 [385.637734] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.024s) [385.640061] Subtest crc-primary-basic-4-tiled-mtl-mc-ccs: SUCCESS (8.155s) [386.816015] [097/131] (634s left) gem_workarounds (reset-fd) [386.884774] Starting subtest: reset-fd [387.075077] Subtest reset-fd: SUCCESS (0.190s) [387.232109] [098/131] (634s left) syncobj_timeline (single-wait-all-signaled) [387.298789] Starting subtest: single-wait-all-signaled [387.301244] Subtest single-wait-all-signaled: SUCCESS (0.000s) [387.440427] [099/131] (633s left) prime_mmap (test_errors) [387.491183] Starting subtest: test_errors [387.493401] Starting dynamic subtest: test_errors-smem [387.588965] Dynamic subtest test_errors-smem: SUCCESS (0.099s) [387.591687] Subtest test_errors: SUCCESS (0.100s) [387.719834] [100/131] (633s left) kms_rotation_crc (primary-yf-tiled-reflect-x-90) [387.811048] Starting subtest: primary-yf-tiled-reflect-x-90 [387.814718] Subtest primary-yf-tiled-reflect-x-90: SKIP (0.001s) [387.897547] [101/131] (633s left) kms_atomic_transition (plane-toggle-modeset-transition) [387.989251] Starting subtest: plane-toggle-modeset-transition [387.991053] Starting dynamic subtest: pipe-A-eDP-1 [400.723651] Dynamic subtest pipe-A-eDP-1: SUCCESS (12.732s) [400.735272] Starting dynamic subtest: pipe-B-eDP-1 [413.176132] Dynamic subtest pipe-B-eDP-1: SUCCESS (12.450s) [413.178723] Subtest plane-toggle-modeset-transition: SUCCESS (25.188s) [413.994304] [102/131] (607s left) gem_ctx_shared (create-shared-gtt) [414.058870] Starting subtest: create-shared-gtt [416.212494] Subtest create-shared-gtt: SUCCESS (2.152s) [416.550204] [103/131] (604s left) api_intel_allocator (two-level-inception) [416.602790] Starting subtest: two-level-inception [422.002498] Subtest two-level-inception: SUCCESS (5.398s) [422.137591] [104/131] (599s left) syncobj_timeline (etime-single-wait-all-submitted) [422.194670] Starting subtest: etime-single-wait-all-submitted [422.295074] Subtest etime-single-wait-all-submitted: SUCCESS (0.101s) [422.375879] [105/131] (599s left) gem_exec_schedule (pi-distinct-iova) [422.562814] Starting subtest: pi-distinct-iova [422.565386] Starting dynamic subtest: rcs0 [422.725085] Dynamic subtest rcs0: SUCCESS (0.164s) [422.738368] Starting dynamic subtest: vcs0 [422.822060] Dynamic subtest vcs0: SUCCESS (0.097s) [422.834616] Starting dynamic subtest: vcs1 [422.911937] Dynamic subtest vcs1: SUCCESS (0.090s) [422.925388] Starting dynamic subtest: vecs0 [422.998927] Dynamic subtest vecs0: SUCCESS (0.086s) [423.011804] Starting dynamic subtest: ccs0 [423.125089] Dynamic subtest ccs0: SUCCESS (0.124s) [423.127289] Subtest pi-distinct-iova: SUCCESS (0.565s) [424.039113] [106/131] (597s left) kms_cursor_legacy (cursor-vs-flip-atomic-transitions-varying-size) [424.161587] Starting subtest: cursor-vs-flip-atomic-transitions-varying-size [455.882357] Subtest cursor-vs-flip-atomic-transitions-varying-size: SUCCESS (31.718s) [456.737833] [107/131] (564s left) kms_chamelium_hpd (dp-hpd-for-each-pipe) [457.133457] Subtest dp-hpd-for-each-pipe: SKIP (0.000s) [457.917949] [108/131] (563s left) kms_pipe_crc_basic (hang-read-crc) [458.009063] Starting subtest: hang-read-crc [458.011374] Starting dynamic subtest: pipe-A-eDP-1 [460.122224] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.111s) [460.131979] Starting dynamic subtest: pipe-B-eDP-1 [462.790787] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.668s) [462.804629] Starting dynamic subtest: pipe-C-eDP-1 [465.410614] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.617s) [465.421058] Starting dynamic subtest: pipe-D-eDP-1 [468.059199] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.646s) [468.061526] Subtest hang-read-crc: SUCCESS (10.049s) [468.926783] [109/131] (552s left) kms_addfb_basic (too-high) [469.028747] Starting subtest: too-high [469.030979] Subtest too-high: SUCCESS (0.000s) [469.175085] [110/131] (552s left) kms_vblank (ts-continuation-modeset-rpm) [469.265487] Starting subtest: ts-continuation-modeset-rpm [469.267714] Starting dynamic subtest: pipe-A-eDP-1 [471.812859] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.548s) [471.827886] Starting dynamic subtest: pipe-D-eDP-1 [474.060193] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.243s) [474.062551] Subtest ts-continuation-modeset-rpm: SUCCESS (4.795s) [474.866064] [111/131] (546s left) kms_ccs (random-ccs-data-y-tiled-gen12-rc-ccs-cc) [474.962938] Starting subtest: random-ccs-data-y-tiled-gen12-rc-ccs-cc [474.965242] Starting dynamic subtest: pipe-A-eDP-1 [474.989748] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [475.001062] Starting dynamic subtest: pipe-B-eDP-1 [475.024756] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [475.034378] Starting dynamic subtest: pipe-C-eDP-1 [475.058688] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [475.068493] Starting dynamic subtest: pipe-D-eDP-1 [475.091372] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [475.095251] Subtest random-ccs-data-y-tiled-gen12-rc-ccs-cc: SKIP (0.005s) [477.148205] [112/131] (544s left) kms_frontbuffer_tracking (fbc-2p-rte) [477.247396] Starting subtest: fbc-2p-rte [477.251671] Subtest fbc-2p-rte: SKIP (0.000s) [477.393905] [113/131] (544s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-mmap-cpu) [477.482223] Starting subtest: psr-1p-primscrn-pri-indfb-draw-mmap-cpu [484.415467] Subtest psr-1p-primscrn-pri-indfb-draw-mmap-cpu: SUCCESS (6.935s) [484.562590] [114/131] (537s left) kms_ccs (bad-rotation-90-4-tiled-lnl-ccs) [484.659138] Starting subtest: bad-rotation-90-4-tiled-lnl-ccs [484.663607] Subtest bad-rotation-90-4-tiled-lnl-ccs: SKIP (0.000s) [485.802091] [115/131] (536s left) syncobj_timeline (multi-wait-available-unsubmitted-submitted-signaled) [485.858117] Starting subtest: multi-wait-available-unsubmitted-submitted-signaled [485.860595] Subtest multi-wait-available-unsubmitted-submitted-signaled: SUCCESS (0.000s) [485.983487] [116/131] (536s left) gem_exec_reloc (basic-gtt-wc) [486.044497] Subtest basic-gtt-wc: SKIP (0.000s) [486.134819] [117/131] (535s left) kms_plane_scaling (plane-scaler-unity-scaling-with-pixel-format) [486.234299] Starting subtest: plane-scaler-unity-scaling-with-pixel-format [486.236565] Starting dynamic subtest: pipe-A [487.372326] Dynamic subtest pipe-A: SUCCESS (1.140s) [487.381965] Starting dynamic subtest: pipe-B [489.581776] Dynamic subtest pipe-B: SUCCESS (2.209s) [489.592668] Starting dynamic subtest: pipe-C [490.802145] Dynamic subtest pipe-C: SUCCESS (1.219s) [490.814502] Starting dynamic subtest: pipe-D [491.947072] Dynamic subtest pipe-D: SUCCESS (1.144s) [491.949335] Subtest plane-scaler-unity-scaling-with-pixel-format: SUCCESS (5.716s) [493.151912] [118/131] (528s left) gem_exec_flush (basic-batch-kernel-default-wb) [493.209967] Starting subtest: basic-batch-kernel-default-wb [499.981190] Subtest basic-batch-kernel-default-wb: SUCCESS (6.771s) [500.188190] [119/131] (521s left) gem_tiled_wb [500.317016] [120/131] (521s left) kms_psr (fbc-psr2-no-drrs) [500.416745] Starting subtest: fbc-psr2-no-drrs [500.418892] Starting dynamic subtest: eDP-1 [500.423249] Dynamic subtest eDP-1: SKIP (0.000s) [500.427652] Subtest fbc-psr2-no-drrs: SKIP (0.001s) [500.499545] [121/131] (521s left) gem_ctx_isolation (preservation) [500.565500] Starting subtest: preservation [500.567807] Starting dynamic subtest: rcs0 [500.719490] Dynamic subtest rcs0: SUCCESS (0.154s) [500.731279] Starting dynamic subtest: bcs0 [500.916647] Dynamic subtest bcs0: SUCCESS (0.196s) [500.926253] Starting dynamic subtest: vcs0 [501.098665] Dynamic subtest vcs0: SUCCESS (0.181s) [501.111633] Starting dynamic subtest: vcs1 [503.087305] Dynamic subtest vcs1: SUCCESS (1.987s) [503.096811] Starting dynamic subtest: vecs0 [505.064402] Dynamic subtest vecs0: SUCCESS (1.975s) [505.077140] Starting dynamic subtest: ccs0 [507.056755] Dynamic subtest ccs0: SUCCESS (1.992s) [507.059905] Subtest preservation: SUCCESS (6.491s) [507.324134] [122/131] (514s left) sysfs_timeslice_duration (duration) [507.389375] Starting subtest: duration [507.391903] Starting dynamic subtest: vecs0 [520.819384] Dynamic subtest vecs0: SUCCESS (13.426s) [520.831936] Starting dynamic subtest: ccs0 [533.966187] Dynamic subtest ccs0: SUCCESS (13.144s) [533.980947] Starting dynamic subtest: vcs0 [548.850365] Dynamic subtest vcs0: SUCCESS (14.878s) [548.863238] Starting dynamic subtest: bcs0 [562.017848] Dynamic subtest bcs0: SUCCESS (13.165s) [562.033147] Starting dynamic subtest: rcs0 [575.180569] Dynamic subtest rcs0: SUCCESS (13.158s) [575.196635] Starting dynamic subtest: vcs1 [588.850358] Dynamic subtest vcs1: SUCCESS (13.665s) [588.853492] Subtest duration: SUCCESS (81.456s) [588.977411] [123/131] (433s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-mmap-gtt) [589.086930] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-mmap-gtt [589.091125] Subtest psr-2p-scndscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s) [589.197776] [124/131] (433s left) kms_psr (psr2-cursor-plane-onoff) [589.285866] Starting subtest: psr2-cursor-plane-onoff [589.288381] Starting dynamic subtest: eDP-1 [591.003310] Dynamic subtest eDP-1: SUCCESS (1.719s) [591.005645] Subtest psr2-cursor-plane-onoff: SUCCESS (1.720s) [591.830615] [125/131] (430s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip) [591.932885] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip [592.790365] Subtest x-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip: SUCCESS (0.859s) [593.007512] [126/131] (429s left) kms_plane_scaling (planes-scaler-unity-scaling) [593.098738] Starting subtest: planes-scaler-unity-scaling [593.101268] Starting dynamic subtest: pipe-A [593.163494] Dynamic subtest pipe-A: SUCCESS (0.069s) [593.175637] Starting dynamic subtest: pipe-B [594.337405] Dynamic subtest pipe-B: SUCCESS (1.172s) [594.352991] Starting dynamic subtest: pipe-C [595.455120] Dynamic subtest pipe-C: SUCCESS (1.116s) [595.465079] Starting dynamic subtest: pipe-D [596.587322] Dynamic subtest pipe-D: SUCCESS (1.131s) [596.589714] Subtest planes-scaler-unity-scaling: SUCCESS (3.493s) [597.764156] [127/131] (424s left) gem_create (create-ext-placement-sanity-check) [597.936655] Starting subtest: create-ext-placement-sanity-check [597.939705] Subtest create-ext-placement-sanity-check: SUCCESS (0.005s) [598.058965] [128/131] (424s left) gem_softpin (allocator-fork) [598.115888] Starting subtest: allocator-fork [600.331558] Subtest allocator-fork: SUCCESS (2.215s) [600.470512] [129/131] (422s left) gem_exec_params (readonly) [600.532698] Starting subtest: readonly [600.538628] Subtest readonly: SUCCESS (0.003s) [600.702500] [130/131] (421s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-draw-mmap-wc) [600.805275] Starting subtest: psr-2p-primscrn-cur-indfb-draw-mmap-wc [600.809571] Subtest psr-2p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s) [600.921492] [131/131] (421s left) kms_big_fb (linear-64bpp-rotate-270) [601.026949] Starting subtest: linear-64bpp-rotate-270 [601.046844] Subtest linear-64bpp-rotate-270: SKIP (0.019s) [601.192826] Closing watchdogs results: parsing output: 0/ for test: kms_frontbuffer_tracking results: parsing output: 1/ for test: prime_busy results: parsing output: 2/ for test: api_intel_bb results: parsing output: 3/ for test: kms_frontbuffer_tracking results: parsing output: 4/ for test: gem_exec_whisper results: parsing output: 5/ for test: i915_pm_rps results: parsing output: 6/ for test: kms_psr results: parsing output: 7/ for test: syncobj_basic results: parsing output: 8/ for test: kms_frontbuffer_tracking results: parsing output: 9/ for test: syncobj_timeline results: parsing output: 10/ for test: gem_mmap_wc results: parsing output: 11/ for test: kms_addfb_basic results: parsing output: 12/ for test: gem_exec_balancer results: parsing output: 13/ for test: perf_pmu results: parsing output: 14/ for test: core_getversion results: parsing output: 15/ for test: kms_big_fb results: parsing output: 16/ for test: kms_plane_multiple results: parsing output: 17/ for test: kms_frontbuffer_tracking results: parsing output: 18/ for test: kms_psr2_sf results: parsing output: 19/ for test: kms_ccs results: parsing output: 20/ for test: kms_frontbuffer_tracking results: parsing output: 21/ for test: gem_exec_reloc results: parsing output: 22/ for test: perf_pmu results: parsing output: 23/ for test: kms_psr results: parsing output: 24/ for test: kms_frontbuffer_tracking results: parsing output: 25/ for test: kms_color results: parsing output: 26/ for test: kms_joiner results: parsing output: 27/ for test: fbdev results: parsing output: 28/ for test: gem_spin_batch results: parsing output: 29/ for test: gem_exec_fence results: parsing output: 30/ for test: kms_flip results: parsing output: 31/ for test: gem_render_copy_redux results: parsing output: 32/ for test: gem_exec_whisper results: parsing output: 33/ for test: kms_busy results: parsing output: 34/ for test: kms_big_fb results: parsing output: 35/ for test: gem_pxp results: parsing output: 36/ for test: kms_cursor_legacy results: parsing output: 37/ for test: gem_exec_params results: parsing output: 38/ for test: gem_render_copy results: parsing output: 39/ for test: kms_flip results: parsing output: 40/ for test: kms_frontbuffer_tracking results: parsing output: 41/ for test: kms_atomic_interruptible results: parsing output: 42/ for test: kms_ccs results: parsing output: 43/ for test: kms_big_fb results: parsing output: 44/ for test: gem_exec_basic results: parsing output: 45/ for test: gem_render_copy results: parsing output: 46/ for test: kms_joiner results: parsing output: 47/ for test: kms_atomic_transition results: parsing output: 48/ for test: kms_addfb_basic results: parsing output: 49/ for test: syncobj_wait results: parsing output: 50/ for test: tools_test results: parsing output: 51/ for test: i915_pm_rpm results: parsing output: 52/ for test: kms_frontbuffer_tracking results: parsing output: 53/ for test: kms_psr2_su results: parsing output: 54/ for test: kms_frontbuffer_tracking results: parsing output: 55/ for test: kms_frontbuffer_tracking results: parsing output: 56/ for test: i915_drm_fdinfo results: parsing output: 57/ for test: kms_frontbuffer_tracking results: parsing output: 58/ for test: i915_getparams_basic results: parsing output: 59/ for test: perf results: parsing output: 60/ for test: kms_setmode results: parsing output: 61/ for test: syncobj_timeline results: parsing output: 62/ for test: gem_exec_schedule results: parsing output: 63/ for test: kms_async_flips results: parsing output: 64/ for test: kms_async_flips results: parsing output: 65/ for test: kms_cursor_crc results: parsing output: 66/ for test: gem_lmem_swapping results: parsing output: 67/ for test: gem_mmap_wc results: parsing output: 68/ for test: kms_psr2_sf results: parsing output: 69/ for test: gen9_exec_parse results: parsing output: 70/ for test: kms_fbcon_fbt results: parsing output: 71/ for test: kms_cursor_crc results: parsing output: 72/ for test: kms_chamelium_edid results: parsing output: 73/ for test: gem_ctx_persistence results: parsing output: 74/ for test: kms_dp_linktrain_fallback results: parsing output: 75/ for test: kms_frontbuffer_tracking results: parsing output: 76/ for test: kms_frontbuffer_tracking results: parsing output: 77/ for test: gem_userptr_blits results: parsing output: 78/ for test: gem_readwrite results: parsing output: 79/ for test: kms_big_fb results: parsing output: 80/ for test: kms_frontbuffer_tracking results: parsing output: 81/ for test: kms_flip_scaled_crc results: parsing output: 82/ for test: kms_sequence results: parsing output: 83/ for test: kms_dsc results: parsing output: 84/ for test: kms_prop_blob results: parsing output: 85/ for test: prime_vgem results: parsing output: 86/ for test: gem_mmap_gtt results: parsing output: 87/ for test: kms_cursor_edge_walk results: parsing output: 88/ for test: kms_flip_scaled_crc results: parsing output: 89/ for test: kms_selftest results: parsing output: 90/ for test: kms_pm_rpm results: parsing output: 91/ for test: gem_partial_pwrite_pread results: parsing output: 92/ for test: gem_userptr_blits results: parsing output: 93/ for test: kms_cursor_legacy results: parsing output: 94/ for test: gem_mmap_gtt results: parsing output: 95/ for test: kms_ccs results: parsing output: 96/ for test: gem_workarounds results: parsing output: 97/ for test: syncobj_timeline results: parsing output: 98/ for test: prime_mmap results: parsing output: 99/ for test: kms_rotation_crc results: parsing output: 100/ for test: kms_atomic_transition results: parsing output: 101/ for test: gem_ctx_shared results: parsing output: 102/ for test: api_intel_allocator results: parsing output: 103/ for test: syncobj_timeline results: parsing output: 104/ for test: gem_exec_schedule results: parsing output: 105/ for test: kms_cursor_legacy results: parsing output: 106/ for test: kms_chamelium_hpd results: parsing output: 107/ for test: kms_pipe_crc_basic results: parsing output: 108/ for test: kms_addfb_basic results: parsing output: 109/ for test: kms_vblank results: parsing output: 110/ for test: kms_ccs results: parsing output: 111/ for test: kms_frontbuffer_tracking results: parsing output: 112/ for test: kms_frontbuffer_tracking results: parsing output: 113/ for test: kms_ccs results: parsing output: 114/ for test: syncobj_timeline results: parsing output: 115/ for test: gem_exec_reloc results: parsing output: 116/ for test: kms_plane_scaling results: parsing output: 117/ for test: gem_exec_flush results: parsing output: 118/ for test: gem_tiled_wb results: parsing output: 119/ for test: kms_psr results: parsing output: 120/ for test: gem_ctx_isolation results: parsing output: 121/ for test: sysfs_timeslice_duration results: parsing output: 122/ for test: kms_frontbuffer_tracking results: parsing output: 123/ for test: kms_psr results: parsing output: 124/ for test: kms_big_fb results: parsing output: 125/ for test: kms_plane_scaling results: parsing output: 126/ for test: gem_create results: parsing output: 127/ for test: gem_softpin results: parsing output: 128/ for test: gem_exec_params results: parsing output: 129/ for test: kms_frontbuffer_tracking results: parsing output: 130/ for test: kms_big_fb Done.