[56.119424] Initializing watchdogs [56.119574] /dev/watchdog0 [56.138121] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics] [56.142262] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [56.144387] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [56.147818] [001/156] (960s left) syncobj_timeline (wait-for-submit-delayed-submit) [56.235705] Starting subtest: wait-for-submit-delayed-submit [56.339236] Subtest wait-for-submit-delayed-submit: SUCCESS (0.103s) [56.412265] [002/156] (960s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-primscrn-spr-indfb-move) [56.507256] Starting subtest: fbcpsrhdr-1p-primscrn-spr-indfb-move [56.511550] Subtest fbcpsrhdr-1p-primscrn-spr-indfb-move: SKIP (0.000s) [56.604014] [003/156] (960s left) kms_cursor_legacy (torture-move) [56.722112] Starting subtest: torture-move [56.724494] Starting dynamic subtest: pipe-A [62.383288] Dynamic subtest pipe-A: SUCCESS (5.657s) [62.394533] Starting dynamic subtest: pipe-B [69.123541] Dynamic subtest pipe-B: SUCCESS (6.742s) [69.135903] Starting dynamic subtest: pipe-C [75.667797] Dynamic subtest pipe-C: SUCCESS (6.544s) [75.678309] Starting dynamic subtest: pipe-D [82.443145] Dynamic subtest pipe-D: SUCCESS (6.772s) [82.455607] Starting dynamic subtest: all-pipes [88.742494] Dynamic subtest all-pipes: SUCCESS (6.299s) [88.744779] Subtest torture-move: SUCCESS (32.018s) [88.907190] [004/156] (927s left) syncobj_wait (signal) [88.955084] Starting subtest: signal [88.957110] Subtest signal: SUCCESS (0.000s) [89.039953] [005/156] (927s left) kms_frontbuffer_tracking (hdr-2p-primscrn-spr-indfb-draw-pwrite) [89.140290] Starting subtest: hdr-2p-primscrn-spr-indfb-draw-pwrite [89.144416] Subtest hdr-2p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s) [89.228043] [006/156] (927s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-pwrite) [89.324688] Starting subtest: psr-2p-primscrn-spr-indfb-draw-pwrite [89.329052] Subtest psr-2p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s) [89.435202] [007/156] (927s left) gem_exec_schedule (noreorder-priority) [89.615508] Starting subtest: noreorder-priority [89.618426] Starting dynamic subtest: rcs0 [90.757269] Dynamic subtest rcs0: SUCCESS (1.141s) [90.771108] Starting dynamic subtest: vcs0 [92.299871] Dynamic subtest vcs0: SUCCESS (1.540s) [92.311173] Starting dynamic subtest: vcs1 [94.280186] Dynamic subtest vcs1: SUCCESS (1.980s) [94.289472] Starting dynamic subtest: vecs0 [96.327419] Dynamic subtest vecs0: SUCCESS (2.046s) [96.341548] Starting dynamic subtest: ccs0 [97.470096] Dynamic subtest ccs0: SUCCESS (1.143s) [97.473076] Subtest noreorder-priority: SUCCESS (7.854s) [97.652885] [008/156] (919s left) gem_mmap_wc (read-write-distinct) [97.717523] Subtest read-write-distinct: SKIP (0.000s) [97.768524] [009/156] (919s left) kms_draw_crc (draw-method-mmap-wc) [97.866807] Starting subtest: draw-method-mmap-wc [97.869057] Starting dynamic subtest: xrgb8888-untiled [98.125130] Dynamic subtest xrgb8888-untiled: SUCCESS (0.259s) [98.134597] Starting dynamic subtest: rgb565-untiled [98.346843] Dynamic subtest rgb565-untiled: SUCCESS (0.221s) [98.355895] Starting dynamic subtest: xrgb2101010-untiled [98.569582] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.222s) [98.578905] Starting dynamic subtest: xbgr16161616f-untiled [98.791331] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.222s) [98.799353] Starting dynamic subtest: xrgb8888-xtiled [98.937478] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.144s) [98.944672] Starting dynamic subtest: rgb565-xtiled [99.080490] Dynamic subtest rgb565-xtiled: SUCCESS (0.144s) [99.090541] Starting dynamic subtest: xrgb2101010-xtiled [99.202293] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.122s) [99.211210] Starting dynamic subtest: xbgr16161616f-xtiled [99.335309] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (0.132s) [99.344689] Starting dynamic subtest: xrgb8888-4tiled [99.502215] Dynamic subtest xrgb8888-4tiled: SUCCESS (0.167s) [99.510997] Starting dynamic subtest: rgb565-4tiled [99.646540] Dynamic subtest rgb565-4tiled: SUCCESS (0.143s) [99.655254] Starting dynamic subtest: xrgb2101010-4tiled [99.802106] Dynamic subtest xrgb2101010-4tiled: SUCCESS (0.155s) [99.811277] Starting dynamic subtest: xbgr16161616f-4tiled [99.968943] Dynamic subtest xbgr16161616f-4tiled: SUCCESS (0.166s) [99.970913] Subtest draw-method-mmap-wc: SUCCESS (2.104s) [100.068686] [010/156] (916s left) kms_properties (colorop-properties-atomic) [100.160148] Starting subtest: colorop-properties-atomic [100.161737] Starting dynamic subtest: pipe-A-eDP-1 [100.547100] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.387s) [100.559317] Starting dynamic subtest: pipe-B-eDP-1 [101.648274] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.100s) [101.658257] Starting dynamic subtest: pipe-C-eDP-1 [102.698621] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.048s) [102.708628] Starting dynamic subtest: pipe-D-eDP-1 [103.823441] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.127s) [103.825779] Subtest colorop-properties-atomic: SUCCESS (3.665s) [104.638956] [011/156] (912s left) gem_mmap_offset (mmap-unmap) [104.700061] Starting subtest: mmap-unmap [104.702560] Starting dynamic subtest: smem0 [128.367292] Dynamic subtest smem0: SUCCESS (23.667s) [128.369878] Subtest mmap-unmap: SUCCESS (23.668s) [128.472612] [012/156] (888s left) kms_frontbuffer_tracking (fbchdr-2p-scndscrn-cur-indfb-draw-mmap-wc) [128.574625] Starting subtest: fbchdr-2p-scndscrn-cur-indfb-draw-mmap-wc [128.579206] Subtest fbchdr-2p-scndscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s) [128.678753] [013/156] (888s left) kms_frontbuffer_tracking (psrhdr-1p-primscrn-pri-shrfb-draw-mmap-gtt) [128.775290] Starting subtest: psrhdr-1p-primscrn-pri-shrfb-draw-mmap-gtt [128.779636] Subtest psrhdr-1p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s) [128.887590] [014/156] (888s left) kms_frontbuffer_tracking (psrhdr-1p-offscreen-pri-indfb-draw-mmap-cpu) [128.989825] Starting subtest: psrhdr-1p-offscreen-pri-indfb-draw-mmap-cpu [128.994295] Subtest psrhdr-1p-offscreen-pri-indfb-draw-mmap-cpu: SKIP (0.000s) [129.104750] [015/156] (888s left) i915_getparams_basic (basic-subslice-total) [129.158978] Starting subtest: basic-subslice-total [129.163708] Subtest basic-subslice-total: SUCCESS (0.000s) [129.251668] [016/156] (887s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-mmap-gtt) [129.349865] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-mmap-gtt [129.353805] Subtest fbc-1p-offscreen-pri-indfb-draw-mmap-gtt: SKIP (0.000s) [129.450757] [017/156] (887s left) testdisplay [129.752918] [018/156] (887s left) kms_frontbuffer_tracking (fbchdr-2p-scndscrn-spr-indfb-move) [129.855224] Starting subtest: fbchdr-2p-scndscrn-spr-indfb-move [129.859184] Subtest fbchdr-2p-scndscrn-spr-indfb-move: SKIP (0.000s) [129.949745] [019/156] (887s left) syncobj_timeline (etime-multi-wait-all-for-submit-available-unsubmitted) [130.009924] Starting subtest: etime-multi-wait-all-for-submit-available-unsubmitted [130.113974] Subtest etime-multi-wait-all-for-submit-available-unsubmitted: SUCCESS (0.102s) [130.196391] [020/156] (887s left) gem_pxp (regular-baseline-src-copy-readible) [130.311956] Starting subtest: regular-baseline-src-copy-readible [130.370304] Subtest regular-baseline-src-copy-readible: SUCCESS (0.060s) [130.481983] [021/156] (886s left) kms_ccs (bad-rotation-90-y-tiled-gen12-mc-ccs) [130.580693] Starting subtest: bad-rotation-90-y-tiled-gen12-mc-ccs [130.583074] Starting dynamic subtest: pipe-A-eDP-1 [130.605654] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [130.616511] Starting dynamic subtest: pipe-B-eDP-1 [130.638081] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [130.645383] Starting dynamic subtest: pipe-C-eDP-1 [130.667039] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [130.674412] Starting dynamic subtest: pipe-D-eDP-1 [130.696309] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [130.700734] Subtest bad-rotation-90-y-tiled-gen12-mc-ccs: SKIP (0.003s) [132.892629] [022/156] (884s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-mmap-gtt) [132.998847] Starting subtest: fbcpsr-rgb101010-draw-mmap-gtt [133.003217] Subtest fbcpsr-rgb101010-draw-mmap-gtt: SKIP (0.000s) [133.092065] [023/156] (884s left) gem_exec_schedule (semaphore-user) [133.170070] Starting subtest: semaphore-user [133.221367] Subtest semaphore-user: SUCCESS (0.058s) [134.331188] [024/156] (883s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-render) [134.428469] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-render [134.433292] Subtest fbc-2p-scndscrn-spr-indfb-draw-render: SKIP (0.000s) [134.544726] [025/156] (883s left) perf (enable-disable) [134.661679] Starting subtest: enable-disable [134.663937] Starting dynamic subtest: 0-rcs0 [136.929737] Dynamic subtest 0-rcs0: SUCCESS (2.268s) [136.940648] Starting dynamic subtest: 1-vecs0 [141.415110] Dynamic subtest 1-vecs0: SUCCESS (4.485s) [141.417630] Subtest enable-disable: SUCCESS (6.754s) [141.461256] [026/156] (876s left) kms_lease (lease-invalid-crtc) [141.559590] Starting subtest: lease-invalid-crtc [141.562222] Starting dynamic subtest: pipe-A-eDP-1 [141.564295] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s) [141.574675] Starting dynamic subtest: pipe-B-eDP-1 [141.576947] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s) [141.584640] Starting dynamic subtest: pipe-C-eDP-1 [141.586543] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s) [141.593704] Starting dynamic subtest: pipe-D-eDP-1 [141.595627] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s) [141.597525] Subtest lease-invalid-crtc: SUCCESS (0.002s) [141.631239] [027/156] (875s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-move) [141.732450] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-move [149.290694] Subtest fbcpsr-1p-primscrn-cur-indfb-move: SUCCESS (7.565s) [149.449970] [028/156] (868s left) gem_exec_fence (syncobj-invalid-wait) [149.920479] Starting subtest: syncobj-invalid-wait [149.922855] Subtest syncobj-invalid-wait: SUCCESS (0.000s) [151.398321] [FACT gem_exec_fence (syncobj-invalid-wait)] new: kernel.kmod_is_loaded.vgem: true [151.401878] [029/156] (866s left) kms_cursor_crc (cursor-rapid-movement-128x42) [151.619663] Starting subtest: cursor-rapid-movement-128x42 [151.669448] Subtest cursor-rapid-movement-128x42: SKIP (0.045s) [151.867552] [030/156] (865s left) kms_addfb_basic (basic) [151.920053] Starting subtest: basic [151.921928] Subtest basic: SUCCESS (0.000s) [152.045520] [031/156] (865s left) kms_addfb_basic (invalid-get-prop-any) [152.097947] Starting subtest: invalid-get-prop-any [152.100108] Subtest invalid-get-prop-any: SUCCESS (0.000s) [152.247635] [032/156] (865s left) kms_frontbuffer_tracking (psrhdr-2p-primscrn-pri-shrfb-draw-mmap-cpu) [152.343284] Starting subtest: psrhdr-2p-primscrn-pri-shrfb-draw-mmap-cpu [152.346994] Subtest psrhdr-2p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s) [152.442549] [033/156] (865s left) kms_pm_rpm (i2c) [154.479645] Starting subtest: i2c [159.508150] Subtest i2c: SUCCESS (5.031s) [159.642844] [034/156] (858s left) gem_mmap_gtt (basic-write-read-distinct) [159.696773] Subtest basic-write-read-distinct: SKIP (0.000s) [159.750983] [035/156] (858s left) gem_exec_schedule (smoketest-all) [159.812445] Starting subtest: smoketest-all [192.183641] Subtest smoketest-all: SUCCESS (32.326s) [193.330392] [036/156] (824s left) kms_frontbuffer_tracking (fbchdr-1p-primscrn-pri-shrfb-draw-pwrite) [193.434423] Starting subtest: fbchdr-1p-primscrn-pri-shrfb-draw-pwrite [193.438432] Subtest fbchdr-1p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s) [193.536996] [037/156] (824s left) fbdev (eof) [193.587674] Starting subtest: eof [193.595528] Subtest eof: SUCCESS (0.000s) [193.651835] [038/156] (824s left) core_setmaster (master-drop-set-shared-fd) [193.740233] Starting subtest: master-drop-set-shared-fd [193.764174] Subtest master-drop-set-shared-fd: SUCCESS (0.022s) [193.809736] [039/156] (824s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-shrfb-pgflip-blt) [193.902289] Starting subtest: fbcpsr-1p-primscrn-shrfb-pgflip-blt [201.272252] Subtest fbcpsr-1p-primscrn-shrfb-pgflip-blt: SUCCESS (7.374s) [201.417841] [040/156] (816s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-offscreen-pri-shrfb-draw-mmap-gtt) [201.524818] Starting subtest: fbcpsrhdr-1p-offscreen-pri-shrfb-draw-mmap-gtt [201.529422] Subtest fbcpsrhdr-1p-offscreen-pri-shrfb-draw-mmap-gtt: SKIP (0.000s) [201.616148] [041/156] (816s left) kms_frontbuffer_tracking (fbchdr-rgb101010-draw-mmap-wc) [201.723237] Starting subtest: fbchdr-rgb101010-draw-mmap-wc [201.727896] Subtest fbchdr-rgb101010-draw-mmap-wc: SKIP (0.000s) [201.810274] [042/156] (816s left) gem_lmem_swapping (massive-random) [201.850859] Subtest massive-random: SKIP (0.000s) [201.894447] [043/156] (816s left) kms_busy (extended-modeset-hang-newfb) [201.998672] Starting subtest: extended-modeset-hang-newfb [202.001069] Starting dynamic subtest: pipe-A [236.278357] Dynamic subtest pipe-A: SUCCESS (34.276s) [236.288563] Starting dynamic subtest: pipe-D [259.227181] Dynamic subtest pipe-D: SUCCESS (22.949s) [259.230113] Subtest extended-modeset-hang-newfb: SUCCESS (57.231s) [260.122831] [044/156] (758s left) vgem_basic (create) [260.170605] Starting subtest: create [260.241327] Subtest create: FAIL (0.034s) [260.278567] [045/156] (758s left) kms_selftest (drm_dp_mst_helper) [260.315117] Starting subtest: drm_dp_mst_helper [260.361090] Starting dynamic subtest: drm_test_dp_mst_calc_pbn_mode [260.454620] Dynamic subtest drm_test_dp_mst_calc_pbn_mode: SUCCESS (0.093s) [260.463065] Starting dynamic subtest: drm_test_dp_mst_calc_pbn_div [260.544451] Dynamic subtest drm_test_dp_mst_calc_pbn_div: SUCCESS (0.089s) [260.552684] Starting dynamic subtest: drm_test_dp_mst_sideband_msg_req_decode [260.686070] Dynamic subtest drm_test_dp_mst_sideband_msg_req_decode: SUCCESS (0.141s) [260.688316] Subtest drm_dp_mst_helper: SUCCESS (0.371s) [260.879585] [046/156] (757s left) kms_vblank (wait-forked-busy) [260.965962] Starting subtest: wait-forked-busy [260.968239] Starting dynamic subtest: pipe-A-eDP-1 [262.850845] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.884s) [262.864010] Starting dynamic subtest: pipe-D-eDP-1 [265.481213] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.627s) [265.483552] Subtest wait-forked-busy: SUCCESS (4.514s) [266.378979] [047/156] (752s left) gem_workarounds (suspend-resume) [266.437497] Starting subtest: suspend-resume [282.602084] Subtest suspend-resume: SUCCESS (1.272s) [282.740157] [048/156] (735s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-render) [282.849696] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-render [286.592715] Subtest fbc-1p-primscrn-spr-indfb-draw-render: SUCCESS (3.751s) [287.793961] [049/156] (730s left) kms_plane (pixel-format-linear-modifier) [287.877697] Starting subtest: pixel-format-linear-modifier [287.903786] Starting dynamic subtest: pipe-A-plane-0 [288.448587] Dynamic subtest pipe-A-plane-0: SUCCESS (0.544s) [288.461571] Starting dynamic subtest: pipe-A-plane-3 [288.881228] Dynamic subtest pipe-A-plane-3: SUCCESS (0.433s) [288.890969] Starting dynamic subtest: pipe-A-plane-5 [289.092927] Dynamic subtest pipe-A-plane-5: SUCCESS (0.211s) [290.174809] Starting dynamic subtest: pipe-B-plane-0 [290.788880] Dynamic subtest pipe-B-plane-0: SUCCESS (0.622s) [290.800062] Starting dynamic subtest: pipe-B-plane-3 [291.221471] Dynamic subtest pipe-B-plane-3: SUCCESS (0.432s) [291.234864] Starting dynamic subtest: pipe-B-plane-5 [291.432777] Dynamic subtest pipe-B-plane-5: SUCCESS (0.210s) [291.744523] Subtest pixel-format-linear-modifier: SUCCESS (3.866s) [292.557527] [050/156] (725s left) gem_close (basic) [292.619457] Starting subtest: basic [292.621603] Subtest basic: SUCCESS (0.000s) [292.730286] [051/156] (725s left) kms_plane_scaling (planes-downscale-factor-0-5-upscale-factor-0-25) [292.826694] Starting subtest: planes-downscale-factor-0-5-upscale-factor-0-25 [292.829035] Starting dynamic subtest: pipe-A [292.849495] Dynamic subtest pipe-A: SKIP (0.018s) [292.859996] Starting dynamic subtest: pipe-B [292.882323] Dynamic subtest pipe-B: SKIP (0.032s) [292.892207] Starting dynamic subtest: pipe-C [292.915164] Dynamic subtest pipe-C: SKIP (0.032s) [292.924579] Starting dynamic subtest: pipe-D [292.946889] Dynamic subtest pipe-D: SKIP (0.032s) [292.950918] Subtest planes-downscale-factor-0-5-upscale-factor-0-25: SKIP (0.117s) [293.039890] [052/156] (725s left) kms_ccs (crc-sprite-planes-basic-y-tiled-gen12-mc-ccs) [293.127583] Starting subtest: crc-sprite-planes-basic-y-tiled-gen12-mc-ccs [293.129855] Starting dynamic subtest: pipe-A-eDP-1 [293.187861] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s) [293.197164] Starting dynamic subtest: pipe-B-eDP-1 [293.254451] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s) [293.265272] Starting dynamic subtest: pipe-C-eDP-1 [293.323554] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s) [293.336639] Starting dynamic subtest: pipe-D-eDP-1 [293.392604] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s) [293.396695] Subtest crc-sprite-planes-basic-y-tiled-gen12-mc-ccs: SKIP (0.008s) [295.405640] [053/156] (723s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-render) [295.508632] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-render [295.512877] Subtest fbc-2p-scndscrn-cur-indfb-draw-render: SKIP (0.000s) [295.600599] [054/156] (723s left) gem_exec_gttfill (engines) [295.661173] Starting subtest: engines [295.663650] Starting dynamic subtest: rcs0 [318.404992] Dynamic subtest rcs0: SUCCESS (22.741s) [318.415034] Starting dynamic subtest: bcs0 [341.692566] Dynamic subtest bcs0: SUCCESS (23.286s) [341.705911] Starting dynamic subtest: vcs0 [364.970490] Dynamic subtest vcs0: SUCCESS (23.274s) [364.980733] Starting dynamic subtest: vcs1 [388.218945] Dynamic subtest vcs1: SUCCESS (23.245s) [388.229452] Starting dynamic subtest: vecs0 [411.518777] Dynamic subtest vecs0: SUCCESS (23.296s) [411.529151] Starting dynamic subtest: ccs0 [434.787347] Dynamic subtest ccs0: SUCCESS (23.266s) [434.789643] Subtest engines: SUCCESS (139.117s) [434.997156] [055/156] (583s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-draw-mmap-gtt) [435.156453] Starting subtest: psr-2p-primscrn-cur-indfb-draw-mmap-gtt [435.160460] Subtest psr-2p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s) [435.256202] [056/156] (583s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-onoff) [435.366838] Starting subtest: psr-2p-scndscrn-cur-indfb-onoff [435.371407] Subtest psr-2p-scndscrn-cur-indfb-onoff: SKIP (0.000s) [435.458926] [057/156] (583s left) gem_eio (in-flight-internal-10ms) [435.703863] Starting subtest: in-flight-internal-10ms [437.242741] Subtest in-flight-internal-10ms: SUCCESS (1.540s) [437.370613] [058/156] (581s left) gem_exec_params (rel-constants-invalid) [437.438978] Starting subtest: rel-constants-invalid [437.441284] Subtest rel-constants-invalid: SUCCESS (0.000s) [437.537787] [059/156] (581s left) kms_frontbuffer_tracking (hdr-1p-primscrn-pri-indfb-draw-pwrite) [437.633582] Starting subtest: hdr-1p-primscrn-pri-indfb-draw-pwrite [437.637958] Subtest hdr-1p-primscrn-pri-indfb-draw-pwrite: SKIP (0.000s) [437.712283] [060/156] (581s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-move) [437.801831] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-move [437.806092] Subtest fbcpsr-2p-scndscrn-cur-indfb-move: SKIP (0.000s) [437.906536] [061/156] (581s left) kms_psr (fbc-psr2-cursor-mmap-gtt) [437.992641] Starting subtest: fbc-psr2-cursor-mmap-gtt [437.994893] Starting dynamic subtest: eDP-1 [437.998995] Dynamic subtest eDP-1: SKIP (0.000s) [438.003118] Subtest fbc-psr2-cursor-mmap-gtt: SKIP (0.001s) [438.068683] [062/156] (580s left) gen9_exec_parse (bb-secure) [438.124497] Subtest bb-secure: SKIP (0.000s) [438.197605] [063/156] (580s left) i915_drm_fdinfo (all-busy-idle-check-all) [438.233187] Starting subtest: all-busy-idle-check-all [438.238959] Subtest all-busy-idle-check-all: SKIP (0.004s) [438.298913] [064/156] (580s left) syncobj_basic (bad-destroy-pad) [438.389735] Starting subtest: bad-destroy-pad [438.391834] Subtest bad-destroy-pad: SUCCESS (0.000s) [438.511622] [065/156] (580s left) kms_properties (get_properties-sanity-atomic) [438.604258] Starting subtest: get_properties-sanity-atomic [438.606090] Subtest get_properties-sanity-atomic: SUCCESS (0.002s) [438.683254] [066/156] (580s left) kms_cursor_legacy (cursorb-vs-flipb-atomic-transitions-varying-size) [438.807930] Starting subtest: cursorB-vs-flipB-atomic-transitions-varying-size [438.811715] Subtest cursorB-vs-flipB-atomic-transitions-varying-size: SKIP (0.001s) [438.958160] [067/156] (580s left) perf_pmu (busy) [438.999167] Starting subtest: busy [439.001072] Starting dynamic subtest: rcs0 [439.592636] Dynamic subtest rcs0: SUCCESS (0.592s) [439.605728] Starting dynamic subtest: bcs0 [440.153841] Dynamic subtest bcs0: SUCCESS (0.559s) [440.166531] Starting dynamic subtest: vcs0 [442.225181] Dynamic subtest vcs0: SUCCESS (2.068s) [442.239645] Starting dynamic subtest: vcs1 [444.209321] Dynamic subtest vcs1: SUCCESS (1.981s) [444.223854] Starting dynamic subtest: vecs0 [446.192848] Dynamic subtest vecs0: SUCCESS (1.980s) [446.207751] Starting dynamic subtest: ccs0 [446.770192] Dynamic subtest ccs0: SUCCESS (0.576s) [446.773048] Subtest busy: SUCCESS (7.770s) [446.901721] [068/156] (572s left) kms_frontbuffer_tracking (psrhdr-2p-scndscrn-cur-indfb-draw-mmap-wc) [447.005392] Starting subtest: psrhdr-2p-scndscrn-cur-indfb-draw-mmap-wc [447.009562] Subtest psrhdr-2p-scndscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s) [447.104667] [069/156] (572s left) kms_cursor_legacy (cursora-vs-flipa-legacy) [447.219248] Starting subtest: cursorA-vs-flipA-legacy [458.391234] Subtest cursorA-vs-flipA-legacy: SUCCESS (11.169s) [459.244855] [070/156] (560s left) i915_selftest (mock) [463.804247] Starting subtest: mock [463.808678] Starting dynamic subtest: sanitycheck [464.494996] Dynamic subtest sanitycheck: SUCCESS (0.694s) [464.506126] Starting dynamic subtest: shmem [465.174031] Dynamic subtest shmem: SUCCESS (0.677s) [465.184875] Starting dynamic subtest: fence [473.350941] Dynamic subtest fence: SUCCESS (8.174s) [473.361410] Starting dynamic subtest: scatterlist [475.025786] Dynamic subtest scatterlist: SUCCESS (1.673s) [475.036497] Starting dynamic subtest: syncmap [478.248680] Dynamic subtest syncmap: SUCCESS (3.221s) [478.260086] Starting dynamic subtest: uncore [478.914434] Dynamic subtest uncore: SUCCESS (0.664s) [478.925458] Starting dynamic subtest: ring [479.595177] Dynamic subtest ring: SUCCESS (0.679s) [479.604808] Starting dynamic subtest: engine [480.287285] Dynamic subtest engine: SUCCESS (0.690s) [480.297152] Starting dynamic subtest: timelines [484.135481] Dynamic subtest timelines: SUCCESS (3.845s) [484.147443] Starting dynamic subtest: requests [487.980075] Dynamic subtest requests: SUCCESS (3.843s) [487.990648] Starting dynamic subtest: objects [488.753713] Dynamic subtest objects: SUCCESS (0.772s) [488.764831] Starting dynamic subtest: phys [489.512742] Dynamic subtest phys: SUCCESS (0.758s) [489.523687] Starting dynamic subtest: dmabuf [490.272713] Dynamic subtest dmabuf: SUCCESS (0.759s) [490.283677] Starting dynamic subtest: vma [495.938597] Dynamic subtest vma: SUCCESS (5.663s) [495.949552] Starting dynamic subtest: evict [497.379588] Dynamic subtest evict: SUCCESS (1.440s) [497.390724] Starting dynamic subtest: gtt [500.738774] Dynamic subtest gtt: SUCCESS (3.358s) [500.749914] Starting dynamic subtest: hugepages [501.654191] Dynamic subtest hugepages: SUCCESS (0.914s) [501.665491] Starting dynamic subtest: memory_region [504.075880] Dynamic subtest memory_region: SUCCESS (2.420s) [504.078425] Subtest mock: SUCCESS (40.272s) [504.105627] [FACT i915_selftest (mock)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [504.106304] [FACT i915_selftest (mock)] deleted: kernel.kmod_is_loaded.i915: true [504.109164] [071/156] (515s left) kms_frontbuffer_tracking (fbchdr-1p-offscreen-pri-indfb-draw-blt) [505.708115] Starting subtest: fbchdr-1p-offscreen-pri-indfb-draw-blt [505.712178] Subtest fbchdr-1p-offscreen-pri-indfb-draw-blt: SKIP (0.000s) [505.818258] [FACT kms_frontbuffer_tracking (fbchdr-1p-offscreen-pri-indfb-draw-blt)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [505.819498] [FACT kms_frontbuffer_tracking (fbchdr-1p-offscreen-pri-indfb-draw-blt)] new: kernel.kmod_is_loaded.i915: true [505.823252] [072/156] (513s left) kms_psr (psr2-cursor-mmap-cpu) [505.924630] Starting subtest: psr2-cursor-mmap-cpu [505.926960] Starting dynamic subtest: eDP-1 [507.599281] Dynamic subtest eDP-1: SUCCESS (1.674s) [507.601471] Subtest psr2-cursor-mmap-cpu: SUCCESS (1.675s) [508.506490] [073/156] (510s left) i915_pm_rps (fence-order) [508.560771] Starting subtest: fence-order [511.436967] Subtest fence-order: SUCCESS (2.873s) [511.552807] [074/156] (507s left) gem_ctx_persistence (heartbeat-hang) [511.614293] Starting subtest: heartbeat-hang [511.619727] Subtest heartbeat-hang: SKIP (0.000s) [511.730410] [075/156] (507s left) gem_pread (bench) [511.801300] Subtest bench: SKIP (0.000s) [511.876839] [076/156] (507s left) syncobj_timeline (invalid-multi-wait-unsubmitted-signaled) [511.931230] Starting subtest: invalid-multi-wait-unsubmitted-signaled [511.933505] Subtest invalid-multi-wait-unsubmitted-signaled: SUCCESS (0.000s) [512.049841] [077/156] (507s left) kms_plane (pixel-format-4-tiled-modifier) [512.143702] Starting subtest: pixel-format-4-tiled-modifier [512.170591] Starting dynamic subtest: pipe-A-plane-0 [512.569890] Dynamic subtest pipe-A-plane-0: SUCCESS (0.399s) [512.580564] Starting dynamic subtest: pipe-A-plane-3 [512.902545] Dynamic subtest pipe-A-plane-3: SUCCESS (0.333s) [512.912019] Starting dynamic subtest: pipe-A-plane-5 [512.915873] Dynamic subtest pipe-A-plane-5: SKIP (0.000s) [513.995469] Starting dynamic subtest: pipe-B-plane-0 [514.386926] Dynamic subtest pipe-B-plane-0: SUCCESS (0.400s) [514.397402] Starting dynamic subtest: pipe-B-plane-3 [514.698195] Dynamic subtest pipe-B-plane-3: SUCCESS (0.311s) [514.709836] Starting dynamic subtest: pipe-B-plane-5 [514.714521] Dynamic subtest pipe-B-plane-5: SKIP (0.000s) [515.014116] Subtest pixel-format-4-tiled-modifier: SUCCESS (2.870s) [515.872213] [078/156] (503s left) kms_frontbuffer_tracking (fbc-1p-primscrn-indfb-plflip-blt) [515.973623] Starting subtest: fbc-1p-primscrn-indfb-plflip-blt [520.564134] Subtest fbc-1p-primscrn-indfb-plflip-blt: SUCCESS (4.596s) [521.685059] [079/156] (498s left) kms_async_flips (alternate-sync-async-flip) [521.794170] Starting subtest: alternate-sync-async-flip [522.166091] Starting dynamic subtest: pipe-A-eDP-1 [524.964378] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.800s) [525.344179] Starting dynamic subtest: pipe-B-eDP-1 [528.094138] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.762s) [528.479869] Starting dynamic subtest: pipe-C-eDP-1 [531.229200] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.761s) [531.601978] Starting dynamic subtest: pipe-D-eDP-1 [534.358062] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.765s) [534.359997] Subtest alternate-sync-async-flip: SUCCESS (12.566s) [535.527309] [080/156] (484s left) api_intel_bb (full-batch) [535.586520] Starting subtest: full-batch [535.592244] Subtest full-batch: SUCCESS (0.005s) [535.705214] [081/156] (484s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-0-async-flip) [535.810674] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-0-async-flip [535.815066] Subtest y-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SKIP (0.000s) [535.924574] [082/156] (483s left) gem_exec_capture (capture) [535.997652] Starting subtest: capture [535.999835] Starting dynamic subtest: rcs0-smem [536.833518] Dynamic subtest rcs0-smem: SUCCESS (0.836s) [536.846725] Starting dynamic subtest: bcs0-smem [538.161446] Dynamic subtest bcs0-smem: SUCCESS (1.326s) [538.173653] Starting dynamic subtest: vcs0-smem [538.977190] Dynamic subtest vcs0-smem: SUCCESS (0.813s) [538.994365] Starting dynamic subtest: vcs1-smem [539.795541] Dynamic subtest vcs1-smem: SUCCESS (0.816s) [539.805837] Starting dynamic subtest: vecs0-smem [541.192668] Dynamic subtest vecs0-smem: FAIL (1.339s) [541.205982] Starting dynamic subtest: ccs0-smem [542.458210] Dynamic subtest ccs0-smem: SUCCESS (1.323s) [542.460488] Subtest capture: FAIL (6.459s) [542.567522] [083/156] (477s left) kms_ccs (crc-primary-rotation-180-4-tiled-lnl-ccs) [542.662726] Starting subtest: crc-primary-rotation-180-4-tiled-lnl-ccs [542.667277] Subtest crc-primary-rotation-180-4-tiled-lnl-ccs: SKIP (0.000s) [543.760223] [084/156] (476s left) kms_flip_scaled_crc (flip-64bpp-linear-to-16bpp-linear-downscaling) [543.858782] Starting subtest: flip-64bpp-linear-to-16bpp-linear-downscaling [543.861237] Starting dynamic subtest: pipe-A-default-mode [545.020207] Dynamic subtest pipe-A-default-mode: SKIP (1.161s) [545.024775] Subtest flip-64bpp-linear-to-16bpp-linear-downscaling: SKIP (1.162s) [545.166993] [085/156] (474s left) gem_mmap_wc (write-cpu-read-wc-unflushed) [545.221371] Subtest write-cpu-read-wc-unflushed: SKIP (0.000s) [545.282530] [086/156] (474s left) gem_eio (create-ext) [545.464447] Starting subtest: create-ext [545.716411] Subtest create-ext: SUCCESS (0.252s) [545.862693] [087/156] (474s left) kms_cursor_legacy (cursor-vs-flip-varying-size) [545.990875] Starting subtest: cursor-vs-flip-varying-size [577.131642] Subtest cursor-vs-flip-varying-size: SUCCESS (31.138s) [578.023249] [088/156] (442s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-primscrn-indfb-pgflip-blt) [578.119984] Starting subtest: fbcpsrhdr-1p-primscrn-indfb-pgflip-blt [578.123953] Subtest fbcpsrhdr-1p-primscrn-indfb-pgflip-blt: SKIP (0.000s) [578.214714] [089/156] (441s left) gem_exec_flush (basic-wb-ro-before-default) [578.273609] Starting subtest: basic-wb-ro-before-default [583.725520] Subtest basic-wb-ro-before-default: SUCCESS (5.453s) [583.924763] [090/156] (436s left) api_intel_allocator (alloc-simple) [583.980358] Starting subtest: alloc-simple [583.982976] Subtest alloc-simple: SUCCESS (0.006s) [584.115104] [091/156] (436s left) kms_pm_rpm (pm-caching) [586.345234] Starting subtest: pm-caching [586.350127] Subtest pm-caching: SKIP (0.000s) [586.759511] [092/156] (433s left) kms_atomic_transition (plane-primary-toggle-with-vblank-wait) [586.854719] Starting subtest: plane-primary-toggle-with-vblank-wait [586.857102] Starting dynamic subtest: pipe-A-eDP-1 [587.027923] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.174s) [587.342555] Starting dynamic subtest: pipe-B-eDP-1 [588.239330] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.906s) [588.539469] Subtest plane-primary-toggle-with-vblank-wait: SUCCESS (1.684s) [589.397368] [093/156] (430s left) gem_workarounds (basic-read-fd) [589.462436] Starting subtest: basic-read-fd [589.477080] Subtest basic-read-fd: SUCCESS (0.015s) [589.608839] [094/156] (430s left) kms_psr (fbc-psr-primary-mmap-cpu) [589.708598] Starting subtest: fbc-psr-primary-mmap-cpu [589.710884] Starting dynamic subtest: eDP-1 [589.715113] Dynamic subtest eDP-1: SKIP (0.000s) [589.719445] Subtest fbc-psr-primary-mmap-cpu: SKIP (0.001s) [589.782077] [095/156] (430s left) perf_pmu (pmu-read) [589.821108] Starting subtest: pmu-read [589.823454] Subtest pmu-read: SUCCESS (0.002s) [589.923240] [096/156] (430s left) kms_pm_backlight (basic-brightness) [590.026270] Starting subtest: basic-brightness [590.077100] Starting dynamic subtest: eDP-1 [590.601477] Dynamic subtest eDP-1: SUCCESS (0.526s) [590.603937] Subtest basic-brightness: SUCCESS (0.576s) [591.441993] [097/156] (429s left) syncobj_timeline (multi-wait-for-submit-submitted-signaled) [591.489341] Starting subtest: multi-wait-for-submit-submitted-signaled [591.491464] Subtest multi-wait-for-submit-submitted-signaled: SUCCESS (0.000s) [591.591689] [098/156] (428s left) gem_ctx_param (invalid-get-engines) [591.646746] Starting subtest: invalid-get-engines [591.649257] Subtest invalid-get-engines: SUCCESS (0.002s) [591.778807] [099/156] (428s left) kms_getfb (getfb-handle-valid) [591.874838] Starting subtest: getfb-handle-valid [591.877151] Subtest getfb-handle-valid: SUCCESS (0.000s) [591.968332] [100/156] (428s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-scndscrn-pri-shrfb-draw-mmap-gtt) [592.072003] Starting subtest: fbcpsrhdr-2p-scndscrn-pri-shrfb-draw-mmap-gtt [592.076402] Subtest fbcpsrhdr-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s) [592.191300] [101/156] (428s left) syncobj_wait (invalid-signal-illegal-handle) [592.250065] Starting subtest: invalid-signal-illegal-handle [592.252216] Subtest invalid-signal-illegal-handle: SUCCESS (0.000s) [592.344016] [102/156] (428s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-primscrn-spr-indfb-draw-mmap-wc) [592.431582] Starting subtest: fbcpsrhdr-2p-primscrn-spr-indfb-draw-mmap-wc [592.435168] Subtest fbcpsrhdr-2p-primscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s) [592.520878] [103/156] (428s left) kms_universal_plane (cursor-fb-leak) [592.607050] Starting subtest: cursor-fb-leak [592.608591] Starting dynamic subtest: pipe-A-eDP-1 [592.937260] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.331s) [592.953139] Starting dynamic subtest: pipe-B-eDP-1 [594.359713] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.419s) [594.372526] Starting dynamic subtest: pipe-C-eDP-1 [595.682543] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.320s) [595.696017] Starting dynamic subtest: pipe-D-eDP-1 [597.015789] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.332s) [597.018292] Subtest cursor-fb-leak: SUCCESS (4.410s) [598.187485] [104/156] (422s left) kms_psr2_sf (pr-primary-plane-update-sf-dmg-area-big-fb) [598.280748] Starting subtest: pr-primary-plane-update-sf-dmg-area-big-fb [598.285466] Subtest pr-primary-plane-update-sf-dmg-area-big-fb: SKIP (0.000s) [598.360674] [105/156] (422s left) vgem_basic (dmabuf-fence-before) [598.403968] Starting subtest: dmabuf-fence-before [598.406066] Subtest dmabuf-fence-before: SUCCESS (0.001s) [598.458731] [106/156] (422s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-scndscrn-spr-indfb-draw-mmap-gtt) [598.553689] Starting subtest: fbcpsrhdr-2p-scndscrn-spr-indfb-draw-mmap-gtt [598.557870] Subtest fbcpsrhdr-2p-scndscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s) [598.645397] [107/156] (422s left) kms_async_flips (test-time-stamp) [598.726823] Starting subtest: test-time-stamp [599.098677] Starting dynamic subtest: pipe-A-eDP-1 [599.892777] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.792s) [600.270682] Starting dynamic subtest: pipe-B-eDP-1 [601.117552] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.854s) [601.501532] Starting dynamic subtest: pipe-C-eDP-1 [602.264694] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.771s) [602.629423] Starting dynamic subtest: pipe-D-eDP-1 [603.398434] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.777s) [603.400943] Subtest test-time-stamp: SUCCESS (4.672s) [604.568175] [108/156] (416s left) gem_mmap_gtt (cpuset-big-copy) [604.647696] Subtest cpuset-big-copy: SKIP (0.000s) [604.718095] [109/156] (416s left) kms_chamelium_hpd (vga-hpd-enable-disable-mode) [605.102500] Subtest vga-hpd-enable-disable-mode: SKIP (0.000s) [605.895656] [110/156] (415s left) kms_big_fb (4-tiled-64bpp-rotate-90) [606.004358] Starting subtest: 4-tiled-64bpp-rotate-90 [606.029967] Subtest 4-tiled-64bpp-rotate-90: SKIP (0.023s) [606.147391] [111/156] (414s left) kms_hdr (invalid-metadata-sizes) [606.232889] Starting subtest: invalid-metadata-sizes [606.235242] Starting dynamic subtest: pipe-A-eDP-1-XRGB2101010 [606.239887] Dynamic subtest pipe-A-eDP-1-XRGB2101010: SKIP (0.000s) [606.253144] Starting dynamic subtest: pipe-A-eDP-1-XRGB16161616F [606.257389] Dynamic subtest pipe-A-eDP-1-XRGB16161616F: SKIP (0.000s) [606.261641] Subtest invalid-metadata-sizes: SKIP (0.006s) [606.317479] [112/156] (414s left) gem_create (create-ext-placement-each) [606.473162] Starting subtest: create-ext-placement-each [606.475717] Subtest create-ext-placement-each: SUCCESS (0.000s) [606.568905] [113/156] (414s left) kms_frontbuffer_tracking (fbc-rgb565-draw-render) [606.657674] Starting subtest: fbc-rgb565-draw-render [610.925734] Subtest fbc-rgb565-draw-render: SUCCESS (4.274s) [612.131668] [114/156] (409s left) gem_tiled_pread_basic (basic) [612.187678] Subtest basic: SKIP (0.000s) [612.241648] [115/156] (409s left) kms_cursor_legacy (forked-bo) [612.365251] Starting subtest: forked-bo [612.367536] Starting dynamic subtest: pipe-A [617.817556] Dynamic subtest pipe-A: SUCCESS (5.448s) [617.838307] Starting dynamic subtest: pipe-B [623.280743] Dynamic subtest pipe-B: SUCCESS (5.460s) [623.301939] Starting dynamic subtest: pipe-C [628.749310] Dynamic subtest pipe-C: SUCCESS (5.466s) [628.760229] Starting dynamic subtest: pipe-D [634.242670] Dynamic subtest pipe-D: SUCCESS (5.490s) [634.255591] Starting dynamic subtest: all-pipes [639.743739] Dynamic subtest all-pipes: SUCCESS (5.499s) [639.746248] Subtest forked-bo: SUCCESS (27.375s) [639.889641] [116/156] (381s left) gem_exec_reloc (basic-gtt-active) [639.967064] Subtest basic-gtt-active: SKIP (0.000s) [640.045214] [117/156] (381s left) kms_color (degamma) [640.140556] Starting subtest: degamma [640.142667] Starting dynamic subtest: pipe-A-eDP-1 [640.865619] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.723s) [640.876499] Starting dynamic subtest: pipe-B-eDP-1 [642.370384] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.505s) [642.382093] Starting dynamic subtest: pipe-C-eDP-1 [643.718076] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.346s) [643.732021] Starting dynamic subtest: pipe-D-eDP-1 [645.063195] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.345s) [645.065751] Subtest degamma: SUCCESS (4.924s) [645.883314] [118/156] (375s left) sriov_basic (bind-unbind-vf) [645.941495] Starting subtest: bind-unbind-vf [645.943942] Starting dynamic subtest: vf-1 [645.948703] Dynamic subtest vf-1: SKIP (0.001s) [645.961738] Starting dynamic subtest: vf-2 [645.966185] Dynamic subtest vf-2: SKIP (0.000s) [645.978187] Starting dynamic subtest: vf-3 [645.982678] Dynamic subtest vf-3: SKIP (0.000s) [645.993128] Starting dynamic subtest: vf-4 [645.997586] Dynamic subtest vf-4: SKIP (0.000s) [646.007833] Starting dynamic subtest: vf-5 [646.012196] Dynamic subtest vf-5: SKIP (0.000s) [646.022900] Starting dynamic subtest: vf-6 [646.027382] Dynamic subtest vf-6: SKIP (0.000s) [646.037873] Starting dynamic subtest: vf-7 [646.042370] Dynamic subtest vf-7: SKIP (0.000s) [646.055368] Starting dynamic subtest: vf-random [646.059572] Dynamic subtest vf-random: SKIP (0.000s) [646.072831] Starting dynamic subtest: vf-last [646.077440] Dynamic subtest vf-last: SKIP (0.000s) [646.081768] Subtest bind-unbind-vf: SKIP (0.010s) [646.120254] [119/156] (375s left) kms_big_fb (yf-tiled-32bpp-rotate-0) [646.213720] Starting subtest: yf-tiled-32bpp-rotate-0 [646.218215] Subtest yf-tiled-32bpp-rotate-0: SKIP (0.000s) [646.328054] [120/156] (375s left) kms_frontbuffer_tracking (hdr-2p-scndscrn-indfb-plflip-blt) [646.422582] Starting subtest: hdr-2p-scndscrn-indfb-plflip-blt [646.426859] Subtest hdr-2p-scndscrn-indfb-plflip-blt: SKIP (0.000s) [646.546197] [121/156] (374s left) kms_psr (fbc-pr-sprite-mmap-cpu) [646.636727] Starting subtest: fbc-pr-sprite-mmap-cpu [646.641088] Subtest fbc-pr-sprite-mmap-cpu: SKIP (0.000s) [646.708323] [122/156] (374s left) gem_exec_reloc (basic-cpu-gtt) [646.764581] Subtest basic-cpu-gtt: SKIP (0.000s) [646.847607] [123/156] (374s left) kms_frontbuffer_tracking (psr-rgb101010-draw-pwrite) [646.945492] Starting subtest: psr-rgb101010-draw-pwrite [654.684536] Subtest psr-rgb101010-draw-pwrite: SUCCESS (7.741s) [654.813030] [124/156] (366s left) kms_flip_scaled_crc (flip-32bpp-ytileccs-to-64bpp-ytile-upscaling) [654.904769] Starting subtest: flip-32bpp-ytileccs-to-64bpp-ytile-upscaling [654.909435] Subtest flip-32bpp-ytileccs-to-64bpp-ytile-upscaling: SKIP (0.000s) [654.991430] [125/156] (366s left) kms_cursor_legacy (cursorb-vs-flipb-toggle) [655.118451] Starting subtest: cursorB-vs-flipB-toggle [655.123848] Subtest cursorB-vs-flipB-toggle: SKIP (0.001s) [655.266152] [126/156] (366s left) sysfs_heartbeat_interval (precise) [655.331431] Starting subtest: precise [655.333810] Starting dynamic subtest: vecs0 [663.218851] Dynamic subtest vecs0: SUCCESS (7.886s) [663.231391] Starting dynamic subtest: ccs0 [664.411856] Dynamic subtest ccs0: SUCCESS (1.191s) [664.428654] Starting dynamic subtest: vcs0 [672.172829] Dynamic subtest vcs0: SUCCESS (7.755s) [672.186458] Starting dynamic subtest: bcs0 [675.104701] Dynamic subtest bcs0: SUCCESS (2.932s) [675.121375] Starting dynamic subtest: rcs0 [676.221647] Dynamic subtest rcs0: SUCCESS (1.115s) [676.234594] Starting dynamic subtest: vcs1 [684.213826] Dynamic subtest vcs1: SUCCESS (7.989s) [684.216349] Subtest precise: SUCCESS (28.879s) [684.306195] [127/156] (337s left) kms_frontbuffer_tracking (psrhdr-rgb101010-draw-mmap-gtt) [684.409185] Starting subtest: psrhdr-rgb101010-draw-mmap-gtt [684.413277] Subtest psrhdr-rgb101010-draw-mmap-gtt: SKIP (0.000s) [684.508106] [128/156] (337s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-mmap-gtt) [684.599723] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-mmap-gtt [684.603932] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s) [684.705290] [129/156] (337s left) kms_cdclk (plane-scaling) [684.799556] Starting subtest: plane-scaling [684.801757] Starting dynamic subtest: pipe-A-eDP-1 [685.092110] Dynamic subtest pipe-A-eDP-1: SKIP (0.291s) [685.103978] Starting dynamic subtest: pipe-B-eDP-1 [685.108633] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s) [685.119663] Starting dynamic subtest: pipe-C-eDP-1 [685.124452] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s) [685.135541] Starting dynamic subtest: pipe-D-eDP-1 [685.140189] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s) [685.144703] Subtest plane-scaling: SKIP (0.298s) [685.942820] [130/156] (335s left) kms_pipe_crc_basic (read-crc) [686.038828] Starting subtest: read-crc [686.041294] Starting dynamic subtest: pipe-A-eDP-1 [686.747400] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.706s) [686.758788] Starting dynamic subtest: pipe-B-eDP-1 [688.174243] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.426s) [688.187506] Starting dynamic subtest: pipe-C-eDP-1 [689.522340] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.347s) [689.534738] Starting dynamic subtest: pipe-D-eDP-1 [690.860494] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.338s) [690.862901] Subtest read-crc: SUCCESS (4.824s) [691.678389] [131/156] (330s left) kms_hdmi_inject (inject-audio) [692.023612] Starting subtest: inject-audio [692.320867] Subtest inject-audio: SUCCESS (0.298s) [692.949365] [132/156] (329s left) kms_cursor_crc (cursor-onscreen-32x32) [693.088689] Starting subtest: cursor-onscreen-32x32 [693.137115] Subtest cursor-onscreen-32x32: SKIP (0.043s) [693.433314] [133/156] (328s left) kms_frontbuffer_tracking (fbcpsrhdr-suspend) [693.541091] Starting subtest: fbcpsrhdr-suspend [693.545326] Subtest fbcpsrhdr-suspend: SKIP (0.000s) [693.663078] [134/156] (328s left) kms_big_fb (x-tiled-32bpp-rotate-0) [693.761037] Starting subtest: x-tiled-32bpp-rotate-0 [695.240552] Subtest x-tiled-32bpp-rotate-0: SUCCESS (1.481s) [695.387725] [135/156] (326s left) kms_force_connector_basic (prune-stale-modes) [695.459831] Starting subtest: prune-stale-modes [695.926862] Subtest prune-stale-modes: SUCCESS (0.468s) [696.071692] [136/156] (326s left) syncobj_timeline (invalid-query-bad-pad) [696.119604] Starting subtest: invalid-query-bad-pad [696.121267] Subtest invalid-query-bad-pad: SUCCESS (0.000s) [696.220978] [137/156] (326s left) gem_render_copy (y-tiled-ccs-to-yf-tiled-mc-ccs) [696.267923] Starting subtest: y-tiled-ccs-to-yf-tiled-mc-ccs [696.271513] Subtest y-tiled-ccs-to-yf-tiled-mc-ccs: SKIP (0.000s) [696.466413] [138/156] (325s left) kms_content_protection (legacy) [696.619288] Starting subtest: legacy [696.624005] Subtest legacy: SKIP (0.000s) [696.986873] [139/156] (325s left) kms_atomic_transition (plane-all-modeset-transition-fencing-internal-panels) [697.086109] Starting subtest: plane-all-modeset-transition-fencing-internal-panels [697.088035] Starting dynamic subtest: pipe-A-eDP-1 [698.435103] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.348s) [698.716201] Starting dynamic subtest: pipe-B-eDP-1 [699.755620] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.050s) [700.028384] Subtest plane-all-modeset-transition-fencing-internal-panels: SUCCESS (2.943s) [700.869778] [140/156] (321s left) kms_frontbuffer_tracking (hdr-rgb101010-draw-mmap-wc) [700.968420] Starting subtest: hdr-rgb101010-draw-mmap-wc [700.973040] Subtest hdr-rgb101010-draw-mmap-wc: SKIP (0.000s) [701.069707] [141/156] (321s left) kms_pipe_b_c_ivb (from-pipe-c-to-b-with-3-lanes) [701.131232] Subtest from-pipe-C-to-B-with-3-lanes: SKIP (0.000s) [701.192091] [142/156] (321s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-fullscreen) [701.294704] Starting subtest: fbc-2p-scndscrn-spr-indfb-fullscreen [701.299179] Subtest fbc-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s) [701.398377] [143/156] (321s left) gem_userptr_blits (stress-purge) [701.475264] Starting subtest: stress-purge [706.878950] Subtest stress-purge: SUCCESS (5.406s) [707.003663] [144/156] (315s left) kms_invalid_mode (uint-max-clock) [707.139949] Starting subtest: uint-max-clock [707.141775] Starting dynamic subtest: pipe-A-eDP-1 [707.427783] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.289s) [707.439610] Starting dynamic subtest: pipe-B-eDP-1 [707.441587] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s) [707.452277] Starting dynamic subtest: pipe-C-eDP-1 [707.454785] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s) [707.468224] Starting dynamic subtest: pipe-D-eDP-1 [707.470557] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s) [707.473546] Subtest uint-max-clock: SUCCESS (0.295s) [708.300970] [145/156] (314s left) kms_frontbuffer_tracking (fbchdr-2p-pri-indfb-multidraw) [708.413432] Starting subtest: fbchdr-2p-pri-indfb-multidraw [708.417543] Subtest fbchdr-2p-pri-indfb-multidraw: SKIP (0.000s) [708.515000] [146/156] (314s left) kms_psr (psr2-primary-mmap-cpu) [708.601422] Starting subtest: psr2-primary-mmap-cpu [708.603866] Starting dynamic subtest: eDP-1 [710.398194] Dynamic subtest eDP-1: SUCCESS (1.796s) [710.400437] Subtest psr2-primary-mmap-cpu: SUCCESS (1.797s) [711.279472] [147/156] (311s left) gem_exec_flush (basic-batch-kernel-default-uc) [711.345089] Starting subtest: basic-batch-kernel-default-uc [718.588916] Subtest basic-batch-kernel-default-uc: SUCCESS (7.244s) [718.795735] [148/156] (303s left) gem_exec_balancer (invalid-bonds) [718.856324] Starting subtest: invalid-bonds [718.861094] Subtest invalid-bonds: SKIP (0.000s) [719.175388] [149/156] (303s left) kms_ccs (bad-pixel-format-y-tiled-ccs) [719.267863] Starting subtest: bad-pixel-format-y-tiled-ccs [719.270245] Starting dynamic subtest: pipe-A-eDP-1 [719.293685] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [719.305758] Starting dynamic subtest: pipe-B-eDP-1 [719.328024] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [719.338527] Starting dynamic subtest: pipe-C-eDP-1 [719.360435] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [719.371246] Starting dynamic subtest: pipe-D-eDP-1 [719.393526] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [719.397981] Subtest bad-pixel-format-y-tiled-ccs: SKIP (0.004s) [721.526935] [150/156] (301s left) kms_big_fb (linear-16bpp-rotate-270) [721.624768] Starting subtest: linear-16bpp-rotate-270 [721.644497] Subtest linear-16bpp-rotate-270: SKIP (0.019s) [721.774058] [151/156] (301s left) gem_exec_whisper (basic-fds-priority-all) [721.830238] Starting subtest: basic-fds-priority-all [745.421350] Subtest basic-fds-priority-all: SUCCESS (23.585s) [745.605553] [152/156] (277s left) kms_frontbuffer_tracking (hdr-1p-rte) [745.714371] Starting subtest: hdr-1p-rte [745.718484] Subtest hdr-1p-rte: SKIP (0.000s) [745.806659] [153/156] (277s left) kms_frontbuffer_tracking (psrhdr-2p-primscrn-cur-indfb-move) [745.914562] Starting subtest: psrhdr-2p-primscrn-cur-indfb-move [745.918450] Subtest psrhdr-2p-primscrn-cur-indfb-move: SKIP (0.000s) [746.024440] [154/156] (276s left) gem_exec_flush (basic-uc-set-default) [746.091349] Starting subtest: basic-uc-set-default [751.572901] Subtest basic-uc-set-default: SUCCESS (5.482s) [751.764335] [155/156] (271s left) kms_big_fb (yf-tiled-64bpp-rotate-180) [751.861522] Starting subtest: yf-tiled-64bpp-rotate-180 [751.866079] Subtest yf-tiled-64bpp-rotate-180: SKIP (0.000s) [751.946903] [156/156] (271s left) kms_chamelium_frames (dp-crc-multiple) [752.350193] Subtest dp-crc-multiple: SKIP (0.000s) [753.149175] Closing watchdogs results: parsing output: 0/ for test: syncobj_timeline results: parsing output: 1/ for test: kms_frontbuffer_tracking results: parsing output: 2/ for test: kms_cursor_legacy results: parsing output: 3/ for test: syncobj_wait results: parsing output: 4/ for test: kms_frontbuffer_tracking results: parsing output: 5/ for test: kms_frontbuffer_tracking results: parsing output: 6/ for test: gem_exec_schedule results: parsing output: 7/ for test: gem_mmap_wc results: parsing output: 8/ for test: kms_draw_crc results: parsing output: 9/ for test: kms_properties results: parsing output: 10/ for test: gem_mmap_offset results: parsing output: 11/ for test: kms_frontbuffer_tracking results: parsing output: 12/ for test: kms_frontbuffer_tracking results: parsing output: 13/ for test: kms_frontbuffer_tracking results: parsing output: 14/ for test: i915_getparams_basic results: parsing output: 15/ for test: kms_frontbuffer_tracking results: parsing output: 16/ for test: testdisplay results: parsing output: 17/ for test: kms_frontbuffer_tracking results: parsing output: 18/ for test: syncobj_timeline results: parsing output: 19/ for test: gem_pxp results: parsing output: 20/ for test: kms_ccs results: parsing output: 21/ for test: kms_frontbuffer_tracking results: parsing output: 22/ for test: gem_exec_schedule results: parsing output: 23/ for test: kms_frontbuffer_tracking results: parsing output: 24/ for test: perf results: parsing output: 25/ for test: kms_lease results: parsing output: 26/ for test: kms_frontbuffer_tracking results: parsing output: 27/ for test: gem_exec_fence results: parsing output: 28/ for test: kms_cursor_crc results: parsing output: 29/ for test: kms_addfb_basic results: parsing output: 30/ for test: kms_addfb_basic results: parsing output: 31/ for test: kms_frontbuffer_tracking results: parsing output: 32/ for test: kms_pm_rpm results: parsing output: 33/ for test: gem_mmap_gtt results: parsing output: 34/ for test: gem_exec_schedule results: parsing output: 35/ for test: kms_frontbuffer_tracking results: parsing output: 36/ for test: fbdev results: parsing output: 37/ for test: core_setmaster results: parsing output: 38/ for test: kms_frontbuffer_tracking results: parsing output: 39/ for test: kms_frontbuffer_tracking results: parsing output: 40/ for test: kms_frontbuffer_tracking results: parsing output: 41/ for test: gem_lmem_swapping results: parsing output: 42/ for test: kms_busy results: parsing output: 43/ for test: vgem_basic results: parsing output: 44/ for test: kms_selftest results: parsing output: 45/ for test: kms_vblank results: parsing output: 46/ for test: gem_workarounds results: parsing output: 47/ for test: kms_frontbuffer_tracking results: parsing output: 48/ for test: kms_plane results: parsing output: 49/ for test: gem_close results: parsing output: 50/ for test: kms_plane_scaling results: parsing output: 51/ for test: kms_ccs results: parsing output: 52/ for test: kms_frontbuffer_tracking results: parsing output: 53/ for test: gem_exec_gttfill results: parsing output: 54/ for test: kms_frontbuffer_tracking results: parsing output: 55/ for test: kms_frontbuffer_tracking results: parsing output: 56/ for test: gem_eio results: parsing output: 57/ for test: gem_exec_params results: parsing output: 58/ for test: kms_frontbuffer_tracking results: parsing output: 59/ for test: kms_frontbuffer_tracking results: parsing output: 60/ for test: kms_psr results: parsing output: 61/ for test: gen9_exec_parse results: parsing output: 62/ for test: i915_drm_fdinfo results: parsing output: 63/ for test: syncobj_basic results: parsing output: 64/ for test: kms_properties results: parsing output: 65/ for test: kms_cursor_legacy results: parsing output: 66/ for test: perf_pmu results: parsing output: 67/ for test: kms_frontbuffer_tracking results: parsing output: 68/ for test: kms_cursor_legacy results: parsing output: 69/ for test: i915_selftest results: parsing output: 70/ for test: kms_frontbuffer_tracking results: parsing output: 71/ for test: kms_psr results: parsing output: 72/ for test: i915_pm_rps results: parsing output: 73/ for test: gem_ctx_persistence results: parsing output: 74/ for test: gem_pread results: parsing output: 75/ for test: syncobj_timeline results: parsing output: 76/ for test: kms_plane results: parsing output: 77/ for test: kms_frontbuffer_tracking results: parsing output: 78/ for test: kms_async_flips results: parsing output: 79/ for test: api_intel_bb results: parsing output: 80/ for test: kms_big_fb results: parsing output: 81/ for test: gem_exec_capture results: parsing output: 82/ for test: kms_ccs results: parsing output: 83/ for test: kms_flip_scaled_crc results: parsing output: 84/ for test: gem_mmap_wc results: parsing output: 85/ for test: gem_eio results: parsing output: 86/ for test: kms_cursor_legacy results: parsing output: 87/ for test: kms_frontbuffer_tracking results: parsing output: 88/ for test: gem_exec_flush results: parsing output: 89/ for test: api_intel_allocator results: parsing output: 90/ for test: kms_pm_rpm results: parsing output: 91/ for test: kms_atomic_transition results: parsing output: 92/ for test: gem_workarounds results: parsing output: 93/ for test: kms_psr results: parsing output: 94/ for test: perf_pmu results: parsing output: 95/ for test: kms_pm_backlight results: parsing output: 96/ for test: syncobj_timeline results: parsing output: 97/ for test: gem_ctx_param results: parsing output: 98/ for test: kms_getfb results: parsing output: 99/ for test: kms_frontbuffer_tracking results: parsing output: 100/ for test: syncobj_wait results: parsing output: 101/ for test: kms_frontbuffer_tracking results: parsing output: 102/ for test: kms_universal_plane results: parsing output: 103/ for test: kms_psr2_sf results: parsing output: 104/ for test: vgem_basic results: parsing output: 105/ for test: kms_frontbuffer_tracking results: parsing output: 106/ for test: kms_async_flips results: parsing output: 107/ for test: gem_mmap_gtt results: parsing output: 108/ for test: kms_chamelium_hpd results: parsing output: 109/ for test: kms_big_fb results: parsing output: 110/ for test: kms_hdr results: parsing output: 111/ for test: gem_create results: parsing output: 112/ for test: kms_frontbuffer_tracking results: parsing output: 113/ for test: gem_tiled_pread_basic results: parsing output: 114/ for test: kms_cursor_legacy results: parsing output: 115/ for test: gem_exec_reloc results: parsing output: 116/ for test: kms_color results: parsing output: 117/ for test: sriov_basic results: parsing output: 118/ for test: kms_big_fb results: parsing output: 119/ for test: kms_frontbuffer_tracking results: parsing output: 120/ for test: kms_psr results: parsing output: 121/ for test: gem_exec_reloc results: parsing output: 122/ for test: kms_frontbuffer_tracking results: parsing output: 123/ for test: kms_flip_scaled_crc results: parsing output: 124/ for test: kms_cursor_legacy results: parsing output: 125/ for test: sysfs_heartbeat_interval results: parsing output: 126/ for test: kms_frontbuffer_tracking results: parsing output: 127/ for test: kms_frontbuffer_tracking results: parsing output: 128/ for test: kms_cdclk results: parsing output: 129/ for test: kms_pipe_crc_basic results: parsing output: 130/ for test: kms_hdmi_inject results: parsing output: 131/ for test: kms_cursor_crc results: parsing output: 132/ for test: kms_frontbuffer_tracking results: parsing output: 133/ for test: kms_big_fb results: parsing output: 134/ for test: kms_force_connector_basic results: parsing output: 135/ for test: syncobj_timeline results: parsing output: 136/ for test: gem_render_copy results: parsing output: 137/ for test: kms_content_protection results: parsing output: 138/ for test: kms_atomic_transition results: parsing output: 139/ for test: kms_frontbuffer_tracking results: parsing output: 140/ for test: kms_pipe_b_c_ivb results: parsing output: 141/ for test: kms_frontbuffer_tracking results: parsing output: 142/ for test: gem_userptr_blits results: parsing output: 143/ for test: kms_invalid_mode results: parsing output: 144/ for test: kms_frontbuffer_tracking results: parsing output: 145/ for test: kms_psr results: parsing output: 146/ for test: gem_exec_flush results: parsing output: 147/ for test: gem_exec_balancer results: parsing output: 148/ for test: kms_ccs results: parsing output: 149/ for test: kms_big_fb results: parsing output: 150/ for test: gem_exec_whisper results: parsing output: 151/ for test: kms_frontbuffer_tracking results: parsing output: 152/ for test: kms_frontbuffer_tracking results: parsing output: 153/ for test: gem_exec_flush results: parsing output: 154/ for test: kms_big_fb results: parsing output: 155/ for test: kms_chamelium_frames Done.