Author Topic: [Server] Server Frame took over 1 Second  (Read 325 times)

Wurst

  • Newbie
  • *
  • Status:
    Offline
    Posts:
    1
    • View Profile
on: February 19, 2019, 09:31:32 PM
Hello to all
first of all sorry for my not so good english
I have been running a locally hosted server for a short time, where we currently play with 3 people on it.
In the log you can see the following message from time to time

Code: [Select]
2019-02-19 20-57-49| scheduled save for sector (-259:141), 0x58552b0, entities: 462
2019-02-19 20-57-49| saving sector (-259:141)
2019-02-19 20-57-49| Server frame took over 1 second.
2019-02-19 20-57-49| [ void Server::update(float): 1067.04 ms; 100% ]
2019-02-19 20-57-49|   [ void Server::updatePlayerCommunicatorAdministration(float): 583.981 ms; 54.7% ]
2019-02-19 20-57-49|   [ void Galaxy::update(float): 335.878 ms; 31.5% ]
2019-02-19 20-57-49|     [ void Galaxy::updateSectors(float): 335.694 ms; 31.5% ]
2019-02-19 20-57-49|     [ void Galaxy::updateJumpingEntities(): 0.154 ms; 0% ]
2019-02-19 20-57-49|     [ void Galaxy::updateWormHoleResults(): 0.005 ms; 0% ]
2019-02-19 20-57-49|     [ void Galaxy::updateEntityTransfers(): 0.004 ms; 0% ]
2019-02-19 20-57-49|     [ void Galaxy::handleFinishedScriptPacketCallbacks(): 0.001 ms; 0% ]
2019-02-19 20-57-49|   [ void SectorDatabase::update(): 146.204 ms; 13.7% ]
2019-02-19 20-57-49|     [ void SectorDatabase::cleanUpSaveJobs(): 146.174 ms; 13.7% ]
2019-02-19 20-57-49|     [ void SectorDatabase::startUnloadSaveJobs(): 0.007 ms; 0% ]
2019-02-19 20-57-49|     [ void SectorDatabase::cleanUpCreationJobs(): 0.006 ms; 0% ]
2019-02-19 20-57-49|   [ MessageServer update: 0.489 ms; 0% ]
2019-02-19 20-57-49|     [ virtual void SteamNetworkingServer::update(): 0.467 ms; 0% ]
2019-02-19 20-57-49|       [ void SteamNetworkingServer::sendUpdatedServerDetailsToSteam(): 0.414 ms; 0% ]
2019-02-19 20-57-49|       [ void SteamNetworkingServer::receiveNetworkData(): 0.031 ms; 0% ]
2019-02-19 20-57-49|       [ void SteamNetworkingServer::updateTimeouts(): 0.001 ms; 0% ]
2019-02-19 20-57-49|       [ void SteamNetworkingServer::updatePendingClosing(): 0.001 ms; 0% ]
2019-02-19 20-57-49|   [ void Server::updateDebugDiagnostics(): 0.196 ms; 0% ]
2019-02-19 20-57-49|
2019-02-19 20-57-50| sector (-259:141) saved to "C:\Users\Administrator\AppData\Roaming\Avorion\galaxies\Wurst\sectors\-259_141"

After approx. one day the message appears more and more frequently. The log file is relatively short after a restart of the server.

can someone possibly give me a hint

many thanks in advance



harrier

  • Newbie
  • *
  • Status:
    Offline
    Posts:
    15
    • View Profile
on: February 23, 2019, 05:39:39 PM
i am getting this to, just started to get it and now im getting told people are getting kicked off the server randomly



2019-02-23 16-17-15| [ void Server::update(float): 1092.07 ms; 100% ]
2019-02-23 16-17-15|   [ void Galaxy::update(float): 1089.74 ms; 99.8% ]
2019-02-23 16-17-15|     [ void Galaxy::updateSectors(float): 1089.57 ms; 99.8% ]
2019-02-23 16-17-15|     [ void Galaxy::updateJumpingEntities(): 0.062 ms; 0% ]
2019-02-23 16-17-15|     [ void Galaxy::updateWormHoleResults(): 0.052 ms; 0% ]
2019-02-23 16-17-15|     [ void Galaxy::updateEntityTransfers(): 0.001 ms; 0% ]
2019-02-23 16-17-15|     [ void Galaxy::handleFinishedScriptPacketCallbacks(): 0.001 ms; 0% ]
2019-02-23 16-17-15|   [ void Server::updateDebugDiagnostics(): 1.122 ms; 0.1% ]
2019-02-23 16-17-15|   [ MessageServer update: 0.713 ms; 0.1% ]
2019-02-23 16-17-15|     [ virtual void SteamNetworkingServer::update(): 0.665 ms; 0.1% ]
2019-02-23 16-17-15|       [ void SteamNetworkingServer::receiveNetworkData(): 0.35 ms; 0% ]
2019-02-23 16-17-15|       [ void SteamNetworkingServer::sendUpdatedServerDetailsToSteam(): 0.298 ms; 0% ]
2019-02-23 16-17-15|       [ void SteamNetworkingServer::updateTimeouts(): 0.001 ms; 0% ]
2019-02-23 16-17-15|       [ void SteamNetworkingServer::updatePendingClosing(): 0 ms; 0% ]
2019-02-23 16-17-15|   [ void Server::updatePlayerCommunicatorAdministration(float): 0.141 ms; 0% ]
2019-02-23 16-17-15|   [ void FactionDatabase::update(float, bool): 0.1 ms; 0% ]
2019-02-23 16-17-15|
2019-02-23 16-17-25| starting event fakedistresssignal
2019-02-23 16-17-28| Player Ymir moved to sector (-190:31)from (-187:33) server time taken for change: 48ms
2019-02-23 16-17-28| SectorDatabase: Loading Sector SectorDatabase: Loading Sector (-193:33)
2019-02-23 16-17-28| (-193:28)
2019-02-23 16-17-28| scheduled save for sector (-190:31), 0x5762db00, entities: 876
2019-02-23 16-17-28| saving sector (-190:31)
2019-02-23 16-17-28| scheduled save for sector (-193:33), 0x3c2ae060, entities: 3
2019-02-23 16-17-29| Entered exception handler
2019-02-23 16-17-29| Thread 13 Error: EXCEPTION_ACCESS_VIOLATION
2019-02-23 16-17-29| Workpacket [90]:
2019-02-23 16-17-29| Thread Name [90]: Communicator Message WorkerPool Thread 0