After upgrade to 3.4.0.24 caldav sync stopped working

[apisoft]

REPRODUCIBILITY (% or how often): always
BUILD ID = OS VERSION (Settings > About product): 3.4.0.24
HARDWARE (Jolla1, Tablet, XA2,…): XPERIA 10
UI LANGUAGE: en
REGRESSION: (compared to previous public release: Yes, No, ?): Yes

DESCRIPTION:

After upgrade to 3.4.0.24 caldav sync stopped working. Also can not create caldav and nextcloud account.

PRECONDITIONS:

STEPS TO REPRODUCE:

EXPECTED RESULT:

Caldav account created.

ACTUAL RESULT:

Error while creating account.

ADDITIONAL INFORMATION:

Server logs:

10.8.0.10 - - [22/Oct/2020:02:09:22 +0200] “PROPFIND / HTTP/1.1” 403 0
10.8.0.10 - - [22/Oct/2020:02:09:22 +0200] “PROPFIND /.well-known/caldav HTTP/1.1” 301 0
10.8.0.10 - - [22/Oct/2020:02:09:23 +0200] “PROPFIND /remote.php/dav HTTP/1.1” 401 0
10.8.0.10 - - [22/Oct/2020:02:09:23 +0200] " " 400 0

tcpdump:

02:22:03.092602 192.168.1.5.80 > 10.8.0.10.42550: P 1:725(724) ack 276 win 272 <nop,nop,timestamp 1578846720 19679261> (DF)
E…1.@.@.:…
…
.P.6…:…H…
^.J…,H.HTTP/1.0 301 Moved Permanently
Date: Thu, 22 Oct 2020 00:22:03 GMT
Server: OpenBSD httpd
Connection: close
Content-Type: text/html
Content-Length: 510
Location: https://workspace/remote.php/dav

301 Moved Permanently

301 Moved Permanently

---

OpenBSD httpd

02:22:03.202346 10.8.0.10.42550 > 192.168.1.5.80: P 276:361(85) ack 725 win 343 <nop,nop,timestamp 19679461 1578846720> (DF)
E… .@.?.O0
…
…6.P…W.J…
.,H.^.J.<d:propfind xmlns:d=“DAV:”><d:prop><d:current-user-principal /></d:prop></d:propfind>

[cartron]

hum you’re getting a 301 HTTP ERRCODE, so not sure this comes from your SFOS upgrade.
Can you give more details on what type of CardDAV server / account this is?

[yokisuci]

I’m having the same issues with carddav and caldav. I’m using fastmail. Adding the email worked without problem, but carddav and caldav not so much anymore. I’m getting

“Account error
Could not create account
Check sign-in details and try again. Authentication failed for URL https://carddav.fastmail.com”

For some reason, I’m getting this:
"Oct 23 14:28:14 XperiaX estart[7678]: [W] unknown:0 - sendAuthenticatedRequest(): request error: QNetworkReply::NetworkError(ContentNotFoundError) response code: 404 url: “https://carddav.fastmail.com/”

I’m certain that the adress is correct, both for caldav and carddav. And yeah, i’m getting the same error with caldav.

[WT.Sane]

Just a suggestion: There are issues with email accounts after an OS update where credentials had to be retyped or accounts newly set up on the phone. Maybe deleting and recreating the caldav account settings in the phone might help.

[askolsam]

I’m also experiencing this same issue.

After upgrading my XA2 to 3.4.0.24 it stopped syncing to my personal radicale server. I also have a Jolla1 running 3.1.0.11 and it still syncs without any issues.

I did several “remove and reconfigure the CalDAV account” operations on the XA2 but to no avail.

After setting up the credentials, server address, correct paths and clicking “Accept”, my radicale (web)server logs the following:

RE.DA.CT.ED - - [25/Oct/2020:14:13:12 +0200] "HEAD /radicale/ HTTP/1.1" 302 0 "-" "Mozilla/5.0"
RE.DA.CT.ED - - [25/Oct/2020:14:13:12 +0200] "PROPFIND /radicale/CALENDAR_ROOT/ HTTP/1.1" 401 61 "-" "Mozilla/5.0"
RE.DA.CT.ED - USERNAME [25/Oct/2020:14:13:13 +0200] "PROPFIND /radicale/CALENDAR_ROOT/ HTTP/1.1" 207 467 "-" "Mozilla/5.0"

XA2 fetches the available calendars successfully and displays them in the UI:

After the last “Accept” I try to sync, see the following in the server logs and nothing gets synced:

RE.DA.CT.ED - - [25/Oct/2020:14:24:39 +0200] "PROPFIND / HTTP/1.1" 403 1889 "-" "Mozilla/5.0"
RE.DA.CT.ED - - [25/Oct/2020:14:24:39 +0200] "PROPFIND /radicale/CALENDAR_ROOT/ HTTP/1.1" 401 61 "-" "Mozilla/5.0"
RE.DA.CT.ED - USERNAME [25/Oct/2020:14:24:40 +0200] "PROPFIND /radicale/CALENDAR_ROOT/ HTTP/1.1" 403 61 "-" "Mozilla/5.0"

A successfull sync with the Jolla1 and 3.1.0.11 looks like this:

RE.DA.CT.ED - - [25/Oct/2020:15:08:20 +0200] "REPORT /radicale/CALENDAR_ROOT/CALENDAR/ HTTP/1.1" 401 61 "-" "Mozilla/5.0"
RE.DA.CT.ED - USERNAME [25/Oct/2020:15:08:21 +0200] "REPORT /radicale/CALENDAR_ROOT/CALENDAR/ HTTP/1.1" 207 3577 "-" "Mozilla/5.0"
RE.DA.CT.ED - USERNAME [25/Oct/2020:15:08:22 +0200] "REPORT /radicale/CALENDAR_ROOT/CALENDAR/ HTTP/1.1" 207 8197 "-" "Mozilla/5.0"

As outlined in the wiki page, I logged the output of msyncd on both devices and tried to figure out what is going wrong, but maybe someone more knowledgeable could figure out what am I seeing here; I just have a vague hunch that login credentials to the CalDAV server are lost / not provided correctly:

Failed sync with 3.4.0.24

[D] unknown:0 - Starting Log At : QDateTime(2020-10-25 17:54:26.813 EET Qt::TimeSpec(LocalTime))
[D] unknown:0 - Primary profile path set to "/home/nemo/.cache/msyncd"
[D] unknown:0 - Secondary profile path set to "/etc/buteo/profiles"
[D] unknown:0 - Primary profile path set to "/home/nemo/.cache/msyncd"
[D] unknown:0 - Secondary profile path set to "/etc/buteo/profiles"
[D] unknown:0 - Starting msyncd
[D] unknown:0 - Registered to D-Bus
[D] unknown:0 - New network state: true  New type:  "LTE" ( 10 )
[D] unknown:0 - Network status:
[D] unknown:0 - 	Online:: true
[D] unknown:0 - 	Connection:: 10
[D] unknown:0 - New network state: true  New type:  "LTE" ( 10 )
[D] unknown:0 - Network status:
[D] unknown:0 - 	Online:: true
[D] unknown:0 - 	Connection:: 10
[D] unknown:0 - Starting/Resuming server plug-ins
[D] unknown:0 - "No carrier"
[D] unknown:0 - Registered sync backup to D-Bus
[D] unknown:0 - Primary profile path set to "/home/nemo/.cache/msyncd"
[D] unknown:0 - Secondary profile path set to "/etc/buteo/profiles"
[D] unknown:0 - Synchronizer::getBackUpRestoreState
[D] unknown:0 - Sync externally is off for profile: "caldav-sync-37"
[D] unknown:0 - Synchronizer::getBackUpRestoreState
[D] unknown:0 - Sync externally is off for profile: "carddav.Contacts-37"
[D] unknown:0 - lastSync: QDateTime(2020-10-25 17:01:16.000 EET Qt::TimeSpec(LocalTime))
[D] unknown:0 - aPrevSync "Sun Oct 25 17:01:16 2020" Last Configured Time  "" CurrentDateTime QDateTime(2020-10-25 17:54:26.913 EET Qt::TimeSpec(LocalTime))
[D] unknown:0 - Sync interval defined as 60
[D] unknown:0 - numberOfInterval: 1 interval time 60
[D] unknown:0 - next non rush hour sync is at::  QDateTime(2020-10-25 18:01:16.000 EET Qt::TimeSpec(LocalTime))
[D] unknown:0 - nextSync "Sun Oct 25 18:01:16 2020"
[D] unknown:0 - BackgroundSync::set() profile name = "syncemail-4" with frequency  6 minutes, waiting.
[D] unknown:0 - Synchronizer::getBackUpRestoreState
[D] unknown:0 - Sync externally is off for profile: "syncemail-4"
[D] unknown:0 - lastSync: QDateTime(2020-10-25 17:01:19.000 EET Qt::TimeSpec(LocalTime))
[D] unknown:0 - aPrevSync "Sun Oct 25 17:01:19 2020" Last Configured Time  "" CurrentDateTime QDateTime(2020-10-25 17:54:26.915 EET Qt::TimeSpec(LocalTime))
[D] unknown:0 - Sync interval defined as 60
[D] unknown:0 - numberOfInterval: 1 interval time 60
[D] unknown:0 - next non rush hour sync is at::  QDateTime(2020-10-25 18:01:19.000 EET Qt::TimeSpec(LocalTime))
[D] unknown:0 - nextSync "Sun Oct 25 18:01:19 2020"
[D] unknown:0 - BackgroundSync::set() profile name = "syncemail-5" with frequency  6 minutes, waiting.
[D] unknown:0 - Synchronizer::getBackUpRestoreState
[D] unknown:0 - Sync externally is off for profile: "syncemail-5"
[D] unknown:0 - No profiles interested in SOC
[D] unknown:0 - Entering event loop
[D] unknown:0 - AccountsHelper::registerAccountListener() is disabled!  Not listening to change signals for account: 37
[D] unknown:0 - AccountsHelper::registerAccountListener() is disabled!  Not listening to change signals for account: 17
[D] unknown:0 - AccountsHelper::registerAccountListener() is disabled!  Not listening to change signals for account: 5
[D] unknown:0 - AccountsHelper::registerAccountListener() is disabled!  Not listening to change signals for account: 4
[D] unknown:0 - New network state: true  New type:  "LTE" ( 10 )
[D] unknown:0 - Synchronizer::getBackUpRestoreState
[D] unknown:0 - Start sync requested for profile: "caldav-sync-37"
[D] unknown:0 - Synchronizer::getBackUpRestoreState
[D] unknown:0 - Starting sync with profile "caldav-sync-37"
[D] unknown:0 - Disable sync on change: false false
[D] unknown:0 - Starting oop plugin  "caldav-sync-37"
[D] unknown:0 - Starting process  "/usr/lib/buteo-plugins-qt5//oopp/caldav-client"  with plugin name  "caldav"  and profile name  "caldav-sync-37"
[D] unknown:0 - New network state: true  New type:  "LTE" ( 10 )
[D] unknown:0 - Network status:
[D] unknown:0 - 	Online:: true
[D] unknown:0 - 	Connection:: 10
[D] unknown:0 - attempting to register dbus service: "com.buteo.msyncd.plugin.caldav-sync-37"
[D] unknown:0 - Plugin  "caldav"  with profile  "caldav-sync-37"  registered at dbus  "com.buteo.msyncd.plugin.caldav-sync-37"  and path  /
[D] unknown:0 - "No carrier"
[D] unknown:0 - Process  "/usr/lib/buteo-plugins-qt5//oopp/caldav-client"  started with pid  12240
[D] unknown:0 - Client plug-in runner initialized
[D] unknown:0 - New network state: true  New type:  "LTE" ( 10 )
[D] unknown:0 - Network status:
[D] unknown:0 - 	Online:: true
[D] unknown:0 - 	Connection:: 10
[D] unknown:0 - sync-ui dbus interface is getting called
[D] unknown:0 - Sync session started
[D] unknown:0 - ClientPluginRunner started thread for plugin: "caldav-sync-37" , returning: true
[D] unknown:0 - attempt to start sync session due to network session opened succeeded.
[D] unknown:0 - Sync status changed for account "37"
[D] unknown:0 - Primary profile path set to "/home/nemo/.cache/msyncd"
[D] unknown:0 - Secondary profile path set to "/etc/buteo/profiles"
[D] unknown:0 - Initiating config...
[D] unknown:0 - Sync running for 37
[D] unknown:0 - Init done. Continuing with sync
[D] unknown:0 - Authenticated!
[D] unknown:0 - "---------------------------------------------------------------------"
[D] unknown:0 - "Depth : 1"
[D] unknown:0 - "Prefer : return-minimal"
[D] unknown:0 - "Content-Length : 93"
[D] unknown:0 - "Content-Type : application/xml; charset=utf-8"
[D] unknown:0 - "URL = https://user:pass@REDACTED/"
[D] unknown:0 - "Request : PROPFIND"
[D] unknown:0 - "<d:propfind xmlns:d=\"DAV:\">  <d:prop>    <d:current-user-principal />  </d:prop></d:propfind>"
[D] unknown:0 - "---------------------------------------------------------------------"
[D] unknown:0 - Process PROPFIND response.
[D] unknown:0 - The "PROPFIND" operation requested on the remote content is not permitted
[W] unknown:0 - Cannot find the calendar root for this user, guess it from account.
[D] unknown:0 - "---------------------------------------------------------------------"
[D] unknown:0 - "Depth : 1"
[D] unknown:0 - "Prefer : return-minimal"
[D] unknown:0 - "Content-Length : 220"
[D] unknown:0 - "Content-Type : application/xml; charset=utf-8"
[D] unknown:0 - "URL = https://user:pass@REDACTED/radicale/CALENDAR_ROOT/"
[D] unknown:0 - "Request : PROPFIND"
[D] unknown:0 - "<d:propfind xmlns:d=\"DAV:\" xmlns:a=\"http://apple.com/ns/ical/\"> <d:prop>  <d:resourcetype />  <d:current-user-principal />  <d:current-user-privilege-set />  <d:displayname />  <a:calendar-color /> </d:prop></d:propfind>"
[D] unknown:0 - "---------------------------------------------------------------------"
[D] unknown:0 - Process PROPFIND response.
[D] unknown:0 - The "PROPFIND" operation requested on the remote content is not permitted
[D] unknown:0 - CalDAV sync succeeded! "No calendars for this account"
[D] unknown:0 - Session finished: "caldav-sync-37" , status: 4
[D] unknown:0 - ProfileManager::enableStorages
[D] unknown:0 - ProfileManager::enableStorages
[D] unknown:0 - Clean up session for profile "caldav-sync-37"
[D] unknown:0 - Stopping the OOP process for  "caldav"
[D] unknown:0 - Process  "/usr/lib/buteo-plugins-qt5//oopp/caldav-client"  finished with exit code 15
[D] unknown:0 - Sync status changed for account "37"
[D] unknown:0 - lastSync: QDateTime(2020-10-25 17:54:34.000 EET Qt::TimeSpec(LocalTime))
[D] unknown:0 - lastSync: QDateTime( Qt::TimeSpec(LocalTime))

Successful sync with 3.1.0.11

[D] unknown:0 - Starting Log At : QDateTime(2020-10-25 17:38:22.221 EET Qt::TimeSpec(LocalTime))
[D] unknown:0 - Primary profile path set to "/home/nemo/.cache/msyncd"
[D] unknown:0 - Secondary profile path set to "/etc/buteo/profiles"
[D] unknown:0 - Primary profile path set to "/home/nemo/.cache/msyncd"
[D] unknown:0 - Secondary profile path set to "/etc/buteo/profiles"
[D] unknown:0 - Starting msyncd
[D] unknown:0 - Registered to D-Bus
[D] unknown:0 - New network state: true  New type:  "WLAN" ( 2 )
[D] unknown:0 - Network status:
[D] unknown:0 - 	Online:: true
[D] unknown:0 - 	Connection:: 2
[W] unknown:0 - This device does not have a BT adapter
[D] unknown:0 - New network state: true  New type:  "WLAN" ( 2 )
[D] unknown:0 - Network status:
[D] unknown:0 - 	Online:: true
[D] unknown:0 - 	Connection:: 2
[D] unknown:0 - Starting/Resuming server plug-ins
[D] unknown:0 - Primary profile path set to "/home/nemo/.cache/msyncd"
[D] unknown:0 - Secondary profile path set to "/etc/buteo/profiles"
[D] unknown:0 - ProfileManager::syncProfile( "caldav-sync-28" )
[D] unknown:0 - found a valid sync profile with the given name: "caldav-sync-28"
[D] unknown:0 - ProfileManager::syncProfile( "carddav.Contacts-28" )
[D] unknown:0 - found a valid sync profile with the given name: "carddav.Contacts-28"
[D] unknown:0 - ProfileManager::syncProfile( "syncemail-29" )
[D] unknown:0 - found a valid sync profile with the given name: "syncemail-29"
[D] unknown:0 - ProfileManager::syncProfile( "syncemail-8" )
[D] unknown:0 - found a valid sync profile with the given name: "syncemail-8"
[D] unknown:0 - ProfileManager::syncProfile( "caldav-sync" )
[D] unknown:0 - found a valid sync profile with the given name: "caldav-sync"
[D] unknown:0 - No sync log found for profile: "caldav-sync"
[D] unknown:0 - ProfileManager::syncProfile( "carddav.Contacts" )
[D] unknown:0 - found a valid sync profile with the given name: "carddav.Contacts"
[D] unknown:0 - No sync log found for profile: "carddav.Contacts"
[D] unknown:0 - ProfileManager::syncProfile( "dropbox.Backup" )
[D] unknown:0 - found a valid sync profile with the given name: "dropbox.Backup"
[D] unknown:0 - No sync log found for profile: "dropbox.Backup"
[D] unknown:0 - ProfileManager::syncProfile( "dropbox.Images" )
[D] unknown:0 - found a valid sync profile with the given name: "dropbox.Images"
[D] unknown:0 - No sync log found for profile: "dropbox.Images"
[D] unknown:0 - ProfileManager::syncProfile( "facebook.Calendars" )
[D] unknown:0 - found a valid sync profile with the given name: "facebook.Calendars"
[D] unknown:0 - No sync log found for profile: "facebook.Calendars"
[D] unknown:0 - ProfileManager::syncProfile( "facebook.Contacts" )
[D] unknown:0 - found a valid sync profile with the given name: "facebook.Contacts"
[D] unknown:0 - No sync log found for profile: "facebook.Contacts"
[D] unknown:0 - ProfileManager::syncProfile( "facebook.Images" )
[D] unknown:0 - found a valid sync profile with the given name: "facebook.Images"
[D] unknown:0 - No sync log found for profile: "facebook.Images"
[D] unknown:0 - ProfileManager::syncProfile( "facebook.Signon" )
[D] unknown:0 - found a valid sync profile with the given name: "facebook.Signon"
[D] unknown:0 - No sync log found for profile: "facebook.Signon"
[D] unknown:0 - ProfileManager::syncProfile( "google.Calendars" )
[D] unknown:0 - found a valid sync profile with the given name: "google.Calendars"
[D] unknown:0 - No sync log found for profile: "google.Calendars"
[D] unknown:0 - ProfileManager::syncProfile( "google.Contacts" )
[D] unknown:0 - found a valid sync profile with the given name: "google.Contacts"
[D] unknown:0 - No sync log found for profile: "google.Contacts"
[D] unknown:0 - ProfileManager::syncProfile( "google.Signon" )
[D] unknown:0 - found a valid sync profile with the given name: "google.Signon"
[D] unknown:0 - No sync log found for profile: "google.Signon"
[D] unknown:0 - ProfileManager::syncProfile( "onedrive.Backup" )
[D] unknown:0 - found a valid sync profile with the given name: "onedrive.Backup"
[D] unknown:0 - No sync log found for profile: "onedrive.Backup"
[D] unknown:0 - ProfileManager::syncProfile( "onedrive.Images" )
[D] unknown:0 - found a valid sync profile with the given name: "onedrive.Images"
[D] unknown:0 - No sync log found for profile: "onedrive.Images"
[D] unknown:0 - ProfileManager::syncProfile( "onedrive.Signon" )
[D] unknown:0 - found a valid sync profile with the given name: "onedrive.Signon"
[D] unknown:0 - No sync log found for profile: "onedrive.Signon"
[D] unknown:0 - ProfileManager::syncProfile( "sociald.All" )
[D] unknown:0 - found a valid sync profile with the given name: "sociald.All"
[D] unknown:0 - No sync log found for profile: "sociald.All"
[D] unknown:0 - ProfileManager::syncProfile( "syncemail" )
[D] unknown:0 - found a valid sync profile with the given name: "syncemail"
[D] unknown:0 - No sync log found for profile: "syncemail"
[D] unknown:0 - ProfileManager::syncProfile( "twitter.Notifications" )
[D] unknown:0 - found a valid sync profile with the given name: "twitter.Notifications"
[D] unknown:0 - No sync log found for profile: "twitter.Notifications"
[D] unknown:0 - ProfileManager::syncProfile( "twitter.Posts" )
[D] unknown:0 - found a valid sync profile with the given name: "twitter.Posts"
[D] unknown:0 - No sync log found for profile: "twitter.Posts"
[D] unknown:0 - ProfileManager::syncProfile( "vk.Calendars" )
[D] unknown:0 - found a valid sync profile with the given name: "vk.Calendars"
[D] unknown:0 - No sync log found for profile: "vk.Calendars"
[D] unknown:0 - ProfileManager::syncProfile( "vk.Contacts" )
[D] unknown:0 - found a valid sync profile with the given name: "vk.Contacts"
[D] unknown:0 - No sync log found for profile: "vk.Contacts"
[D] unknown:0 - ProfileManager::syncProfile( "vk.Images" )
[D] unknown:0 - found a valid sync profile with the given name: "vk.Images"
[D] unknown:0 - No sync log found for profile: "vk.Images"
[D] unknown:0 - ProfileManager::syncProfile( "vk.Notifications" )
[D] unknown:0 - found a valid sync profile with the given name: "vk.Notifications"
[D] unknown:0 - No sync log found for profile: "vk.Notifications"
[D] unknown:0 - ProfileManager::syncProfile( "vk.Posts" )
[D] unknown:0 - found a valid sync profile with the given name: "vk.Posts"
[D] unknown:0 - No sync log found for profile: "vk.Posts"
[D] unknown:0 - Sync externally is off for profile: "caldav-sync-28"
[D] unknown:0 - Sync externally is off for profile: "carddav.Contacts-28"
[D] unknown:0 - lastSync: QDateTime(2020-10-25 17:33:55.000 EET Qt::TimeSpec(LocalTime))
[D] unknown:0 - aPrevSync "Sun Oct 25 17:33:55 2020" Last Configured Time  "" CurrentDateTime QDateTime(2020-10-25 17:38:22.456 EET Qt::TimeSpec(LocalTime))
[D] unknown:0 - Sync interval defined as 15
[D] unknown:0 - numberOfInterval: 1 interval time 15
[D] unknown:0 - next non rush hour sync is at::  QDateTime(2020-10-25 17:48:55.000 EET Qt::TimeSpec(LocalTime))
[D] unknown:0 - nextSync "Sun Oct 25 17:48:55 2020"
[D] unknown:0 - BackgroundSync::set() profile name = "syncemail-29" with frequency  10 minutes, waiting.
[D] unknown:0 - Sync externally is off for profile: "syncemail-29"
[D] unknown:0 - lastSync: QDateTime(2020-10-25 17:33:53.000 EET Qt::TimeSpec(LocalTime))
[D] unknown:0 - aPrevSync "Sun Oct 25 17:33:53 2020" Last Configured Time  "" CurrentDateTime QDateTime(2020-10-25 17:38:22.465 EET Qt::TimeSpec(LocalTime))
[D] unknown:0 - Sync interval defined as 30
[D] unknown:0 - numberOfInterval: 1 interval time 30
[D] unknown:0 - next non rush hour sync is at::  QDateTime(2020-10-25 18:03:53.000 EET Qt::TimeSpec(LocalTime))
[D] unknown:0 - nextSync "Sun Oct 25 18:03:53 2020"
[D] unknown:0 - BackgroundSync::set() profile name = "syncemail-8" with frequency  25 minutes, waiting.
[D] unknown:0 - Sync externally is off for profile: "syncemail-8"
[D] unknown:0 - Registered sync backup to D-Bus
[D] unknown:0 - ProfileManager::syncProfile( "caldav-sync-28" )
[D] unknown:0 - found a valid sync profile with the given name: "caldav-sync-28"
[D] unknown:0 - ProfileManager::syncProfile( "carddav.Contacts-28" )
[D] unknown:0 - found a valid sync profile with the given name: "carddav.Contacts-28"
[D] unknown:0 - ProfileManager::syncProfile( "syncemail-29" )
[D] unknown:0 - found a valid sync profile with the given name: "syncemail-29"
[D] unknown:0 - ProfileManager::syncProfile( "syncemail-8" )
[D] unknown:0 - found a valid sync profile with the given name: "syncemail-8"
[D] unknown:0 - ProfileManager::syncProfile( "caldav-sync" )
[D] unknown:0 - found a valid sync profile with the given name: "caldav-sync"
[D] unknown:0 - No sync log found for profile: "caldav-sync"
[D] unknown:0 - ProfileManager::syncProfile( "carddav.Contacts" )
[D] unknown:0 - found a valid sync profile with the given name: "carddav.Contacts"
[D] unknown:0 - No sync log found for profile: "carddav.Contacts"
[D] unknown:0 - ProfileManager::syncProfile( "dropbox.Backup" )
[D] unknown:0 - found a valid sync profile with the given name: "dropbox.Backup"
[D] unknown:0 - No sync log found for profile: "dropbox.Backup"
[D] unknown:0 - ProfileManager::syncProfile( "dropbox.Images" )
[D] unknown:0 - found a valid sync profile with the given name: "dropbox.Images"
[D] unknown:0 - No sync log found for profile: "dropbox.Images"
[D] unknown:0 - ProfileManager::syncProfile( "facebook.Calendars" )
[D] unknown:0 - found a valid sync profile with the given name: "facebook.Calendars"
[D] unknown:0 - No sync log found for profile: "facebook.Calendars"
[D] unknown:0 - ProfileManager::syncProfile( "facebook.Contacts" )
[D] unknown:0 - found a valid sync profile with the given name: "facebook.Contacts"
[D] unknown:0 - No sync log found for profile: "facebook.Contacts"
[D] unknown:0 - ProfileManager::syncProfile( "facebook.Images" )
[D] unknown:0 - found a valid sync profile with the given name: "facebook.Images"
[D] unknown:0 - No sync log found for profile: "facebook.Images"
[D] unknown:0 - ProfileManager::syncProfile( "facebook.Signon" )
[D] unknown:0 - found a valid sync profile with the given name: "facebook.Signon"
[D] unknown:0 - No sync log found for profile: "facebook.Signon"
[D] unknown:0 - ProfileManager::syncProfile( "google.Calendars" )
[D] unknown:0 - found a valid sync profile with the given name: "google.Calendars"
[D] unknown:0 - No sync log found for profile: "google.Calendars"
[D] unknown:0 - ProfileManager::syncProfile( "google.Contacts" )
[D] unknown:0 - found a valid sync profile with the given name: "google.Contacts"
[D] unknown:0 - No sync log found for profile: "google.Contacts"
[D] unknown:0 - ProfileManager::syncProfile( "google.Signon" )
[D] unknown:0 - found a valid sync profile with the given name: "google.Signon"
[D] unknown:0 - No sync log found for profile: "google.Signon"
[D] unknown:0 - ProfileManager::syncProfile( "onedrive.Backup" )
[D] unknown:0 - found a valid sync profile with the given name: "onedrive.Backup"
[D] unknown:0 - No sync log found for profile: "onedrive.Backup"
[D] unknown:0 - ProfileManager::syncProfile( "onedrive.Images" )
[D] unknown:0 - found a valid sync profile with the given name: "onedrive.Images"
[D] unknown:0 - No sync log found for profile: "onedrive.Images"
[D] unknown:0 - ProfileManager::syncProfile( "onedrive.Signon" )
[D] unknown:0 - found a valid sync profile with the given name: "onedrive.Signon"
[D] unknown:0 - No sync log found for profile: "onedrive.Signon"
[D] unknown:0 - ProfileManager::syncProfile( "sociald.All" )
[D] unknown:0 - found a valid sync profile with the given name: "sociald.All"
[D] unknown:0 - No sync log found for profile: "sociald.All"
[D] unknown:0 - ProfileManager::syncProfile( "syncemail" )
[D] unknown:0 - found a valid sync profile with the given name: "syncemail"
[D] unknown:0 - No sync log found for profile: "syncemail"
[D] unknown:0 - ProfileManager::syncProfile( "twitter.Notifications" )
[D] unknown:0 - found a valid sync profile with the given name: "twitter.Notifications"
[D] unknown:0 - No sync log found for profile: "twitter.Notifications"
[D] unknown:0 - ProfileManager::syncProfile( "twitter.Posts" )
[D] unknown:0 - found a valid sync profile with the given name: "twitter.Posts"
[D] unknown:0 - No sync log found for profile: "twitter.Posts"
[D] unknown:0 - ProfileManager::syncProfile( "vk.Calendars" )
[D] unknown:0 - found a valid sync profile with the given name: "vk.Calendars"
[D] unknown:0 - No sync log found for profile: "vk.Calendars"
[D] unknown:0 - ProfileManager::syncProfile( "vk.Contacts" )
[D] unknown:0 - found a valid sync profile with the given name: "vk.Contacts"
[D] unknown:0 - No sync log found for profile: "vk.Contacts"
[D] unknown:0 - ProfileManager::syncProfile( "vk.Images" )
[D] unknown:0 - found a valid sync profile with the given name: "vk.Images"
[D] unknown:0 - No sync log found for profile: "vk.Images"
[D] unknown:0 - ProfileManager::syncProfile( "vk.Notifications" )
[D] unknown:0 - found a valid sync profile with the given name: "vk.Notifications"
[D] unknown:0 - No sync log found for profile: "vk.Notifications"
[D] unknown:0 - ProfileManager::syncProfile( "vk.Posts" )
[D] unknown:0 - found a valid sync profile with the given name: "vk.Posts"
[D] unknown:0 - No sync log found for profile: "vk.Posts"
[D] unknown:0 - No profiles interested in SOC
[D] unknown:0 - Entering event loop
[D] unknown:0 - AccountsHelper::registerAccountListener() is disabled!  Not listening to change signals for account: 29
[D] unknown:0 - AccountsHelper::registerAccountListener() is disabled!  Not listening to change signals for account: 28
[D] unknown:0 - AccountsHelper::registerAccountListener() is disabled!  Not listening to change signals for account: 14
[D] unknown:0 - AccountsHelper::registerAccountListener() is disabled!  Not listening to change signals for account: 8
[D] unknown:0 - New network state: true  New type:  "WLAN" ( 2 )
[D] unknown:0 - Synchronizer::getBackUpRestoreState
[D] unknown:0 - Start sync requested for profile: "caldav-sync-28"
[D] unknown:0 - ProfileManager::syncProfile( "caldav-sync-28" )
[D] unknown:0 - found a valid sync profile with the given name: "caldav-sync-28"
[D] unknown:0 - Synchronizer::getBackUpRestoreState
[D] unknown:0 - Starting sync with profile "caldav-sync-28"
[D] unknown:0 - Disable sync on change: false false
[D] unknown:0 - Starting oop plugin  "caldav-sync-28"
[D] unknown:0 - Starting process  "/usr/lib/buteo-plugins-qt5//oopp/caldav-client"  with plugin name  "caldav"  and profile name  "caldav-sync-28"
[W] unknown:0 - This device does not have a BT adapter
[D] unknown:0 - New network state: true  New type:  "WLAN" ( 2 )
[D] unknown:0 - Network status:
[D] unknown:0 - 	Online:: true
[D] unknown:0 - 	Connection:: 2
[D] unknown:0 - attempting to register dbus service: "com.buteo.msyncd.plugin.caldav-sync-28"
[D] unknown:0 - Plugin  "caldav"  with profile  "caldav-sync-28"  registered at dbus  "com.buteo.msyncd.plugin.caldav-sync-28"  and path  /
[D] unknown:0 - Process  "/usr/lib/buteo-plugins-qt5//oopp/caldav-client"  started with pid  7872
[D] unknown:0 - Client plug-in runner initialized
[D] unknown:0 - New network state: true  New type:  "WLAN" ( 2 )
[D] unknown:0 - Network status:
[D] unknown:0 - 	Online:: true
[D] unknown:0 - 	Connection:: 2
[D] unknown:0 - sync-ui dbus interface is getting called
[D] unknown:0 - Sync session started
[D] unknown:0 - ClientPluginRunner started thread for plugin: "caldav-sync-28" , returning: true
[D] unknown:0 - attempt to start sync session due to network session opened succeeded.
[D] unknown:0 - ProfileManager::syncProfile( "caldav-sync-28" )
[D] unknown:0 - found a valid sync profile with the given name: "caldav-sync-28"
[D] unknown:0 - Sync status changed for account "28"
[D] unknown:0 - ProfileManager::syncProfile( "caldav-sync-28" )
[D] unknown:0 - Primary profile path set to "/home/nemo/.cache/msyncd"
[D] unknown:0 - Secondary profile path set to "/etc/buteo/profiles"
[D] unknown:0 - ProfileManager::syncProfile( "caldav-sync-28" )
[D] unknown:0 - found a valid sync profile with the given name: "caldav-sync-28"
[D] unknown:0 - Initiating config...
[D] unknown:0 - found a valid sync profile with the given name: "caldav-sync-28"
[D] unknown:0 - ProfileManager::syncProfile( "carddav.Contacts-28" )
[D] unknown:0 - found a valid sync profile with the given name: "carddav.Contacts-28"
[D] unknown:0 - ProfileManager::syncProfile( "syncemail-29" )
[D] unknown:0 - found a valid sync profile with the given name: "syncemail-29"
[D] unknown:0 - ProfileManager::syncProfile( "syncemail-8" )
[D] unknown:0 - found a valid sync profile with the given name: "syncemail-8"
[D] unknown:0 - ProfileManager::syncProfile( "caldav-sync" )
[D] unknown:0 - found a valid sync profile with the given name: "caldav-sync"
[D] unknown:0 - No sync log found for profile: "caldav-sync"
[D] unknown:0 - ProfileManager::syncProfile( "carddav.Contacts" )
[D] unknown:0 - found a valid sync profile with the given name: "carddav.Contacts"
[D] unknown:0 - No sync log found for profile: "carddav.Contacts"
[D] unknown:0 - ProfileManager::syncProfile( "dropbox.Backup" )
[D] unknown:0 - found a valid sync profile with the given name: "dropbox.Backup"
[D] unknown:0 - No sync log found for profile: "dropbox.Backup"
[D] unknown:0 - ProfileManager::syncProfile( "dropbox.Images" )
[D] unknown:0 - found a valid sync profile with the given name: "dropbox.Images"
[D] unknown:0 - No sync log found for profile: "dropbox.Images"
[D] unknown:0 - ProfileManager::syncProfile( "facebook.Calendars" )
[D] unknown:0 - found a valid sync profile with the given name: "facebook.Calendars"
[D] unknown:0 - No sync log found for profile: "facebook.Calendars"
[D] unknown:0 - ProfileManager::syncProfile( "facebook.Contacts" )
[D] unknown:0 - found a valid sync profile with the given name: "facebook.Contacts"
[D] unknown:0 - No sync log found for profile: "facebook.Contacts"
[D] unknown:0 - ProfileManager::syncProfile( "facebook.Images" )
[D] unknown:0 - found a valid sync profile with the given name: "facebook.Images"
[D] unknown:0 - No sync log found for profile: "facebook.Images"
[D] unknown:0 - ProfileManager::syncProfile( "facebook.Signon" )
[D] unknown:0 - found a valid sync profile with the given name: "facebook.Signon"
[D] unknown:0 - No sync log found for profile: "facebook.Signon"
[D] unknown:0 - ProfileManager::syncProfile( "google.Calendars" )
[D] unknown:0 - found a valid sync profile with the given name: "google.Calendars"
[D] unknown:0 - connection-manager.cpp 107 setupSocketConnection p2p error: QDBusError("org.freedesktop.DBus.Error.FileNotFound", "Failed to connect to socket /run/user/100000/signond/socket: No such file or directory") 1
[D] unknown:0 - connection-manager.cpp 148 init Peer connection unavailable, activating service
[D] unknown:0 - identityimpl.cpp 96 updateState Updating state:  "PendingRegistration" SignOn::IdentityImpl(0x2092c00)
[D] unknown:0 - authsessionimpl.cpp 94 initInterface
[D] unknown:0 - No sync log found for profile: "google.Calendars"
[D] unknown:0 - ProfileManager::syncProfile( "google.Contacts" )
[D] unknown:0 - found a valid sync profile with the given name: "google.Contacts"
[D] unknown:0 - No sync log found for profile: "google.Contacts"
[D] unknown:0 - ProfileManager::syncProfile( "google.Signon" )
[D] unknown:0 - found a valid sync profile with the given name: "google.Signon"
[D] unknown:0 - No sync log found for profile: "google.Signon"
[D] unknown:0 - ProfileManager::syncProfile( "onedrive.Backup" )
[D] unknown:0 - found a valid sync profile with the given name: "onedrive.Backup"
[D] unknown:0 - No sync log found for profile: "onedrive.Backup"
[D] unknown:0 - ProfileManager::syncProfile( "onedrive.Images" )
[D] unknown:0 - found a valid sync profile with the given name: "onedrive.Images"
[D] unknown:0 - No sync log found for profile: "onedrive.Images"
[D] unknown:0 - ProfileManager::syncProfile( "onedrive.Signon" )
[D] unknown:0 - found a valid sync profile with the given name: "onedrive.Signon"
[D] unknown:0 - authsessionimpl.cpp 94 initInterface
[D] unknown:0 - Init done. Continuing with sync
[D] unknown:0 - No sync log found for profile: "onedrive.Signon"
[D] unknown:0 - ProfileManager::syncProfile( "sociald.All" )
[D] unknown:0 - found a valid sync profile with the given name: "sociald.All"
[D] unknown:0 - No sync log found for profile: "sociald.All"
[D] unknown:0 - ProfileManager::syncProfile( "syncemail" )
[D] unknown:0 - found a valid sync profile with the given name: "syncemail"
[D] unknown:0 - No sync log found for profile: "syncemail"
[D] unknown:0 - ProfileManager::syncProfile( "twitter.Notifications" )
[D] unknown:0 - found a valid sync profile with the given name: "twitter.Notifications"
[D] unknown:0 - No sync log found for profile: "twitter.Notifications"
[D] unknown:0 - ProfileManager::syncProfile( "twitter.Posts" )
[D] unknown:0 - found a valid sync profile with the given name: "twitter.Posts"
[D] unknown:0 - No sync log found for profile: "twitter.Posts"
[D] unknown:0 - ProfileManager::syncProfile( "vk.Calendars" )
[D] unknown:0 - found a valid sync profile with the given name: "vk.Calendars"
[D] unknown:0 - No sync log found for profile: "vk.Calendars"
[D] unknown:0 - ProfileManager::syncProfile( "vk.Contacts" )
[D] unknown:0 - found a valid sync profile with the given name: "vk.Contacts"
[D] unknown:0 - No sync log found for profile: "vk.Contacts"
[D] unknown:0 - ProfileManager::syncProfile( "vk.Images" )
[D] unknown:0 - found a valid sync profile with the given name: "vk.Images"
[D] unknown:0 - No sync log found for profile: "vk.Images"
[D] unknown:0 - ProfileManager::syncProfile( "vk.Notifications" )
[D] unknown:0 - found a valid sync profile with the given name: "vk.Notifications"
[D] unknown:0 - No sync log found for profile: "vk.Notifications"
[D] unknown:0 - ProfileManager::syncProfile( "vk.Posts" )
[D] unknown:0 - found a valid sync profile with the given name: "vk.Posts"
[D] unknown:0 - No sync log found for profile: "vk.Posts"
[D] unknown:0 - Sync running for 28
[D] unknown:0 - connection-manager.cpp 165 init Connected to "libsignon-qt1"
[D] unknown:0 - identityimpl.cpp 96 updateState Updating state:  "Ready" SignOn::IdentityImpl(0x2092c00)
[D] unknown:0 - identityimpl.cpp 96 updateState Updating state:  "NeedsUpdate" SignOn::IdentityImpl(0x2092c00)
[D] unknown:0 - identityimpl.cpp 96 updateState Updating state:  "PendingUpdate" SignOn::IdentityImpl(0x2092c00)
[D] unknown:0 - identityimpl.cpp 442 infoUpdated SERVER INFO UPDATED. NeedsUpdate " 30 "
[D] unknown:0 - Authenticated!
[W] unknown:0 - sqlitestorage.cpp: 193 - database "/home/nemo/.local/share/system/privileged/Calendar/mkcal/db" opened
[D] unknown:0 - found notebook: "b772ad20-eaf7-4842-b84f-06edeafd221a" for remote calendar: "/radicale/CALENDAR_ROOT/CALENDAR/"
[D] unknown:0 - Start quick sync for notebook: "b772ad20-eaf7-4842-b84f-06edeafd221a" between QDateTime(2020-04-25 15:38:36.779 UTC Qt::TimeSpec(UTC)) to QDateTime(2021-10-25 15:38:36.779 UTC Qt::TimeSpec(UTC)) , sync changes since QDateTime(2020-10-25 15:14:07.000 UTC Qt::TimeSpec(UTC))
[D] unknown:0 - "---------------------------------------------------------------------"
[D] unknown:0 - "Depth : 1"
[D] unknown:0 - "Prefer : return-minimal"
[D] unknown:0 - "Content-Length : 302"
[D] unknown:0 - "Content-Type : application/xml; charset=utf-8"
[D] unknown:0 - "URL = https://user:pass@REDACTED/radicale/CALENDAR_ROOT/CALENDAR/"
[D] unknown:0 - "Request : REPORT"
[D] unknown:0 - "<c:calendar-query xmlns:d=\"DAV:\" xmlns:c=\"urn:ietf:params:xml:ns:caldav\"><d:prop><d:getetag /></d:prop><c:filter><c:comp-filter name=\"VCALENDAR\"><c:comp-filter name=\"VEVENT\"> <c:time-range start=\"20200425T153836Z\" end=\"20211025T153836Z\"  /></c:comp-filter></c:comp-filter></c:filter></c:calendar-query>"
[D] unknown:0 - "---------------------------------------------------------------------"
[D] unknown:0 - identityimpl.cpp 381 getInfoReply QMap(("ACL", QVariant(QStringList, ()))("AuthMethods", QVariant(QDBusArgument, ))("Caption", QVariant(QString, "Jolla"))("Id", QVariant(uint, 30))("Owner", QVariant(QStringList, ()))("Realms", QVariant(QStringList, ()))("RefCount", QVariant(int, 0))("StoreSecret", QVariant(bool, true))("Type", QVariant(int, 0))("UserName", QVariant(QString, "USERNAME"))("UserNameSecret", QVariant(bool, false))("Validated", QVariant(bool, true)))
[D] unknown:0 - identityimpl.cpp 96 updateState Updating state:  "Ready" SignOn::IdentityImpl(0x2092c00)
[D] unknown:0 - Process REPORT response for server path "/radicale/CALENDAR_ROOT/CALENDAR/"
[D] unknown:0 - "---------------------------------------------------------------------"
[D] unknown:0 - "REPORT response status code: 207"
[D] unknown:0 - "REPORT response headers:"
[D] unknown:0 - "\tServer : nginx/1.16.1"
[D] unknown:0 - "\tDate : Sun, 25 Oct 2020 15:38:37 GMT"
[D] unknown:0 - "\tContent-Type : text/xml; charset=utf-8"
[D] unknown:0 - "\tConnection : keep-alive"
[D] unknown:0 - "\tContent-Encoding : gzip"
[D] unknown:0 - "REPORT response data:<?xml version='1.0' encoding='utf-8'?>"
<<REDACTED MULTIPLE LINES>>
[D] unknown:0 - "---------------------------------------------------------------------"
[D] unknown:0 - Process tags for server path "/radicale/CALENDAR_ROOT/CALENDAR/"
<<REDACTED MULTIPLE LINES>>
[D] unknown:0 - Calculated local  A/M/R: 0 / 1 / 0
[D] unknown:0 - Calculated remote A/M/R: 19 / 0 / 0
[D] unknown:0 - "---------------------------------------------------------------------"
[D] unknown:0 - "Depth : 1"
[D] unknown:0 - "Prefer : return-minimal"
[D] unknown:0 - "Content-Length : 2495"
[D] unknown:0 - "Content-Type : application/xml; charset=utf-8"
[D] unknown:0 - "URL = https://user:pass@REDACTED/radicale/CALENDAR_ROOT/CALENDAR/"
[D] unknown:0 - "Request : REPORT"
<<REDACTED MULTIPLE LINES>>    
[D] unknown:0 - "---------------------------------------------------------------------"
[D] unknown:0 - New network state: true  New type:  "WLAN" ( 2 )
[D] unknown:0 - Process REPORT response for server path "/radicale/CALENDAR_ROOT/CALENDAR/"
[D] unknown:0 - "---------------------------------------------------------------------"
[D] unknown:0 - "REPORT response status code: 207"
[D] unknown:0 - "REPORT response headers:"
[D] unknown:0 - "\tServer : nginx/1.16.1"
[D] unknown:0 - "\tDate : Sun, 25 Oct 2020 15:38:38 GMT"
[D] unknown:0 - "\tContent-Type : text/xml; charset=utf-8"
[D] unknown:0 - "\tConnection : keep-alive"
[D] unknown:0 - "\tContent-Encoding : gzip"
[D] unknown:0 - "REPORT response data:<?xml version='1.0' encoding='utf-8'?>"
<<REDACTED MULTIPLE LINES>>    
[D] unknown:0 - "</C:calendar-data></prop><status>HTTP/1.1 200 OK</status></propstat></response></multistatus>"
[D] unknown:0 - "---------------------------------------------------------------------"
[D] unknown:0 - iCal data contains 1 VEVENT instances
[D] unknown:0 - iCal data contains 1 VEVENT instances
[D] unknown:0 - iCal data contains 1 VEVENT instances
<<REDACTED MULTIPLE LINES>>    
[D] unknown:0 - Report request finished: received: 4 iCal blobs containing a total of 4 incidences of which 3 incidences were remote additions/modifications
[D] unknown:0 - no local changes to upsync - finished with notebook "CALENDAR_ROOT/CALENDAR" "/radicale/CALENDAR_ROOT/CALENDAR/"
[D] unknown:0 - Notebook sync finished. Total agents: 1
<<REDACTED MULTIPLE LINES>>    
[D] unknown:0 - Calendar storage saved successfully after writing notebook changes!
[D] unknown:0 - CalDAV sync succeeded! ""
[D] unknown:0 - Session finished: "caldav-sync-28" , status: 4
[D] unknown:0 - ProfileManager::enableStorages
[D] unknown:0 - ProfileManager::enableStorages
[D] unknown:0 - aStatus 4
[D] unknown:0 - ProfileManager::syncProfile( "caldav-sync-28" )
[D] unknown:0 - found a valid sync profile with the given name: "caldav-sync-28"
[D] unknown:0 - Stopping the OOP process for  "caldav"
[D] unknown:0 - Process  "/usr/lib/buteo-plugins-qt5//oopp/caldav-client"  finished with exit code 15
[D] unknown:0 - ProfileManager::syncProfile( "caldav-sync-28" )
[D] unknown:0 - found a valid sync profile with the given name: "caldav-sync-28"
[D] unknown:0 - Sync status changed for account "28"
[D] unknown:0 - ProfileManager::syncProfile( "caldav-sync-28" )
[D] unknown:0 - found a valid sync profile with the given name: "caldav-sync-28"
[D] unknown:0 - ProfileManager::syncProfile( "carddav.Contacts-28" )
[D] unknown:0 - found a valid sync profile with the given name: "carddav.Contacts-28"
[D] unknown:0 - ProfileManager::syncProfile( "syncemail-29" )
[D] unknown:0 - found a valid sync profile with the given name: "syncemail-29"
[D] unknown:0 - ProfileManager::syncProfile( "syncemail-8" )
[D] unknown:0 - found a valid sync profile with the given name: "syncemail-8"
[D] unknown:0 - ProfileManager::syncProfile( "caldav-sync" )
[D] unknown:0 - found a valid sync profile with the given name: "caldav-sync"
[D] unknown:0 - No sync log found for profile: "caldav-sync"
[D] unknown:0 - ProfileManager::syncProfile( "carddav.Contacts" )
[D] unknown:0 - found a valid sync profile with the given name: "carddav.Contacts"
[D] unknown:0 - No sync log found for profile: "carddav.Contacts"
[D] unknown:0 - ProfileManager::syncProfile( "dropbox.Backup" )
[D] unknown:0 - found a valid sync profile with the given name: "dropbox.Backup"
[D] unknown:0 - No sync log found for profile: "dropbox.Backup"
[D] unknown:0 - ProfileManager::syncProfile( "dropbox.Images" )
[D] unknown:0 - found a valid sync profile with the given name: "dropbox.Images"
[D] unknown:0 - No sync log found for profile: "dropbox.Images"
[D] unknown:0 - ProfileManager::syncProfile( "facebook.Calendars" )
[D] unknown:0 - found a valid sync profile with the given name: "facebook.Calendars"
[D] unknown:0 - No sync log found for profile: "facebook.Calendars"
[D] unknown:0 - ProfileManager::syncProfile( "facebook.Contacts" )
[D] unknown:0 - found a valid sync profile with the given name: "facebook.Contacts"
[D] unknown:0 - No sync log found for profile: "facebook.Contacts"
[D] unknown:0 - ProfileManager::syncProfile( "facebook.Images" )
[D] unknown:0 - found a valid sync profile with the given name: "facebook.Images"
[D] unknown:0 - No sync log found for profile: "facebook.Images"
[D] unknown:0 - ProfileManager::syncProfile( "facebook.Signon" )
[D] unknown:0 - found a valid sync profile with the given name: "facebook.Signon"
[D] unknown:0 - No sync log found for profile: "facebook.Signon"
[D] unknown:0 - ProfileManager::syncProfile( "google.Calendars" )
[D] unknown:0 - found a valid sync profile with the given name: "google.Calendars"
[D] unknown:0 - No sync log found for profile: "google.Calendars"
[D] unknown:0 - ProfileManager::syncProfile( "google.Contacts" )
[D] unknown:0 - found a valid sync profile with the given name: "google.Contacts"
[D] unknown:0 - No sync log found for profile: "google.Contacts"
[D] unknown:0 - ProfileManager::syncProfile( "google.Signon" )
[D] unknown:0 - found a valid sync profile with the given name: "google.Signon"
[D] unknown:0 - No sync log found for profile: "google.Signon"
[D] unknown:0 - ProfileManager::syncProfile( "onedrive.Backup" )
[D] unknown:0 - found a valid sync profile with the given name: "onedrive.Backup"
[D] unknown:0 - No sync log found for profile: "onedrive.Backup"
[D] unknown:0 - ProfileManager::syncProfile( "onedrive.Images" )
[D] unknown:0 - found a valid sync profile with the given name: "onedrive.Images"
[D] unknown:0 - No sync log found for profile: "onedrive.Images"
[D] unknown:0 - ProfileManager::syncProfile( "onedrive.Signon" )
[D] unknown:0 - found a valid sync profile with the given name: "onedrive.Signon"
[D] unknown:0 - No sync log found for profile: "onedrive.Signon"
[D] unknown:0 - ProfileManager::syncProfile( "sociald.All" )
[D] unknown:0 - found a valid sync profile with the given name: "sociald.All"
[D] unknown:0 - No sync log found for profile: "sociald.All"
[D] unknown:0 - ProfileManager::syncProfile( "syncemail" )
[D] unknown:0 - found a valid sync profile with the given name: "syncemail"
[D] unknown:0 - No sync log found for profile: "syncemail"
[D] unknown:0 - ProfileManager::syncProfile( "twitter.Notifications" )
[D] unknown:0 - found a valid sync profile with the given name: "twitter.Notifications"
[D] unknown:0 - No sync log found for profile: "twitter.Notifications"
[D] unknown:0 - ProfileManager::syncProfile( "twitter.Posts" )
[D] unknown:0 - found a valid sync profile with the given name: "twitter.Posts"
[D] unknown:0 - No sync log found for profile: "twitter.Posts"
[D] unknown:0 - ProfileManager::syncProfile( "vk.Calendars" )
[D] unknown:0 - found a valid sync profile with the given name: "vk.Calendars"
[D] unknown:0 - No sync log found for profile: "vk.Calendars"
[D] unknown:0 - ProfileManager::syncProfile( "vk.Contacts" )
[D] unknown:0 - found a valid sync profile with the given name: "vk.Contacts"
[D] unknown:0 - No sync log found for profile: "vk.Contacts"
[D] unknown:0 - ProfileManager::syncProfile( "vk.Images" )
[D] unknown:0 - found a valid sync profile with the given name: "vk.Images"
[D] unknown:0 - No sync log found for profile: "vk.Images"
[D] unknown:0 - ProfileManager::syncProfile( "vk.Notifications" )
[D] unknown:0 - found a valid sync profile with the given name: "vk.Notifications"
[D] unknown:0 - No sync log found for profile: "vk.Notifications"
[D] unknown:0 - ProfileManager::syncProfile( "vk.Posts" )
[D] unknown:0 - found a valid sync profile with the given name: "vk.Posts"
[D] unknown:0 - No sync log found for profile: "vk.Posts"
[D] unknown:0 - lastSync: QDateTime(2020-10-25 15:38:39.000 UTC Qt::TimeSpec(UTC))
[D] unknown:0 - lastSync: QDateTime( Qt::TimeSpec(LocalTime))

[dcaliste]

Thanks for the detailed logs. I’ll try to find what’s wrong when the code tries to find the calendar paths and find none. I don’t think it’s a credential issue but more a wrong handling of the server answer in the discovery code path that I changed in 3.4.0. Sorry for that.

[dcaliste]

Ok, I found the faulty code path in your case. See this merge request upstream :

[buteo-sync-plugin-caldav] Don't report access denied in PROPFIND as a...

It was an issue with the contentPermissionError that was treated as a no error code path, while it should and then falback on stored calendars instead of trying to list them from server.

As soon as the SDK for 3.4.0 is out (it’s not yet I think, right ?) I’ll compile a package that you can use to test and tell me if it solves the issue. If you agree to do so.

[flypig]

@dcaliste

As soon as the SDK for 3.4.0 is out (it’s not yet I think, right ?)

There’s a 3.4.0 Early Access target which I think should do the job (at your own risk, etc. etc.):

[release notes] Sailfish SDK 3.2

Update #3 - 30.9.2020 Today (Sep 30th) at 08:00 UTC we published an update to the Early Access Build Targets. These now match the Sailfish OS release 3.4.0.22 (Pallas-Yllästunturi). If you have an older version of the Early Access Build Targets installed, you should see an update notification in the Sailfish SDK soon. Please, read the following notes about the Early Access Build Targets: The Early Access Build Targets match the latest Sailfish OS version released to Early Access users By us…

[dcaliste]

Thanks @flypig, somehow I missed the annoucement. I’ll update my SDK.

[askolsam]

As soon as the SDK for 3.4.0 is out (it’s not yet I think, right ?) I’ll compile a package that you can use to test and tell me if it solves the issue. If you agree to do so.

Sure thing.

I assume that updating requires me just to rpm -i the updated package and to check if the sync starts working?

[dcaliste]

You may try to use this RPM : https://git.sailfishos.org/mer-core/buteo-sync-plugin-caldav/merge_requests/73#note_60319

• To install it, devel-su pkcon install-local buteo-sync-plugin-caldav-0.1.71-1.armv7hl.rpm
• To revert to the official 3.4.0 version, devel-su pkcon install buteo-sync-plugin-caldav

It is not exactly based on the 3.4.0 release, but on the HEAD of the master branch plus the patch proposed in the mentioned merge request.

[askolsam]

I downloaded and installed the .rpm and did some quick testing.

Using the phone:

• Pull calendar from the CalDAV server (radicale) - OK
• Modify an existing event and sync changes to the CalDAV server - OK
• Create a new event and sync changes to the CalDAV server - OK

So the fix seems to be working. Nice!

[dcaliste]

@askolsam

So the fix seems to be working.

Good, don’t hesitate to report if there is some other issues that may appear later.

[askolsam]

@dcaliste

Good, don’t hesitate to report if there is some other issues that may appear later.

Without a doubt, I’ve been using XA2 as my daily driver for the past 1½ years and a working calendar is a ‘must have’ feature.

[alistair23]

Even with the updated packed I continue to see caldav failures when using Fastmail.

Do you need more logs?

[dcaliste]

@alistair23

Do you need more logs?

Yes please, otherwise it’s difficult to guess what is wrong. You may follow the instructions there: https://sailfishos.org/wiki/CalDAV_and_CardDAV_Community_Contributions

You may open a new bug report also if the issue does not correspond to the observation of the original post.

[alistair23]

Thanks, it’s the same issue that @yokisuci this thread has, but a different one to the original probelm so I created a new issue here: Unable to sync Fastmail Calendars after 3.4.0.24 Upgrade