[55.822270] Initializing watchdogs [55.822314] /dev/watchdog0 [55.836358] [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] [55.840819] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [55.842953] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [55.846453] [001/131] (960s left) syncobj_timeline (etime-multi-wait-all-available-unsubmitted-submitted-signal [55.920108] Starting subtest: etime-multi-wait-all-available-unsubmitted-submitted-signaled [56.024498] Subtest etime-multi-wait-all-available-unsubmitted-submitted-signaled: SUCCESS (0.104s) [56.094444] [002/131] (960s left) kms_chamelium_frames (hdmi-frame-dump) [56.486838] Subtest hdmi-frame-dump: SKIP (0.000s) [57.276027] [003/131] (959s left) kms_ccs (random-ccs-data-y-tiled-gen12-rc-ccs-cc) [57.369148] Starting subtest: random-ccs-data-y-tiled-gen12-rc-ccs-cc [57.371734] Starting dynamic subtest: pipe-A-eDP-1 [57.398403] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [57.406687] Starting dynamic subtest: pipe-B-eDP-1 [57.431076] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [57.438680] Starting dynamic subtest: pipe-C-eDP-1 [57.463585] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [57.471274] Starting dynamic subtest: pipe-D-eDP-1 [57.496107] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [57.500241] Subtest random-ccs-data-y-tiled-gen12-rc-ccs-cc: SKIP (0.002s) [59.553178] [004/131] (956s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-onoff) [59.655682] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-onoff [59.660180] Subtest fbcpsr-2p-primscrn-cur-indfb-onoff: SKIP (0.000s) [59.768742] [005/131] (956s left) kms_big_fb (x-tiled-64bpp-rotate-90) [59.866639] Starting subtest: x-tiled-64bpp-rotate-90 [59.886342] Subtest x-tiled-64bpp-rotate-90: SKIP (0.019s) [60.003307] [006/131] (956s left) gem_spin_batch (spin-each) [60.064719] Starting subtest: spin-each [63.336089] Subtest spin-each: SUCCESS (3.263s) [63.987694] [007/131] (952s left) kms_color (ctm-negative) [64.086012] Starting subtest: ctm-negative [64.088390] Starting dynamic subtest: pipe-A-eDP-1 [64.781039] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.694s) [64.791721] Starting dynamic subtest: pipe-B-eDP-1 [66.144662] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.363s) [66.153285] Starting dynamic subtest: pipe-C-eDP-1 [67.483083] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.339s) [67.492209] Starting dynamic subtest: pipe-D-eDP-1 [68.833331] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.349s) [68.835697] Subtest ctm-negative: SUCCESS (4.746s) [69.635879] [008/131] (946s left) kms_flip_scaled_crc (flip-64bpp-linear-to-16bpp-linear-downscaling) [69.737250] Starting subtest: flip-64bpp-linear-to-16bpp-linear-downscaling [69.739676] Starting dynamic subtest: pipe-A-default-mode [70.892700] Dynamic subtest pipe-A-default-mode: SKIP (1.151s) [70.897416] Subtest flip-64bpp-linear-to-16bpp-linear-downscaling: SKIP (1.152s) [71.049402] [009/131] (945s left) kms_atomic_transition (modeset-transition-fencing) [71.241491] Starting subtest: modeset-transition-fencing [71.243846] Starting dynamic subtest: 1x-outputs [81.756087] Dynamic subtest 1x-outputs: SUCCESS (10.515s) [82.021647] Subtest modeset-transition-fencing: SUCCESS (10.780s) [82.877825] [010/131] (933s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-blt) [82.980085] Starting subtest: fbcpsr-rgb101010-draw-blt [90.766803] Subtest fbcpsr-rgb101010-draw-blt: SUCCESS (7.790s) [90.921182] [011/131] (925s left) prime_mmap (test_correct) [90.990118] Starting subtest: test_correct [90.992504] Starting dynamic subtest: test_correct-smem [91.021476] Dynamic subtest test_correct-smem: SUCCESS (0.031s) [91.023937] Subtest test_correct: SUCCESS (0.031s) [91.132921] [012/131] (925s left) kms_psr (fbc-psr-primary-mmap-gtt) [91.229857] Starting subtest: fbc-psr-primary-mmap-gtt [91.232079] Starting dynamic subtest: eDP-1 [91.236300] Dynamic subtest eDP-1: SKIP (0.000s) [91.240794] Subtest fbc-psr-primary-mmap-gtt: SKIP (0.000s) [91.299635] [013/131] (925s left) syncobj_wait (invalid-multi-wait-unsubmitted) [91.360846] Starting subtest: invalid-multi-wait-unsubmitted [91.363182] Subtest invalid-multi-wait-unsubmitted: SUCCESS (0.000s) [91.470690] [014/131] (925s left) kms_rmfb (rmfb-ioctl) [91.570147] Starting subtest: rmfb-ioctl [91.572727] Starting dynamic subtest: pipe-A-eDP-1 [91.686451] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.116s) [91.695318] Starting dynamic subtest: pipe-B-eDP-1 [92.862744] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.175s) [92.871960] Starting dynamic subtest: pipe-C-eDP-1 [94.005439] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.141s) [94.014381] Starting dynamic subtest: pipe-D-eDP-1 [95.202810] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.197s) [95.205127] Subtest rmfb-ioctl: SUCCESS (3.633s) [96.400111] [015/131] (920s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-fullscreen) [96.500109] Starting subtest: psr-2p-scndscrn-spr-indfb-fullscreen [96.504112] Subtest psr-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s) [96.617585] [016/131] (920s left) kms_invalid_mode (bad-vsync-end) [96.716211] Starting subtest: bad-vsync-end [96.718666] Starting dynamic subtest: pipe-A-eDP-1 [97.000893] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.284s) [97.009113] Starting dynamic subtest: pipe-B-eDP-1 [97.011075] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s) [97.017243] Starting dynamic subtest: pipe-C-eDP-1 [97.019184] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s) [97.025855] Starting dynamic subtest: pipe-D-eDP-1 [97.028161] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s) [97.030396] Subtest bad-vsync-end: SUCCESS (0.288s) [97.817507] [017/131] (919s left) prime_self_import (basic-llseek-bad) [97.850036] Starting subtest: basic-llseek-bad [97.866861] Subtest basic-llseek-bad: SUCCESS (0.015s) [97.974933] [018/131] (918s left) gem_exec_schedule (u-fairslice-all) [98.038768] Starting subtest: u-fairslice-all [100.092795] Subtest u-fairslice-all: SUCCESS (2.060s) [101.900991] [019/131] (915s left) gem_set_tiling_vs_blt (tiled-to-tiled) [101.953556] Subtest tiled-to-tiled: SKIP (0.000s) [102.034744] [020/131] (914s left) kms_vblank (wait-forked-busy-hang) [102.125981] Starting subtest: wait-forked-busy-hang [102.128401] Starting dynamic subtest: pipe-A-eDP-1 [128.648305] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.518s) [128.660324] Starting dynamic subtest: pipe-D-eDP-1 [153.682173] Dynamic subtest pipe-D-eDP-1: SUCCESS (25.035s) [153.684078] Subtest wait-forked-busy-hang: SUCCESS (51.556s) [154.464686] [021/131] (862s left) gem_fence_thrash (bo-copy) [154.493944] Starting subtest: bo-copy [154.515830] Subtest bo-copy: SKIP (0.019s) [154.587267] [022/131] (862s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-render) [154.692075] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-render [154.696125] Subtest fbc-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s) [154.791658] [023/131] (862s left) i915_pm_rc6_residency (media-rc6-accuracy) [154.839497] Starting subtest: media-rc6-accuracy [154.843970] Subtest media-rc6-accuracy: SKIP (0.000s) [154.934109] [024/131] (862s left) perf (oa-exponents) [155.045725] Starting subtest: oa-exponents [155.048058] Starting dynamic subtest: 0-rcs0 [156.899899] Dynamic subtest 0-rcs0: SUCCESS (1.854s) [156.907405] Starting dynamic subtest: 1-vcs1 [158.815945] Dynamic subtest 1-vcs1: SUCCESS (1.916s) [158.818997] Subtest oa-exponents: SUCCESS (3.771s) [158.863930] [025/131] (858s left) kms_frontbuffer_tracking (psr-1p-primscrn-indfb-msflip-blt) [158.969500] Starting subtest: psr-1p-primscrn-indfb-msflip-blt [166.223020] Subtest psr-1p-primscrn-indfb-msflip-blt: SUCCESS (7.260s) [166.369149] [026/131] (850s left) i915_suspend (basic-s3-without-i915) [166.402734] Starting subtest: basic-s3-without-i915 [168.288243] Subtest basic-s3-without-i915: SKIP (1.881s) [169.758409] [027/131] (847s left) kms_cursor_crc (cursor-random-512x170) [170.040824] Starting subtest: cursor-random-512x170 [170.044910] Subtest cursor-random-512x170: SKIP (0.001s) [170.192580] [028/131] (847s left) kms_psr (psr-sprite-blt) [170.288172] Starting subtest: psr-sprite-blt [170.290542] Starting dynamic subtest: eDP-1 [172.062979] Dynamic subtest eDP-1: SUCCESS (1.775s) [172.065443] Subtest psr-sprite-blt: SUCCESS (1.775s) [172.886762] [029/131] (844s left) i915_query (engine-info-invalid) [172.947146] Starting subtest: engine-info-invalid [172.949490] Subtest engine-info-invalid: SUCCESS (0.000s) [173.056298] [030/131] (844s left) gem_exec_basic (basic) [173.118412] Starting subtest: basic [173.120315] Starting dynamic subtest: rcs0-smem [173.122199] Dynamic subtest rcs0-smem: SUCCESS (0.007s) [173.130369] Starting dynamic subtest: bcs0-smem [173.132644] Dynamic subtest bcs0-smem: SUCCESS (0.002s) [173.139100] Starting dynamic subtest: vcs0-smem [173.141056] Dynamic subtest vcs0-smem: SUCCESS (0.001s) [173.147445] Starting dynamic subtest: vcs1-smem [173.149371] Dynamic subtest vcs1-smem: SUCCESS (0.001s) [173.155870] Starting dynamic subtest: vecs0-smem [173.157815] Dynamic subtest vecs0-smem: SUCCESS (0.001s) [173.164199] Starting dynamic subtest: ccs0-smem [173.166079] Dynamic subtest ccs0-smem: SUCCESS (0.002s) [173.167942] Subtest basic: SUCCESS (0.016s) [174.965870] [031/131] (842s left) gem_softpin (allocator-fork) [175.027224] Starting subtest: allocator-fork [177.239064] Subtest allocator-fork: SUCCESS (2.211s) [177.382269] [032/131] (840s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-mmap-wc) [177.482397] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-mmap-wc [177.486595] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s) [177.572101] [033/131] (839s left) prime_mmap (test_aperture_limit) [177.618761] Starting subtest: test_aperture_limit [177.621071] Starting dynamic subtest: test_aperture_limit-smem [177.630522] Dynamic subtest test_aperture_limit-smem: SKIP (0.010s) [177.634650] Subtest test_aperture_limit: SKIP (0.011s) [177.727514] [034/131] (839s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-blt) [177.817785] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-blt [177.822278] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-blt: SKIP (0.000s) [177.913071] [035/131] (839s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-180-async-flip) [178.005160] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-180-async-flip [178.009331] Subtest y-tiled-max-hw-stride-64bpp-rotate-180-async-flip: SKIP (0.000s) [178.103632] [036/131] (839s left) api_intel_allocator (fork-simple-stress-signal) [178.155990] Starting subtest: fork-simple-stress-signal [183.557117] Subtest fork-simple-stress-signal: SUCCESS (5.402s) [183.675012] [037/131] (833s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-mmap-wc) [183.783032] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-mmap-wc [183.787122] Subtest psr-2p-scndscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s) [183.897008] [038/131] (833s left) syncobj_timeline (invalid-single-wait-unsubmitted) [183.956434] Starting subtest: invalid-single-wait-unsubmitted [183.958806] Subtest invalid-single-wait-unsubmitted: SUCCESS (0.000s) [184.054943] [039/131] (833s left) kms_writeback (writeback-check-output) [184.153232] Subtest writeback-check-output: SKIP (0.000s) [184.207557] [040/131] (833s left) gem_exec_suspend (basic-s4-devices) [184.271467] Starting subtest: basic-S4-devices [184.273850] Starting dynamic subtest: smem [195.925788] Dynamic subtest smem: SUCCESS (11.653s) [195.928842] Subtest basic-S4-devices: SUCCESS (11.654s) [203.119493] [041/131] (821s left) gem_exec_fence (syncobj-stationary-timeline-chain-engines) [203.737368] Starting subtest: syncobj-stationary-timeline-chain-engines [203.889049] Subtest syncobj-stationary-timeline-chain-engines: SUCCESS (0.152s) [205.003880] [FACT gem_exec_fence (syncobj-stationary-timeline-chain-engines)] new: kernel.kmod_is_loaded.vgem: true [205.006947] [042/131] (819s left) kms_plane (plane-position-hole) [205.101999] Starting subtest: plane-position-hole [205.615445] Starting dynamic subtest: pipe-A-plane-1 [206.946174] Dynamic subtest pipe-A-plane-1: SUCCESS (1.330s) [206.955803] Starting dynamic subtest: pipe-A-plane-2 [208.256200] Dynamic subtest pipe-A-plane-2: SUCCESS (1.312s) [208.264446] Starting dynamic subtest: pipe-A-plane-3 [209.472344] Dynamic subtest pipe-A-plane-3: SUCCESS (1.216s) [209.482202] Starting dynamic subtest: pipe-A-plane-4 [210.736197] Dynamic subtest pipe-A-plane-4: SUCCESS (1.263s) [210.744999] Starting dynamic subtest: pipe-A-plane-5 [210.776782] Dynamic subtest pipe-A-plane-5: SUCCESS (0.039s) [211.962303] Starting dynamic subtest: pipe-B-plane-1 [213.182523] Dynamic subtest pipe-B-plane-1: SUCCESS (1.227s) [213.191849] Starting dynamic subtest: pipe-B-plane-2 [214.399736] Dynamic subtest pipe-B-plane-2: SUCCESS (1.220s) [214.408730] Starting dynamic subtest: pipe-B-plane-3 [215.606620] Dynamic subtest pipe-B-plane-3: SUCCESS (1.207s) [215.618558] Starting dynamic subtest: pipe-B-plane-4 [216.835400] Dynamic subtest pipe-B-plane-4: SUCCESS (1.226s) [216.844562] Starting dynamic subtest: pipe-B-plane-5 [216.874867] Dynamic subtest pipe-B-plane-5: SUCCESS (0.039s) [216.877441] Subtest plane-position-hole: SUCCESS (11.771s) [217.631690] [043/131] (807s left) kms_atomic (atomic-plane-damage) [217.720031] Starting subtest: atomic-plane-damage [217.776822] Starting dynamic subtest: pipe-A-eDP-1 [218.414050] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.635s) [218.415849] Subtest atomic-plane-damage: SUCCESS (0.692s) [219.258744] [044/131] (805s left) gem_partial_pwrite_pread (reads) [219.322735] Subtest reads: SKIP (0.000s) [219.396087] [045/131] (805s left) kms_ccs (bad-pixel-format-4-tiled-mtl-mc-ccs) [219.486074] Starting subtest: bad-pixel-format-4-tiled-mtl-mc-ccs [219.488442] Starting dynamic subtest: pipe-A-eDP-1 [219.508815] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s) [219.519862] Starting dynamic subtest: pipe-B-eDP-1 [219.538353] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s) [219.546300] Starting dynamic subtest: pipe-C-eDP-1 [219.565463] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s) [219.573822] Starting dynamic subtest: pipe-D-eDP-1 [219.593388] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s) [219.595270] Subtest bad-pixel-format-4-tiled-mtl-mc-ccs: SUCCESS (0.005s) [221.612678] [046/131] (803s left) kms_frontbuffer_tracking (psr-2p-rte) [221.706581] Starting subtest: psr-2p-rte [221.710806] Subtest psr-2p-rte: SKIP (0.000s) [221.803109] [047/131] (803s left) gem_ctx_persistence (legacy-engines-hostile) [221.860591] Starting subtest: legacy-engines-hostile [221.862939] Starting dynamic subtest: render [222.011784] Dynamic subtest render: SUCCESS (0.150s) [222.023347] Starting dynamic subtest: bsd1 [222.121944] Dynamic subtest bsd1: SUCCESS (0.108s) [222.133030] Starting dynamic subtest: bsd2 [222.197537] Dynamic subtest bsd2: SUCCESS (0.074s) [222.207847] Starting dynamic subtest: blt [222.353603] Dynamic subtest blt: SUCCESS (0.153s) [222.365246] Starting dynamic subtest: vebox [222.458352] Dynamic subtest vebox: SUCCESS (0.103s) [222.461053] Subtest legacy-engines-hostile: SUCCESS (0.597s) [222.544620] [048/131] (802s left) kms_cursor_edge_walk (256x256-left-edge) [222.641758] Starting subtest: 256x256-left-edge [222.643578] Starting dynamic subtest: pipe-A-eDP-1 [226.057659] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.413s) [226.069120] Starting dynamic subtest: pipe-D-eDP-1 [229.169982] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.111s) [229.172371] Subtest 256x256-left-edge: SUCCESS (6.526s) [229.980109] [049/131] (795s left) gem_exec_alignment (many) [230.046644] Starting subtest: many [252.478287] Subtest many: SUCCESS (22.431s) [254.585067] [050/131] (770s left) i915_fb_tiling (basic-x-tiling) [254.665144] Subtest basic-x-tiling: SKIP (0.000s) [254.730782] [051/131] (770s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-shrfb-pgflip-blt) [254.832797] Starting subtest: fbc-2p-scndscrn-shrfb-pgflip-blt [254.836981] Subtest fbc-2p-scndscrn-shrfb-pgflip-blt: SKIP (0.000s) [254.947857] [052/131] (770s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-indfb-plflip-blt) [255.052642] Starting subtest: fbc-2p-scndscrn-indfb-plflip-blt [255.056722] Subtest fbc-2p-scndscrn-indfb-plflip-blt: SKIP (0.000s) [255.163546] [053/131] (770s left) kms_big_fb (y-tiled-64bpp-rotate-180) [255.259367] Starting subtest: y-tiled-64bpp-rotate-180 [255.263609] Subtest y-tiled-64bpp-rotate-180: SKIP (0.000s) [255.351771] [054/131] (770s left) syncobj_timeline (wait-any-interrupted) [255.413906] Starting subtest: wait-any-interrupted [255.517077] Subtest wait-any-interrupted: SUCCESS (0.102s) [255.591242] [055/131] (769s left) sriov_basic (bind-unbind-vf) [255.654431] Starting subtest: bind-unbind-vf [255.657218] Starting dynamic subtest: vf-1 [255.738494] Dynamic subtest vf-1: FAIL (0.025s) [255.748104] Starting dynamic subtest: vf-2 [255.820041] Dynamic subtest vf-2: FAIL (0.003s) [255.830434] Starting dynamic subtest: vf-3 [255.903445] Dynamic subtest vf-3: FAIL (0.003s) [255.912979] Starting dynamic subtest: vf-4 [255.986868] Dynamic subtest vf-4: FAIL (0.003s) [255.997131] Starting dynamic subtest: vf-5 [256.070697] Dynamic subtest vf-5: FAIL (0.003s) [256.080517] Starting dynamic subtest: vf-6 [256.154812] Dynamic subtest vf-6: FAIL (0.003s) [256.164749] Starting dynamic subtest: vf-7 [256.237431] Dynamic subtest vf-7: FAIL (0.003s) [256.247423] Starting dynamic subtest: vf-random [256.320269] Dynamic subtest vf-random: FAIL (0.003s) [256.330253] Starting dynamic subtest: vf-last [256.404788] Dynamic subtest vf-last: FAIL (0.511s) [256.407148] Subtest bind-unbind-vf: FAIL (0.563s) [256.444710] [056/131] (768s left) gem_exec_whisper (basic-sync-all) [256.527207] Starting subtest: basic-sync-all [263.334229] Subtest basic-sync-all: SUCCESS (6.807s) [263.520598] [057/131] (761s left) gem_pxp (create-regular-buffer) [263.635744] Starting subtest: create-regular-buffer [263.637826] Subtest create-regular-buffer: SUCCESS (0.000s) [263.756246] [058/131] (761s left) kms_frontbuffer_tracking (fbc-2p-primscrn-indfb-pgflip-blt) [263.864569] Starting subtest: fbc-2p-primscrn-indfb-pgflip-blt [263.868751] Subtest fbc-2p-primscrn-indfb-pgflip-blt: SKIP (0.000s) [263.972809] [059/131] (761s left) kms_rotation_crc (sprite-rotation-180) [264.062444] Starting subtest: sprite-rotation-180 [269.001788] Subtest sprite-rotation-180: SUCCESS (4.939s) [270.228455] [060/131] (755s left) gem_ctx_isolation (preservation) [270.291439] Starting subtest: preservation [270.293772] Starting dynamic subtest: rcs0 [270.571614] Dynamic subtest rcs0: SUCCESS (0.279s) [270.581671] Starting dynamic subtest: bcs0 [270.881289] Dynamic subtest bcs0: SUCCESS (0.308s) [270.893307] Starting dynamic subtest: vcs0 [271.204540] Dynamic subtest vcs0: SUCCESS (0.322s) [271.216906] Starting dynamic subtest: vcs1 [273.194319] Dynamic subtest vcs1: SUCCESS (1.990s) [273.206354] Starting dynamic subtest: vecs0 [275.148417] Dynamic subtest vecs0: SUCCESS (1.953s) [275.157749] Starting dynamic subtest: ccs0 [277.162623] Dynamic subtest ccs0: SUCCESS (2.015s) [277.165290] Subtest preservation: SUCCESS (6.871s) [277.394470] [061/131] (748s left) kms_psr (fbc-pr-primary-page-flip) [277.501839] Starting subtest: fbc-pr-primary-page-flip [277.505832] Subtest fbc-pr-primary-page-flip: SKIP (0.000s) [277.576349] [062/131] (748s left) gen9_exec_parse (bb-start-far) [277.630609] Subtest bb-start-far: SKIP (0.000s) [277.692670] [063/131] (748s left) gem_readwrite (new-obj) [277.749194] Subtest new-obj: SKIP (0.000s) [277.818500] [064/131] (747s left) kms_fbcon_fbt (psr-suspend) [277.863597] Starting subtest: psr-suspend [327.491538] Subtest psr-suspend: SUCCESS (19.868s) [327.575223] [065/131] (698s left) kms_frontbuffer_tracking (fbc-2p-primscrn-indfb-msflip-blt) [327.681591] Starting subtest: fbc-2p-primscrn-indfb-msflip-blt [327.685900] Subtest fbc-2p-primscrn-indfb-msflip-blt: SKIP (0.000s) [327.771282] [066/131] (698s left) gem_mmap_gtt (isolation) [327.833488] Subtest isolation: SKIP (0.000s) [327.892273] [067/131] (697s left) kms_flip (2x-flip-vs-suspend-interruptible) [327.985939] Starting subtest: 2x-flip-vs-suspend-interruptible [327.997295] Subtest 2x-flip-vs-suspend-interruptible: SKIP (0.011s) [328.072691] [068/131] (697s left) kms_content_protection (atomic-dpms) [328.247516] Starting subtest: atomic-dpms [331.636282] Subtest atomic-dpms: SKIP (3.393s) [332.801591] [069/131] (693s left) gem_mmap_wc (read-write-distinct) [332.855930] Subtest read-write-distinct: SKIP (0.000s) [332.925787] [070/131] (693s left) kms_psr2_sf (fbc-pr-overlay-plane-move-continuous-exceed-fully-sf) [337.923811] Starting subtest: fbc-pr-overlay-plane-move-continuous-exceed-fully-sf [337.928791] Subtest fbc-pr-overlay-plane-move-continuous-exceed-fully-sf: SKIP (0.002s) [338.778703] [071/131] (687s left) core_auth (getclient-simple) [338.818487] Starting subtest: getclient-simple [338.831985] Subtest getclient-simple: SUCCESS (0.016s) [338.942331] [072/131] (687s left) dumb_buffer (map-valid) [338.984750] Starting subtest: map-valid [338.987087] Subtest map-valid: SUCCESS (0.000s) [339.084636] [073/131] (687s left) kms_psr (psr-cursor-mmap-gtt) [339.183915] Starting subtest: psr-cursor-mmap-gtt [339.186264] Starting dynamic subtest: eDP-1 [340.858435] Dynamic subtest eDP-1: SUCCESS (1.675s) [340.860833] Subtest psr-cursor-mmap-gtt: SUCCESS (1.676s) [341.724502] [074/131] (684s left) kms_psr (fbc-psr2-primary-mmap-cpu) [341.811956] Starting subtest: fbc-psr2-primary-mmap-cpu [341.814181] Starting dynamic subtest: eDP-1 [341.818566] Dynamic subtest eDP-1: SKIP (0.000s) [341.822921] Subtest fbc-psr2-primary-mmap-cpu: SKIP (0.001s) [341.879006] [075/131] (684s left) gem_exec_reloc (basic-cpu-read-active) [341.928224] Subtest basic-cpu-read-active: SKIP (0.000s) [342.005893] [076/131] (684s left) kms_ccs (crc-primary-basic-4-tiled-bmg-ccs) [342.092694] Starting subtest: crc-primary-basic-4-tiled-bmg-ccs [342.097225] Subtest crc-primary-basic-4-tiled-bmg-ccs: SKIP (0.000s) [343.252055] [077/131] (682s left) kms_plane_scaling (planes-upscale-factor-0-25-downscale-factor-0-75) [343.346703] Starting subtest: planes-upscale-factor-0-25-downscale-factor-0-75 [343.349180] Starting dynamic subtest: pipe-A [343.368714] Dynamic subtest pipe-A: SKIP (0.016s) [343.378782] Starting dynamic subtest: pipe-B [343.399275] Dynamic subtest pipe-B: SKIP (0.030s) [343.408743] Starting dynamic subtest: pipe-C [343.428518] Dynamic subtest pipe-C: SKIP (0.029s) [343.438032] Starting dynamic subtest: pipe-D [343.458412] Dynamic subtest pipe-D: SKIP (0.029s) [343.462593] Subtest planes-upscale-factor-0-25-downscale-factor-0-75: SKIP (0.106s) [343.577626] [078/131] (682s left) kms_flip (2x-nonexisting-fb) [343.682677] Starting subtest: 2x-nonexisting-fb [343.693672] Subtest 2x-nonexisting-fb: SKIP (0.010s) [343.769697] [079/131] (682s left) gem_sync (basic-each) [343.838249] Starting subtest: basic-each [346.139178] Subtest basic-each: SUCCESS (2.313s) [346.321850] [080/131] (680s left) syncobj_wait (multi-wait-all-for-submit-unsubmitted) [346.381856] Starting subtest: multi-wait-all-for-submit-unsubmitted [346.482718] Subtest multi-wait-all-for-submit-unsubmitted: SUCCESS (0.101s) [346.556991] [081/131] (679s left) syncobj_wait (multi-wait-for-submit-unsubmitted-signaled) [346.612443] Starting subtest: multi-wait-for-submit-unsubmitted-signaled [346.614908] Subtest multi-wait-for-submit-unsubmitted-signaled: SUCCESS (0.000s) [346.709969] [082/131] (679s left) kms_big_fb (x-tiled-64bpp-rotate-0) [346.819908] Starting subtest: x-tiled-64bpp-rotate-0 [349.183393] Subtest x-tiled-64bpp-rotate-0: SUCCESS (2.365s) [349.428287] [083/131] (677s left) syncobj_basic (test-valid-cycle) [349.491729] Starting subtest: test-valid-cycle [349.494187] Subtest test-valid-cycle: SUCCESS (0.000s) [349.581940] [084/131] (676s left) syncobj_timeline (etime-single-wait-submitted) [349.625969] Starting subtest: etime-single-wait-submitted [349.731510] Subtest etime-single-wait-submitted: SUCCESS (0.105s) [349.806130] [085/131] (676s left) api_intel_bb (intel-bb-blit-x) [349.870975] Starting subtest: intel-bb-blit-x [353.667025] Subtest intel-bb-blit-x: SUCCESS (3.798s) [353.780721] [086/131] (672s left) gem_render_copy (y-tiled-ccs-to-y-tiled-ccs) [353.846059] Starting subtest: y-tiled-ccs-to-y-tiled-ccs [353.850777] Subtest y-tiled-ccs-to-y-tiled-ccs: SKIP (0.000s) [354.028299] [087/131] (672s left) gem_exec_schedule (implicit-boths) [354.095423] Starting subtest: implicit-boths [354.097433] Starting dynamic subtest: rcs0 [354.264911] Dynamic subtest rcs0: SUCCESS (0.180s) [354.278278] Starting dynamic subtest: vcs0 [354.377867] Dynamic subtest vcs0: SUCCESS (0.112s) [354.388763] Starting dynamic subtest: vcs1 [354.514536] Dynamic subtest vcs1: SUCCESS (0.135s) [354.527595] Starting dynamic subtest: vecs0 [354.608517] Dynamic subtest vecs0: SUCCESS (0.094s) [354.620399] Starting dynamic subtest: ccs0 [354.738217] Dynamic subtest ccs0: SUCCESS (0.128s) [354.741357] Subtest implicit-boths: SUCCESS (0.653s) [355.779215] [088/131] (670s left) gem_userptr_blits (map-fixed-invalidate-overlap) [355.847220] Starting subtest: map-fixed-invalidate-overlap [355.851684] Subtest map-fixed-invalidate-overlap: SKIP (0.000s) [355.988671] [089/131] (670s left) kms_flip (2x-flip-vs-panning-vs-hang) [356.098819] Starting subtest: 2x-flip-vs-panning-vs-hang [356.110229] Subtest 2x-flip-vs-panning-vs-hang: SKIP (0.011s) [356.188690] [090/131] (670s left) perf_pmu (event-wait) [356.235023] Starting subtest: event-wait [356.237342] Starting dynamic subtest: rcs0 [356.241935] Dynamic subtest rcs0: SKIP (0.000s) [356.245939] Subtest event-wait: SKIP (0.001s) [356.339146] [091/131] (670s left) prime_mmap (test_map_unmap) [356.399370] Starting subtest: test_map_unmap [356.401709] Starting dynamic subtest: test_map_unmap-smem [356.429155] Dynamic subtest test_map_unmap-smem: SUCCESS (0.031s) [356.431698] Subtest test_map_unmap: SUCCESS (0.032s) [356.536703] [092/131] (670s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-16bpp-ytile-upscaling) [356.631897] Starting subtest: flip-64bpp-ytile-to-16bpp-ytile-upscaling [356.634125] Starting dynamic subtest: pipe-A-default-mode [356.922994] Dynamic subtest pipe-A-default-mode: SKIP (0.285s) [356.927816] Subtest flip-64bpp-ytile-to-16bpp-ytile-upscaling: SKIP (0.286s) [357.766838] [093/131] (669s left) kms_psr2_sf (psr2-overlay-plane-move-continuous-exceed-fully-sf) [362.834645] Starting subtest: psr2-overlay-plane-move-continuous-exceed-fully-sf [362.837450] Starting dynamic subtest: pipe-A-eDP-1 [379.992898] Dynamic subtest pipe-A-eDP-1: SUCCESS (17.157s) [380.003827] Starting dynamic subtest: pipe-B-eDP-1 [397.130495] Dynamic subtest pipe-B-eDP-1: SUCCESS (17.139s) [397.133274] Subtest psr2-overlay-plane-move-continuous-exceed-fully-sf: SUCCESS (34.299s) [397.917707] [094/131] (629s left) gem_exec_schedule (preempt-hang) [398.102642] Starting subtest: preempt-hang [398.105446] Starting dynamic subtest: rcs0 [398.336434] Dynamic subtest rcs0: SUCCESS (0.232s) [398.346674] Starting dynamic subtest: bcs0 [398.566387] Dynamic subtest bcs0: SUCCESS (0.229s) [398.578097] Starting dynamic subtest: vcs0 [398.791009] Dynamic subtest vcs0: SUCCESS (0.224s) [398.802126] Starting dynamic subtest: vcs1 [399.012840] Dynamic subtest vcs1: SUCCESS (0.221s) [399.024812] Starting dynamic subtest: vecs0 [399.235961] Dynamic subtest vecs0: SUCCESS (0.222s) [399.245693] Starting dynamic subtest: ccs0 [399.460096] Dynamic subtest ccs0: SUCCESS (0.224s) [399.462422] Subtest preempt-hang: SUCCESS (1.357s) [399.839916] [095/131] (627s left) kms_pm_lpsp (kms-lpsp) [400.950293] Starting subtest: kms-lpsp [400.952292] Starting dynamic subtest: pipe-A-eDP-1 [401.106539] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.160s) [401.390652] Subtest kms-lpsp: SUCCESS (0.442s) [402.234410] [096/131] (624s left) kms_chamelium_frames (dp-crc-single) [402.616677] Subtest dp-crc-single: SKIP (0.000s) [403.435698] [097/131] (623s left) sysfs_preempt_timeout (timeout) [403.497108] Starting subtest: timeout [403.499559] Starting dynamic subtest: vecs0 [412.730564] Dynamic subtest vecs0: SUCCESS (9.233s) [412.742514] Starting dynamic subtest: ccs0 [414.054790] Dynamic subtest ccs0: SUCCESS (1.325s) [414.067456] Starting dynamic subtest: vcs0 [423.719298] Dynamic subtest vcs0: SUCCESS (9.658s) [423.730075] Starting dynamic subtest: bcs0 [425.028221] Dynamic subtest bcs0: SUCCESS (1.306s) [425.040425] Starting dynamic subtest: rcs0 [426.278665] Dynamic subtest rcs0: SUCCESS (1.248s) [426.288556] Starting dynamic subtest: vcs1 [435.706510] Dynamic subtest vcs1: SUCCESS (9.420s) [435.709589] Subtest timeout: SUCCESS (32.201s) [435.787899] [098/131] (591s left) gem_exec_reloc (basic-gtt-noreloc) [435.855956] Subtest basic-gtt-noreloc: SKIP (0.000s) [435.951406] [099/131] (591s left) gem_exec_reloc (basic-cpu-noreloc) [436.000852] Subtest basic-cpu-noreloc: SKIP (0.000s) [436.088733] [100/131] (591s left) kms_lease (lease-unleased-connector) [436.200890] Starting subtest: lease-unleased-connector [436.203226] Starting dynamic subtest: pipe-A-eDP-1 [436.211165] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.008s) [436.221535] Starting dynamic subtest: pipe-B-eDP-1 [436.223871] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.009s) [436.234375] Starting dynamic subtest: pipe-C-eDP-1 [436.236548] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.009s) [436.246035] Starting dynamic subtest: pipe-D-eDP-1 [436.248217] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.008s) [436.250328] Subtest lease-unleased-connector: SUCCESS (0.040s) [436.358987] [101/131] (590s left) syncobj_timeline (multi-wait-all-signaled) [436.420414] Starting subtest: multi-wait-all-signaled [436.422878] Subtest multi-wait-all-signaled: SUCCESS (0.001s) [436.539442] [102/131] (590s left) kms_ccs (crc-sprite-planes-basic-4-tiled-mtl-mc-ccs) [436.626683] Starting subtest: crc-sprite-planes-basic-4-tiled-mtl-mc-ccs [436.628884] Starting dynamic subtest: pipe-A-eDP-1 [436.901450] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.247s) [436.910642] Starting dynamic subtest: pipe-B-eDP-1 [438.116826] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.208s) [438.126951] Starting dynamic subtest: pipe-C-eDP-1 [439.325759] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.205s) [439.337484] Starting dynamic subtest: pipe-D-eDP-1 [440.554266] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.230s) [440.556163] Subtest crc-sprite-planes-basic-4-tiled-mtl-mc-ccs: SUCCESS (3.894s) [441.777020] [103/131] (585s left) kms_frontbuffer_tracking (psr-1p-offscren-pri-indfb-draw-mmap-gtt) [441.877388] Starting subtest: psr-1p-offscren-pri-indfb-draw-mmap-gtt [441.881660] Subtest psr-1p-offscren-pri-indfb-draw-mmap-gtt: SKIP (0.000s) [441.981909] [104/131] (585s left) gem_mmap_offset (mmap-unmap) [442.023981] Starting subtest: mmap-unmap [442.025954] Starting dynamic subtest: smem0 [465.329228] Dynamic subtest smem0: SUCCESS (23.299s) [465.331565] Subtest mmap-unmap: SUCCESS (23.301s) [465.456868] [105/131] (561s left) kms_plane_scaling (planes-downscale-factor-0-25-upscale-factor-0-25) [465.558448] Starting subtest: planes-downscale-factor-0-25-upscale-factor-0-25 [465.560847] Starting dynamic subtest: pipe-A [465.578430] Dynamic subtest pipe-A: SKIP (0.012s) [465.588738] Starting dynamic subtest: pipe-B [465.603245] Dynamic subtest pipe-B: SKIP (0.026s) [465.616459] Starting dynamic subtest: pipe-C [465.631868] Dynamic subtest pipe-C: SKIP (0.024s) [465.642513] Starting dynamic subtest: pipe-D [465.651205] Dynamic subtest pipe-D: SKIP (0.023s) [465.655301] Subtest planes-downscale-factor-0-25-upscale-factor-0-25: SKIP (0.088s) [465.755179] [106/131] (561s left) kms_flip (dpms-vs-vblank-race) [465.848669] Starting subtest: dpms-vs-vblank-race [465.850910] Starting dynamic subtest: A-eDP1 [470.845301] Dynamic subtest A-eDP1: SUCCESS (4.993s) [470.856966] Starting dynamic subtest: B-eDP1 [475.451958] Dynamic subtest B-eDP1: SUCCESS (4.604s) [475.462476] Starting dynamic subtest: C-eDP1 [480.037251] Dynamic subtest C-eDP1: SUCCESS (4.586s) [480.048488] Starting dynamic subtest: D-eDP1 [484.624114] Dynamic subtest D-eDP1: SUCCESS (4.587s) [484.626651] Subtest dpms-vs-vblank-race: SUCCESS (18.777s) [485.407711] [107/131] (542s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-draw-mmap-cpu) [485.512026] Starting subtest: psr-2p-primscrn-cur-indfb-draw-mmap-cpu [485.516289] Subtest psr-2p-primscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s) [485.605391] [108/131] (541s left) core_getclient [485.757650] [109/131] (541s left) kms_ccs (crc-primary-basic-y-tiled-gen12-rc-ccs) [485.846430] Starting subtest: crc-primary-basic-y-tiled-gen12-rc-ccs [485.848792] Starting dynamic subtest: pipe-A-eDP-1 [485.871478] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [485.883680] Starting dynamic subtest: pipe-B-eDP-1 [485.905617] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [485.916598] Starting dynamic subtest: pipe-C-eDP-1 [485.938258] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [485.947211] Starting dynamic subtest: pipe-D-eDP-1 [485.969744] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [485.974052] Subtest crc-primary-basic-y-tiled-gen12-rc-ccs: SKIP (0.005s) [487.972669] [110/131] (539s left) kms_pipe_crc_basic (compare-crc-sanitycheck-xr24) [488.070740] Starting subtest: compare-crc-sanitycheck-xr24 [488.073006] Starting dynamic subtest: pipe-A-eDP-1 [488.692055] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.619s) [488.703067] Starting dynamic subtest: pipe-B-eDP-1 [489.914204] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.221s) [489.926019] Starting dynamic subtest: pipe-C-eDP-1 [491.079953] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.165s) [491.090741] Starting dynamic subtest: pipe-D-eDP-1 [492.324664] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.243s) [492.327419] Subtest compare-crc-sanitycheck-xr24: SUCCESS (4.254s) [493.162528] [111/131] (534s left) kms_cursor_legacy (short-flip-after-cursor-atomic-transitions) [493.280346] Starting subtest: short-flip-after-cursor-atomic-transitions [494.239662] Subtest short-flip-after-cursor-atomic-transitions: SUCCESS (0.960s) [495.085973] [112/131] (532s left) kms_psr (pr-primary-page-flip) [495.181675] Starting subtest: pr-primary-page-flip [495.185897] Subtest pr-primary-page-flip: SKIP (0.000s) [495.252966] [113/131] (532s left) gem_create (create-ext-placement-all) [495.414651] Starting subtest: create-ext-placement-all [495.417463] Subtest create-ext-placement-all: SUCCESS (0.000s) [495.524520] [114/131] (532s left) gem_exec_params (rel-constants-invalid-ring) [495.585722] Starting subtest: rel-constants-invalid-ring [495.588303] Subtest rel-constants-invalid-ring: SUCCESS (0.000s) [495.701191] [115/131] (532s left) kms_big_fb (yf-tiled-16bpp-rotate-90) [495.819190] Starting subtest: yf-tiled-16bpp-rotate-90 [495.823746] Subtest yf-tiled-16bpp-rotate-90: SKIP (0.000s) [495.941510] [116/131] (531s left) kms_cursor_crc (cursor-sliding-512x170) [496.231918] Starting subtest: cursor-sliding-512x170 [496.236382] Subtest cursor-sliding-512x170: SKIP (0.001s) [496.402770] [117/131] (531s left) kms_frontbuffer_tracking (fbcpsr-1p-offscren-pri-shrfb-draw-mmap-gtt) [496.495053] Starting subtest: fbcpsr-1p-offscren-pri-shrfb-draw-mmap-gtt [496.498680] Subtest fbcpsr-1p-offscren-pri-shrfb-draw-mmap-gtt: SKIP (0.000s) [496.601912] [118/131] (531s left) kms_draw_crc (draw-method-blt) [496.690195] Starting subtest: draw-method-blt [496.692028] Starting dynamic subtest: xrgb8888-untiled [496.962693] Dynamic subtest xrgb8888-untiled: SUCCESS (0.274s) [496.974257] Starting dynamic subtest: rgb565-untiled [497.173424] Dynamic subtest rgb565-untiled: SUCCESS (0.210s) [497.182885] Starting dynamic subtest: xrgb2101010-untiled [497.351108] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.177s) [497.360368] Starting dynamic subtest: xbgr16161616f-untiled [497.573577] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.221s) [497.582783] Starting dynamic subtest: xrgb8888-xtiled [497.673121] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.099s) [497.683254] Starting dynamic subtest: rgb565-xtiled [497.785023] Dynamic subtest rgb565-xtiled: SUCCESS (0.111s) [497.794512] Starting dynamic subtest: xrgb2101010-xtiled [497.896054] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.111s) [497.912676] Starting dynamic subtest: xbgr16161616f-xtiled [498.017642] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (0.121s) [498.026707] Starting dynamic subtest: xrgb8888-4tiled [498.128887] Dynamic subtest xrgb8888-4tiled: SUCCESS (0.111s) [498.138416] Starting dynamic subtest: rgb565-4tiled [498.240003] Dynamic subtest rgb565-4tiled: SUCCESS (0.110s) [498.250711] Starting dynamic subtest: xrgb2101010-4tiled [498.328785] Dynamic subtest xrgb2101010-4tiled: SUCCESS (0.088s) [498.340398] Starting dynamic subtest: xbgr16161616f-4tiled [498.451346] Dynamic subtest xbgr16161616f-4tiled: SUCCESS (0.122s) [498.453165] Subtest draw-method-blt: SUCCESS (1.763s) [498.565728] [119/131] (529s left) gem_exec_endless (dispatch) [498.630767] Starting subtest: dispatch [498.632795] Starting dynamic subtest: rcs0 [498.638901] Dynamic subtest rcs0: SUCCESS (0.005s) [498.648877] Starting dynamic subtest: bcs0 [498.652356] Dynamic subtest bcs0: SUCCESS (0.004s) [498.661652] Starting dynamic subtest: vcs0 [498.665526] Dynamic subtest vcs0: SUCCESS (0.005s) [498.674130] Starting dynamic subtest: vcs1 [498.677632] Dynamic subtest vcs1: SUCCESS (0.004s) [498.686182] Starting dynamic subtest: vecs0 [498.689428] Dynamic subtest vecs0: SUCCESS (0.004s) [498.698254] Starting dynamic subtest: ccs0 [498.701498] Dynamic subtest ccs0: SUCCESS (0.005s) [498.703220] Subtest dispatch: SUCCESS (0.031s) [500.689664] [120/131] (527s left) kms_universal_plane (universal-plane-functional) [500.790728] Starting subtest: universal-plane-functional [500.793021] Starting dynamic subtest: pipe-A-eDP-1 [504.628217] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.836s) [504.638981] Starting dynamic subtest: pipe-B-eDP-1 [509.072268] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.443s) [509.082947] Starting dynamic subtest: pipe-C-eDP-1 [513.321130] Dynamic subtest pipe-C-eDP-1: SUCCESS (4.246s) [513.331821] Starting dynamic subtest: pipe-D-eDP-1 [517.503033] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.180s) [517.505369] Subtest universal-plane-functional: SUCCESS (16.711s) [518.286536] [121/131] (509s left) gem_exec_parallel (contexts) [518.347838] Starting subtest: contexts [518.350369] Starting dynamic subtest: rcs0 [521.222106] Dynamic subtest rcs0: SUCCESS (2.872s) [521.234973] Starting dynamic subtest: bcs0 [524.589990] Dynamic subtest bcs0: SUCCESS (3.367s) [524.600761] Starting dynamic subtest: vcs0 [529.024955] Dynamic subtest vcs0: SUCCESS (4.434s) [529.041707] Starting dynamic subtest: vcs1 [533.021658] Dynamic subtest vcs1: SUCCESS (3.995s) [533.034914] Starting dynamic subtest: vecs0 [537.079682] Dynamic subtest vecs0: SUCCESS (4.057s) [537.092910] Starting dynamic subtest: ccs0 [540.458433] Dynamic subtest ccs0: SUCCESS (3.376s) [540.461372] Subtest contexts: SUCCESS (22.112s) [540.643727] [122/131] (487s left) kms_pm_rpm (modeset-lpsp-stress-no-wait) [542.888292] Starting subtest: modeset-lpsp-stress-no-wait [552.429303] Subtest modeset-lpsp-stress-no-wait: SUCCESS (9.542s) [552.503906] [123/131] (475s left) kms_cursor_legacy (cursorb-vs-flipa-atomic-transitions-varying-size) [552.638553] Starting subtest: cursorB-vs-flipA-atomic-transitions-varying-size [552.642824] Subtest cursorB-vs-flipA-atomic-transitions-varying-size: SKIP (0.001s) [552.768724] [124/131] (475s left) gen7_exec_parse (bitmasks) [552.818024] Subtest bitmasks: SKIP (0.000s) [552.891841] [125/131] (475s left) gem_lmem_swapping (heavy-verify-multi-ccs) [552.927776] Subtest heavy-verify-multi-ccs: SKIP (0.000s) [552.967202] [126/131] (475s left) gem_ctx_shared (q-independent) [553.024163] Starting subtest: Q-independent [553.026508] Starting dynamic subtest: rcs0 [553.089597] Dynamic subtest rcs0: SUCCESS (0.065s) [553.102570] Starting dynamic subtest: vcs0 [553.126975] Dynamic subtest vcs0: SUCCESS (0.037s) [553.136846] Starting dynamic subtest: vcs1 [553.165164] Dynamic subtest vcs1: SUCCESS (0.038s) [553.174564] Starting dynamic subtest: vecs0 [553.203288] Dynamic subtest vecs0: SUCCESS (0.037s) [553.212952] Starting dynamic subtest: ccs0 [553.250419] Dynamic subtest ccs0: SUCCESS (0.045s) [553.252858] Subtest Q-independent: SUCCESS (0.227s) [554.770997] [127/131] (473s left) kms_big_fb (linear-16bpp-rotate-270) [554.867768] Starting subtest: linear-16bpp-rotate-270 [554.886297] Subtest linear-16bpp-rotate-270: SKIP (0.018s) [554.999531] [128/131] (473s left) kms_frontbuffer_tracking (fbc-tiling-linear) [555.109640] Starting subtest: fbc-tiling-linear [558.847338] Subtest fbc-tiling-linear: SUCCESS (3.742s) [559.968536] [129/131] (468s left) kms_cursor_legacy (2x-flip-vs-cursor-legacy) [560.086056] Starting subtest: 2x-flip-vs-cursor-legacy [560.090368] Subtest 2x-flip-vs-cursor-legacy: SKIP (0.001s) [560.218070] [130/131] (468s left) drm_read (short-buffer-nonblock) [560.379399] Starting subtest: short-buffer-nonblock [560.381922] Subtest short-buffer-nonblock: SUCCESS (0.000s) [560.518652] [131/131] (467s left) kms_setmode (basic) [560.572223] Starting subtest: basic [560.899430] Starting dynamic subtest: pipe-A-eDP-1 [562.967838] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.064s) [563.318459] Starting dynamic subtest: pipe-B-eDP-1 [565.392487] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.079s) [565.699981] Subtest basic: SUCCESS (5.127s) [566.524957] Closing watchdogs results: parsing output: 0/ for test: syncobj_timeline results: parsing output: 1/ for test: kms_chamelium_frames results: parsing output: 2/ for test: kms_ccs results: parsing output: 3/ for test: kms_frontbuffer_tracking results: parsing output: 4/ for test: kms_big_fb results: parsing output: 5/ for test: gem_spin_batch results: parsing output: 6/ for test: kms_color results: parsing output: 7/ for test: kms_flip_scaled_crc results: parsing output: 8/ for test: kms_atomic_transition results: parsing output: 9/ for test: kms_frontbuffer_tracking results: parsing output: 10/ for test: prime_mmap results: parsing output: 11/ for test: kms_psr results: parsing output: 12/ for test: syncobj_wait results: parsing output: 13/ for test: kms_rmfb results: parsing output: 14/ for test: kms_frontbuffer_tracking results: parsing output: 15/ for test: kms_invalid_mode results: parsing output: 16/ for test: prime_self_import results: parsing output: 17/ for test: gem_exec_schedule results: parsing output: 18/ for test: gem_set_tiling_vs_blt results: parsing output: 19/ for test: kms_vblank results: parsing output: 20/ for test: gem_fence_thrash results: parsing output: 21/ for test: kms_frontbuffer_tracking results: parsing output: 22/ for test: i915_pm_rc6_residency results: parsing output: 23/ for test: perf results: parsing output: 24/ for test: kms_frontbuffer_tracking results: parsing output: 25/ for test: i915_suspend results: parsing output: 26/ for test: kms_cursor_crc results: parsing output: 27/ for test: kms_psr results: parsing output: 28/ for test: i915_query results: parsing output: 29/ for test: gem_exec_basic results: parsing output: 30/ for test: gem_softpin results: parsing output: 31/ for test: kms_frontbuffer_tracking results: parsing output: 32/ for test: prime_mmap results: parsing output: 33/ for test: kms_frontbuffer_tracking results: parsing output: 34/ for test: kms_big_fb results: parsing output: 35/ for test: api_intel_allocator results: parsing output: 36/ for test: kms_frontbuffer_tracking results: parsing output: 37/ for test: syncobj_timeline results: parsing output: 38/ for test: kms_writeback results: parsing output: 39/ for test: gem_exec_suspend results: parsing output: 40/ for test: gem_exec_fence results: parsing output: 41/ for test: kms_plane results: parsing output: 42/ for test: kms_atomic results: parsing output: 43/ for test: gem_partial_pwrite_pread results: parsing output: 44/ for test: kms_ccs results: parsing output: 45/ for test: kms_frontbuffer_tracking results: parsing output: 46/ for test: gem_ctx_persistence results: parsing output: 47/ for test: kms_cursor_edge_walk results: parsing output: 48/ for test: gem_exec_alignment results: parsing output: 49/ for test: i915_fb_tiling results: parsing output: 50/ for test: kms_frontbuffer_tracking results: parsing output: 51/ for test: kms_frontbuffer_tracking results: parsing output: 52/ for test: kms_big_fb results: parsing output: 53/ for test: syncobj_timeline results: parsing output: 54/ for test: sriov_basic results: parsing output: 55/ for test: gem_exec_whisper results: parsing output: 56/ for test: gem_pxp results: parsing output: 57/ for test: kms_frontbuffer_tracking results: parsing output: 58/ for test: kms_rotation_crc results: parsing output: 59/ for test: gem_ctx_isolation results: parsing output: 60/ for test: kms_psr results: parsing output: 61/ for test: gen9_exec_parse results: parsing output: 62/ for test: gem_readwrite results: parsing output: 63/ for test: kms_fbcon_fbt results: parsing output: 64/ for test: kms_frontbuffer_tracking results: parsing output: 65/ for test: gem_mmap_gtt results: parsing output: 66/ for test: kms_flip results: parsing output: 67/ for test: kms_content_protection results: parsing output: 68/ for test: gem_mmap_wc results: parsing output: 69/ for test: kms_psr2_sf results: parsing output: 70/ for test: core_auth results: parsing output: 71/ for test: dumb_buffer results: parsing output: 72/ for test: kms_psr results: parsing output: 73/ for test: kms_psr results: parsing output: 74/ for test: gem_exec_reloc results: parsing output: 75/ for test: kms_ccs results: parsing output: 76/ for test: kms_plane_scaling results: parsing output: 77/ for test: kms_flip results: parsing output: 78/ for test: gem_sync results: parsing output: 79/ for test: syncobj_wait results: parsing output: 80/ for test: syncobj_wait results: parsing output: 81/ for test: kms_big_fb results: parsing output: 82/ for test: syncobj_basic results: parsing output: 83/ for test: syncobj_timeline results: parsing output: 84/ for test: api_intel_bb results: parsing output: 85/ for test: gem_render_copy results: parsing output: 86/ for test: gem_exec_schedule results: parsing output: 87/ for test: gem_userptr_blits results: parsing output: 88/ for test: kms_flip results: parsing output: 89/ for test: perf_pmu results: parsing output: 90/ for test: prime_mmap results: parsing output: 91/ for test: kms_flip_scaled_crc results: parsing output: 92/ for test: kms_psr2_sf results: parsing output: 93/ for test: gem_exec_schedule results: parsing output: 94/ for test: kms_pm_lpsp results: parsing output: 95/ for test: kms_chamelium_frames results: parsing output: 96/ for test: sysfs_preempt_timeout results: parsing output: 97/ for test: gem_exec_reloc results: parsing output: 98/ for test: gem_exec_reloc results: parsing output: 99/ for test: kms_lease results: parsing output: 100/ for test: syncobj_timeline results: parsing output: 101/ for test: kms_ccs results: parsing output: 102/ for test: kms_frontbuffer_tracking results: parsing output: 103/ for test: gem_mmap_offset results: parsing output: 104/ for test: kms_plane_scaling results: parsing output: 105/ for test: kms_flip results: parsing output: 106/ for test: kms_frontbuffer_tracking results: parsing output: 107/ for test: core_getclient results: parsing output: 108/ for test: kms_ccs results: parsing output: 109/ for test: kms_pipe_crc_basic results: parsing output: 110/ for test: kms_cursor_legacy results: parsing output: 111/ for test: kms_psr results: parsing output: 112/ for test: gem_create results: parsing output: 113/ for test: gem_exec_params results: parsing output: 114/ for test: kms_big_fb results: parsing output: 115/ for test: kms_cursor_crc results: parsing output: 116/ for test: kms_frontbuffer_tracking results: parsing output: 117/ for test: kms_draw_crc results: parsing output: 118/ for test: gem_exec_endless results: parsing output: 119/ for test: kms_universal_plane results: parsing output: 120/ for test: gem_exec_parallel results: parsing output: 121/ for test: kms_pm_rpm results: parsing output: 122/ for test: kms_cursor_legacy results: parsing output: 123/ for test: gen7_exec_parse results: parsing output: 124/ for test: gem_lmem_swapping results: parsing output: 125/ for test: gem_ctx_shared results: parsing output: 126/ for test: kms_big_fb results: parsing output: 127/ for test: kms_frontbuffer_tracking results: parsing output: 128/ for test: kms_cursor_legacy results: parsing output: 129/ for test: drm_read results: parsing output: 130/ for test: kms_setmode Done.