Page 1 of 1

Issues with getUserMedia, macos 13 and m1 mac

PostPosted: Tue Oct 04, 2022 3:44 am
by sjames1958
Has anyone seen issues with getUserMedia failing when attempting to get video stream?
We are seeing this on macos 13 beta on macs with Arm processors M1 / M2.
It occurs when we make a second attempt to get a video stream after "closing" the previous one.
Enabling Chrome Logging we see the following timeout error. I searched the chrome bugs and did not find anything. This is running a build of our application on CEF 105.3.8
[1003/101338.412853:INFO:CONSOLE(1936)] "Allocating device constraints: {"video":{"deviceId":"0be4bc665d2c20153a664fa257ee931af93d609a69cb499124a0d54ecdc41372"},"audio":false}", source: https://examplify.examid/main.js (1936)
[1003/101338.419916:VERBOSE1:media_stream_manager.cc(972)] MSM::GenerateStreams({render_process_id=5}, {render_frame_id=5}, {requester_id=1}, {page_request_id=0})
[1003/101338.419978:VERBOSE1:media_stream_manager.cc(972)] MSM::DR::DeviceRequest({requesting_process_id=5}, {requesting_frame_id=5}, {requester_id=1}, {request_type=MEDIA_GENERATE_STREAM})
[1003/101338.420012:VERBOSE1:media_stream_manager.cc(972)] MSM::AddRequest([requester_id=1]) => (label=ZkVY0zZI43yc5MHoIRAg5H9HuoBmR6mzoVey)
[1003/101338.420035:VERBOSE1:media_stream_manager.cc(972)] MSM::SetUpRequest([requester_id=1] {label=ZkVY0zZI43yc5MHoIRAg5H9HuoBmR6mzoVey})
[1003/101338.420052:VERBOSE1:media_stream_manager.cc(972)] MSM::DR::SetAudioType([requester_id=1] {audio_type=NO_SERVICE})
[1003/101338.420067:VERBOSE1:media_stream_manager.cc(972)] MSM::StartEnumeration({requester_id=1}, {label=ZkVY0zZI43yc5MHoIRAg5H9HuoBmR6mzoVey})
[1003/101338.420081:VERBOSE1:media_stream_manager.cc(972)] MSM::DR::SetState([requester_id=1] {stream_type=DEVICE_VIDEO_CAPTURE}, {new_state=STATE_REQUESTED})
[1003/101338.445136:VERBOSE1:media_stream_manager.cc(972)] MSM::DevicesEnumerated({label=ZkVY0zZI43yc5MHoIRAg5H9HuoBmR6mzoVey}, {requester_id=1}, {request_type=MEDIA_GENERATE_STREAM})
[1003/101338.445190:VERBOSE1:media_stream_manager.cc(972)] MSM::DR::SetState([requester_id=1] {stream_type=DEVICE_VIDEO_CAPTURE}, {new_state=STATE_PENDING_APPROVAL})
[1003/101338.445207:VERBOSE1:media_stream_manager.cc(972)] MSM::SetUpDeviceCaptureRequest([requester_id=1])
[1003/101338.445236:VERBOSE1:media_stream_manager.cc(972)] MSM::DR::CreateUIRequest([requester_id=1] {requested_audio_device_id=}, {requested_video_device_id=47B4B64B-7067-4B9C-AD2B-AE273A71F4B5})
[1003/101338.445253:VERBOSE1:media_stream_manager.cc(972)] MSM::PostRequestToUI({label=ZkVY0zZI43yc5MHoIRAg5H9HuoBmR6mzoVey},
[1003/101338.445266:VERBOSE1:media_stream_manager.cc(972)] MSM::DR::SetState([requester_id=1] {stream_type=DEVICE_VIDEO_CAPTURE}, {new_state=STATE_PENDING_APPROVAL})
[1003/101338.446018:VERBOSE1:media_stream_manager.cc(972)] MSM::HandleAccessRequestResponse({label=ZkVY0zZI43yc5MHoIRAg5H9HuoBmR6mzoVey}, {request=MEDIA_GENERATE_STREAM}, {result=OK})
[1003/101338.446104:VERBOSE1:media_stream_manager.cc(972)] video capture: VideoCaptureManager::Open, device.name = FaceTime HD Camera, device.id = 47B4B64B-7067-4B9C-AD2B-AE273A71F4B5, capture_session_id = (424FA336F7D785FC7B94606B3A23E114)
[1003/101338.446134:VERBOSE1:media_stream_manager.cc(972)] MSM::DR::SetState([requester_id=1] {stream_type=DEVICE_VIDEO_CAPTURE}, {new_state=STATE_OPENING})
[1003/101338.446153:VERBOSE1:media_stream_manager.cc(972)] MSM::HandleAccessRequestResponse([label=ZkVY0zZI43yc5MHoIRAg5H9HuoBmR6mzoVey]) => (opening device: [id: 0be4bc665d2c20153a664fa257ee931af93d609a69cb499124a0d54ecdc41372, session_id: 424FA336F7D785FC7B94606B3A23E114])
[1003/101338.446219:VERBOSE1:media_stream_manager.cc(972)] MSM::RequestDone({requester_id=1}, {request_type=MEDIA_GENERATE_STREAM})
[1003/101338.446281:VERBOSE1:media_stream_manager.cc(972)] MSM::Opened({stream_type=DEVICE_VIDEO_CAPTURE}, {session_id=424FA336F7D785FC7B94606B3A23E114})
[1003/101338.446843:VERBOSE1:media_stream_manager.cc(972)] MSM::DR::SetState([requester_id=1] {stream_type=DEVICE_VIDEO_CAPTURE}, {new_state=STATE_DONE})
[1003/101338.446906:VERBOSE1:media_stream_manager.cc(972)] MSM::RequestDone({requester_id=1}, {request_type=MEDIA_GENERATE_STREAM})
[1003/101338.446931:VERBOSE1:media_stream_manager.cc(972)] MSM::FinalizeGenerateStreams({label=ZkVY0zZI43yc5MHoIRAg5H9HuoBmR6mzoVey}, {requester_id=1}, {request_type=MEDIA_GENERATE_STREAM})
[1003/101338.448639:VERBOSE1:media_stream_manager.cc(972)] MSM::PanTiltZoomPermissionChecked({label=ZkVY0zZI43yc5MHoIRAg5H9HuoBmR6mzoVey}, {requester_id=1}, {request_type=MEDIA_GENERATE_STREAM}, {pan_tilt_zoom_allowed=0})
[1003/101338.450732:VERBOSE1:media_stream_manager.cc(972)] MDDH::GetVideoInputDeviceFormats({hashed_device_id=0be4bc665d2c20153a664fa257ee931af93d609a69cb499124a0d54ecdc41372}, {try_in_use_first=false})
[1003/101338.463661:VERBOSE1:media_stream_manager.cc(972)] video capture: ConnectClient: session_id = (424FA336F7D785FC7B94606B3A23E114), request: (640x480)@30.000fps, pixel format: PIXEL_FORMAT_NV12
[1003/101338.463755:VERBOSE1:media_stream_manager.cc(972)] video capture: VideoCaptureManager queueing device start for device_id = 47B4B64B-7067-4B9C-AD2B-AE273A71F4B5
[1003/101338.463773:VERBOSE1:media_stream_manager.cc(972)] video capture: VideoCaptureManager::ProcessDeviceStartRequestQueue
[1003/101338.463790:VERBOSE1:media_stream_manager.cc(972)] video capture: VideoCaptureController::CreateAndStartDeviceAsync: serial_id = 1, device_id = 47B4B64B-7067-4B9C-AD2B-AE273A71F4B5
[1003/101338.463929:VERBOSE1:media_stream_manager.cc(972)] video capture: ServiceVideoCaptureDeviceLauncher::LaunchDeviceAsync: Asking video capture service to create source for device_id = 47B4B64B-7067-4B9C-AD2B-AE273A71F4B5
[1003/101338.464079:VERBOSE1:media_stream_manager.cc(972)] video capture: VideoCaptureController::AddClient(): id = (424FA336F7D785FC7B94606B3A23E114), session_id = 424FA336F7D785FC7B94606B3A23E114, params.requested_format = (640x480)@30.000fps, pixel format: PIXEL_FORMAT_NV12
[1003/101338.548031:INFO:crash_reporting.cc(211)] Crash reporting enabled for process: utility
[1003/101343.288623:VERBOSE1:media_stream_manager.cc(972)] video capture: OnDeviceLaunched
[1003/101343.288704:VERBOSE1:media_stream_manager.cc(972)] video capture: Launching device has succeeded. device_id = 47B4B64B-7067-4B9C-AD2B-AE273A71F4B5
[1003/101348.462941:VERBOSE1:media_stream_manager.cc(972)] video capture: VideoCaptureImpl timed out during starting
[1003/101348.463838:VERBOSE1:media_stream_manager.cc(972)] video capture: VideoCaptureImpl changing state to VIDEO_CAPTURE_STATE_ERROR
[1003/101348.464041:VERBOSE1:media_stream_manager.cc(972)] video capture: VideoCaptureController::RemoveClient: id = (424FA336F7D785FC7B94606B3A23E114)
[1003/101348.464068:VERBOSE1:media_stream_manager.cc(972)] video capture: DisconnectClient: session_id = (424FA336F7D785FC7B94606B3A23E114)
[1003/101348.464084:VERBOSE1:media_stream_manager.cc(972)] video capture: VideoCaptureManager stopping device (stream_type = DEVICE_VIDEO_CAPTURE, device_id = 47B4B64B-7067-4B9C-AD2B-AE273A71F4B5)
[1003/101348.464104:VERBOSE1:media_stream_manager.cc(972)] video capture: VideoCaptureController::ReleaseDeviceAsync: serial_id = 1, device_id = 47B4B64B-7067-4B9C-AD2B-AE273A71F4B5
[1003/101348.465764:VERBOSE1:media_stream_manager.cc(972)] MSM::StopStreamDevice({render_process_id=5}, {render_frame_id=5}, {requester_id=1}, {device_id=0be4bc665d2c20153a664fa257ee931af93d609a69cb499124a0d54ecdc41372}, {session_id=424FA336F7D785FC7B94606B3A23E114})
[1003/101348.465824:VERBOSE1:media_stream_manager.cc(972)] MSM::StopDevice({type=DEVICE_VIDEO_CAPTURE}, {session_id=424FA336F7D785FC7B94606B3A23E114})
[1003/101348.465841:VERBOSE1:media_stream_manager.cc(972)] MSM::CloseDevice({type=DEVICE_VIDEO_CAPTURE}, {session_id=424FA336F7D785FC7B94606B3A23E114})
[1003/101348.465857:VERBOSE1:media_stream_manager.cc(972)] video capture: VideoCaptureManager::Close, capture_session_id = (424FA336F7D785FC7B94606B3A23E114)
[1003/101348.465880:VERBOSE1:media_stream_manager.cc(972)] MSM::DR::SetState([requester_id=1] {stream_type=DEVICE_VIDEO_CAPTURE}, {new_state=STATE_CLOSING})
[1003/101348.465900:VERBOSE1:media_stream_manager.cc(972)] MSM::DeleteRequest([label=ZkVY0zZI43yc5MHoIRAg5H9HuoBmR6mzoVey])
[1003/101348.465931:VERBOSE1:media_stream_manager.cc(972)] MSM::Closed({stream_type=DEVICE_VIDEO_CAPTURE}, {session_id=424FA336F7D785FC7B94606B3A23E114})
[1003/101348.500312:INFO:CONSOLE(1936)] "Allocating device error: {}", source: https://examplify.examid/main.js (1936)

Re: Issues with getUserMedia, macos 13 and m1 mac

PostPosted: Tue Oct 04, 2022 8:31 am
by magreenblatt
We are seeing this on macos 13 beta on macs with Arm processors M1 / M2.

Does this issue occur only with MacOS 13 beta on ARM processors?

How does it behave in Google Chrome on the same system?

Re: Issues with getUserMedia, macos 13 and m1 mac

PostPosted: Tue Oct 04, 2022 10:37 am
by sjames1958
It only occurs on macos 13 beta on arm processors - we are running under Rosetta (should have mentioned that), so cannot replicate the same behavior with Chrome running natively.

Re: Issues with getUserMedia, macos 13 and m1 mac

PostPosted: Tue Oct 04, 2022 12:32 pm
by sjames1958
An update, I downloaded CEF 106.0.26 with no change in this behavior.

Re: Issues with getUserMedia, macos 13 and m1 mac

PostPosted: Tue Oct 04, 2022 12:47 pm
by magreenblatt
Have you tested the ARM64 build?

Re: Issues with getUserMedia, macos 13 and m1 mac

PostPosted: Tue Oct 04, 2022 2:06 pm
by sjames1958
I have not testing the arm64 build because our application has not been ported to native arm.

Re: Issues with getUserMedia, macos 13 and m1 mac

PostPosted: Tue Oct 04, 2022 2:27 pm
by magreenblatt
sjames1958 wrote:I have not testing the arm64 build because our application has not been ported to native arm.

OK, but problems that only exist under Rosetta emulation are unlikely to be fixed.

Re: Issues with getUserMedia, macos 13 and m1 mac

PostPosted: Fri May 19, 2023 2:26 pm
by brenthompson
sjames1958 wrote:I have not testing the arm64 build because our application has not been ported to native arm.


sjames1958 - I'm in the same boat. did you ever find a solution?