mrousavy / react-native-vision-camera

šŸ“ø A powerful, high-performance React Native Camera library.
https://react-native-vision-camera.com
MIT License
7.26k stars 1.06k forks source link

šŸ› Memory leak Android #2908

Open ismaelsousa opened 3 months ago

ismaelsousa commented 3 months ago

What's happening?

While recording the camera is consuming all memory and not releasing it.

Reproduceable Code

Code of shadow lens

Relevant log output

--------- beginning of crash
05-23 11:18:49.858 16518 16531 E AndroidRuntime: FATAL EXCEPTION: binder:16518_2
05-23 11:18:49.858 16518 16531 E AndroidRuntime: Process: com.mrousavy.shadowlens, PID: 16518
05-23 11:18:49.858 16518 16531 E AndroidRuntime: java.lang.OutOfMemoryError: Failed to allocate a 80 byte allocation with 35808 free bytes and 34KB until OOM, target footprint 268435456, growth limit 268435456; giving up on allocation because <1% of heap free after GC.
05-23 11:18:49.858 16518 16531 E AndroidRuntime:    at android.hardware.camera2.impl.CaptureResultExtras$1.createFromParcel(CaptureResultExtras.java:43)
05-23 11:18:49.858 16518 16531 E AndroidRuntime:    at android.hardware.camera2.impl.CaptureResultExtras$1.createFromParcel(CaptureResultExtras.java:40)
05-23 11:18:49.858 16518 16531 E AndroidRuntime:    at android.os.Parcel.readTypedObject(Parcel.java:3999)
05-23 11:18:49.858 16518 16531 E AndroidRuntime:    at android.hardware.camera2.ICameraDeviceCallbacks$Stub.onTransact(ICameraDeviceCallbacks.java:148)
05-23 11:18:49.858 16518 16531 E AndroidRuntime:    at android.os.Binder.execTransactInternal(Binder.java:1299)
05-23 11:18:49.858 16518 16531 E AndroidRuntime:    at android.os.Binder.execTransact(Binder.java:1253)
05-23 11:18:49.878 16518 16531 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:49.889 16518 18617 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:49.889 16518 18617 I savy.shadowlens: Alloc concurrent copying GC freed 4(88B) AllocSpace objects, 0(0B) LOS objects, 0% free, 255MB/256MB, paused 167us,87us total 61.738ms
05-23 11:18:49.889 16518 16518 I savy.shadowlens: WaitForGcToComplete blocked Alloc on Alloc for 188.682ms
05-23 11:18:49.889 16518 16518 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:49.889 16518 18413 I savy.shadowlens: WaitForGcToComplete blocked Alloc on Alloc for 181.765ms
05-23 11:18:49.889 16518 18413 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:49.889 16518 18617 W savy.shadowlens: Throwing OutOfMemoryError "Failed to allocate a 2712 byte allocation with 136 free bytes and 136B until OOM, target footprint 268435456, growth limit 268435456" (VmSize 13918424 kB)
05-23 11:18:49.889 16518 16526 I savy.shadowlens: WaitForGcToComplete blocked Background on Alloc for 134.055ms
05-23 11:18:49.889 16518 18413 I savy.shadowlens: Forcing collection of SoftReferences for 64B allocation
05-23 11:18:49.889 16518 18413 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:49.889 16518 16518 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:49.889 16518 16591 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:49.890 16518 16531 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:49.890 16518 18617 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:49.892 16518 16528 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:49.950 16518 16768 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:49.951 16518 18413 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:49.951 16518 18413 I savy.shadowlens: Alloc concurrent copying GC freed 338(28KB) AllocSpace objects, 0(0B) LOS objects, 0% free, 255MB/256MB, paused 200us,121us total 61.158ms
05-23 11:18:49.951 16518 18413 W savy.shadowlens: Throwing OutOfMemoryError "Failed to allocate a 64 byte allocation with 28696 free bytes and 28KB until OOM, target footprint 268435456, growth limit 268435456; giving up on allocation because <1% of heap free after GC." (VmSize 13918424 kB)
05-23 11:18:49.951 16518 18413 E AndroidRuntime: FATAL EXCEPTION: ExoPlayer:Playback
05-23 11:18:49.951 16518 18413 E AndroidRuntime: Process: com.mrousavy.shadowlens, PID: 16518
05-23 11:18:49.951 16518 18413 E AndroidRuntime: java.lang.OutOfMemoryError: Failed to allocate a 64 byte allocation with 28696 free bytes and 28KB until OOM, target footprint 268435456, growth limit 268435456; giving up on allocation because <1% of heap free after GC.
05-23 11:18:49.951 16518 18413 E AndroidRuntime:    at android.media.MediaCodec.getBuffer(Native Method)
05-23 11:18:49.951 16518 18413 E AndroidRuntime:    at android.media.MediaCodec.getOutputBuffer(MediaCodec.java:4149)
05-23 11:18:49.951 16518 18413 E AndroidRuntime:    at androidx.media3.exoplayer.mediacodec.AsynchronousMediaCodecAdapter.getOutputBuffer(AsynchronousMediaCodecAdapter.java:218)
05-23 11:18:49.951 16518 18413 E AndroidRuntime:    at androidx.media3.exoplayer.mediacodec.MediaCodecRenderer.drainOutputBuffer(MediaCodecRenderer.java:1894)
05-23 11:18:49.951 16518 18413 E AndroidRuntime:    at androidx.media3.exoplayer.mediacodec.MediaCodecRenderer.render(MediaCodecRenderer.java:816)
05-23 11:18:49.951 16518 18413 E AndroidRuntime:    at androidx.media3.exoplayer.video.MediaCodecVideoRenderer.render(MediaCodecVideoRenderer.java:852)
05-23 11:18:49.951 16518 18413 E AndroidRuntime:    at androidx.media3.exoplayer.ExoPlayerImplInternal.doSomeWork(ExoPlayerImplInternal.java:1047)
05-23 11:18:49.951 16518 18413 E AndroidRuntime:    at androidx.media3.exoplayer.ExoPlayerImplInternal.handleMessage(ExoPlayerImplInternal.java:522)
05-23 11:18:49.951 16518 18413 E AndroidRuntime:    at android.os.Handler.dispatchMessage(Handler.java:107)
05-23 11:18:49.951 16518 18413 E AndroidRuntime:    at android.os.Looper.loopOnce(Looper.java:238)
05-23 11:18:49.951 16518 18413 E AndroidRuntime:    at android.os.Looper.loop(Looper.java:357)
05-23 11:18:49.951 16518 18413 E AndroidRuntime:    at android.os.HandlerThread.run(HandlerThread.java:85)
05-23 11:18:49.953 16518 16518 I savy.shadowlens: WaitForGcToComplete blocked Alloc on Alloc for 63.211ms
05-23 11:18:49.953 16518 16518 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:49.953 16518 16526 I savy.shadowlens: WaitForGcToComplete blocked Background on Alloc for 63.475ms
05-23 11:18:49.953 16518 16531 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:49.953 16518 18617 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:49.954 16518 16591 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:49.954 16518 16768 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:49.954 16518 16528 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:49.976 16518 16531 I savy.shadowlens: WaitForGcToComplete blocked Alloc on Background for 97.792ms
05-23 11:18:49.976 16518 16531 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:49.976 16518 16591 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:49.976 16518 18617 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:49.976 16518 16768 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:49.977 16518 16528 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:49.997  2128  2310 W ContextImpl: Calling a method in the system process without a qualified user: android.app.ContextImpl.sendBroadcast:1215 com.android.server.location.provider.LocationProviderManager$LocationRegistration$1.test:1028 com.android.server.location.provider.LocationProviderManager$LocationRegistration$1.test:987 android.location.LocationResult.filter:191 com.android.server.location.provider.LocationProviderManager$LocationRegistration.acceptLocationChange:986 
05-23 11:18:49.999  2128  2310 W ContextImpl: Calling a method in the system process without a qualified user: android.app.ContextImpl.sendBroadcast:1215 com.android.server.location.provider.LocationProviderManager$LocationRegistration$1.test:1028 com.android.server.location.provider.LocationProviderManager$LocationRegistration$1.test:987 android.location.LocationResult.filter:191 com.android.server.location.provider.LocationProviderManager$LocationRegistration.acceptLocationChange:986 
05-23 11:18:50.005  3387  4461 I FusedLocation: (REDACTED) location delivery to %s blocked - too fast
05-23 11:18:50.006  3387  4461 I FusedLocation: (REDACTED) location delivery to %s blocked - too fast
05-23 11:18:50.008  3387  4461 I FusedLocation: (REDACTED) location delivery to %s blocked - too close
05-23 11:18:50.016  1199  3367 D DlbDap2Process: process() called [2000] times with input channel mask 0x3 (ProcessingMode=1)
05-23 11:18:50.021 16518 16597 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:50.026 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:50.026 16518 16591 I savy.shadowlens: WaitForGcToComplete blocked Alloc on Background for 318.993ms
05-23 11:18:50.026 16518 16591 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:50.026 16518 18617 I savy.shadowlens: WaitForGcToComplete blocked Alloc on Background for 136.292ms
05-23 11:18:50.026 16518 18617 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:50.026 16518 16768 I savy.shadowlens: WaitForGcToComplete blocked Alloc on Background for 76.657ms
05-23 11:18:50.026 16518 16768 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:50.027 16518 18617 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:50.027 16518 18659 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:50.027 16518 18659 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:50.027 16518 18617 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:50.027 16518 16591 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:50.027 16518 16528 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:50.027 16518 16597 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:50.027 16518 16768 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:50.032 16518 16518 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:50.046 16518 18659 I savy.shadowlens: Alloc young concurrent copying GC freed 471(15KB) AllocSpace objects, 0(0B) LOS objects, 0% free, 255MB/256MB, paused 100us,92us total 19.459ms
05-23 11:18:50.046 16518 18659 I savy.shadowlens: Forcing collection of SoftReferences for 32B allocation
05-23 11:18:50.046 16518 18659 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:50.047 16518 18617 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:50.047 16518 16591 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:50.047 16518 16528 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:50.047 16518 16597 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:50.047 16518 16768 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:50.047 16518 16518 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:50.058 17414 18655 D TrafficStats: tagSocket(135) with statsTag=0xffffffff, statsUid=-1
05-23 11:18:50.094 16518 18659 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:50.094 16518 18659 I savy.shadowlens: Alloc concurrent copying GC freed 99(6608B) AllocSpace objects, 0(0B) LOS objects, 0% free, 255MB/256MB, paused 122us,79us total 47.690ms
05-23 11:18:50.094 16518 18617 I savy.shadowlens: WaitForGcToComplete blocked Alloc on Alloc for 67.652ms
05-23 11:18:50.094 16518 18617 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:50.095 16518 18617 I savy.shadowlens: Forcing collection of SoftReferences for 272B allocation
05-23 11:18:50.095 16518 16591 I savy.shadowlens: WaitForGcToComplete blocked Alloc on Alloc for 67.729ms
05-23 11:18:50.095 16518 18659 W savy.shadowlens: Throwing OutOfMemoryError "Failed to allocate a 32 byte allocation with 22200 free bytes and 21KB until OOM, target footprint 268435456, growth limit 268435456; giving up on allocation because <1% of heap free after GC." (VmSize 13935908 kB)
05-23 11:18:50.095 16518 16591 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:50.095 16518 18659 E AndroidRuntime: FATAL EXCEPTION: ExoPlayer:Loader:ProgressiveMediaPeriod
05-23 11:18:50.095 16518 18659 E AndroidRuntime: Process: com.mrousavy.shadowlens, PID: 16518
05-23 11:18:50.095 16518 18659 E AndroidRuntime: java.lang.OutOfMemoryError: Failed to allocate a 32 byte allocation with 22200 free bytes and 21KB until OOM, target footprint 268435456, growth limit 268435456; giving up on allocation because <1% of heap free after GC.
05-23 11:18:50.095 16518 18659 E AndroidRuntime:    at java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.await(AbstractQueuedSynchronizer.java:1610)
05-23 11:18:50.095 16518 18659 E AndroidRuntime:    at java.util.concurrent.LinkedBlockingQueue.take(LinkedBlockingQueue.java:435)
05-23 11:18:50.095 16518 18659 E AndroidRuntime:    at java.util.concurrent.ThreadPoolExecutor.getTask(ThreadPoolExecutor.java:1071)
05-23 11:18:50.095 16518 18659 E AndroidRuntime:    at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1131)
05-23 11:18:50.095 16518 18659 E AndroidRuntime:    at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:644)
05-23 11:18:50.095 16518 18659 E AndroidRuntime:    at java.lang.Thread.run(Thread.java:1012)
05-23 11:18:50.096 16518 16528 I savy.shadowlens: WaitForGcToComplete blocked Alloc on Alloc for 203.697ms
05-23 11:18:50.096 16518 16528 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:50.096 16518 16597 I savy.shadowlens: WaitForGcToComplete blocked Alloc on Alloc for 75.162ms
05-23 11:18:50.096 16518 16597 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:50.096 16518 16768 I savy.shadowlens: WaitForGcToComplete blocked Alloc on Alloc for 69.030ms
05-23 11:18:50.097 16518 16768 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:50.097 16518 16597 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:50.097 16518 16518 I savy.shadowlens: WaitForGcToComplete blocked Alloc on Alloc for 64.498ms
05-23 11:18:50.097 16518 16518 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:50.097 16518 18617 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:50.097 16518 16597 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:50.098 16518 16518 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:50.178 16518 18617 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:50.178 16518 18617 I savy.shadowlens: Alloc concurrent copying GC freed 334(26KB) AllocSpace objects, 1(20KB) LOS objects, 0% free, 255MB/256MB, paused 1.624ms,98us total 81.138ms
05-23 11:18:50.179 16518 18617 W savy.shadowlens: Throwing OutOfMemoryError "Failed to allocate a 272 byte allocation with 48024 free bytes and 46KB until OOM, target footprint 268435456, growth limit 268435456; giving up on allocation because <1% of heap free after GC." (VmSize 13953392 kB)
05-23 11:18:50.181 16518 16597 I savy.shadowlens: WaitForGcToComplete blocked Alloc on Alloc for 84.049ms
05-23 11:18:50.181 16518 16597 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:50.181 16518 16597 I savy.shadowlens: Forcing collection of SoftReferences for 272B allocation
05-23 11:18:50.181 16518 16597 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:50.182 16518 16518 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:50.245 16518 16597 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:50.245 16518 16597 I savy.shadowlens: Alloc concurrent copying GC freed 132(5984B) AllocSpace objects, 0(0B) LOS objects, 0% free, 255MB/256MB, paused 209us,85us total 63.524ms
05-23 11:18:50.246 16518 16597 W savy.shadowlens: Throwing OutOfMemoryError "Failed to allocate a 272 byte allocation with 44584 free bytes and 43KB until OOM, target footprint 268435456, growth limit 268435456; giving up on allocation because <1% of heap free after GC." (VmSize 13953392 kB)
05-23 11:18:50.246 16518 16597 E JNIHelp : Failed to construct 'android/system/ErrnoException'
05-23 11:18:50.247 16518 16526 I savy.shadowlens: WaitForGcToComplete blocked Background on Alloc for 219.592ms
05-23 11:18:50.247 16518 16518 I savy.shadowlens: WaitForGcToComplete blocked Alloc on Alloc for 148.826ms
05-23 11:18:50.247 16518 16518 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:50.312 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:50.380 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:50.449 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:50.515 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:50.549 16518 16670 I CameraView: invokeOnAverageFpsChanged(0.0)
05-23 11:18:50.586 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:50.613 22214 18654 W adbd    : timed out while waiting for FUNCTIONFS_BIND, trying again
05-23 11:18:50.613 22214 18654 I adbd    : UsbFfs: connection terminated: monitor thread finished
05-23 11:18:50.613 22214 22214 I adbd    : UsbFfs: already offline
05-23 11:18:50.613 22214 22214 I adbd    : destroying transport UsbFfs
05-23 11:18:50.613 22214 22214 I adbd    : UsbFfsConnection being destroyed
05-23 11:18:50.640 22214 22218 I adbd    : opening control endpoint /dev/usb-ffs/adb/ep0
05-23 11:18:50.641 22214 22218 I adbd    : UsbFfsConnection constructed
05-23 11:18:50.642 22214 18661 I adbd    : UsbFfs-monitor thread spawned
05-23 11:18:50.655 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:50.689  1284  2067 I AudioFlinger: BUFFER TIMEOUT: remove(108) from active list on thread 0xb400007f0036f780
05-23 11:18:50.694  1199  2726 V DlbVolumeListener: effectCommand
05-23 11:18:50.694  1199  2726 V DlbVolumeListener: effectCommand :: Command EFFECT_CMD_DISABLE
05-23 11:18:50.695  1199  2728 D MotSpeakerHelper: Speaker ON: volume 0.500000 (step 12), usecase SAFE
05-23 11:18:50.699  1199  2725 V DlbVolumeListener: effectCommand
05-23 11:18:50.699  1199  2725 V DlbVolumeListener: effectCommand :: Command EFFECT_CMD_SET_CONFIG
05-23 11:18:50.700  1199  1259 V DlbVolumeListener: effectCommand
05-23 11:18:50.700  1199  1259 V DlbVolumeListener: effectCommand :: Command EFFECT_CMD_SET_CONFIG
05-23 11:18:50.701  1199  1259 V DlbVolumeListener: release(handle=0xea15f660)
05-23 11:18:50.702  1199  2728 D MotSpeakerHelper: Speaker ON: volume 0.500000 (step 12), usecase SAFE
05-23 11:18:50.703  1284  1840 D APM_AudioPolicyManager: stopOutput() output 21, stream 3, session 849
05-23 11:18:50.704  1199  2728 D MotSpeakerHelper: Speaker ON: volume 0.500000 (step 12), usecase SAFE
05-23 11:18:50.705  1199  2728 D MotSpeakerHelper: Speaker ON: volume 0.500000 (step 12), usecase SAFE
05-23 11:18:50.710  1199  2725 D DlbDlbEffect: handle_EFFECT_CMD_DISABLE()
05-23 11:18:50.710  1199  2725 D DlbEffectDap: updateProcessEnabled(enabled=0, bypassed=0)
05-23 11:18:50.710  1199  2725 D DlbDlbCrossfadeProcess: setEnabled transitioning from PROCESS_ACTIVE state to FADE_TO_BYPASS
05-23 11:18:50.715  1199  2725 D DlbDlbEffect: handle_EFFECT_CMD_SET_CONFIG()
05-23 11:18:50.715  1199  1259 D DlbDlbEffect: handle_EFFECT_CMD_SET_CONFIG()
05-23 11:18:50.719  1199  2726 D DlbDlbEffect: handle_EFFECT_CMD_SET_DEVICE(device=0x00000002)
05-23 11:18:50.719  1199  2726 D DlbDapEndpointParamCache: setDevice(device=0x00000002)
05-23 11:18:50.719  1245  1245 D DMSService: setActiveDevice called with device = 0x2 (original 0x2)
05-23 11:18:50.720  1199  2725 D DlbEffectDap: setAudioMode(mode = 0)
05-23 11:18:50.721  1199  1259 D DlbDlbEffect: handle_EFFECT_CMD_SET_PARAM()
05-23 11:18:50.721  1199  1259 D DlbEffectDap: setIoHandle(ioHandle=13)
05-23 11:18:50.722  1199 24377 D DlbDlbEffect: handle_EFFECT_CMD_ENABLE()
05-23 11:18:50.722  1199 24377 D DlbEffectDap: updateProcessEnabled(enabled=1, bypassed=0)
05-23 11:18:50.722  1199 24377 D DlbDlbCrossfadeProcess: setEnabled transitioning from FADE_TO_BYPASS state to FADE_TO_ACTIVE
05-23 11:18:50.722  1284  1840 D AudioFlinger: moveEffectChain_l: successful move of session 0 from srcThread 0xb400007f0036f780 to dstThread 0xb400007f002b7240 (1 effects moved, 1 effects started)
05-23 11:18:50.724 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:50.791 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:50.858 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:50.896 17414 18666 D TrafficStats: tagSocket(151) with statsTag=0xffffffff, statsUid=-1
05-23 11:18:50.924 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:50.967 17414 17467 D TrafficStats: tagSocket(151) with statsTag=0xffffffff, statsUid=-1
05-23 11:18:50.978 17414 17466 D TrafficStats: tagSocket(152) with statsTag=0xffffffff, statsUid=-1
05-23 11:18:50.990 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:51.057 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:51.122 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:51.186 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:51.240 16518 16591 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:51.245 16518 16518 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:51.252 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:51.252 16518 16591 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:51.252 16518 16518 I savy.shadowlens: WaitForGcToComplete blocked Alloc on HeapTrim for 7.459ms
05-23 11:18:51.253 16518 16518 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:51.253 16518 16591 I savy.shadowlens: WaitForGcToComplete blocked Alloc on HeapTrim for 13.044ms
05-23 11:18:51.253 16518 16591 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:51.253 16518 16564 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:51.253 16518 16564 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:51.254 16518 16591 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:51.254 16518 16528 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:51.262 16518 16518 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:51.271 16518 16564 I savy.shadowlens: WaitForGcToComplete blocked Alloc on Background for 18.130ms
05-23 11:18:51.272 16518 16564 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:51.272 16518 16564 I savy.shadowlens: Forcing collection of SoftReferences for 16B allocation
05-23 11:18:51.272 16518 16564 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:51.272 16518 16591 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:51.272 16518 16518 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:51.272 16518 16528 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:51.340 16518 16564 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:51.340 16518 16564 I savy.shadowlens: Alloc concurrent copying GC freed 100(3216B) AllocSpace objects, 0(0B) LOS objects, 0% free, 255MB/256MB, paused 167us,84us total 68.155ms
05-23 11:18:51.340 16518 16591 I savy.shadowlens: WaitForGcToComplete blocked Alloc on Alloc for 86.458ms
05-23 11:18:51.340 16518 16591 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:51.340 16518 16564 W savy.shadowlens: Throwing OutOfMemoryError "Failed to allocate a 16 byte allocation with 14920 free bytes and 14KB until OOM, target footprint 268435456, growth limit 268435456; giving up on allocation because <1% of heap free after GC." (VmSize 13953392 kB)
05-23 11:18:51.342 16518 16591 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:51.342 16518 16591 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:51.342 16518 16528 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:51.343 16518 16518 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:51.367 16518 16591 I savy.shadowlens: Alloc young concurrent copying GC freed 314(13KB) AllocSpace objects, 0(0B) LOS objects, 0% free, 255MB/256MB, paused 204us,84us total 25.350ms
05-23 11:18:51.367 16518 16591 I savy.shadowlens: Forcing collection of SoftReferences for 96B allocation
05-23 11:18:51.367 16518 16591 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:51.367 16518 16528 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:51.368 16518 16518 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:51.416 16518 16591 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:51.416 16518 16591 I savy.shadowlens: Alloc concurrent copying GC freed 5(104B) AllocSpace objects, 0(0B) LOS objects, 0% free, 255MB/256MB, paused 84us,81us total 48.552ms
05-23 11:18:51.416 16518 16591 W savy.shadowlens: Throwing OutOfMemoryError "Failed to allocate a 96 byte allocation with 14200 free bytes and 13KB until OOM, target footprint 268435456, growth limit 268435456; giving up on allocation because <1% of heap free after GC." (VmSize 13953392 kB)
05-23 11:18:51.423 16518 16518 I savy.shadowlens: WaitForGcToComplete blocked Alloc on Alloc for 160.929ms
05-23 11:18:51.423 16518 16518 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:51.423 16518 16526 I savy.shadowlens: WaitForGcToComplete blocked Background on Alloc for 129.520ms
05-23 11:18:51.423 16518 16528 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:51.440 16518 16528 I savy.shadowlens: WaitForGcToComplete blocked Alloc on Background for 186.083ms
05-23 11:18:51.440 16518 16528 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:51.450  1620 15625 W C2BqBuffer: last successful dequeue was 130077781 us ago, 0 consecutive failures
05-23 11:18:51.488 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:51.515 16518 16564 E AndroidRuntime: FATAL EXCEPTION: mqt_native_modules
05-23 11:18:51.515 16518 16564 E AndroidRuntime: Process: com.mrousavy.shadowlens, PID: 16518
05-23 11:18:51.515 16518 16564 E AndroidRuntime: java.lang.OutOfMemoryError: Failed to allocate a 16 byte allocation with 14920 free bytes and 14KB until OOM, target footprint 268435456, growth limit 268435456; giving up on allocation because <1% of heap free after GC.
05-23 11:18:51.515 16518 16564 E AndroidRuntime:    at com.facebook.react.bridge.ReadableNativeArray.importArray(Native Method)
05-23 11:18:51.515 16518 16564 E AndroidRuntime:    at com.facebook.react.bridge.ReadableNativeArray.getLocalArray(ReadableNativeArray.java:50)
05-23 11:18:51.515 16518 16564 E AndroidRuntime:    at com.facebook.react.bridge.ReadableNativeArray.size(ReadableNativeArray.java:77)
05-23 11:18:51.515 16518 16564 E AndroidRuntime:    at com.facebook.react.bridge.JavaMethodWrapper.invoke(JavaMethodWrapper.java:347)
05-23 11:18:51.515 16518 16564 E AndroidRuntime:    at com.facebook.react.bridge.JavaModuleWrapper.invoke(JavaModuleWrapper.java:149)
05-23 11:18:51.515 16518 16564 E AndroidRuntime:    at com.facebook.jni.NativeRunnable.run(Native Method)
05-23 11:18:51.515 16518 16564 E AndroidRuntime:    at android.os.Handler.handleCallback(Handler.java:984)
05-23 11:18:51.515 16518 16564 E AndroidRuntime:    at android.os.Handler.dispatchMessage(Handler.java:104)
05-23 11:18:51.515 16518 16564 E AndroidRuntime:    at com.facebook.react.bridge.queue.MessageQueueThreadHandler.dispatchMessage(MessageQueueThreadHandler.java:29)
05-23 11:18:51.515 16518 16564 E AndroidRuntime:    at android.os.Looper.loopOnce(Looper.java:238)
05-23 11:18:51.515 16518 16564 E AndroidRuntime:    at android.os.Looper.loop(Looper.java:357)
05-23 11:18:51.515 16518 16564 E AndroidRuntime:    at com.facebook.react.bridge.queue.MessageQueueThreadImpl$4.run(MessageQueueThreadImpl.java:234)
05-23 11:18:51.515 16518 16564 E AndroidRuntime:    at java.lang.Thread.run(Thread.java:1012)
05-23 11:18:51.529 16518 16518 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:51.549 16518 16670 I savy.shadowlens: Waiting for a blocking GC Alloc
05-23 11:18:51.558 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:51.559 16518 16518 I savy.shadowlens: WaitForGcToComplete blocked Alloc on Background for 29.869ms
05-23 11:18:51.559 16518 16518 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:51.559 16518 16670 I savy.shadowlens: WaitForGcToComplete blocked Alloc on Background for 9.438ms
05-23 11:18:51.559 16518 16670 I savy.shadowlens: Starting a blocking GC Alloc
05-23 11:18:51.559 16518 16670 I CameraView: invokeOnAverageFpsChanged(0.0)
05-23 11:18:51.626 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:51.643 22214 18661 W adbd    : timed out while waiting for FUNCTIONFS_BIND, trying again
05-23 11:18:51.643 22214 18661 I adbd    : UsbFfs: connection terminated: monitor thread finished
05-23 11:18:51.643 22214 22214 I adbd    : UsbFfs: already offline
05-23 11:18:51.643 22214 22214 I adbd    : destroying transport UsbFfs
05-23 11:18:51.643 22214 22214 I adbd    : UsbFfsConnection being destroyed
05-23 11:18:51.666 22214 22218 I adbd    : opening control endpoint /dev/usb-ffs/adb/ep0
05-23 11:18:51.667 22214 22218 I adbd    : UsbFfsConnection constructed
05-23 11:18:51.669 22214 18668 I adbd    : UsbFfs-monitor thread spawned
05-23 11:18:51.695 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:51.760 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:51.826 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:51.892 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:51.959 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:52.055 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:52.124 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:52.191 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:52.256 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:52.320 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:52.391 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:52.451 16518 16799 D CCodecBufferChannel: [c2.android.aac.decoder#865] DEBUG: elapsed: n=6 [in=0 pipeline=0 out=2]
05-23 11:18:52.452 16518 16799 D PipelineWatcher: DEBUG: elapsed 2 / 6
05-23 11:18:52.452 16518 16799 D CCodecBufferChannel: [c2.android.avc.decoder#933] DEBUG: elapsed: n=7 [in=0 pipeline=0 out=3]
05-23 11:18:52.452 16518 16799 D PipelineWatcher: DEBUG: elapsed 2 / 7
05-23 11:18:52.460 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:52.528 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:52.550 16518 16670 I CameraView: invokeOnAverageFpsChanged(0.0)
05-23 11:18:52.597 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:52.601  4573  5554 I BistoHotwordHelper: (REDACTED) getHotwordActive::active query: %s, watch: %s, devices connected: %s
05-23 11:18:52.667 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:52.670 22214 18668 W adbd    : timed out while waiting for FUNCTIONFS_BIND, trying again
05-23 11:18:52.670 22214 18668 I adbd    : UsbFfs: connection terminated: monitor thread finished
05-23 11:18:52.670 22214 22214 I adbd    : UsbFfs: already offline
05-23 11:18:52.670 22214 22214 I adbd    : destroying transport UsbFfs
05-23 11:18:52.670 22214 22214 I adbd    : UsbFfsConnection being destroyed
05-23 11:18:52.692 22214 22218 I adbd    : opening control endpoint /dev/usb-ffs/adb/ep0
05-23 11:18:52.697 22214 22218 I adbd    : UsbFfsConnection constructed
05-23 11:18:52.698 22214 18669 I adbd    : UsbFfs-monitor thread spawned
05-23 11:18:52.719  1199  2725 D audio_hw_primary: out_standby: enter: usecase(0: deep-buffer-playback)
05-23 11:18:52.719  1199  2725 D audio_hw_primary: out_standby_l: enter: usecase(0: deep-buffer-playback)
05-23 11:18:52.732 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:52.801 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:52.864  1199  2725 D audio_hw_primary: disable_audio_route: usecase(0) reset and update mixer path: deep-buffer-playback speaker
05-23 11:18:52.865  1199  2725 E soundtrigger: audio_extn_sound_trigger_update_stream_status: invalid input device 0x0, for event 2
05-23 11:18:52.865  1199  2725 D soundtrigger: audio_extn_sound_trigger_update_stream_status: uc_info->id 0 of type 0 for Event 2, with Raise=1
05-23 11:18:52.865  1199  2725 E soundtrigger: audio_extn_sound_trigger_update_stream_status, uc_info->type == PCM_PLAYBACK,devices=0x2
05-23 11:18:52.865  1199  2725 D device_utils: assign_devices_ex,source =0x2
05-23 11:18:52.865  1199  2725 I sound_trigger_platform: platform_stdev_check_and_update_concurrency: Received PLAYBACK_STREAM event, event type 2, usecase type 0
05-23 11:18:52.865  1199  2725 D sound_trigger_platform: platform_stdev_get_capture_device: Device = 0x80000004
05-23 11:18:52.865  1199  2725 D sound_trigger_platform: platform_stdev_get_capture_device: Available device = 0x80000004
05-23 11:18:52.865  1199  2725 D sound_trigger_platform: platform_stdev_check_and_update_concurrency: dedicated path 0, reset backend 1, tx 0, rx 0, concurrency session allowed
05-23 11:18:52.865  1199  2725 D audio_hw_primary: disable_snd_device: snd_device(2: speaker) snd_dev_ref_cnt is 1
05-23 11:18:52.865  1199  2725 D mot_spkr_spin: exit enable_stereo_spkr_spin,spkr_spin_enabled=0, ret=0
05-23 11:18:52.870 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:52.870  1199  2725 D audio_hw_primary: disable_snd_device: snd_device(176: vi-feedback) snd_dev_ref_cnt is 1
05-23 11:18:52.870  1199  2725 D audio_hw_primary: disable_snd_device: snd_device(176: vi-feedback)
05-23 11:18:52.870  1199  2725 V msm8974_platform: platform_check_all_backends_match: be_itf1 = TX_CDC_DMA_TX_3, be_itf2 = (null), match 1
05-23 11:18:52.870  1199  2725 D soundtrigger: audio HAL using same device 176 as ST
05-23 11:18:52.870  1199  2725 I soundtrigger: audio_extn_sound_trigger_update_device_status: device 0xb0 of type 1 for Event 0, with Raise=0
05-23 11:18:52.871  1199  2725 D audio_hw_primary: disable_audio_route: usecase(26) reset and update mixer path: spkr-vi-record
05-23 11:18:52.875  1199  2725 V msm8974_platform: platform_check_all_backends_match: be_itf1 = TX_CDC_DMA_TX_3, be_itf2 = (null), match 1
05-23 11:18:52.875  1199  2725 D soundtrigger: audio HAL using same device 176 as ST
05-23 11:18:52.875  1199  2725 V msm8974_platform: platform_sound_trigger_usecase_needs_event:usecase_id[26] no need to raise event.
05-23 11:18:52.875  1199  2725 D soundtrigger: audio_extn_sound_trigger_update_stream_status: uc_info->id 26 of type 1 for Event 2, with Raise=0
05-23 11:18:52.875  1199  2725 D audio_hw_primary: disable_snd_device: snd_device(2: speaker)
05-23 11:18:52.875  1199  2725 I soundtrigger: audio_extn_sound_trigger_update_device_status: device 0x2 of type 0 for Event 0, with Raise=0
05-23 11:18:52.875  1199  2725 D audio_hw_primary: out_standby_l: exit
05-23 11:18:52.875  1199  2725 D audio_hw_primary: out_standby: exit
05-23 11:18:52.891  2128  3542 W JobScheduler: Job didn't exist in JobStore: 6ad5b57 #u0a216/1034 com.google.android.apps.photos/com.google.android.libraries.social.mediamonitor.MediaMonitorJobSchedulerService
05-23 11:18:52.931 17414 18671 D TrafficStats: tagSocket(151) with statsTag=0xffffffff, statsUid=-1
05-23 11:18:52.943 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:52.988  4031  4031 D BoundBrokerSvc: onUnbind: Intent { act=com.google.android.gms.measurement.START pkg=com.google.android.gms }
05-23 11:18:52.991  2128  2621 W UriGrantsManagerService: No permission grants found for com.google.android.apps.photos
05-23 11:18:52.993  2128  5302 W UriGrantsManagerService: No permission grants found for com.google.android.apps.photos
05-23 11:18:53.015 17414 17467 D TrafficStats: tagSocket(152) with statsTag=0xffffffff, statsUid=-1
05-23 11:18:53.015 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:53.030 17414 17466 D TrafficStats: tagSocket(151) with statsTag=0xffffffff, statsUid=-1
05-23 11:18:53.083 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:53.149 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:53.221 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:53.290 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:53.324  2128  5302 W UriGrantsManagerService: No permission grants found for com.google.android.apps.photos
05-23 11:18:53.326  2128  5302 W UriGrantsManagerService: No permission grants found for com.google.android.apps.photos
05-23 11:18:53.362 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:53.400  4536 19501 I MediaProvider: Open with lower FS for /storage/emulated/0/Movies/mrousavy-7540700267768862749.mov. Uid: 10216
05-23 11:18:53.407  1579  3171 I PlayerServiceFileSource: StagefrightMetadataRetriever::setDataSource(FD URL suppressed)
05-23 11:18:53.409  1579  3171 I ExtendedUtils: printFileName fd(13) -> /storage/emulated/0/Movies/mrousavy-7540700267768862749.mov
05-23 11:18:53.429 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:53.467  4536 19501 I MediaProvider: Open with lower FS for /storage/emulated/0/Movies/mrousavy-7540700267768862749.mov. Uid: 10216
05-23 11:18:53.470 16537 18673 W FileSource: offset/length adjusted from 0/576460752303423487 to 0/43555649
05-23 11:18:53.497 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:53.507  1211  2065 E LocSvc_ApiV02: reportLocEvent:3917] Loc event report: 0 KlobucharIonoMode_valid:0: leapSec_valid:1: tauC_valid:1 featureStatusReport_valid: 0 featureStatusReport: 0
05-23 11:18:53.546  4536 19501 I MediaProvider: Open with lower FS for /storage/emulated/0/Movies/mrousavy-7540700267768862749.mov. Uid: 10216
05-23 11:18:53.549 16518 16670 I CameraView: invokeOnAverageFpsChanged(0.0)
05-23 11:18:53.567 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:53.636 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:53.699 22214 18669 W adbd    : timed out while waiting for FUNCTIONFS_BIND, trying again
05-23 11:18:53.699 22214 18669 I adbd    : UsbFfs: connection terminated: monitor thread finished
05-23 11:18:53.699 22214 22214 I adbd    : UsbFfs: already offline
05-23 11:18:53.699 22214 22214 I adbd    : destroying transport UsbFfs
05-23 11:18:53.699 22214 22214 I adbd    : UsbFfsConnection being destroyed
05-23 11:18:53.705 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:53.726 22214 22218 I adbd    : opening control endpoint /dev/usb-ffs/adb/ep0
05-23 11:18:53.728 22214 22218 I adbd    : UsbFfsConnection constructed
05-23 11:18:53.728 22214 18674 I adbd    : UsbFfs-monitor thread spawned
05-23 11:18:53.746  4536 19501 I MediaProvider: Open with lower FS for /storage/emulated/0/Movies/mrousavy-7540700267768862749.mov. Uid: 10216
05-23 11:18:53.767  1579 25846 I PlayerServiceFileSource: StagefrightMetadataRetriever::setDataSource(FD URL suppressed)
05-23 11:18:53.767  1579 25846 I ExtendedUtils: printFileName fd(13) -> /storage/emulated/0/Movies/mrousavy-7540700267768862749.mov
05-23 11:18:53.777 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:53.844 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:53.910 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:53.922  4536 19501 I MediaProvider: Open with lower FS for /storage/emulated/0/Movies/mrousavy-7540700267768862749.mov. Uid: 10216
05-23 11:18:53.940  4536 19501 I MediaProvider: Open with lower FS for /storage/emulated/0/Movies/mrousavy-7540700267768862749.mov. Uid: 10216
05-23 11:18:53.978 16518 16526 I savy.shadowlens: Clamp target GC heap from 279MB to 256MB
05-23 11:18:53.985  2128 18676 I DropBoxManagerService: add tag=data_app_crash isTagEnabled=true flags=0x2
05-23 11:18:53.993  2128  5302 W ActivityTaskManager:   Force finishing activity com.mrousavy.shadowlens/.MainActivity
05-23 11:18:54.011 16518 16531 I Process : Sending signal. PID: 16518 SIG: 9

Camera Device

Code of shadow lens
- back camera

Device

MOTO G52

VisionCamera Version

Latest shadow lens

Can you reproduce this issue in the VisionCamera Example app?

Yes, I can reproduce the same issue in the Example app here

Additional information

ismaelsousa commented 3 months ago

Maybe related to #2866

rodgomesc commented 3 months ago

android.media.MediaCodec.getBuffer(Native Method) seems really similar to that unsupported codec discussion from another day for camera X, have you tried to play with h264 and different camera resolutions?

ismaelsousa commented 3 months ago

it's using the h264

mrousavy commented 3 months ago

Hmm interesting. CameraX is always h264. Might be a CameraX bug, I'll try to upgrade versions soon and see if that fixes anything.

Thanks for reporting!

mrousavy commented 3 months ago

How long do you have to record before it crashes?

ismaelsousa commented 3 months ago

I usually record 3 videos with 2-3m but my device has just 4 GB of RAM (max ~ 1.5GB available)