[59.778143] Initializing watchdogs [59.778193] /dev/watchdog0 [59.793896] [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] [59.798854] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [59.801181] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [59.803035] [001/133] (960s left) kms_psr (pr-dpms) [59.906814] Starting subtest: pr-dpms [59.908942] Subtest pr-dpms: SKIP (0.000s) [59.984469] [002/133] (960s left) syncobj_wait (multi-wait-all-submitted) [60.037070] Starting subtest: multi-wait-all-submitted [60.154614] Subtest multi-wait-all-submitted: SUCCESS (0.108s) [60.223732] [003/133] (960s left) kms_atomic_interruptible (atomic-setmode) [60.312913] Starting subtest: atomic-setmode [60.313950] Starting dynamic subtest: pipe-A-eDP-1 [67.229295] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.915s) [67.230435] Subtest atomic-setmode: SUCCESS (6.916s) [68.094689] [004/133] (952s left) testdisplay [68.497242] [005/133] (951s left) gem_render_copy (yf-tiled-ccs-to-y-tiled) [68.558593] Starting subtest: yf-tiled-ccs-to-y-tiled [68.560544] Subtest yf-tiled-ccs-to-y-tiled: SKIP (0.000s) [68.743395] [006/133] (951s left) kms_cursor_legacy (forked-bo) [68.859298] Starting subtest: forked-bo [68.860150] Starting dynamic subtest: pipe-A [74.378500] Dynamic subtest pipe-A: SUCCESS (5.472s) [74.386398] Starting dynamic subtest: pipe-B [79.813059] Dynamic subtest pipe-B: SUCCESS (5.470s) [79.819943] Starting dynamic subtest: pipe-C [85.296026] Dynamic subtest pipe-C: SUCCESS (5.481s) [85.303217] Starting dynamic subtest: pipe-D [90.810337] Dynamic subtest pipe-D: SUCCESS (5.475s) [90.819065] Starting dynamic subtest: all-pipes [96.294430] Dynamic subtest all-pipes: SUCCESS (5.483s) [96.295561] Subtest forked-bo: SUCCESS (27.387s) [96.388337] [007/133] (924s left) gem_exec_schedule (preempt-contexts) [96.454315] Starting subtest: preempt-contexts [96.455231] Starting dynamic subtest: rcs0 [96.509978] Dynamic subtest rcs0: SUCCESS (0.055s) [96.518518] Starting dynamic subtest: bcs0 [96.577552] Dynamic subtest bcs0: SUCCESS (0.067s) [96.586680] Starting dynamic subtest: vcs0 [96.630614] Dynamic subtest vcs0: SUCCESS (0.053s) [96.638749] Starting dynamic subtest: vcs1 [96.680058] Dynamic subtest vcs1: SUCCESS (0.049s) [96.687983] Starting dynamic subtest: vecs0 [96.728468] Dynamic subtest vecs0: SUCCESS (0.047s) [96.737566] Starting dynamic subtest: ccs0 [96.773892] Dynamic subtest ccs0: SUCCESS (0.046s) [96.774814] Subtest preempt-contexts: SUCCESS (0.320s) [97.955455] [008/133] (922s left) syncobj_wait (multi-wait-all-for-submit-submitted-signaled) [98.001282] Starting subtest: multi-wait-all-for-submit-submitted-signaled [98.106230] Subtest multi-wait-all-for-submit-submitted-signaled: SUCCESS (0.104s) [98.172126] [009/133] (922s left) kms_joiner (invalid-modeset-force-big-joiner) [98.261798] Starting subtest: invalid-modeset-force-big-joiner [98.263523] Subtest invalid-modeset-force-big-joiner: SKIP (0.000s) [98.321172] [010/133] (922s left) gem_eio (in-flight-internal-1us) [98.538971] Starting subtest: in-flight-internal-1us [99.997225] Subtest in-flight-internal-1us: SUCCESS (1.459s) [100.126768] [011/133] (920s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-indfb-plflip-blt) [100.209121] Starting subtest: fbcpsr-1p-primscrn-indfb-plflip-blt [107.708134] Subtest fbcpsr-1p-primscrn-indfb-plflip-blt: SUCCESS (7.500s) [107.826614] [012/133] (912s left) kms_psr (fbc-psr2-sprite-render) [107.918242] Starting subtest: fbc-psr2-sprite-render [107.919183] Starting dynamic subtest: eDP-1 [107.920936] Dynamic subtest eDP-1: SKIP (0.000s) [107.922827] Subtest fbc-psr2-sprite-render: SKIP (0.000s) [108.003442] [013/133] (912s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-mmap-wc) [108.087011] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-mmap-wc [112.096739] Subtest fbc-1p-offscreen-pri-shrfb-draw-mmap-wc: SUCCESS (4.010s) [113.234346] [014/133] (907s left) kms_frontbuffer_tracking (fbcpsr-2p-indfb-fliptrack-mmap-gtt) [113.329343] Starting subtest: fbcpsr-2p-indfb-fliptrack-mmap-gtt [113.331217] Subtest fbcpsr-2p-indfb-fliptrack-mmap-gtt: SKIP (0.000s) [113.429645] [015/133] (907s left) syncobj_basic (bad-destroy-pad) [113.480241] Starting subtest: bad-destroy-pad [113.481231] Subtest bad-destroy-pad: SUCCESS (0.000s) [113.582519] [016/133] (907s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-pwrite) [113.676145] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-pwrite [118.071355] Subtest fbc-1p-primscrn-cur-indfb-draw-pwrite: SUCCESS (4.395s) [119.238721] [017/133] (901s left) kms_frontbuffer_tracking (fbcpsr-2p-rte) [119.329400] Starting subtest: fbcpsr-2p-rte [119.330929] Subtest fbcpsr-2p-rte: SKIP (0.000s) [119.406531] [018/133] (901s left) gem_close (many-handles-one-vma) [119.450142] Starting subtest: many-handles-one-vma [119.474980] Subtest many-handles-one-vma: SUCCESS (0.025s) [119.569297] [019/133] (901s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-move) [119.653780] Starting subtest: fbc-2p-primscrn-spr-indfb-move [119.655455] Subtest fbc-2p-primscrn-spr-indfb-move: SKIP (0.000s) [119.756674] [020/133] (901s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-fullscreen) [119.844658] Starting subtest: psr-1p-primscrn-spr-indfb-fullscreen [126.550197] Subtest psr-1p-primscrn-spr-indfb-fullscreen: SUCCESS (6.706s) [126.656448] [021/133] (894s left) gem_pwrite_snooped [126.776659] [022/133] (894s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-0) [126.874068] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-0 [127.897434] Subtest 4-tiled-max-hw-stride-64bpp-rotate-0: SUCCESS (1.023s) [128.026074] [023/133] (892s left) gem_watchdog (default-virtual) [128.079705] Starting subtest: default-virtual [134.369625] Subtest default-virtual: SUCCESS (6.282s) [134.433927] [024/133] (886s left) kms_selftest (drm_plane_helper) [134.473192] Starting subtest: drm_plane_helper [134.487608] Starting dynamic subtest: drm_test_check_plane_state [134.580180] Dynamic subtest drm_test_check_plane_state: SUCCESS (0.092s) [134.587331] Starting dynamic subtest: drm_test_check_invalid_plane_state [134.669150] Dynamic subtest drm_test_check_invalid_plane_state: SUCCESS (0.089s) [134.670144] Subtest drm_plane_helper: SUCCESS (0.196s) [134.813316] [025/133] (886s left) perf (short-reads) [134.940768] Starting subtest: short-reads [134.955260] Subtest short-reads: SUCCESS (0.015s) [134.989887] [026/133] (886s left) kms_content_protection (uevent-hdcp14) [135.127575] Starting subtest: uevent-hdcp14 [135.129586] Subtest uevent-hdcp14: SKIP (0.000s) [135.234524] [027/133] (885s left) kms_busy (extended-modeset-hang-oldfb-with-reset) [135.344810] Starting subtest: extended-modeset-hang-oldfb-with-reset [135.345739] Starting dynamic subtest: pipe-A [146.859412] Dynamic subtest pipe-A: SUCCESS (11.509s) [146.868754] Starting dynamic subtest: pipe-D [159.133226] Dynamic subtest pipe-D: SUCCESS (12.275s) [159.134106] Subtest extended-modeset-hang-oldfb-with-reset: SUCCESS (23.788s) [160.024171] [028/133] (861s left) core_hotunplug (unbind-rebind) [160.112815] Starting subtest: unbind-rebind [166.027673] Subtest unbind-rebind: SUCCESS (5.914s) [166.059663] [029/133] (855s left) kms_hdmi_inject (inject-audio) [168.153456] Starting subtest: inject-audio [168.431723] Subtest inject-audio: SUCCESS (0.279s) [168.984351] [030/133] (852s left) kms_plane_lowres (tiling-x) [169.068368] Starting subtest: tiling-x [169.069317] Starting dynamic subtest: pipe-A-eDP-1 [169.071287] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [169.367912] Starting dynamic subtest: pipe-B-eDP-1 [169.369837] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [169.376457] Starting dynamic subtest: pipe-C-eDP-1 [169.378292] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [169.384873] Starting dynamic subtest: pipe-D-eDP-1 [169.386782] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [169.388620] Subtest tiling-x: SKIP (0.292s) [170.153273] [031/133] (851s left) kms_ccs (crc-primary-suspend-yf-tiled-ccs) [170.234309] Starting subtest: crc-primary-suspend-yf-tiled-ccs [170.235258] Starting dynamic subtest: pipe-A-eDP-1 [170.238871] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [170.246434] Starting dynamic subtest: pipe-B-eDP-1 [170.249642] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [170.256191] Starting dynamic subtest: pipe-C-eDP-1 [170.259508] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [170.265988] Starting dynamic subtest: pipe-D-eDP-1 [170.269429] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [170.271057] Subtest crc-primary-suspend-yf-tiled-ccs: SKIP (0.003s) [172.462024] [032/133] (848s left) gem_pxp (create-regular-buffer) [172.595316] Starting subtest: create-regular-buffer [172.596791] Subtest create-regular-buffer: SUCCESS (0.000s) [172.695022] [033/133] (848s left) gem_madvise (dontneed-before-mmap) [172.725091] Starting subtest: dontneed-before-mmap [172.743860] Subtest dontneed-before-mmap: SUCCESS (0.018s) [172.870430] [034/133] (848s left) gem_mmap_gtt (basic-short) [172.921826] Subtest basic-short: SKIP (0.000s) [172.997458] [035/133] (848s left) kms_psr2_sf (pr-overlay-plane-update-sf-dmg-area) [173.087037] Starting subtest: pr-overlay-plane-update-sf-dmg-area [173.088786] Subtest pr-overlay-plane-update-sf-dmg-area: SKIP (0.000s) [173.150715] [036/133] (848s left) kms_flip_scaled_crc (flip-64bpp-linear-to-16bpp-linear-upscaling) [173.232421] Starting subtest: flip-64bpp-linear-to-16bpp-linear-upscaling [173.233328] Starting dynamic subtest: pipe-A-default-mode [175.959360] Dynamic subtest pipe-A-default-mode: SUCCESS (2.727s) [175.960493] Subtest flip-64bpp-linear-to-16bpp-linear-upscaling: SUCCESS (2.728s) [176.748520] [037/133] (844s left) kms_rotation_crc (primary-y-tiled-reflect-x-180) [176.843395] Starting subtest: primary-y-tiled-reflect-x-180 [176.903889] Subtest primary-y-tiled-reflect-x-180: SKIP (0.060s) [176.998256] [038/133] (844s left) kms_prop_blob (blob-prop-validate) [177.064590] Starting subtest: blob-prop-validate [177.065626] Subtest blob-prop-validate: SUCCESS (0.000s) [177.172867] [039/133] (844s left) kms_async_flips (invalid-async-flip-atomic) [177.253056] Starting subtest: invalid-async-flip-atomic [177.638996] Starting dynamic subtest: pipe-A-eDP-1 [178.454744] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.815s) [178.813160] Starting dynamic subtest: pipe-B-eDP-1 [179.654346] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.847s) [180.009739] Starting dynamic subtest: pipe-C-eDP-1 [180.842809] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.839s) [181.202516] Starting dynamic subtest: pipe-D-eDP-1 [182.043940] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.847s) [182.045027] Subtest invalid-async-flip-atomic: SUCCESS (4.791s) [183.253703] [040/133] (838s left) kms_getfb (getfb-handle-closed) [183.334347] Starting subtest: getfb-handle-closed [183.335241] Subtest getfb-handle-closed: SUCCESS (0.000s) [183.420700] [041/133] (838s left) gem_exec_schedule (implicit-boths) [183.478706] Starting subtest: implicit-boths [183.479624] Starting dynamic subtest: rcs0 [183.584830] Dynamic subtest rcs0: SUCCESS (0.106s) [183.599615] Starting dynamic subtest: vcs0 [183.680629] Dynamic subtest vcs0: SUCCESS (0.094s) [183.695304] Starting dynamic subtest: vcs1 [183.773032] Dynamic subtest vcs1: SUCCESS (0.092s) [183.782945] Starting dynamic subtest: vecs0 [183.853466] Dynamic subtest vecs0: SUCCESS (0.078s) [183.863474] Starting dynamic subtest: ccs0 [183.937883] Dynamic subtest ccs0: SUCCESS (0.084s) [183.939227] Subtest implicit-boths: SUCCESS (0.460s) [185.018752] [042/133] (836s left) kms_plane_scaling (plane-scaler-unity-scaling-with-rotation) [185.115321] Starting subtest: plane-scaler-unity-scaling-with-rotation [185.116215] Starting dynamic subtest: pipe-A [185.341466] Dynamic subtest pipe-A: SUCCESS (0.228s) [185.348519] Starting dynamic subtest: pipe-B [186.615737] Dynamic subtest pipe-B: SUCCESS (1.273s) [186.623758] Starting dynamic subtest: pipe-C [187.921222] Dynamic subtest pipe-C: SUCCESS (1.305s) [187.929479] Starting dynamic subtest: pipe-D [189.209904] Dynamic subtest pipe-D: SUCCESS (1.288s) [189.210961] Subtest plane-scaler-unity-scaling-with-rotation: SUCCESS (4.097s) [190.346761] [043/133] (831s left) kms_cursor_legacy (cursorb-vs-flipb-legacy) [190.461328] Starting subtest: cursorB-vs-flipB-legacy [190.463217] Subtest cursorB-vs-flipB-legacy: SKIP (0.001s) [190.599659] [044/133] (831s left) i915_query (query-regions-sanity-check) [190.650605] Starting subtest: query-regions-sanity-check [190.661905] Subtest query-regions-sanity-check: SUCCESS (0.012s) [190.771214] [045/133] (830s left) kms_psr2_sf (psr2-primary-plane-update-sf-dmg-area) [190.857359] Starting subtest: psr2-primary-plane-update-sf-dmg-area [190.858310] Starting dynamic subtest: pipe-A-eDP-1 [196.630750] Dynamic subtest pipe-A-eDP-1: SUCCESS (5.774s) [196.638852] Starting dynamic subtest: pipe-B-eDP-1 [203.125361] Dynamic subtest pipe-B-eDP-1: SUCCESS (6.493s) [203.126604] Subtest psr2-primary-plane-update-sf-dmg-area: SUCCESS (12.270s) [203.959621] [046/133] (817s left) kms_psr (fbc-psr2-basic) [204.051514] Starting subtest: fbc-psr2-basic [204.052412] Starting dynamic subtest: eDP-1 [204.054115] Dynamic subtest eDP-1: SKIP (0.000s) [204.055699] Subtest fbc-psr2-basic: SKIP (0.001s) [204.116561] [047/133] (817s left) gem_render_copy (mixed-tiled-to-y-tiled-ccs) [204.176307] Starting subtest: mixed-tiled-to-y-tiled-ccs [204.178025] Subtest mixed-tiled-to-y-tiled-ccs: SKIP (0.000s) [204.350962] [048/133] (817s left) perf_pmu (busy-check-all) [204.384087] Starting subtest: busy-check-all [204.384990] Starting dynamic subtest: rcs0 [204.941038] Dynamic subtest rcs0: SUCCESS (0.556s) [204.952901] Starting dynamic subtest: bcs0 [205.491364] Dynamic subtest bcs0: SUCCESS (0.548s) [205.502113] Starting dynamic subtest: vcs0 [206.941769] Dynamic subtest vcs0: SUCCESS (1.439s) [206.951726] Starting dynamic subtest: vcs1 [208.926468] Dynamic subtest vcs1: SUCCESS (1.982s) [208.936095] Starting dynamic subtest: vecs0 [210.909633] Dynamic subtest vecs0: SUCCESS (1.980s) [210.919754] Starting dynamic subtest: ccs0 [211.456888] Dynamic subtest ccs0: SUCCESS (0.554s) [211.459928] Subtest busy-check-all: SUCCESS (7.074s) [211.559748] [049/133] (810s left) kms_pm_dc (dc5-psr) [212.663561] Starting subtest: dc5-psr [215.546027] Subtest dc5-psr: SUCCESS (2.882s) [216.347209] [050/133] (805s left) gem_render_tiled_blits (basic) [216.398526] Subtest basic: SKIP (0.000s) [216.457565] [051/133] (805s left) kms_lease (master-vs-lease) [216.539535] Starting subtest: master-vs-lease [216.540394] Subtest master-vs-lease: SUCCESS (0.002s) [216.641960] [052/133] (805s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-move) [216.737454] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-move [216.739352] Subtest fbcpsr-2p-scndscrn-cur-indfb-move: SKIP (0.000s) [216.843931] [053/133] (805s left) perf_pmu (busy-idle-check-all) [216.885676] Starting subtest: busy-idle-check-all [216.886716] Starting dynamic subtest: rcs0 [217.536060] Dynamic subtest rcs0: SUCCESS (0.651s) [217.556570] Starting dynamic subtest: bcs0 [218.189412] Dynamic subtest bcs0: SUCCESS (0.651s) [218.201317] Starting dynamic subtest: vcs0 [219.934567] Dynamic subtest vcs0: SUCCESS (1.733s) [219.944534] Starting dynamic subtest: vcs1 [221.918375] Dynamic subtest vcs1: SUCCESS (1.981s) [221.926716] Starting dynamic subtest: vecs0 [223.902417] Dynamic subtest vecs0: SUCCESS (1.981s) [223.912396] Starting dynamic subtest: ccs0 [224.550955] Dynamic subtest ccs0: SUCCESS (0.655s) [224.554184] Subtest busy-idle-check-all: SUCCESS (7.669s) [224.658781] [054/133] (797s left) kms_plane_scaling (plane-upscale-20x20-with-modifiers) [224.761060] Starting subtest: plane-upscale-20x20-with-modifiers [224.761841] Starting dynamic subtest: pipe-A [225.099278] Dynamic subtest pipe-A: SUCCESS (0.338s) [225.106638] Starting dynamic subtest: pipe-B [226.516901] Dynamic subtest pipe-B: SUCCESS (1.417s) [226.529940] Starting dynamic subtest: pipe-C [227.934186] Dynamic subtest pipe-C: SUCCESS (1.415s) [227.941820] Starting dynamic subtest: pipe-D [229.316756] Dynamic subtest pipe-D: SUCCESS (1.382s) [229.318958] Subtest plane-upscale-20x20-with-modifiers: SUCCESS (4.557s) [230.536118] [055/133] (791s left) gem_ctx_param (vm) [230.596794] Starting subtest: vm [230.639270] Subtest vm: SUCCESS (0.042s) [230.765443] [056/133] (791s left) kms_ccs (crc-sprite-planes-basic-yf-tiled-ccs) [230.857667] Starting subtest: crc-sprite-planes-basic-yf-tiled-ccs [230.858579] Starting dynamic subtest: pipe-A-eDP-1 [230.882493] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s) [230.894844] Starting dynamic subtest: pipe-B-eDP-1 [230.916926] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s) [230.925181] Starting dynamic subtest: pipe-C-eDP-1 [230.944822] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s) [230.951988] Starting dynamic subtest: pipe-D-eDP-1 [230.971769] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s) [230.973338] Subtest crc-sprite-planes-basic-yf-tiled-ccs: SKIP (0.009s) [233.164154] [057/133] (788s left) kms_flip (plain-flip-ts-check-interruptible) [233.266343] Starting subtest: plain-flip-ts-check-interruptible [233.270614] Starting dynamic subtest: A-eDP1 [242.140349] Dynamic subtest A-eDP1: SUCCESS (8.845s) [242.150500] Starting dynamic subtest: B-eDP1 [251.028628] Dynamic subtest B-eDP1: SUCCESS (8.886s) [251.038254] Starting dynamic subtest: C-eDP1 [259.835595] Dynamic subtest C-eDP1: SUCCESS (8.792s) [259.846312] Starting dynamic subtest: D-eDP1 [268.633160] Dynamic subtest D-eDP1: SUCCESS (8.797s) [268.634068] Subtest plain-flip-ts-check-interruptible: SUCCESS (35.336s) [269.755193] [058/133] (752s left) syncobj_timeline (wait-all-for-submit-snapshot) [269.796742] Starting subtest: wait-all-for-submit-snapshot [269.879416] Subtest wait-all-for-submit-snapshot: SUCCESS (0.082s) [269.946990] [059/133] (752s left) kms_big_fb (4-tiled-64bpp-rotate-270) [270.058277] Starting subtest: 4-tiled-64bpp-rotate-270 [270.078115] Subtest 4-tiled-64bpp-rotate-270: SKIP (0.019s) [270.212486] [060/133] (751s left) syncobj_timeline (multi-wait-for-submit-unsubmitted-submitted-signaled) [270.262525] Starting subtest: multi-wait-for-submit-unsubmitted-submitted-signaled [270.263462] Subtest multi-wait-for-submit-unsubmitted-submitted-signaled: SUCCESS (0.000s) [270.368693] [061/133] (751s left) kms_psr (psr2-primary-render) [270.464499] Starting subtest: psr2-primary-render [270.465402] Starting dynamic subtest: eDP-1 [272.220575] Dynamic subtest eDP-1: SUCCESS (1.756s) [272.221498] Subtest psr2-primary-render: SUCCESS (1.757s) [273.039546] [062/133] (749s left) syncobj_timeline (device-signal-unordered) [273.088261] Starting subtest: device-signal-unordered [273.089167] Subtest device-signal-unordered: SUCCESS (0.000s) [273.176330] [063/133] (749s left) kms_frontbuffer_tracking (psr-1p-primscrn-indfb-plflip-blt) [273.287489] Starting subtest: psr-1p-primscrn-indfb-plflip-blt [280.792885] Subtest psr-1p-primscrn-indfb-plflip-blt: SUCCESS (7.506s) [280.907398] [064/133] (741s left) kms_feature_discovery (display-1x) [280.988786] Starting subtest: display-1x [280.989684] Subtest display-1x: SUCCESS (0.000s) [281.054442] [065/133] (741s left) vgem_basic (dmabuf-fence-before) [281.136607] Starting subtest: dmabuf-fence-before [281.139542] Subtest dmabuf-fence-before: SUCCESS (0.002s) [281.187878] [FACT vgem_basic (dmabuf-fence-before)] new: kernel.kmod_is_loaded.vgem: true [281.189618] [066/133] (741s left) api_intel_allocator (fork-simple-stress-signal) [281.236464] Starting subtest: fork-simple-stress-signal [286.685697] Subtest fork-simple-stress-signal: SUCCESS (5.403s) [286.756331] [067/133] (735s left) kms_big_fb (linear-max-hw-stride-32bpp-rotate-180) [286.862102] Starting subtest: linear-max-hw-stride-32bpp-rotate-180 [288.075380] Subtest linear-max-hw-stride-32bpp-rotate-180: SUCCESS (1.213s) [288.216626] [068/133] (734s left) gem_exec_reloc (basic-softpin) [288.269979] Subtest basic-softpin: SKIP (0.000s) [288.356100] [069/133] (734s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-mmap-gtt) [288.466364] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-mmap-gtt [288.468199] Subtest psr-2p-scndscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s) [288.578279] [070/133] (733s left) prime_mmap (test_errors) [288.640022] Starting subtest: test_errors [288.642025] Starting dynamic subtest: test_errors-smem [288.855952] Dynamic subtest test_errors-smem: SUCCESS (0.211s) [288.857150] Subtest test_errors: SUCCESS (0.212s) [288.967981] [071/133] (733s left) kms_pipe_crc_basic (disable-crc-after-crtc) [289.061590] Starting subtest: disable-crc-after-crtc [289.062543] Starting dynamic subtest: pipe-A-eDP-1 [290.774062] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.711s) [290.783183] Starting dynamic subtest: pipe-B-eDP-1 [293.181740] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.404s) [293.190416] Starting dynamic subtest: pipe-C-eDP-1 [295.550551] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.369s) [295.558691] Starting dynamic subtest: pipe-D-eDP-1 [297.859807] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.307s) [297.860768] Subtest disable-crc-after-crtc: SUCCESS (8.797s) [298.651450] [072/133] (723s left) kms_chamelium_frames (hdmi-crc-multiple) [299.025159] Subtest hdmi-crc-multiple: SKIP (0.000s) [299.814102] [073/133] (722s left) prime_vgem (coherency-blt) [299.885698] Starting subtest: coherency-blt [300.974389] Subtest coherency-blt: SUCCESS (1.078s) [301.080470] [074/133] (721s left) gem_exec_balancer (waits) [301.127249] Starting subtest: waits [307.655645] Subtest waits: SUCCESS (6.518s) [307.952262] [075/133] (714s left) kms_ccs (bad-aux-stride-y-tiled-gen12-rc-ccs) [308.050029] Starting subtest: bad-aux-stride-y-tiled-gen12-rc-ccs [308.050926] Starting dynamic subtest: pipe-A-eDP-1 [308.059071] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [308.066778] Starting dynamic subtest: pipe-B-eDP-1 [308.075319] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [308.082752] Starting dynamic subtest: pipe-C-eDP-1 [308.090661] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [308.099205] Starting dynamic subtest: pipe-D-eDP-1 [308.106969] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [308.108571] Subtest bad-aux-stride-y-tiled-gen12-rc-ccs: SKIP (0.005s) [310.246747] [076/133] (712s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-180) [310.349422] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-180 [311.349691] Subtest x-tiled-max-hw-stride-64bpp-rotate-180: SUCCESS (1.001s) [311.470542] [077/133] (711s left) kms_cursor_crc (cursor-onscreen-256x85) [311.718122] Starting subtest: cursor-onscreen-256x85 [311.764907] Subtest cursor-onscreen-256x85: SKIP (0.045s) [311.947892] [078/133] (710s left) gem_render_copy (linear) [311.998695] Starting subtest: linear [311.999602] Starting dynamic subtest: smem [312.037577] Dynamic subtest smem: SUCCESS (0.040s) [312.038835] Subtest linear: SUCCESS (0.041s) [312.261206] [079/133] (710s left) gem_mmap_gtt (hang) [312.317947] Subtest hang: SKIP (0.000s) [312.381078] [080/133] (710s left) kms_pm_rpm (modeset-non-lpsp) [313.996318] Starting subtest: modeset-non-lpsp [315.158205] Subtest modeset-non-lpsp: SKIP (1.160s) [315.527531] [081/133] (707s left) kms_frontbuffer_tracking (psr-rgb565-draw-mmap-gtt) [315.620322] Starting subtest: psr-rgb565-draw-mmap-gtt [315.621964] Subtest psr-rgb565-draw-mmap-gtt: SKIP (0.000s) [315.736309] [082/133] (707s left) api_intel_bb (purge-bb) [315.779254] Starting subtest: purge-bb [315.782261] Subtest purge-bb: SUCCESS (0.004s) [315.907326] [083/133] (707s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-render) [315.994448] Starting subtest: fbcpsr-rgb101010-draw-render [322.666476] Subtest fbcpsr-rgb101010-draw-render: SUCCESS (6.672s) [322.798894] [084/133] (700s left) kms_plane (pixel-format-x-tiled-modifier-source-clamping) [322.896033] Starting subtest: pixel-format-x-tiled-modifier-source-clamping [322.923461] Starting dynamic subtest: pipe-A-plane-0 [323.523245] Dynamic subtest pipe-A-plane-0: SUCCESS (0.600s) [323.530978] Starting dynamic subtest: pipe-A-plane-3 [323.968040] Dynamic subtest pipe-A-plane-3: SUCCESS (0.444s) [325.099041] Starting dynamic subtest: pipe-B-plane-0 [325.691660] Dynamic subtest pipe-B-plane-0: SUCCESS (0.600s) [325.699587] Starting dynamic subtest: pipe-B-plane-3 [326.158173] Dynamic subtest pipe-B-plane-3: SUCCESS (0.466s) [326.466980] Subtest pixel-format-x-tiled-modifier-source-clamping: SUCCESS (3.570s) [327.340664] [085/133] (695s left) gem_exec_balancer (full-late) [327.401658] Starting subtest: full-late [331.782502] Subtest full-late: SUCCESS (4.381s) [332.106675] [086/133] (690s left) kms_flip (2x-plain-flip-interruptible) [332.202395] Starting subtest: 2x-plain-flip-interruptible [332.214066] Subtest 2x-plain-flip-interruptible: SKIP (0.011s) [332.288510] [087/133] (690s left) gem_lmem_swapping (parallel-random-verify) [332.326206] Subtest parallel-random-verify: SKIP (0.000s) [332.362773] [088/133] (690s left) syncobj_wait (invalid-multi-wait-unsubmitted-signaled) [332.406681] Starting subtest: invalid-multi-wait-unsubmitted-signaled [332.407900] Subtest invalid-multi-wait-unsubmitted-signaled: SUCCESS (0.000s) [332.493956] [089/133] (690s left) kms_color (legacy-gamma) [332.573606] Starting subtest: legacy-gamma [332.574403] Starting dynamic subtest: pipe-A-eDP-1 [333.284497] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.711s) [333.291996] Starting dynamic subtest: pipe-B-eDP-1 [334.758750] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.474s) [334.766201] Starting dynamic subtest: pipe-C-eDP-1 [336.070246] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.311s) [336.078260] Starting dynamic subtest: pipe-D-eDP-1 [337.479346] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.407s) [337.480376] Subtest legacy-gamma: SUCCESS (4.906s) [338.333060] [090/133] (684s left) kms_cursor_edge_walk (64x64-top-edge) [338.433545] Starting subtest: 64x64-top-edge [338.434470] Starting dynamic subtest: pipe-A-eDP-1 [341.887858] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.453s) [341.895343] Starting dynamic subtest: pipe-D-eDP-1 [345.079126] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.190s) [345.079910] Subtest 64x64-top-edge: SUCCESS (6.646s) [345.946849] [091/133] (677s left) i915_pm_rps (min-max-config-loaded) [346.006829] Starting subtest: min-max-config-loaded [346.008752] Subtest min-max-config-loaded: SKIP (0.001s) [346.097526] [092/133] (677s left) gem_exec_fence (syncobj-timeline-invalid-flags) [346.664578] Starting subtest: syncobj-timeline-invalid-flags [346.665883] Subtest syncobj-timeline-invalid-flags: SUCCESS (0.000s) [347.999255] [093/133] (675s left) gem_exec_whisper (basic-contexts) [348.056336] Starting subtest: basic-contexts [355.903019] Subtest basic-contexts: SUCCESS (7.835s) [356.080411] [094/133] (667s left) gen7_exec_parse (cmd-crossing-page) [356.129942] Subtest cmd-crossing-page: SKIP (0.000s) [356.200404] [095/133] (667s left) gem_mmap_wc (write-cpu-read-wc-unflushed) [356.245869] Subtest write-cpu-read-wc-unflushed: SKIP (0.000s) [356.297543] [096/133] (667s left) kms_vblank (wait-idle-hang) [356.394255] Starting subtest: wait-idle-hang [356.395087] Starting dynamic subtest: pipe-A-eDP-1 [383.641758] Dynamic subtest pipe-A-eDP-1: SUCCESS (27.245s) [383.652110] Starting dynamic subtest: pipe-D-eDP-1 [398.743877] Dynamic subtest pipe-D-eDP-1: SUCCESS (15.098s) [398.744830] Subtest wait-idle-hang: SUCCESS (42.349s) [399.536296] [097/133] (623s left) sw_sync (sync_multi_producer_single_consumer) [399.574178] Starting subtest: sync_multi_producer_single_consumer [400.657494] Subtest sync_multi_producer_single_consumer: SUCCESS (1.075s) [400.703952] [098/133] (622s left) gem_spin_batch (resubmit-all) [400.761480] Starting subtest: resubmit-all [400.762376] Starting dynamic subtest: rcs0 [400.773757] Dynamic subtest rcs0: SUCCESS (0.012s) [400.784098] Starting dynamic subtest: bcs0 [400.785033] Dynamic subtest bcs0: SUCCESS (0.002s) [400.793182] Starting dynamic subtest: vcs0 [400.793995] Dynamic subtest vcs0: SUCCESS (0.002s) [400.801597] Starting dynamic subtest: vcs1 [400.802443] Dynamic subtest vcs1: SUCCESS (0.002s) [400.809899] Starting dynamic subtest: vecs0 [400.810808] Dynamic subtest vecs0: SUCCESS (0.002s) [400.818351] Starting dynamic subtest: ccs0 [400.819241] Dynamic subtest ccs0: SUCCESS (0.002s) [400.820070] Subtest resubmit-all: SUCCESS (0.027s) [401.927441] [099/133] (621s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-pwrite) [402.022859] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-pwrite [411.638852] Subtest psr-1p-offscreen-pri-shrfb-draw-pwrite: SUCCESS (9.615s) [411.747770] [100/133] (611s left) kms_rotation_crc (primary-rotation-180) [411.842857] Starting subtest: primary-rotation-180 [418.818039] Subtest primary-rotation-180: SUCCESS (6.976s) [420.044888] [101/133] (603s left) kms_big_fb (yf-tiled-8bpp-rotate-0) [420.147029] Starting subtest: yf-tiled-8bpp-rotate-0 [420.148861] Subtest yf-tiled-8bpp-rotate-0: SKIP (0.000s) [420.242401] [102/133] (603s left) gem_userptr_blits (readonly-pwrite-unsync) [420.293596] Subtest readonly-pwrite-unsync: SKIP (0.000s) [420.410935] [103/133] (603s left) gem_bad_reloc (negative-reloc) [420.462914] Subtest negative-reloc: SKIP (0.000s) [420.532799] [104/133] (603s left) kms_flip (2x-flip-vs-dpms-off-vs-modeset-interruptible) [420.631429] Starting subtest: 2x-flip-vs-dpms-off-vs-modeset-interruptible [420.643987] Subtest 2x-flip-vs-dpms-off-vs-modeset-interruptible: SKIP (0.012s) [420.721317] [105/133] (603s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-onoff) [420.809646] Starting subtest: fbc-2p-scndscrn-cur-indfb-onoff [420.811378] Subtest fbc-2p-scndscrn-cur-indfb-onoff: SKIP (0.000s) [420.896914] [106/133] (602s left) kms_chamelium_hpd (dp-hpd-after-suspend) [421.274711] Subtest dp-hpd-after-suspend: SKIP (0.000s) [422.118999] [107/133] (601s left) gem_mmap_gtt (basic) [422.171174] Subtest basic: SKIP (0.000s) [422.235278] [108/133] (601s left) gem_ctx_sseu (invalid-sseu) [422.283555] Subtest invalid-sseu: SKIP (0.000s) [422.343139] [109/133] (601s left) gem_create (create-ext-placement-each) [422.517085] Starting subtest: create-ext-placement-each [422.518140] Subtest create-ext-placement-each: SUCCESS (0.000s) [422.605909] [110/133] (601s left) gem_exec_reloc (basic-cpu-read-active) [422.668550] Subtest basic-cpu-read-active: SKIP (0.000s) [422.740367] [111/133] (601s left) kms_big_fb (y-tiled-16bpp-rotate-0) [422.834191] Starting subtest: y-tiled-16bpp-rotate-0 [422.835655] Subtest y-tiled-16bpp-rotate-0: SKIP (0.000s) [422.951202] [112/133] (601s left) i915_drm_fdinfo (busy-check-all) [422.982533] Starting subtest: busy-check-all [422.983468] Starting dynamic subtest: rcs0 [422.988177] Dynamic subtest rcs0: SKIP (0.005s) [422.998537] Starting dynamic subtest: bcs0 [423.000295] Dynamic subtest bcs0: SKIP (0.000s) [423.008287] Starting dynamic subtest: vcs0 [423.009863] Dynamic subtest vcs0: SKIP (0.000s) [423.017662] Starting dynamic subtest: vcs1 [423.019361] Dynamic subtest vcs1: SKIP (0.000s) [423.026803] Starting dynamic subtest: vecs0 [423.028621] Dynamic subtest vecs0: SKIP (0.000s) [423.036793] Starting dynamic subtest: ccs0 [423.038496] Dynamic subtest ccs0: SKIP (0.000s) [423.040194] Subtest busy-check-all: SKIP (0.012s) [423.069734] [113/133] (600s left) gem_exec_whisper (basic-sync) [423.135378] Starting subtest: basic-sync [430.244502] Subtest basic-sync: SUCCESS (7.099s) [430.415875] [114/133] (593s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-render) [430.517639] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-render [430.519466] Subtest psr-2p-primscrn-pri-shrfb-draw-render: SKIP (0.000s) [430.616259] [115/133] (593s left) kms_cursor_legacy (cursor-vs-flip-atomic-transitions) [430.738439] Starting subtest: cursor-vs-flip-atomic-transitions [460.820653] Subtest cursor-vs-flip-atomic-transitions: SUCCESS (30.080s) [461.643324] [116/133] (562s left) sysfs_timeslice_duration (idempotent) [461.713196] Starting subtest: idempotent [461.714120] Starting dynamic subtest: vecs0 [461.715024] Dynamic subtest vecs0: SUCCESS (0.000s) [461.724950] Starting dynamic subtest: ccs0 [461.725793] Dynamic subtest ccs0: SUCCESS (0.000s) [461.733876] Starting dynamic subtest: vcs0 [461.734715] Dynamic subtest vcs0: SUCCESS (0.000s) [461.742201] Starting dynamic subtest: bcs0 [461.742944] Dynamic subtest bcs0: SUCCESS (0.000s) [461.750317] Starting dynamic subtest: rcs0 [461.751206] Dynamic subtest rcs0: SUCCESS (0.000s) [461.758646] Starting dynamic subtest: vcs1 [461.759465] Dynamic subtest vcs1: SUCCESS (0.000s) [461.760255] Subtest idempotent: SUCCESS (0.007s) [461.825196] [117/133] (562s left) syncobj_wait (single-wait-all-submitted) [461.877375] Starting subtest: single-wait-all-submitted [461.986033] Subtest single-wait-all-submitted: SUCCESS (0.107s) [462.060741] [118/133] (562s left) kms_cursor_crc (cursor-rapid-movement-max-size) [462.342071] Starting subtest: cursor-rapid-movement-max-size [462.344660] Subtest cursor-rapid-movement-max-size: SKIP (0.000s) [462.472657] [119/133] (561s left) kms_ccs (ccs-on-another-bo-4-tiled-mtl-rc-ccs-cc) [462.565354] Starting subtest: ccs-on-another-bo-4-tiled-mtl-rc-ccs-cc [462.566205] Starting dynamic subtest: pipe-A-eDP-1 [462.573791] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s) [462.585097] Starting dynamic subtest: pipe-B-eDP-1 [462.592505] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s) [462.600409] Starting dynamic subtest: pipe-C-eDP-1 [462.607333] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s) [462.615094] Starting dynamic subtest: pipe-D-eDP-1 [462.621853] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s) [462.622634] Subtest ccs-on-another-bo-4-tiled-mtl-rc-ccs-cc: SUCCESS (0.009s) [464.829958] [120/133] (559s left) syncobj_timeline (invalid-query-zero-handles) [464.884711] Starting subtest: invalid-query-zero-handles [464.885678] Subtest invalid-query-zero-handles: SUCCESS (0.000s) [464.982625] [121/133] (559s left) i915_hangman (gt-engine-hang) [465.041756] Starting subtest: gt-engine-hang [465.042717] Starting dynamic subtest: rcs0 [466.876820] Dynamic subtest rcs0: SUCCESS (1.826s) [466.886309] Starting dynamic subtest: bcs0 [468.860685] Dynamic subtest bcs0: SUCCESS (1.981s) [468.872051] Starting dynamic subtest: vcs0 [470.843508] Dynamic subtest vcs0: SUCCESS (1.980s) [470.852240] Starting dynamic subtest: vcs1 [472.893076] Dynamic subtest vcs1: SUCCESS (2.047s) [472.903684] Starting dynamic subtest: vecs0 [474.876851] Dynamic subtest vecs0: SUCCESS (1.981s) [474.888081] Starting dynamic subtest: ccs0 [476.860626] Dynamic subtest ccs0: SUCCESS (1.981s) [476.862331] Subtest gt-engine-hang: SUCCESS (11.811s) [476.981990] [122/133] (547s left) kms_ccs (random-ccs-data-y-tiled-gen12-rc-ccs) [477.078408] Starting subtest: random-ccs-data-y-tiled-gen12-rc-ccs [477.079309] Starting dynamic subtest: pipe-A-eDP-1 [477.088465] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [477.099206] Starting dynamic subtest: pipe-B-eDP-1 [477.108038] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [477.116071] Starting dynamic subtest: pipe-C-eDP-1 [477.124879] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [477.132092] Starting dynamic subtest: pipe-D-eDP-1 [477.142070] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [477.143820] Subtest random-ccs-data-y-tiled-gen12-rc-ccs: SKIP (0.005s) [479.315426] [123/133] (545s left) kms_psr (psr-suspend) [479.406622] Starting subtest: psr-suspend [479.407586] Starting dynamic subtest: eDP-1 [497.704447] Dynamic subtest eDP-1: SUCCESS (3.400s) [497.705328] Subtest psr-suspend: SUCCESS (3.401s) [505.580919] [124/133] (525s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-mmap-cpu) [505.691909] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-mmap-cpu [505.693526] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s) [505.805236] [125/133] (525s left) gem_partial_pwrite_pread (writes-after-reads-uncached) [505.854619] Subtest writes-after-reads-uncached: SKIP (0.000s) [505.919888] [126/133] (525s left) kms_cursor_legacy (flip-vs-cursor-legacy) [506.028342] Starting subtest: flip-vs-cursor-legacy [513.312555] Subtest flip-vs-cursor-legacy: SUCCESS (7.271s) [514.130887] [127/133] (517s left) kms_flip_event_leak (basic) [514.213728] Starting subtest: basic [514.214677] Starting dynamic subtest: pipe-A-eDP-1 [514.636521] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.421s) [514.647709] Starting dynamic subtest: pipe-B-eDP-1 [515.728451] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.090s) [515.738221] Starting dynamic subtest: pipe-C-eDP-1 [516.800385] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.070s) [516.810040] Starting dynamic subtest: pipe-D-eDP-1 [517.903106] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.100s) [517.903945] Subtest basic: SUCCESS (3.687s) [518.732462] [128/133] (512s left) kms_async_flips (alternate-sync-async-flip-atomic) [518.823429] Starting subtest: alternate-sync-async-flip-atomic [519.211349] Starting dynamic subtest: pipe-A-eDP-1 [522.001548] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.788s) [522.370562] Starting dynamic subtest: pipe-B-eDP-1 [525.195868] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.832s) [525.576528] Starting dynamic subtest: pipe-C-eDP-1 [528.395135] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.825s) [528.772050] Starting dynamic subtest: pipe-D-eDP-1 [531.604582] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.839s) [531.606873] Subtest alternate-sync-async-flip-atomic: SUCCESS (12.777s) [532.834846] [129/133] (498s left) gem_mmap_gtt (isolation) [532.887524] Subtest isolation: SKIP (0.000s) [532.952366] [130/133] (498s left) gem_ctx_persistence (legacy-engines-hostile-preempt) [533.015527] Starting subtest: legacy-engines-hostile-preempt [533.017054] Starting dynamic subtest: render [533.091150] Dynamic subtest render: SUCCESS (0.075s) [533.104318] Starting dynamic subtest: bsd1 [534.796987] Dynamic subtest bsd1: SUCCESS (1.693s) [534.807998] Starting dynamic subtest: bsd2 [536.843128] Dynamic subtest bsd2: SUCCESS (2.042s) [536.853302] Starting dynamic subtest: blt [536.883445] Dynamic subtest blt: SUCCESS (0.047s) [536.895323] Starting dynamic subtest: vebox [538.829152] Dynamic subtest vebox: SUCCESS (1.934s) [538.830595] Subtest legacy-engines-hostile-preempt: SUCCESS (5.806s) [538.902420] [131/133] (492s left) gem_exec_schedule (promotion) [538.970858] Starting subtest: promotion [538.971808] Starting dynamic subtest: rcs0 [539.144797] Dynamic subtest rcs0: SUCCESS (0.173s) [539.155259] Starting dynamic subtest: vcs0 [539.269510] Dynamic subtest vcs0: SUCCESS (0.123s) [539.283216] Starting dynamic subtest: vcs1 [539.395108] Dynamic subtest vcs1: SUCCESS (0.125s) [539.408902] Starting dynamic subtest: vecs0 [539.519589] Dynamic subtest vecs0: SUCCESS (0.123s) [539.536519] Starting dynamic subtest: ccs0 [539.655228] Dynamic subtest ccs0: SUCCESS (0.133s) [539.656759] Subtest promotion: SUCCESS (0.684s) [540.888641] [132/133] (490s left) syncobj_timeline (invalid-multi-wait-all-unsubmitted-submitted) [540.938852] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted [540.939778] Subtest invalid-multi-wait-all-unsubmitted-submitted: SUCCESS (0.000s) [541.028958] [133/133] (490s left) vgem_basic (create) [541.073118] Starting subtest: create [541.073969] Subtest create: SUCCESS (0.000s) [541.125970] Closing watchdogs results: parsing output: 0/ for test: kms_psr results: parsing output: 1/ for test: syncobj_wait results: parsing output: 2/ for test: kms_atomic_interruptible results: parsing output: 3/ for test: testdisplay results: parsing output: 4/ for test: gem_render_copy results: parsing output: 5/ for test: kms_cursor_legacy results: parsing output: 6/ for test: gem_exec_schedule results: parsing output: 7/ for test: syncobj_wait results: parsing output: 8/ for test: kms_joiner results: parsing output: 9/ for test: gem_eio results: parsing output: 10/ for test: kms_frontbuffer_tracking results: parsing output: 11/ for test: kms_psr results: parsing output: 12/ for test: kms_frontbuffer_tracking results: parsing output: 13/ for test: kms_frontbuffer_tracking results: parsing output: 14/ for test: syncobj_basic results: parsing output: 15/ for test: kms_frontbuffer_tracking results: parsing output: 16/ for test: kms_frontbuffer_tracking results: parsing output: 17/ for test: gem_close results: parsing output: 18/ for test: kms_frontbuffer_tracking results: parsing output: 19/ for test: kms_frontbuffer_tracking results: parsing output: 20/ for test: gem_pwrite_snooped results: parsing output: 21/ for test: kms_big_fb results: parsing output: 22/ for test: gem_watchdog results: parsing output: 23/ for test: kms_selftest results: parsing output: 24/ for test: perf results: parsing output: 25/ for test: kms_content_protection results: parsing output: 26/ for test: kms_busy results: parsing output: 27/ for test: core_hotunplug results: parsing output: 28/ for test: kms_hdmi_inject results: parsing output: 29/ for test: kms_plane_lowres results: parsing output: 30/ for test: kms_ccs results: parsing output: 31/ for test: gem_pxp results: parsing output: 32/ for test: gem_madvise results: parsing output: 33/ for test: gem_mmap_gtt results: parsing output: 34/ for test: kms_psr2_sf results: parsing output: 35/ for test: kms_flip_scaled_crc results: parsing output: 36/ for test: kms_rotation_crc results: parsing output: 37/ for test: kms_prop_blob results: parsing output: 38/ for test: kms_async_flips results: parsing output: 39/ for test: kms_getfb results: parsing output: 40/ for test: gem_exec_schedule results: parsing output: 41/ for test: kms_plane_scaling results: parsing output: 42/ for test: kms_cursor_legacy results: parsing output: 43/ for test: i915_query results: parsing output: 44/ for test: kms_psr2_sf results: parsing output: 45/ for test: kms_psr results: parsing output: 46/ for test: gem_render_copy results: parsing output: 47/ for test: perf_pmu results: parsing output: 48/ for test: kms_pm_dc results: parsing output: 49/ for test: gem_render_tiled_blits results: parsing output: 50/ for test: kms_lease results: parsing output: 51/ for test: kms_frontbuffer_tracking results: parsing output: 52/ for test: perf_pmu results: parsing output: 53/ for test: kms_plane_scaling results: parsing output: 54/ for test: gem_ctx_param results: parsing output: 55/ for test: kms_ccs results: parsing output: 56/ for test: kms_flip results: parsing output: 57/ for test: syncobj_timeline results: parsing output: 58/ for test: kms_big_fb results: parsing output: 59/ for test: syncobj_timeline results: parsing output: 60/ for test: kms_psr results: parsing output: 61/ for test: syncobj_timeline results: parsing output: 62/ for test: kms_frontbuffer_tracking results: parsing output: 63/ for test: kms_feature_discovery results: parsing output: 64/ for test: vgem_basic results: parsing output: 65/ for test: api_intel_allocator results: parsing output: 66/ for test: kms_big_fb results: parsing output: 67/ for test: gem_exec_reloc results: parsing output: 68/ for test: kms_frontbuffer_tracking results: parsing output: 69/ for test: prime_mmap results: parsing output: 70/ for test: kms_pipe_crc_basic results: parsing output: 71/ for test: kms_chamelium_frames results: parsing output: 72/ for test: prime_vgem results: parsing output: 73/ for test: gem_exec_balancer results: parsing output: 74/ for test: kms_ccs results: parsing output: 75/ for test: kms_big_fb results: parsing output: 76/ for test: kms_cursor_crc results: parsing output: 77/ for test: gem_render_copy results: parsing output: 78/ for test: gem_mmap_gtt results: parsing output: 79/ for test: kms_pm_rpm results: parsing output: 80/ for test: kms_frontbuffer_tracking results: parsing output: 81/ for test: api_intel_bb results: parsing output: 82/ for test: kms_frontbuffer_tracking results: parsing output: 83/ for test: kms_plane results: parsing output: 84/ for test: gem_exec_balancer results: parsing output: 85/ for test: kms_flip results: parsing output: 86/ for test: gem_lmem_swapping results: parsing output: 87/ for test: syncobj_wait results: parsing output: 88/ for test: kms_color results: parsing output: 89/ for test: kms_cursor_edge_walk results: parsing output: 90/ for test: i915_pm_rps results: parsing output: 91/ for test: gem_exec_fence results: parsing output: 92/ for test: gem_exec_whisper results: parsing output: 93/ for test: gen7_exec_parse results: parsing output: 94/ for test: gem_mmap_wc results: parsing output: 95/ for test: kms_vblank results: parsing output: 96/ for test: sw_sync results: parsing output: 97/ for test: gem_spin_batch results: parsing output: 98/ for test: kms_frontbuffer_tracking results: parsing output: 99/ for test: kms_rotation_crc results: parsing output: 100/ for test: kms_big_fb results: parsing output: 101/ for test: gem_userptr_blits results: parsing output: 102/ for test: gem_bad_reloc results: parsing output: 103/ for test: kms_flip results: parsing output: 104/ for test: kms_frontbuffer_tracking results: parsing output: 105/ for test: kms_chamelium_hpd results: parsing output: 106/ for test: gem_mmap_gtt results: parsing output: 107/ for test: gem_ctx_sseu results: parsing output: 108/ for test: gem_create results: parsing output: 109/ for test: gem_exec_reloc results: parsing output: 110/ for test: kms_big_fb results: parsing output: 111/ for test: i915_drm_fdinfo results: parsing output: 112/ for test: gem_exec_whisper results: parsing output: 113/ for test: kms_frontbuffer_tracking results: parsing output: 114/ for test: kms_cursor_legacy results: parsing output: 115/ for test: sysfs_timeslice_duration results: parsing output: 116/ for test: syncobj_wait results: parsing output: 117/ for test: kms_cursor_crc results: parsing output: 118/ for test: kms_ccs results: parsing output: 119/ for test: syncobj_timeline results: parsing output: 120/ for test: i915_hangman results: parsing output: 121/ for test: kms_ccs results: parsing output: 122/ for test: kms_psr results: parsing output: 123/ for test: kms_frontbuffer_tracking results: parsing output: 124/ for test: gem_partial_pwrite_pread results: parsing output: 125/ for test: kms_cursor_legacy results: parsing output: 126/ for test: kms_flip_event_leak results: parsing output: 127/ for test: kms_async_flips results: parsing output: 128/ for test: gem_mmap_gtt results: parsing output: 129/ for test: gem_ctx_persistence results: parsing output: 130/ for test: gem_exec_schedule results: parsing output: 131/ for test: syncobj_timeline results: parsing output: 132/ for test: vgem_basic Done.