[59.285342] Initializing watchdogs [59.285462] /dev/watchdog0 [59.304145] [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.308650] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [59.310960] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [59.312915] [001/132] (960s left) kms_rotation_crc (primary-4-tiled-reflect-x-180) [59.407974] Starting subtest: primary-4-tiled-reflect-x-180 [66.447279] Subtest primary-4-tiled-reflect-x-180: SUCCESS (6.999s) [67.675217] [002/132] (952s left) kms_big_fb (4-tiled-32bpp-rotate-90) [67.802787] Starting subtest: 4-tiled-32bpp-rotate-90 [67.824121] Subtest 4-tiled-32bpp-rotate-90: SKIP (0.021s) [67.988028] [003/132] (951s left) syncobj_timeline (multi-wait-submitted-signaled) [68.071154] Starting subtest: multi-wait-submitted-signaled [68.072187] Subtest multi-wait-submitted-signaled: SUCCESS (0.001s) [68.256472] [004/132] (951s left) kms_color (ctm-0-50) [68.348057] Starting subtest: ctm-0-50 [68.348963] Starting dynamic subtest: pipe-A-eDP-1 [71.864988] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.509s) [71.872247] Starting dynamic subtest: pipe-B-eDP-1 [76.070855] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.200s) [76.082044] Starting dynamic subtest: pipe-C-eDP-1 [80.128777] Dynamic subtest pipe-C-eDP-1: SUCCESS (4.054s) [80.135659] Starting dynamic subtest: pipe-D-eDP-1 [84.135231] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.002s) [84.136053] Subtest ctm-0-50: SUCCESS (15.767s) [84.958558] [005/132] (935s left) gem_ctx_engines (execute-one) [85.016870] Starting subtest: execute-one [87.314899] Subtest execute-one: SUCCESS (2.297s) [87.492601] [006/132] (932s left) gem_exec_reloc (basic-cpu-wc-active) [87.542056] Subtest basic-cpu-wc-active: SKIP (0.000s) [87.598417] [007/132] (932s left) syncobj_wait (multi-wait-all-for-submit-unsubmitted) [87.661593] Starting subtest: multi-wait-all-for-submit-unsubmitted [87.769840] Subtest multi-wait-all-for-submit-unsubmitted: SUCCESS (0.107s) [87.840248] [008/132] (932s left) kms_dsc (dsc-with-output-formats) [87.933040] Starting subtest: dsc-with-output-formats [87.941847] Subtest dsc-with-output-formats: SKIP (0.001s) [88.001653] [009/132] (932s left) gem_mmap_gtt (medium-copy) [88.048198] Subtest medium-copy: SKIP (0.000s) [88.107392] [010/132] (932s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-move) [88.203152] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-move [95.569035] Subtest fbcpsr-1p-primscrn-cur-indfb-move: SUCCESS (7.362s) [95.710373] [011/132] (924s left) syncobj_timeline (wait-all-interrupted) [95.755507] Starting subtest: wait-all-interrupted [95.858416] Subtest wait-all-interrupted: SUCCESS (0.102s) [95.924449] [012/132] (924s left) kms_big_fb (yf-tiled-16bpp-rotate-270) [96.029500] Starting subtest: yf-tiled-16bpp-rotate-270 [96.031842] Subtest yf-tiled-16bpp-rotate-270: SKIP (0.000s) [96.117953] [013/132] (924s left) gem_wait (invalid-flags) [96.166337] Starting subtest: invalid-flags [96.167399] Subtest invalid-flags: SUCCESS (0.000s) [96.353297] [014/132] (923s left) kms_flip (flip-vs-dpms-on-nop-interruptible) [96.443109] Starting subtest: flip-vs-dpms-on-nop-interruptible [96.445350] Starting dynamic subtest: A-eDP1 [98.301040] Dynamic subtest A-eDP1: SUCCESS (1.855s) [98.309218] Starting dynamic subtest: B-eDP1 [100.145501] Dynamic subtest B-eDP1: SUCCESS (1.842s) [100.155089] Starting dynamic subtest: C-eDP1 [101.964589] Dynamic subtest C-eDP1: SUCCESS (1.815s) [101.971253] Starting dynamic subtest: D-eDP1 [103.800974] Dynamic subtest D-eDP1: SUCCESS (1.834s) [103.802062] Subtest flip-vs-dpms-on-nop-interruptible: SUCCESS (7.356s) [104.983947] [015/132] (915s left) syncobj_wait (single-wait-for-submit-unsubmitted) [105.044193] Starting subtest: single-wait-for-submit-unsubmitted [105.162620] Subtest single-wait-for-submit-unsubmitted: SUCCESS (0.108s) [105.233846] [016/132] (915s left) kms_rotation_crc (bad-tiling) [105.336491] Starting subtest: bad-tiling [105.338403] Subtest bad-tiling: SKIP (0.001s) [105.399915] [017/132] (914s left) gem_exec_reloc (basic-cpu-active) [105.459097] Subtest basic-cpu-active: SKIP (0.000s) [105.529891] [018/132] (914s left) kms_pipe_b_c_ivb (disable-pipe-b-enable-pipe-c) [105.584984] Subtest disable-pipe-B-enable-pipe-C: SKIP (0.000s) [105.641336] [019/132] (914s left) kms_cursor_edge_walk (256x256-top-bottom) [105.733418] Starting subtest: 256x256-top-bottom [105.734493] Starting dynamic subtest: pipe-A-eDP-1 [109.149079] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.414s) [109.155623] Starting dynamic subtest: pipe-D-eDP-1 [112.268167] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.118s) [112.269155] Subtest 256x256-top-bottom: SUCCESS (6.534s) [113.062542] [020/132] (907s left) gem_userptr_blits (readonly-pwrite-unsync) [113.117863] Subtest readonly-pwrite-unsync: SKIP (0.000s) [113.231325] [021/132] (907s left) kms_flip (flip-vs-dpms-off-vs-modeset-interruptible) [113.329288] Starting subtest: flip-vs-dpms-off-vs-modeset-interruptible [113.331445] Starting dynamic subtest: A-eDP1 [116.901741] Dynamic subtest A-eDP1: SUCCESS (3.569s) [116.910584] Starting dynamic subtest: B-eDP1 [120.110186] Dynamic subtest B-eDP1: SUCCESS (3.207s) [120.116919] Starting dynamic subtest: C-eDP1 [123.201820] Dynamic subtest C-eDP1: SUCCESS (3.090s) [123.208672] Starting dynamic subtest: D-eDP1 [126.321238] Dynamic subtest D-eDP1: SUCCESS (3.118s) [126.323218] Subtest flip-vs-dpms-off-vs-modeset-interruptible: SUCCESS (12.991s) [127.124629] [022/132] (893s left) i915_drm_fdinfo (context-close-stress) [127.174143] Starting subtest: context-close-stress [137.936655] Subtest context-close-stress: SUCCESS (10.744s) [137.987730] [023/132] (882s left) gem_mmap_gtt (cpuset-medium-copy-xy) [138.176899] Subtest cpuset-medium-copy-XY: SKIP (0.000s) [138.216825] [024/132] (882s left) kms_plane_scaling (planes-upscale-factor-0-25) [138.308255] Starting subtest: planes-upscale-factor-0-25 [138.309052] Starting dynamic subtest: pipe-A [138.371860] Dynamic subtest pipe-A: SUCCESS (0.064s) [138.380814] Starting dynamic subtest: pipe-B [139.554149] Dynamic subtest pipe-B: SUCCESS (1.181s) [139.561894] Starting dynamic subtest: pipe-C [140.671530] Dynamic subtest pipe-C: SUCCESS (1.116s) [140.680220] Starting dynamic subtest: pipe-D [141.796196] Dynamic subtest pipe-D: SUCCESS (1.124s) [141.797253] Subtest planes-upscale-factor-0-25: SUCCESS (3.489s) [142.945454] [025/132] (877s left) core_getstats (basic) [142.999339] Starting subtest: basic [143.000219] Subtest basic: SUCCESS (0.000s) [143.114328] [026/132] (877s left) kms_psr (psr2-primary-mmap-gtt) [143.210345] Starting subtest: psr2-primary-mmap-gtt [143.211273] Starting dynamic subtest: eDP-1 [144.656844] Dynamic subtest eDP-1: SKIP (1.435s) [144.658967] Subtest psr2-primary-mmap-gtt: SKIP (1.437s) [144.798091] [027/132] (875s left) gem_ctx_param (invalid-ctx-get) [144.848799] Starting subtest: invalid-ctx-get [144.850030] Subtest invalid-ctx-get: SUCCESS (0.000s) [144.917853] [028/132] (875s left) kms_big_fb (x-tiled-64bpp-rotate-0) [145.008979] Starting subtest: x-tiled-64bpp-rotate-0 [146.533070] Subtest x-tiled-64bpp-rotate-0: SUCCESS (1.525s) [146.727469] [029/132] (874s left) gem_mmap_gtt (basic-read) [146.785490] Subtest basic-read: SKIP (0.000s) [146.842158] [030/132] (873s left) gem_exec_balancer (individual) [146.909243] Starting subtest: individual [148.895454] Subtest individual: SUCCESS (1.977s) [149.200282] [031/132] (871s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-pgflip-blt) [149.292246] Starting subtest: fbc-1p-primscrn-shrfb-pgflip-blt [153.875859] Subtest fbc-1p-primscrn-shrfb-pgflip-blt: SUCCESS (4.585s) [154.990653] [032/132] (865s left) i915_pm_rpm (gem-evict-pwrite) [157.025281] Starting subtest: gem-evict-pwrite [157.027728] Subtest gem-evict-pwrite: SKIP (0.000s) [157.402888] [033/132] (863s left) kms_legacy_colorkey (invalid-plane) [157.489374] Starting subtest: invalid-plane [157.490189] Starting dynamic subtest: zero-id [157.491144] Dynamic subtest zero-id: SUCCESS (0.000s) [157.502267] Starting dynamic subtest: outrange-id [157.503199] Dynamic subtest outrange-id: SUCCESS (0.000s) [157.504038] Subtest invalid-plane: SUCCESS (0.001s) [157.566596] [034/132] (863s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt) [157.648705] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt [157.650396] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s) [157.733766] [035/132] (863s left) perf_pmu (pmu-read) [157.766253] Starting subtest: pmu-read [157.768891] Subtest pmu-read: SUCCESS (0.003s) [157.856530] [036/132] (863s left) kms_big_fb (yf-tiled-addfb) [157.946260] Starting subtest: yf-tiled-addfb [157.947906] Subtest yf-tiled-addfb: SKIP (0.000s) [158.065331] [037/132] (862s left) kms_flip (2x-absolute-wf_vblank) [158.162793] Starting subtest: 2x-absolute-wf_vblank [158.173685] Subtest 2x-absolute-wf_vblank: SKIP (0.011s) [158.278160] [038/132] (862s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-mmap-cpu) [158.361477] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-mmap-cpu [158.363077] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s) [158.460269] [039/132] (862s left) kms_big_fb (linear-32bpp-rotate-0) [158.553495] Starting subtest: linear-32bpp-rotate-0 [160.098210] Subtest linear-32bpp-rotate-0: SUCCESS (1.545s) [160.242407] [040/132] (860s left) gem_ringfill (engines-basic) [165.921882] Starting subtest: engines-basic [165.922941] Starting dynamic subtest: rcs0 [165.962871] Dynamic subtest rcs0: SUCCESS (0.049s) [165.972596] Starting dynamic subtest: bcs0 [166.003870] Dynamic subtest bcs0: SUCCESS (0.040s) [166.011836] Starting dynamic subtest: vcs0 [166.045564] Dynamic subtest vcs0: SUCCESS (0.040s) [166.055453] Starting dynamic subtest: vcs1 [166.089096] Dynamic subtest vcs1: SUCCESS (0.042s) [166.098859] Starting dynamic subtest: vecs0 [166.133554] Dynamic subtest vecs0: SUCCESS (0.042s) [166.142350] Starting dynamic subtest: ccs0 [166.178892] Dynamic subtest ccs0: SUCCESS (0.044s) [166.180284] Subtest engines-basic: SUCCESS (0.267s) [166.249574] [FACT gem_ringfill (engines-basic)] new: kernel.kmod_is_loaded.vgem: true [166.251662] [041/132] (854s left) gem_pwrite (basic-exhaustion) [166.303341] Subtest basic-exhaustion: SKIP (0.000s) [166.357825] [042/132] (854s left) fbdev (unaligned-write) [166.396413] Starting subtest: unaligned-write [166.546350] Subtest unaligned-write: SUCCESS (0.140s) [166.596497] [043/132] (854s left) kms_cursor_crc (cursor-rapid-movement-max-size) [166.900171] Starting subtest: cursor-rapid-movement-max-size [166.903342] Subtest cursor-rapid-movement-max-size: SKIP (0.000s) [167.015083] [044/132] (854s left) gen9_exec_parse (bb-start-cmd) [167.062773] Subtest bb-start-cmd: SKIP (0.000s) [167.129701] [045/132] (854s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-move) [167.221436] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-move [167.223233] Subtest fbcpsr-2p-primscrn-spr-indfb-move: SKIP (0.000s) [167.312316] [046/132] (854s left) gem_exec_big (single) [167.365921] Starting subtest: single [172.387849] Subtest single: SUCCESS (4.977s) [172.613398] [047/132] (848s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-move) [172.754963] Starting subtest: psr-2p-scndscrn-spr-indfb-move [172.757023] Subtest psr-2p-scndscrn-spr-indfb-move: SKIP (0.000s) [172.850975] [048/132] (848s left) kms_plane_scaling (plane-scaler-with-clipping-clamping-modifiers) [172.949477] Starting subtest: plane-scaler-with-clipping-clamping-modifiers [172.950371] Starting dynamic subtest: pipe-A [173.299727] Dynamic subtest pipe-A: SUCCESS (0.351s) [173.307687] Starting dynamic subtest: pipe-B [174.720884] Dynamic subtest pipe-B: SUCCESS (1.420s) [174.729269] Starting dynamic subtest: pipe-C [176.134858] Dynamic subtest pipe-C: SUCCESS (1.412s) [176.143316] Starting dynamic subtest: pipe-D [177.566615] Dynamic subtest pipe-D: SUCCESS (1.431s) [177.567640] Subtest plane-scaler-with-clipping-clamping-modifiers: SUCCESS (4.619s) [178.721828] [049/132] (842s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-blt) [178.818856] Starting subtest: psr-2p-primscrn-spr-indfb-draw-blt [178.820726] Subtest psr-2p-primscrn-spr-indfb-draw-blt: SKIP (0.000s) [178.913296] [050/132] (842s left) kms_busy (basic) [179.003053] Starting subtest: basic [179.004076] Starting dynamic subtest: flip [179.617614] Dynamic subtest flip: SUCCESS (0.615s) [179.625312] Starting dynamic subtest: modeset [183.055499] Dynamic subtest modeset: SUCCESS (3.436s) [183.056455] Subtest basic: SUCCESS (4.053s) [183.845964] [051/132] (837s left) gem_exec_schedule (independent) [183.922201] Starting subtest: independent [183.923195] Starting dynamic subtest: rcs0 [185.887580] Dynamic subtest rcs0: SUCCESS (1.956s) [185.897957] Starting dynamic subtest: vcs0 [187.959946] Dynamic subtest vcs0: SUCCESS (2.070s) [187.971851] Starting dynamic subtest: vcs1 [189.926769] Dynamic subtest vcs1: SUCCESS (1.965s) [189.938236] Starting dynamic subtest: vecs0 [191.914965] Dynamic subtest vecs0: SUCCESS (1.986s) [191.926107] Starting dynamic subtest: ccs0 [193.950880] Dynamic subtest ccs0: SUCCESS (2.033s) [193.952314] Subtest independent: SUCCESS (10.021s) [194.259095] [052/132] (827s left) i915_selftest (mock) [197.603804] Starting subtest: mock [197.605322] Starting dynamic subtest: sanitycheck [198.364404] Dynamic subtest sanitycheck: SUCCESS (0.753s) [198.372807] Starting dynamic subtest: shmem [199.069260] Dynamic subtest shmem: SUCCESS (0.703s) [199.077738] Starting dynamic subtest: fence [207.038333] Dynamic subtest fence: SUCCESS (7.966s) [207.047241] Starting dynamic subtest: scatterlist [208.726739] Dynamic subtest scatterlist: SUCCESS (1.687s) [208.736292] Starting dynamic subtest: syncmap [211.896526] Dynamic subtest syncmap: SUCCESS (3.168s) [211.906293] Starting dynamic subtest: uncore [212.595418] Dynamic subtest uncore: SUCCESS (0.697s) [212.605087] Starting dynamic subtest: ring [213.283326] Dynamic subtest ring: SUCCESS (0.686s) [213.292169] Starting dynamic subtest: engine [213.988321] Dynamic subtest engine: SUCCESS (0.703s) [213.996909] Starting dynamic subtest: timelines [218.028989] Dynamic subtest timelines: SUCCESS (4.037s) [218.037608] Starting dynamic subtest: requests [221.558584] Dynamic subtest requests: SUCCESS (3.529s) [221.567521] Starting dynamic subtest: objects [222.326250] Dynamic subtest objects: SUCCESS (0.767s) [222.334961] Starting dynamic subtest: phys [223.103227] Dynamic subtest phys: SUCCESS (0.776s) [223.114277] Starting dynamic subtest: dmabuf [223.886366] Dynamic subtest dmabuf: SUCCESS (0.782s) [223.895062] Starting dynamic subtest: vma [230.217063] Dynamic subtest vma: SUCCESS (6.328s) [230.225783] Starting dynamic subtest: evict [231.678146] Dynamic subtest evict: SUCCESS (1.459s) [231.687045] Starting dynamic subtest: gtt [235.133385] Dynamic subtest gtt: SUCCESS (3.454s) [235.142267] Starting dynamic subtest: hugepages [236.048565] Dynamic subtest hugepages: SUCCESS (0.913s) [236.057259] Starting dynamic subtest: memory_region [238.735988] Dynamic subtest memory_region: SUCCESS (2.687s) [238.737534] Subtest mock: SUCCESS (41.126s) [238.759857] [FACT i915_selftest (mock)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [238.760592] [FACT i915_selftest (mock)] deleted: kernel.kmod_is_loaded.i915: true [238.762362] [053/132] (782s left) kms_chamelium_frames (hdmi-crc-fast) [240.596522] Subtest hdmi-crc-fast: SKIP (0.000s) [241.417823] [FACT kms_chamelium_frames (hdmi-crc-fast)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [241.419706] [FACT kms_chamelium_frames (hdmi-crc-fast)] new: kernel.kmod_is_loaded.i915: true [241.421924] [054/132] (780s left) gem_exec_params (no-vebox) [241.480666] Starting subtest: no-vebox [241.486417] Subtest no-vebox: SUCCESS (0.006s) [242.975854] [055/132] (778s left) gem_spin_batch (spin-all) [243.033450] Starting subtest: spin-all [243.047366] Subtest spin-all: SUCCESS (0.014s) [244.947332] [056/132] (776s left) gem_exec_gttfill (basic) [245.004819] Starting subtest: basic [248.062049] Subtest basic: SUCCESS (3.056s) [248.270455] [057/132] (773s left) kms_hdr (bpc-switch) [248.397293] Starting subtest: bpc-switch [249.427641] Starting dynamic subtest: pipe-A-eDP-1 [252.932721] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.505s) [252.933625] Subtest bpc-switch: SUCCESS (4.537s) [253.040569] [058/132] (768s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-move) [253.136783] Starting subtest: fbc-1p-primscrn-cur-indfb-move [257.177723] Subtest fbc-1p-primscrn-cur-indfb-move: SUCCESS (4.040s) [258.327882] [059/132] (763s left) gem_vm_create (create-ext) [258.403471] Starting subtest: create-ext [258.408865] Subtest create-ext: SUCCESS (0.005s) [258.527858] [060/132] (763s left) syncobj_eventfd (invalid-illegal-handle) [258.580515] Starting subtest: invalid-illegal-handle [258.581529] Subtest invalid-illegal-handle: SUCCESS (0.000s) [258.681880] [061/132] (763s left) gem_mmap_offset (mmap-boundaries) [258.738358] Starting subtest: mmap-boundaries [258.739337] Starting dynamic subtest: smem0 [259.030438] Dynamic subtest smem0: SUCCESS (0.281s) [259.031749] Subtest mmap-boundaries: SUCCESS (0.283s) [259.135090] [062/132] (762s left) gem_pwrite_snooped [259.248584] [063/132] (762s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-render) [259.335122] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-render [259.336952] Subtest fbc-2p-scndscrn-spr-indfb-draw-render: SKIP (0.000s) [259.442090] [064/132] (762s left) kms_ccs (random-ccs-data-4-tiled-bmg-ccs) [259.530369] Starting subtest: random-ccs-data-4-tiled-bmg-ccs [259.532392] Subtest random-ccs-data-4-tiled-bmg-ccs: SKIP (0.000s) [260.636984] [065/132] (761s left) syncobj_timeline (invalid-multi-wait-unsubmitted-submitted) [260.694326] Starting subtest: invalid-multi-wait-unsubmitted-submitted [260.695463] Subtest invalid-multi-wait-unsubmitted-submitted: SUCCESS (0.000s) [260.792698] [066/132] (761s left) kms_setmode (invalid-clone-single-crtc) [260.852092] Starting subtest: invalid-clone-single-crtc [260.854763] Subtest invalid-clone-single-crtc: SKIP (0.000s) [260.940531] [067/132] (761s left) kms_frontbuffer_tracking (fbcpsr-stridechange) [261.039339] Starting subtest: fbcpsr-stridechange [267.289481] Subtest fbcpsr-stridechange: SUCCESS (6.251s) [267.408962] [068/132] (754s left) sysfs_timeslice_duration (timeout) [267.469644] Starting subtest: timeout [267.470696] Starting dynamic subtest: vecs0 [276.888211] Dynamic subtest vecs0: SUCCESS (9.408s) [276.897018] Starting dynamic subtest: ccs0 [278.192385] Dynamic subtest ccs0: SUCCESS (1.309s) [278.202449] Starting dynamic subtest: vcs0 [287.893261] Dynamic subtest vcs0: SUCCESS (9.691s) [287.902401] Starting dynamic subtest: bcs0 [288.586624] Dynamic subtest bcs0: SUCCESS (0.699s) [288.596880] Starting dynamic subtest: rcs0 [289.825076] Dynamic subtest rcs0: SUCCESS (1.235s) [289.833449] Starting dynamic subtest: vcs1 [298.914676] Dynamic subtest vcs1: SUCCESS (9.080s) [298.915810] Subtest timeout: SUCCESS (31.433s) [298.978196] [069/132] (723s left) kms_psr2_sf (fbc-psr2-cursor-plane-move-continuous-sf) [299.075820] Starting subtest: fbc-psr2-cursor-plane-move-continuous-sf [299.076891] Starting dynamic subtest: pipe-A-eDP-1 [299.155363] Dynamic subtest pipe-A-eDP-1: SKIP (0.077s) [299.162932] Starting dynamic subtest: pipe-B-eDP-1 [300.331228] Dynamic subtest pipe-B-eDP-1: SKIP (1.175s) [300.333275] Subtest fbc-psr2-cursor-plane-move-continuous-sf: SKIP (1.255s) [301.510537] [070/132] (720s left) kms_chamelium_hpd (vga-hpd-for-each-pipe) [301.899871] Subtest vga-hpd-for-each-pipe: SKIP (0.000s) [302.717901] [071/132] (719s left) gem_exec_reloc (basic-wc-cpu) [302.764095] Subtest basic-wc-cpu: SKIP (0.000s) [302.836992] [072/132] (719s left) kms_psr (pr-sprite-plane-onoff) [302.917431] Starting subtest: pr-sprite-plane-onoff [302.919203] Subtest pr-sprite-plane-onoff: SKIP (0.000s) [302.983945] [073/132] (719s left) kms_frontbuffer_tracking (fbcpsr-tiling-y) [303.073292] Starting subtest: fbcpsr-tiling-y [303.075114] Subtest fbcpsr-tiling-y: SKIP (0.000s) [303.159766] [074/132] (719s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-mmap-gtt) [303.242530] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-mmap-gtt [303.244303] Subtest fbc-2p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s) [303.335854] [075/132] (718s left) kms_psr (fbc-psr-cursor-render) [303.429332] Starting subtest: fbc-psr-cursor-render [303.430158] Starting dynamic subtest: eDP-1 [303.431893] Dynamic subtest eDP-1: SKIP (0.000s) [303.433726] Subtest fbc-psr-cursor-render: SKIP (0.001s) [303.498407] [076/132] (718s left) kms_universal_plane (universal-plane-functional) [303.580819] Starting subtest: universal-plane-functional [303.581975] Starting dynamic subtest: pipe-A-eDP-1 [307.615752] Dynamic subtest pipe-A-eDP-1: SUCCESS (4.033s) [307.624473] Starting dynamic subtest: pipe-B-eDP-1 [312.115990] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.498s) [312.125965] Starting dynamic subtest: pipe-C-eDP-1 [316.457377] Dynamic subtest pipe-C-eDP-1: SUCCESS (4.332s) [316.468557] Starting dynamic subtest: pipe-D-eDP-1 [320.776099] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.325s) [320.776992] Subtest universal-plane-functional: SUCCESS (17.194s) [321.641358] [077/132] (700s left) kms_plane (pixel-format-4-tiled-modifier) [321.735261] Starting subtest: pixel-format-4-tiled-modifier [321.764510] Starting dynamic subtest: pipe-A-plane-0 [322.464569] Dynamic subtest pipe-A-plane-0: SUCCESS (0.700s) [322.474371] Starting dynamic subtest: pipe-A-plane-3 [322.898009] Dynamic subtest pipe-A-plane-3: SUCCESS (0.431s) [322.910570] Starting dynamic subtest: pipe-A-plane-5 [322.912352] Dynamic subtest pipe-A-plane-5: SKIP (0.000s) [324.035928] Starting dynamic subtest: pipe-B-plane-0 [324.672823] Dynamic subtest pipe-B-plane-0: SUCCESS (0.644s) [324.681877] Starting dynamic subtest: pipe-B-plane-3 [325.083927] Dynamic subtest pipe-B-plane-3: SUCCESS (0.409s) [325.091821] Starting dynamic subtest: pipe-B-plane-5 [325.093531] Dynamic subtest pipe-B-plane-5: SKIP (0.000s) [325.402291] Subtest pixel-format-4-tiled-modifier: SUCCESS (3.666s) [326.200010] [078/132] (696s left) kms_big_fb (4-tiled-16bpp-rotate-180) [326.301490] Starting subtest: 4-tiled-16bpp-rotate-180 [327.657528] Subtest 4-tiled-16bpp-rotate-180: SUCCESS (1.356s) [327.780872] [079/132] (694s left) gem_mmap_gtt (basic-read-write-distinct) [327.830795] Subtest basic-read-write-distinct: SKIP (0.000s) [327.890981] [080/132] (694s left) gem_exec_schedule (u-semaphore-resolve) [327.945598] Starting subtest: u-semaphore-resolve [327.980825] Subtest u-semaphore-resolve: SUCCESS (0.035s) [328.337187] [081/132] (694s left) kms_addfb_basic (bad-pitch-1024) [328.403103] Starting subtest: bad-pitch-1024 [328.404032] Subtest bad-pitch-1024: SUCCESS (0.000s) [328.546148] [082/132] (694s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-plflip-blt) [328.634059] Starting subtest: fbc-1p-primscrn-shrfb-plflip-blt [333.395411] Subtest fbc-1p-primscrn-shrfb-plflip-blt: SUCCESS (4.761s) [334.510972] [083/132] (688s left) kms_content_protection (mei-interface) [334.652669] Starting subtest: mei-interface [334.654647] Subtest mei-interface: SKIP (0.001s) [334.753374] [084/132] (687s left) kms_cursor_legacy (flip-vs-cursor-atomic-transitions) [334.861917] Starting subtest: flip-vs-cursor-atomic-transitions [342.590050] Subtest flip-vs-cursor-atomic-transitions: SUCCESS (7.727s) [343.437857] [085/132] (679s left) gem_mmap_gtt (basic-small-bo-tiledx) [343.502568] Subtest basic-small-bo-tiledX: SKIP (0.000s) [343.554785] [086/132] (679s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-32bpp-ytile-upscaling) [343.655458] Starting subtest: flip-64bpp-ytile-to-32bpp-ytile-upscaling [343.657059] Subtest flip-64bpp-ytile-to-32bpp-ytile-upscaling: SKIP (0.000s) [343.721376] [087/132] (679s left) kms_cursor_crc (cursor-offscreen-64x64) [343.904892] Starting subtest: cursor-offscreen-64x64 [343.909585] Starting dynamic subtest: pipe-A-eDP-1 [345.843534] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.933s) [345.880044] Starting dynamic subtest: pipe-D-eDP-1 [348.444589] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.577s) [348.445689] Subtest cursor-offscreen-64x64: SUCCESS (4.538s) [349.292655] [088/132] (673s left) kms_dirtyfb (fbc-dirtyfb-ioctl) [349.382073] Starting subtest: fbc-dirtyfb-ioctl [349.383029] Starting dynamic subtest: A-eDP-1 [351.962267] Dynamic subtest A-eDP-1: SUCCESS (2.579s) [351.963023] Subtest fbc-dirtyfb-ioctl: SUCCESS (2.581s) [352.767993] [089/132] (670s left) kms_psr (fbc-pr-cursor-plane-move) [352.872610] Starting subtest: fbc-pr-cursor-plane-move [352.874502] Subtest fbc-pr-cursor-plane-move: SKIP (0.000s) [352.940913] [090/132] (669s left) kms_plane_lowres (tiling-4) [353.035708] Starting subtest: tiling-4 [353.036630] Starting dynamic subtest: pipe-A-eDP-1 [353.039008] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [353.350040] Starting dynamic subtest: pipe-B-eDP-1 [353.351843] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [353.359374] Starting dynamic subtest: pipe-C-eDP-1 [353.361100] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [353.368538] Starting dynamic subtest: pipe-D-eDP-1 [353.370308] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [353.372162] Subtest tiling-4: SKIP (0.308s) [354.184519] [091/132] (668s left) kms_big_fb (y-tiled-64bpp-rotate-90) [354.305172] Starting subtest: y-tiled-64bpp-rotate-90 [354.307193] Subtest y-tiled-64bpp-rotate-90: SKIP (0.000s) [354.397384] [092/132] (668s left) kms_pm_rpm (fences-dpms) [356.038096] Starting subtest: fences-dpms [356.039873] Subtest fences-dpms: SKIP (0.000s) [356.634336] [093/132] (666s left) kms_ccs (crc-primary-basic-4-tiled-dg2-rc-ccs) [356.714411] Starting subtest: crc-primary-basic-4-tiled-dg2-rc-ccs [356.715334] Starting dynamic subtest: pipe-A-eDP-1 [356.723535] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [356.731605] Starting dynamic subtest: pipe-B-eDP-1 [356.740253] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [356.748220] Starting dynamic subtest: pipe-C-eDP-1 [356.756371] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [356.763783] Starting dynamic subtest: pipe-D-eDP-1 [356.772562] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [356.774267] Subtest crc-primary-basic-4-tiled-dg2-rc-ccs: SKIP (0.006s) [358.907761] [094/132] (664s left) dmabuf (all-tests) [358.941860] Starting subtest: all-tests [358.942797] Starting dynamic subtest: sanitycheck [359.080928] Dynamic subtest sanitycheck: SUCCESS (0.138s) [359.094862] Starting dynamic subtest: dma_fence [359.276180] Dynamic subtest dma_fence: SUCCESS (0.193s) [359.289239] Starting dynamic subtest: dma_fence_chain [369.168467] Dynamic subtest dma_fence_chain: SUCCESS (9.880s) [369.177700] Starting dynamic subtest: dma_fence_unwrap [369.251850] Dynamic subtest dma_fence_unwrap: SUCCESS (0.088s) [369.265467] Starting dynamic subtest: dma_resv [369.354030] Dynamic subtest dma_resv: SUCCESS (0.100s) [369.355499] Subtest all-tests: SUCCESS (10.412s) [369.417811] [095/132] (653s left) kms_psr (fbc-psr2-cursor-render) [369.508868] Starting subtest: fbc-psr2-cursor-render [369.509675] Starting dynamic subtest: eDP-1 [369.511238] Dynamic subtest eDP-1: SKIP (0.000s) [369.512768] Subtest fbc-psr2-cursor-render: SKIP (0.001s) [369.580763] [096/132] (653s left) gem_exec_flush (basic-uc-pro-default) [369.633660] Starting subtest: basic-uc-pro-default [375.101962] Subtest basic-uc-pro-default: SUCCESS (5.468s) [375.287879] [097/132] (647s left) syncobj_wait (multi-wait-for-submit-unsubmitted-submitted) [375.342320] Starting subtest: multi-wait-for-submit-unsubmitted-submitted [375.450326] Subtest multi-wait-for-submit-unsubmitted-submitted: SUCCESS (0.106s) [375.523434] [098/132] (647s left) gem_userptr_blits (sync-overlap) [375.597419] Starting subtest: sync-overlap [375.598345] Subtest sync-overlap: SUCCESS (0.000s) [375.714352] [099/132] (647s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-move) [375.810538] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-move [375.812214] Subtest fbcpsr-2p-scndscrn-spr-indfb-move: SKIP (0.000s) [375.901538] [100/132] (647s left) gem_exec_whisper (basic-queues-forked-all) [375.957434] Starting subtest: basic-queues-forked-all [394.378515] Subtest basic-queues-forked-all: SUCCESS (18.410s) [394.551523] [101/132] (628s left) gem_exec_params (readonly) [394.616409] Starting subtest: readonly [394.622081] Subtest readonly: SUCCESS (0.006s) [394.709315] [102/132] (628s left) prime_self_import (basic-llseek-size) [394.742596] Starting subtest: basic-llseek-size [394.755091] Subtest basic-llseek-size: SUCCESS (0.013s) [394.852193] [103/132] (628s left) sriov_basic (bind-unbind-vf) [394.893540] Starting subtest: bind-unbind-vf [394.896466] Starting dynamic subtest: vf-1 [394.927784] Dynamic subtest vf-1: FAIL (0.015s) [394.938291] Starting dynamic subtest: vf-2 [394.968239] Dynamic subtest vf-2: FAIL (0.006s) [394.978021] Starting dynamic subtest: vf-3 [395.004532] Dynamic subtest vf-3: FAIL (0.004s) [395.012038] Starting dynamic subtest: vf-4 [395.037366] Dynamic subtest vf-4: FAIL (0.004s) [395.044880] Starting dynamic subtest: vf-5 [395.070361] Dynamic subtest vf-5: FAIL (0.004s) [395.077825] Starting dynamic subtest: vf-6 [395.104748] Dynamic subtest vf-6: FAIL (0.004s) [395.112226] Starting dynamic subtest: vf-7 [395.137858] Dynamic subtest vf-7: FAIL (0.004s) [395.145357] Starting dynamic subtest: vf-random [395.172589] Dynamic subtest vf-random: FAIL (0.004s) [395.180080] Starting dynamic subtest: vf-last [395.206102] Dynamic subtest vf-last: FAIL (0.004s) [395.206881] Subtest bind-unbind-vf: FAIL (0.056s) [395.240664] [104/132] (628s left) kms_cursor_legacy (cursorb-vs-flipa-atomic-transitions-varying-size) [395.353801] Starting subtest: cursorB-vs-flipA-atomic-transitions-varying-size [395.355601] Subtest cursorB-vs-flipA-atomic-transitions-varying-size: SKIP (0.001s) [395.490160] [105/132] (627s left) gem_exec_whisper (basic-fds-forked) [395.548499] Starting subtest: basic-fds-forked [419.592163] Subtest basic-fds-forked: SUCCESS (24.032s) [419.770353] [106/132] (603s left) kms_psr2_sf (pr-overlay-primary-update-sf-dmg-area) [419.871718] Starting subtest: pr-overlay-primary-update-sf-dmg-area [419.873660] Subtest pr-overlay-primary-update-sf-dmg-area: SKIP (0.000s) [419.958659] [107/132] (603s left) gem_ctx_isolation (nonpriv-switch) [420.018549] Starting subtest: nonpriv-switch [420.019694] Starting dynamic subtest: rcs0 [420.313898] Dynamic subtest rcs0: SUCCESS (0.295s) [420.324829] Starting dynamic subtest: bcs0 [420.629063] Dynamic subtest bcs0: SUCCESS (0.314s) [420.639846] Starting dynamic subtest: vcs0 [420.938797] Dynamic subtest vcs0: SUCCESS (0.309s) [420.948871] Starting dynamic subtest: vcs1 [422.170377] Dynamic subtest vcs1: SUCCESS (1.230s) [422.181198] Starting dynamic subtest: vecs0 [424.217647] Dynamic subtest vecs0: SUCCESS (2.046s) [424.227323] Starting dynamic subtest: ccs0 [426.272303] Dynamic subtest ccs0: SUCCESS (2.053s) [426.273708] Subtest nonpriv-switch: SUCCESS (6.254s) [426.514512] [108/132] (596s left) perf_pmu (interrupts-sync) [426.557230] Starting subtest: interrupts-sync [427.687577] Subtest interrupts-sync: SUCCESS (1.120s) [427.785515] [109/132] (595s left) kms_addfb_basic (addfb25-yf-tiled-legacy) [427.874797] Starting subtest: addfb25-yf-tiled-legacy [427.875697] Subtest addfb25-yf-tiled-legacy: SUCCESS (0.000s) [427.970217] [110/132] (595s left) kms_pipe_stress (stress-xrgb8888-yftiled) [428.065105] Starting subtest: stress-xrgb8888-yftiled [428.066836] Subtest stress-xrgb8888-yftiled: SKIP (0.000s) [428.131560] [111/132] (595s left) kms_joiner (invalid-modeset-big-joiner) [428.218868] Starting subtest: invalid-modeset-big-joiner [428.220548] Subtest invalid-modeset-big-joiner: SKIP (0.000s) [428.297426] [112/132] (595s left) kms_getfb (getfb-handle-valid) [428.392819] Starting subtest: getfb-handle-valid [428.393743] Subtest getfb-handle-valid: SUCCESS (0.000s) [428.496938] [113/132] (595s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-render) [428.588057] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-render [428.590072] Subtest fbc-2p-primscrn-pri-shrfb-draw-render: SKIP (0.000s) [428.687599] [114/132] (595s left) gem_exec_fence (syncobj-channel) [429.140623] Starting subtest: syncobj-channel [430.164179] Subtest syncobj-channel: SUCCESS (1.015s) [430.989821] [115/132] (592s left) api_intel_allocator (fork-simple-stress-signal) [431.042860] Starting subtest: fork-simple-stress-signal [436.492637] Subtest fork-simple-stress-signal: SUCCESS (5.405s) [436.569299] [116/132] (587s left) i915_hangman (gt-engine-error) [436.646083] Starting subtest: gt-engine-error [436.647472] Starting dynamic subtest: rcs0 [437.884668] Dynamic subtest rcs0: SUCCESS (1.229s) [437.898374] Starting dynamic subtest: bcs0 [439.872989] Dynamic subtest bcs0: SUCCESS (1.985s) [439.884871] Starting dynamic subtest: vcs0 [441.917918] Dynamic subtest vcs0: SUCCESS (2.042s) [441.929532] Starting dynamic subtest: vcs1 [443.899720] Dynamic subtest vcs1: SUCCESS (1.979s) [443.910553] Starting dynamic subtest: vecs0 [445.819842] Dynamic subtest vecs0: SUCCESS (1.917s) [445.831298] Starting dynamic subtest: ccs0 [447.868393] Dynamic subtest ccs0: SUCCESS (2.045s) [447.870050] Subtest gt-engine-error: SUCCESS (11.214s) [447.992296] [117/132] (575s left) kms_flip_scaled_crc (flip-64bpp-yftile-to-16bpp-yftile-downscaling) [448.085228] Starting subtest: flip-64bpp-yftile-to-16bpp-yftile-downscaling [448.087210] Subtest flip-64bpp-yftile-to-16bpp-yftile-downscaling: SKIP (0.000s) [448.152719] [118/132] (575s left) kms_ccs (crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc) [448.232018] Starting subtest: crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc [448.232970] Starting dynamic subtest: pipe-A-eDP-1 [448.241992] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [448.251433] Starting dynamic subtest: pipe-B-eDP-1 [448.259813] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [448.268093] Starting dynamic subtest: pipe-C-eDP-1 [448.276179] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [448.283862] Starting dynamic subtest: pipe-D-eDP-1 [448.292452] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [448.293965] Subtest crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc: SKIP (0.006s) [450.386659] [119/132] (573s left) kms_pm_rpm (basic-pci-d3-state) [452.113620] Starting subtest: basic-pci-d3-state [453.593652] Subtest basic-pci-d3-state: SUCCESS (1.481s) [453.677283] [120/132] (570s left) gem_render_copy (yf-tiled) [453.745529] Starting subtest: yf-tiled [453.747359] Subtest yf-tiled: SKIP (0.000s) [453.924447] [121/132] (570s left) gem_caching (reads) [453.983145] Subtest reads: SKIP (0.000s) [454.034525] [122/132] (569s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-render) [454.131163] Starting subtest: psr-1p-primscrn-spr-indfb-draw-render [460.914386] Subtest psr-1p-primscrn-spr-indfb-draw-render: SUCCESS (6.783s) [461.034241] [123/132] (562s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-move) [461.127634] Starting subtest: fbc-2p-scndscrn-spr-indfb-move [461.129396] Subtest fbc-2p-scndscrn-spr-indfb-move: SKIP (0.000s) [461.213474] [124/132] (562s left) kms_ccs (random-ccs-data-4-tiled-lnl-ccs) [461.298407] Starting subtest: random-ccs-data-4-tiled-lnl-ccs [461.300290] Subtest random-ccs-data-4-tiled-lnl-ccs: SKIP (0.000s) [462.413264] [125/132] (561s left) gem_ctx_persistence (heartbeat-hang) [462.477342] Starting subtest: heartbeat-hang [462.479030] Subtest heartbeat-hang: SKIP (0.000s) [462.589846] [126/132] (561s left) kms_ccs (bad-aux-stride-y-tiled-ccs) [462.679808] Starting subtest: bad-aux-stride-y-tiled-ccs [462.680785] Starting dynamic subtest: pipe-A-eDP-1 [462.689586] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [462.697934] Starting dynamic subtest: pipe-B-eDP-1 [462.707231] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [462.717082] Starting dynamic subtest: pipe-C-eDP-1 [462.725658] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [462.734147] Starting dynamic subtest: pipe-D-eDP-1 [462.742905] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [462.744566] Subtest bad-aux-stride-y-tiled-ccs: SKIP (0.006s) [464.876431] [127/132] (559s left) gem_softpin (noreloc-interruptible) [464.938496] Starting subtest: noreloc-interruptible [470.410196] Subtest noreloc-interruptible: SUCCESS (5.424s) [470.492188] [128/132] (553s left) perf_pmu (busy) [470.524826] Starting subtest: busy [470.525737] Starting dynamic subtest: rcs0 [471.105201] Dynamic subtest rcs0: SUCCESS (0.579s) [471.117353] Starting dynamic subtest: bcs0 [471.677585] Dynamic subtest bcs0: SUCCESS (0.570s) [471.689970] Starting dynamic subtest: vcs0 [472.926859] Dynamic subtest vcs0: SUCCESS (1.237s) [472.937841] Starting dynamic subtest: vcs1 [474.910974] Dynamic subtest vcs1: SUCCESS (1.981s) [474.924049] Starting dynamic subtest: vecs0 [476.894618] Dynamic subtest vecs0: SUCCESS (1.981s) [476.904449] Starting dynamic subtest: ccs0 [477.447731] Dynamic subtest ccs0: SUCCESS (0.560s) [477.451031] Subtest busy: SUCCESS (6.923s) [477.535832] [129/132] (546s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-mmap-cpu) [477.627319] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-mmap-cpu [477.628792] Subtest psr-2p-scndscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s) [477.733973] [130/132] (546s left) kms_vblank (query-forked-busy-hang) [477.821375] Starting subtest: query-forked-busy-hang [477.822279] Starting dynamic subtest: pipe-A-eDP-1 [504.663727] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.839s) [504.674079] Starting dynamic subtest: pipe-D-eDP-1 [529.687113] Dynamic subtest pipe-D-eDP-1: SUCCESS (25.019s) [529.688022] Subtest query-forked-busy-hang: SUCCESS (51.862s) [530.528583] [131/132] (493s left) syncobj_timeline (etime-multi-wait-for-submit-unsubmitted) [530.580175] Starting subtest: etime-multi-wait-for-submit-unsubmitted [530.681649] Subtest etime-multi-wait-for-submit-unsubmitted: SUCCESS (0.101s) [530.753838] [132/132] (493s left) gem_softpin (softpin) [530.809476] Starting subtest: softpin [563.086193] Subtest softpin: SUCCESS (32.266s) [563.207874] Closing watchdogs results: parsing output: 0/ for test: kms_rotation_crc results: parsing output: 1/ for test: kms_big_fb results: parsing output: 2/ for test: syncobj_timeline results: parsing output: 3/ for test: kms_color results: parsing output: 4/ for test: gem_ctx_engines results: parsing output: 5/ for test: gem_exec_reloc results: parsing output: 6/ for test: syncobj_wait results: parsing output: 7/ for test: kms_dsc results: parsing output: 8/ for test: gem_mmap_gtt results: parsing output: 9/ for test: kms_frontbuffer_tracking results: parsing output: 10/ for test: syncobj_timeline results: parsing output: 11/ for test: kms_big_fb results: parsing output: 12/ for test: gem_wait results: parsing output: 13/ for test: kms_flip results: parsing output: 14/ for test: syncobj_wait results: parsing output: 15/ for test: kms_rotation_crc results: parsing output: 16/ for test: gem_exec_reloc results: parsing output: 17/ for test: kms_pipe_b_c_ivb results: parsing output: 18/ for test: kms_cursor_edge_walk results: parsing output: 19/ for test: gem_userptr_blits results: parsing output: 20/ for test: kms_flip results: parsing output: 21/ for test: i915_drm_fdinfo results: parsing output: 22/ for test: gem_mmap_gtt results: parsing output: 23/ for test: kms_plane_scaling results: parsing output: 24/ for test: core_getstats results: parsing output: 25/ for test: kms_psr results: parsing output: 26/ for test: gem_ctx_param results: parsing output: 27/ for test: kms_big_fb results: parsing output: 28/ for test: gem_mmap_gtt results: parsing output: 29/ for test: gem_exec_balancer results: parsing output: 30/ for test: kms_frontbuffer_tracking results: parsing output: 31/ for test: i915_pm_rpm results: parsing output: 32/ for test: kms_legacy_colorkey results: parsing output: 33/ for test: kms_frontbuffer_tracking results: parsing output: 34/ for test: perf_pmu results: parsing output: 35/ for test: kms_big_fb results: parsing output: 36/ for test: kms_flip results: parsing output: 37/ for test: kms_frontbuffer_tracking results: parsing output: 38/ for test: kms_big_fb results: parsing output: 39/ for test: gem_ringfill results: parsing output: 40/ for test: gem_pwrite results: parsing output: 41/ for test: fbdev results: parsing output: 42/ for test: kms_cursor_crc results: parsing output: 43/ for test: gen9_exec_parse results: parsing output: 44/ for test: kms_frontbuffer_tracking results: parsing output: 45/ for test: gem_exec_big results: parsing output: 46/ for test: kms_frontbuffer_tracking results: parsing output: 47/ for test: kms_plane_scaling results: parsing output: 48/ for test: kms_frontbuffer_tracking results: parsing output: 49/ for test: kms_busy results: parsing output: 50/ for test: gem_exec_schedule results: parsing output: 51/ for test: i915_selftest results: parsing output: 52/ for test: kms_chamelium_frames results: parsing output: 53/ for test: gem_exec_params results: parsing output: 54/ for test: gem_spin_batch results: parsing output: 55/ for test: gem_exec_gttfill results: parsing output: 56/ for test: kms_hdr results: parsing output: 57/ for test: kms_frontbuffer_tracking results: parsing output: 58/ for test: gem_vm_create results: parsing output: 59/ for test: syncobj_eventfd results: parsing output: 60/ for test: gem_mmap_offset results: parsing output: 61/ for test: gem_pwrite_snooped results: parsing output: 62/ for test: kms_frontbuffer_tracking results: parsing output: 63/ for test: kms_ccs results: parsing output: 64/ for test: syncobj_timeline results: parsing output: 65/ for test: kms_setmode results: parsing output: 66/ for test: kms_frontbuffer_tracking results: parsing output: 67/ for test: sysfs_timeslice_duration results: parsing output: 68/ for test: kms_psr2_sf results: parsing output: 69/ for test: kms_chamelium_hpd results: parsing output: 70/ for test: gem_exec_reloc results: parsing output: 71/ for test: kms_psr results: parsing output: 72/ for test: kms_frontbuffer_tracking results: parsing output: 73/ for test: kms_frontbuffer_tracking results: parsing output: 74/ for test: kms_psr results: parsing output: 75/ for test: kms_universal_plane results: parsing output: 76/ for test: kms_plane results: parsing output: 77/ for test: kms_big_fb results: parsing output: 78/ for test: gem_mmap_gtt results: parsing output: 79/ for test: gem_exec_schedule results: parsing output: 80/ for test: kms_addfb_basic results: parsing output: 81/ for test: kms_frontbuffer_tracking results: parsing output: 82/ for test: kms_content_protection results: parsing output: 83/ for test: kms_cursor_legacy results: parsing output: 84/ for test: gem_mmap_gtt results: parsing output: 85/ for test: kms_flip_scaled_crc results: parsing output: 86/ for test: kms_cursor_crc results: parsing output: 87/ for test: kms_dirtyfb results: parsing output: 88/ for test: kms_psr results: parsing output: 89/ for test: kms_plane_lowres results: parsing output: 90/ for test: kms_big_fb results: parsing output: 91/ for test: kms_pm_rpm results: parsing output: 92/ for test: kms_ccs results: parsing output: 93/ for test: dmabuf results: parsing output: 94/ for test: kms_psr results: parsing output: 95/ for test: gem_exec_flush results: parsing output: 96/ for test: syncobj_wait results: parsing output: 97/ for test: gem_userptr_blits results: parsing output: 98/ for test: kms_frontbuffer_tracking results: parsing output: 99/ for test: gem_exec_whisper results: parsing output: 100/ for test: gem_exec_params results: parsing output: 101/ for test: prime_self_import results: parsing output: 102/ for test: sriov_basic results: parsing output: 103/ for test: kms_cursor_legacy results: parsing output: 104/ for test: gem_exec_whisper results: parsing output: 105/ for test: kms_psr2_sf results: parsing output: 106/ for test: gem_ctx_isolation results: parsing output: 107/ for test: perf_pmu results: parsing output: 108/ for test: kms_addfb_basic results: parsing output: 109/ for test: kms_pipe_stress results: parsing output: 110/ for test: kms_joiner results: parsing output: 111/ for test: kms_getfb results: parsing output: 112/ for test: kms_frontbuffer_tracking results: parsing output: 113/ for test: gem_exec_fence results: parsing output: 114/ for test: api_intel_allocator results: parsing output: 115/ for test: i915_hangman results: parsing output: 116/ for test: kms_flip_scaled_crc results: parsing output: 117/ for test: kms_ccs results: parsing output: 118/ for test: kms_pm_rpm results: parsing output: 119/ for test: gem_render_copy results: parsing output: 120/ for test: gem_caching results: parsing output: 121/ for test: kms_frontbuffer_tracking results: parsing output: 122/ for test: kms_frontbuffer_tracking results: parsing output: 123/ for test: kms_ccs results: parsing output: 124/ for test: gem_ctx_persistence results: parsing output: 125/ for test: kms_ccs results: parsing output: 126/ for test: gem_softpin results: parsing output: 127/ for test: perf_pmu results: parsing output: 128/ for test: kms_frontbuffer_tracking results: parsing output: 129/ for test: kms_vblank results: parsing output: 130/ for test: syncobj_timeline results: parsing output: 131/ for test: gem_softpin Done.