RIC-E2-TERMINATION/sctpThread.cpp

   1 // Copyright 2019 AT&T Intellectual Property
   2 // Copyright 2019 Nokia
   3 //
   4 // Licensed under the Apache License, Version 2.0 (the "License");
   5 // you may not use this file except in compliance with the License.
   6 // You may obtain a copy of the License at
   7 //
   8 //      http://www.apache.org/licenses/LICENSE-2.0
   9 //
  10 // Unless required by applicable law or agreed to in writing, software
  11 // distributed under the License is distributed on an "AS IS" BASIS,
  12 // WITHOUT WARRANTIES OR CONDITIONS OF ANY KIND, either express or implied.
  13 // See the License for the specific language governing permissions and
  14 // limitations under the License.
  15
  16 //  This source code is part of the near-RT RIC (RAN Intelligent Controller)
  17 //  platform project (RICP).
  18
  19 // TODO: High-level file comment.
  20
  21
  22
  23 #include <3rdparty/oranE2/RANfunctions-List.h>
  24 #include "sctpThread.h"
  25 #include "BuildRunName.h"
  26
  27 #include "3rdparty/oranE2SM/E2SM-gNB-NRT-RANfunction-Definition.h"
  28 #include "BuildXml.h"
  29 #include "pugixml/src/pugixml.hpp"
  30
  31 using namespace std;
  32 //using namespace std::placeholders;
  33 using namespace boost::filesystem;
  34
  35 //#ifdef __cplusplus
  36 //extern "C"
  37 //{
  38 //#endif
  39
  40 // need to expose without the include of gcov
  41 extern "C" void __gcov_flush(void);
  42
  43 static void catch_function(int signal) {
  44     __gcov_flush();
  45     exit(signal);
  46 }
  47
  48
  49 BOOST_LOG_INLINE_GLOBAL_LOGGER_DEFAULT(my_logger, src::logger_mt)
  50
  51 boost::shared_ptr<sinks::synchronous_sink<sinks::text_file_backend>> boostLogger;
  52 double cpuClock = 0.0;
  53 bool jsonTrace = true;
  54
  55 void init_log() {
  56     mdclog_attr_t *attr;
  57     mdclog_attr_init(&attr);
  58     mdclog_attr_set_ident(attr, "E2Terminator");
  59     mdclog_init(attr);
  60     mdclog_attr_destroy(attr);
  61 }
  62 auto start_time = std::chrono::high_resolution_clock::now();
  63 typedef std::chrono::duration<double, std::ratio<1,1>> seconds_t;
  64
  65 double age() {
  66     return seconds_t(std::chrono::high_resolution_clock::now() - start_time).count();
  67 }
  68
  69 double approx_CPU_MHz(unsigned sleeptime) {
  70     using namespace std::chrono_literals;
  71     uint32_t aux = 0;
  72     uint64_t cycles_start = rdtscp(aux);
  73     double time_start = age();
  74     std::this_thread::sleep_for(sleeptime * 1ms);
  75     uint64_t elapsed_cycles = rdtscp(aux) - cycles_start;
  76     double elapsed_time = age() - time_start;
  77     return elapsed_cycles / elapsed_time;
  78 }
  79
  80 //std::atomic<int64_t> rmrCounter{0};
  81 std::atomic<int64_t> num_of_messages{0};
  82 std::atomic<int64_t> num_of_XAPP_messages{0};
  83 static long transactionCounter = 0;
  84
  85 int buildListeningPort(sctp_params_t &sctpParams) {
  86     sctpParams.listenFD = socket (AF_INET6, SOCK_STREAM, IPPROTO_SCTP);
  87     struct sockaddr_in6 servaddr {};
  88     servaddr.sin6_family = AF_INET6;
  89     servaddr.sin6_addr   = in6addr_any;
  90     servaddr.sin6_port = htons(sctpParams.sctpPort);
  91     if (bind(sctpParams.listenFD, (SA *)&servaddr, sizeof(servaddr)) < 0 ) {
  92         mdclog_write(MDCLOG_ERR, "Error binding. %s\n", strerror(errno));
  93         return -1;
  94     }
  95     if (setSocketNoBlocking(sctpParams.listenFD) == -1) {
  96         //mdclog_write(MDCLOG_ERR, "Error binding. %s", strerror(errno));
  97         return -1;
  98     }
  99     if (mdclog_level_get() >= MDCLOG_DEBUG) {
 100         struct sockaddr_in6 cliaddr {};
 101         socklen_t len = sizeof(cliaddr);
 102         getsockname(sctpParams.listenFD, (SA *)&cliaddr, &len);
 103         char buff[1024] {};
 104         inet_ntop(AF_INET6, &cliaddr.sin6_addr, buff, sizeof(buff));
 105         mdclog_write(MDCLOG_DEBUG, "My address: %s, port %d\n", buff, htons(cliaddr.sin6_port));
 106     }
 107
 108     if (listen(sctpParams.listenFD, SOMAXCONN) < 0) {
 109         mdclog_write(MDCLOG_ERR, "Error listening. %s\n", strerror(errno));
 110         return -1;
 111     }
 112     struct epoll_event event {};
 113     event.events = EPOLLIN | EPOLLET;
 114     event.data.fd = sctpParams.listenFD;
 115
 116     // add listening port to epoll
 117     if (epoll_ctl(sctpParams.epoll_fd, EPOLL_CTL_ADD, sctpParams.listenFD, &event)) {
 118         printf("Failed to add descriptor to epoll\n");
 119         mdclog_write(MDCLOG_ERR, "Failed to add descriptor to epoll. %s\n", strerror(errno));
 120         return -1;
 121     }
 122
 123     return 0;
 124 }
 125
 126 int buildConfiguration(sctp_params_t &sctpParams) {
 127     path p = (sctpParams.configFilePath + "/" + sctpParams.configFileName).c_str();
 128     if (exists(p)) {
 129         const int size = 2048;
 130         auto fileSize = file_size(p);
 131         if (fileSize > size) {
 132             mdclog_write(MDCLOG_ERR, "File %s larger than %d", p.string().c_str(), size);
 133             return -1;
 134         }
 135     } else {
 136         mdclog_write(MDCLOG_ERR, "Configuration File %s not exists", p.string().c_str());
 137         return -1;
 138     }
 139
 140     ReadConfigFile conf;
 141     if (conf.openConfigFile(p.string()) == -1) {
 142         mdclog_write(MDCLOG_ERR, "Filed to open config file %s, %s",
 143                      p.string().c_str(), strerror(errno));
 144         return -1;
 145     }
 146     int rmrPort = conf.getIntValue("nano");
 147     if (rmrPort == -1) {
 148         mdclog_write(MDCLOG_ERR, "illigal RMR port ");
 149         return -1;
 150     }
 151     sctpParams.rmrPort = (uint16_t)rmrPort;
 152     snprintf(sctpParams.rmrAddress, sizeof(sctpParams.rmrAddress), "%d", (int) (sctpParams.rmrPort));
 153
 154     auto tmpStr = conf.getStringValue("loglevel");
 155     if (tmpStr.length() == 0) {
 156         mdclog_write(MDCLOG_ERR, "illigal loglevel. Set loglevel to MDCLOG_INFO");
 157         tmpStr = "info";
 158     }
 159     transform(tmpStr.begin(), tmpStr.end(), tmpStr.begin(), ::tolower);
 160
 161     if ((tmpStr.compare("debug")) == 0) {
 162         sctpParams.logLevel = MDCLOG_DEBUG;
 163     } else if ((tmpStr.compare("info")) == 0) {
 164         sctpParams.logLevel = MDCLOG_INFO;
 165     } else if ((tmpStr.compare("warning")) == 0) {
 166         sctpParams.logLevel = MDCLOG_WARN;
 167     } else if ((tmpStr.compare("error")) == 0) {
 168         sctpParams.logLevel = MDCLOG_ERR;
 169     } else {
 170         mdclog_write(MDCLOG_ERR, "illigal loglevel = %s. Set loglevel to MDCLOG_INFO", tmpStr.c_str());
 171         sctpParams.logLevel = MDCLOG_INFO;
 172     }
 173     mdclog_level_set(sctpParams.logLevel);
 174
 175     tmpStr = conf.getStringValue("volume");
 176     if (tmpStr.length() == 0) {
 177         mdclog_write(MDCLOG_ERR, "illigal volume.");
 178         return -1;
 179     }
 180
 181     char tmpLogFilespec[VOLUME_URL_SIZE];
 182     tmpLogFilespec[0] = 0;
 183     sctpParams.volume[0] = 0;
 184     snprintf(sctpParams.volume, VOLUME_URL_SIZE, "%s", tmpStr.c_str());
 185     // copy the name to temp file as well
 186     snprintf(tmpLogFilespec, VOLUME_URL_SIZE, "%s", tmpStr.c_str());
 187
 188
 189     // define the file name in the tmp directory under the volume
 190     strcat(tmpLogFilespec,"/tmp/E2Term_%Y-%m-%d_%H-%M-%S.%N.tmpStr");
 191
 192     sctpParams.myIP = conf.getStringValue("local-ip");
 193     if (sctpParams.myIP.length() == 0) {
 194         mdclog_write(MDCLOG_ERR, "illigal local-ip.");
 195         return -1;
 196     }
 197
 198     int sctpPort = conf.getIntValue("sctp-port");
 199     if (sctpPort == -1) {
 200         mdclog_write(MDCLOG_ERR, "illigal SCTP port ");
 201         return -1;
 202     }
 203     sctpParams.sctpPort = (uint16_t)sctpPort;
 204
 205     sctpParams.fqdn = conf.getStringValue("external-fqdn");
 206     if (sctpParams.fqdn.length() == 0) {
 207         mdclog_write(MDCLOG_ERR, "illigal external-fqdn");
 208         return -1;
 209     }
 210
 211     std::string pod = conf.getStringValue("pod_name");
 212     if (pod.length() == 0) {
 213         mdclog_write(MDCLOG_ERR, "illigal pod_name in config file");
 214         return -1;
 215     }
 216     auto *podName = getenv(pod.c_str());
 217     if (podName == nullptr) {
 218         mdclog_write(MDCLOG_ERR, "illigal pod_name or environment varible not exists : %s", pod.c_str());
 219         return -1;
 220
 221     } else {
 222         sctpParams.podName.assign(podName);
 223         if (sctpParams.podName.length() == 0) {
 224             mdclog_write(MDCLOG_ERR, "illigal pod_name");
 225             return -1;
 226         }
 227     }
 228
 229     tmpStr = conf.getStringValue("trace");
 230     transform(tmpStr.begin(), tmpStr.end(), tmpStr.begin(), ::tolower);
 231     if ((tmpStr.compare("start")) == 0) {
 232         mdclog_write(MDCLOG_INFO, "Trace set to: start");
 233         sctpParams.trace = true;
 234     } else if ((tmpStr.compare("stop")) == 0) {
 235         mdclog_write(MDCLOG_INFO, "Trace set to: stop");
 236         sctpParams.trace = false;
 237     }
 238     jsonTrace = sctpParams.trace;
 239
 240     sctpParams.ka_message_length = snprintf(sctpParams.ka_message, KA_MESSAGE_SIZE, "{\"address\": \"%s:%d\","
 241                                                                                     "\"fqdn\": \"%s\","
 242                                                                                     "\"pod_name\": \"%s\"}",
 243                                             (const char *)sctpParams.myIP.c_str(),
 244                                             sctpParams.rmrPort,
 245                                             sctpParams.fqdn.c_str(),
 246                                             sctpParams.podName.c_str());
 247
 248     if (mdclog_level_get() >= MDCLOG_INFO) {
 249         mdclog_mdc_add("RMR Port", to_string(sctpParams.rmrPort).c_str());
 250         mdclog_mdc_add("LogLevel", to_string(sctpParams.logLevel).c_str());
 251         mdclog_mdc_add("volume", sctpParams.volume);
 252         mdclog_mdc_add("tmpLogFilespec", tmpLogFilespec);
 253         mdclog_mdc_add("my ip", sctpParams.myIP.c_str());
 254         mdclog_mdc_add("pod name", sctpParams.podName.c_str());
 255
 256         mdclog_write(MDCLOG_INFO, "running parameters for instance : %s", sctpParams.ka_message);
 257     }
 258     mdclog_mdc_clean();
 259
 260     // Files written to the current working directory
 261     boostLogger = logging::add_file_log(
 262             keywords::file_name = tmpLogFilespec, // to temp directory
 263             keywords::rotation_size = 10 * 1024 * 1024,
 264             keywords::time_based_rotation = sinks::file::rotation_at_time_interval(posix_time::hours(1)),
 265             keywords::format = "%Message%"
 266             //keywords::format = "[%TimeStamp%]: %Message%" // use each tmpStr with time stamp
 267     );
 268
 269     // Setup a destination folder for collecting rotated (closed) files --since the same volumn can use rename()
 270     boostLogger->locked_backend()->set_file_collector(sinks::file::make_collector(
 271             keywords::target = sctpParams.volume
 272     ));
 273
 274     // Upon restart, scan the directory for files matching the file_name pattern
 275     boostLogger->locked_backend()->scan_for_files();
 276
 277     // Enable auto-flushing after each tmpStr record written
 278     if (mdclog_level_get() >= MDCLOG_DEBUG) {
 279         boostLogger->locked_backend()->auto_flush(true);
 280     }
 281
 282     return 0;
 283 }
 284
 285
 286
 287 int main(const int argc, char **argv) {
 288     sctp_params_t sctpParams;
 289
 290     {
 291         std::random_device device{};
 292         std::mt19937 generator(device());
 293         std::uniform_int_distribution<long> distribution(1, (long) 1e12);
 294         transactionCounter = distribution(generator);
 295     }
 296
 297 //    uint64_t st = 0;
 298 //    uint32_t aux1 = 0;
 299 //   st = rdtscp(aux1);
 300
 301     unsigned num_cpus = std::thread::hardware_concurrency();
 302     init_log();
 303     mdclog_level_set(MDCLOG_INFO);
 304
 305     if (std::signal(SIGINT, catch_function) == SIG_ERR) {
 306         mdclog_write(MDCLOG_ERR, "Error initializing SIGINT");
 307         exit(1);
 308     }
 309     if (std::signal(SIGABRT, catch_function)== SIG_ERR) {
 310         mdclog_write(MDCLOG_ERR, "Error initializing SIGABRT");
 311         exit(1);
 312     }
 313     if (std::signal(SIGTERM, catch_function)== SIG_ERR) {
 314         mdclog_write(MDCLOG_ERR, "Error initializing SIGTERM");
 315         exit(1);
 316     }
 317
 318     cpuClock = approx_CPU_MHz(100);
 319
 320     mdclog_write(MDCLOG_DEBUG, "CPU speed %11.11f", cpuClock);
 321
 322     auto result = parse(argc, argv, sctpParams);
 323
 324     if (buildConfiguration(sctpParams) != 0) {
 325         exit(-1);
 326     }
 327
 328     // start epoll
 329     sctpParams.epoll_fd = epoll_create1(0);
 330     if (sctpParams.epoll_fd == -1) {
 331         mdclog_write(MDCLOG_ERR, "failed to open epoll descriptor");
 332         exit(-1);
 333     }
 334
 335     getRmrContext(sctpParams);
 336     if (sctpParams.rmrCtx == nullptr) {
 337         close(sctpParams.epoll_fd);
 338         exit(-1);
 339     }
 340
 341     if (buildInotify(sctpParams) == -1) {
 342         close(sctpParams.rmrListenFd);
 343         rmr_close(sctpParams.rmrCtx);
 344         close(sctpParams.epoll_fd);
 345         exit(-1);
 346     }
 347
 348     if (buildListeningPort(sctpParams) != 0) {
 349         close(sctpParams.rmrListenFd);
 350         rmr_close(sctpParams.rmrCtx);
 351         close(sctpParams.epoll_fd);
 352         exit(-1);
 353     }
 354
 355     sctpParams.sctpMap = new mapWrapper();
 356
 357     std::vector<std::thread> threads(num_cpus);
 358 //    std::vector<std::thread> threads;
 359
 360     num_cpus = 1;
 361     for (unsigned int i = 0; i < num_cpus; i++) {
 362         threads[i] = std::thread(listener, &sctpParams);
 363
 364         cpu_set_t cpuset;
 365         CPU_ZERO(&cpuset);
 366         CPU_SET(i, &cpuset);
 367         int rc = pthread_setaffinity_np(threads[i].native_handle(), sizeof(cpu_set_t), &cpuset);
 368         if (rc != 0) {
 369             mdclog_write(MDCLOG_ERR, "Error calling pthread_setaffinity_np: %d", rc);
 370         }
 371     }
 372
 373     auto statFlag = false;
 374     auto statThread = std::thread(statColectorThread, (void *)&statFlag);
 375
 376     //loop over term_init until first message from xApp
 377     handleTermInit(sctpParams);
 378
 379     for (auto &t : threads) {
 380         t.join();
 381     }
 382
 383     statFlag = true;
 384     statThread.join();
 385
 386     return 0;
 387 }
 388
 389 void handleTermInit(sctp_params_t &sctpParams) {
 390     sendTermInit(sctpParams);
 391     //send to e2 manager init of e2 term
 392     //E2_TERM_INIT
 393
 394     int count = 0;
 395     while (true) {
 396         auto xappMessages = num_of_XAPP_messages.load(std::memory_order_acquire);
 397         if (xappMessages > 0) {
 398             if (mdclog_level_get() >=  MDCLOG_INFO) {
 399                 mdclog_write(MDCLOG_INFO, "Got a message from some appliction, stop sending E2_TERM_INIT");
 400             }
 401             return;
 402         }
 403         usleep(100000);
 404         count++;
 405         if (count % 1000 == 0) {
 406             mdclog_write(MDCLOG_ERR, "GOT No messages from any xApp");
 407             sendTermInit(sctpParams);
 408         }
 409     }
 410 }
 411
 412 void sendTermInit(sctp_params_t &sctpParams) {
 413     rmr_mbuf_t *msg = rmr_alloc_msg(sctpParams.rmrCtx, sctpParams.ka_message_length);
 414     auto count = 0;
 415     while (true) {
 416         msg->mtype = E2_TERM_INIT;
 417         msg->state = 0;
 418         rmr_bytes2payload(msg, (unsigned char *)sctpParams.ka_message, sctpParams.ka_message_length);
 419         static unsigned char tx[32];
 420         auto txLen = snprintf((char *) tx, sizeof tx, "%15ld", transactionCounter++);
 421         rmr_bytes2xact(msg, tx, txLen);
 422         msg = rmr_send_msg(sctpParams.rmrCtx, msg);
 423         if (msg == nullptr) {
 424             msg = rmr_alloc_msg(sctpParams.rmrCtx, sctpParams.ka_message_length);
 425         } else if (msg->state == 0) {
 426             rmr_free_msg(msg);
 427             if (mdclog_level_get() >=  MDCLOG_INFO) {
 428                 mdclog_write(MDCLOG_INFO, "E2_TERM_INIT succsesfuly sent ");
 429             }
 430             return;
 431         } else {
 432             if (count % 100 == 0) {
 433                 mdclog_write(MDCLOG_ERR, "Error sending E2_TERM_INIT cause : %s ", translateRmrErrorMessages(msg->state).c_str());
 434             }
 435             sleep(1);
 436         }
 437         count++;
 438     }
 439 }
 440
 441 /**
 442  *
 443  * @param argc
 444  * @param argv
 445  * @param sctpParams
 446  * @return
 447  */
 448 cxxopts::ParseResult parse(int argc, char *argv[], sctp_params_t &sctpParams) {
 449     cxxopts::Options options(argv[0], "e2 term help");
 450     options.positional_help("[optional args]").show_positional_help();
 451     options.allow_unrecognised_options().add_options()
 452             ("p,path", "config file path", cxxopts::value<std::string>(sctpParams.configFilePath)->default_value("config"))
 453             ("f,file", "config file name", cxxopts::value<std::string>(sctpParams.configFileName)->default_value("config.conf"))
 454             ("h,help", "Print help");
 455
 456     auto result = options.parse(argc, argv);
 457
 458     if (result.count("help")) {
 459         std::cout << options.help({""}) << std::endl;
 460         exit(0);
 461     }
 462     return result;
 463 }
 464
 465 /**
 466  *
 467  * @param sctpParams
 468  * @return -1 failed 0 success
 469  */
 470 int buildInotify(sctp_params_t &sctpParams) {
 471     sctpParams.inotifyFD = inotify_init1(IN_NONBLOCK);
 472     if (sctpParams.inotifyFD == -1) {
 473         mdclog_write(MDCLOG_ERR, "Failed to init inotify (inotify_init1) %s", strerror(errno));
 474         close(sctpParams.rmrListenFd);
 475         rmr_close(sctpParams.rmrCtx);
 476         close(sctpParams.epoll_fd);
 477         return -1;
 478     }
 479
 480     sctpParams.inotifyWD = inotify_add_watch(sctpParams.inotifyFD,
 481                                              (const char *)sctpParams.configFilePath.c_str(),
 482                                              (unsigned)IN_OPEN | (unsigned)IN_CLOSE_WRITE | (unsigned)IN_CLOSE_NOWRITE); //IN_CLOSE = (IN_CLOSE_WRITE | IN_CLOSE_NOWRITE)
 483     if (sctpParams.inotifyWD == -1) {
 484         mdclog_write(MDCLOG_ERR, "Failed to add directory : %s to  inotify (inotify_add_watch) %s",
 485                      sctpParams.configFilePath.c_str(),
 486                      strerror(errno));
 487         close(sctpParams.inotifyFD);
 488         return -1;
 489     }
 490
 491     struct epoll_event event{};
 492     event.events = (EPOLLIN);
 493     event.data.fd = sctpParams.inotifyFD;
 494     // add listening RMR FD to epoll
 495     if (epoll_ctl(sctpParams.epoll_fd, EPOLL_CTL_ADD, sctpParams.inotifyFD, &event)) {
 496         mdclog_write(MDCLOG_ERR, "Failed to add inotify FD to epoll");
 497         close(sctpParams.inotifyFD);
 498         return -1;
 499     }
 500     return 0;
 501 }
 502
 503 /**
 504  *
 505  * @param args
 506  * @return
 507  */
 508 void listener(sctp_params_t *params) {
 509     int num_of_SCTP_messages = 0;
 510     auto totalTime = 0.0;
 511     mdclog_mdc_clean();
 512     mdclog_level_set(params->logLevel);
 513
 514     std::thread::id this_id = std::this_thread::get_id();
 515     //save cout
 516     streambuf *oldCout = cout.rdbuf();
 517     ostringstream memCout;
 518     // create new cout
 519     cout.rdbuf(memCout.rdbuf());
 520     cout << this_id;
 521     //return to the normal cout
 522     cout.rdbuf(oldCout);
 523
 524     char tid[32];
 525     memcpy(tid, memCout.str().c_str(), memCout.str().length() < 32 ? memCout.str().length() : 31);
 526     tid[memCout.str().length()] = 0;
 527     mdclog_mdc_add("thread id", tid);
 528
 529     if (mdclog_level_get() >= MDCLOG_DEBUG) {
 530         mdclog_write(MDCLOG_DEBUG, "started thread number %s", tid);
 531     }
 532
 533
 534     RmrMessagesBuffer_t rmrMessageBuffer{};
 535     //create and init RMR
 536     rmrMessageBuffer.rmrCtx = params->rmrCtx;
 537
 538     auto *events = (struct epoll_event *) calloc(MAXEVENTS, sizeof(struct epoll_event));
 539     struct timespec end{0, 0};
 540     struct timespec start{0, 0};
 541
 542     rmrMessageBuffer.rcvMessage = rmr_alloc_msg(rmrMessageBuffer.rmrCtx, RECEIVE_XAPP_BUFFER_SIZE);
 543     rmrMessageBuffer.sendMessage = rmr_alloc_msg(rmrMessageBuffer.rmrCtx, RECEIVE_XAPP_BUFFER_SIZE);
 544
 545     memcpy(rmrMessageBuffer.ka_message, params->ka_message, params->ka_message_length);
 546     rmrMessageBuffer.ka_message_len = params->ka_message_length;
 547     rmrMessageBuffer.ka_message[rmrMessageBuffer.ka_message_len] = 0;
 548
 549     if (mdclog_level_get() >= MDCLOG_DEBUG) {
 550         mdclog_write(MDCLOG_DEBUG, "keep alive message is : %s", rmrMessageBuffer.ka_message);
 551     }
 552
 553     ReportingMessages_t message {};
 554
 555 //    for (int i = 0; i < MAX_RMR_BUFF_ARRY; i++) {
 556 //        rmrMessageBuffer.rcvBufferedMessages[i] = rmr_alloc_msg(rmrMessageBuffer.rmrCtx, RECEIVE_XAPP_BUFFER_SIZE);
 557 //        rmrMessageBuffer.sendBufferedMessages[i] = rmr_alloc_msg(rmrMessageBuffer.rmrCtx, RECEIVE_XAPP_BUFFER_SIZE);
 558 //    }
 559
 560     message.statCollector = StatCollector::GetInstance();
 561
 562     while (true) {
 563         if (mdclog_level_get() >= MDCLOG_DEBUG) {
 564             mdclog_write(MDCLOG_DEBUG, "Start EPOLL Wait");
 565         }
 566         auto numOfEvents = epoll_wait(params->epoll_fd, events, MAXEVENTS, -1);
 567         if (numOfEvents < 0 && errno == EINTR) {
 568             if (mdclog_level_get() >= MDCLOG_DEBUG) {
 569                 mdclog_write(MDCLOG_DEBUG, "got EINTR : %s", strerror(errno));
 570             }
 571             continue;
 572         }
 573         if (numOfEvents < 0) {
 574             mdclog_write(MDCLOG_ERR, "Epoll wait failed, errno = %s", strerror(errno));
 575             return;
 576         }
 577         for (auto i = 0; i < numOfEvents; i++) {
 578             if (mdclog_level_get() >= MDCLOG_DEBUG) {
 579                 mdclog_write(MDCLOG_DEBUG, "handling epoll event %d out of %d", i + 1, numOfEvents);
 580             }
 581             clock_gettime(CLOCK_MONOTONIC, &message.message.time);
 582             start.tv_sec = message.message.time.tv_sec;
 583             start.tv_nsec = message.message.time.tv_nsec;
 584
 585
 586             if ((events[i].events & EPOLLERR) || (events[i].events & EPOLLHUP)) {
 587                 handlepoll_error(events[i], message, rmrMessageBuffer, params);
 588             } else if (events[i].events & EPOLLOUT) {
 589                 handleEinprogressMessages(events[i], message, rmrMessageBuffer, params);
 590             } else if (params->listenFD == events[i].data.fd) {
 591                 if (mdclog_level_get() >= MDCLOG_INFO) {
 592                     mdclog_write(MDCLOG_INFO, "New connection request from sctp network\n");
 593                 }
 594                 // new connection is requested from RAN  start build connection
 595                 while (true) {
 596                     struct sockaddr in_addr {};
 597                     socklen_t in_len;
 598                     char hostBuff[NI_MAXHOST];
 599                     char portBuff[NI_MAXSERV];
 600
 601                     in_len = sizeof(in_addr);
 602                     auto *peerInfo = (ConnectedCU_t *)calloc(1, sizeof(ConnectedCU_t));
 603                     peerInfo->sctpParams = params;
 604                     peerInfo->fileDescriptor = accept(params->listenFD, &in_addr, &in_len);
 605                     if (peerInfo->fileDescriptor == -1) {
 606                         if ((errno == EAGAIN) || (errno == EWOULDBLOCK)) {
 607                             /* We have processed all incoming connections. */
 608                             break;
 609                         } else {
 610                             mdclog_write(MDCLOG_ERR, "Accept error, errno = %s", strerror(errno));
 611                             break;
 612                         }
 613                     }
 614                     if (setSocketNoBlocking(peerInfo->fileDescriptor) == -1) {
 615                         mdclog_write(MDCLOG_ERR, "setSocketNoBlocking failed to set new connection %s on port %s\n", hostBuff, portBuff);
 616                         close(peerInfo->fileDescriptor);
 617                         break;
 618                     }
 619                     auto  ans = getnameinfo(&in_addr, in_len,
 620                                             peerInfo->hostName, NI_MAXHOST,
 621                                             peerInfo->portNumber, NI_MAXSERV, (unsigned )((unsigned int)NI_NUMERICHOST | (unsigned int)NI_NUMERICSERV));
 622                     if (ans < 0) {
 623                         mdclog_write(MDCLOG_ERR, "Failed to get info on connection request. %s\n", strerror(errno));
 624                         close(peerInfo->fileDescriptor);
 625                         break;
 626                     }
 627                     if (mdclog_level_get() >= MDCLOG_DEBUG) {
 628                         mdclog_write(MDCLOG_DEBUG, "Accepted connection on descriptor %d (host=%s, port=%s)\n", peerInfo->fileDescriptor, peerInfo->hostName, peerInfo->portNumber);
 629                     }
 630                     peerInfo->isConnected = false;
 631                     peerInfo->gotSetup = false;
 632                     if (addToEpoll(params->epoll_fd,
 633                                    peerInfo,
 634                                    (EPOLLIN | EPOLLET),
 635                                    params->sctpMap, nullptr,
 636                                    0) != 0) {
 637                         break;
 638                     }
 639                     break;
 640                 }
 641             } else if (params->rmrListenFd == events[i].data.fd) {
 642                 // got message from XAPP
 643                 num_of_XAPP_messages.fetch_add(1, std::memory_order_release);
 644                 num_of_messages.fetch_add(1, std::memory_order_release);
 645                 if (mdclog_level_get() >= MDCLOG_DEBUG) {
 646                     mdclog_write(MDCLOG_DEBUG, "new message from RMR");
 647                 }
 648                 if (receiveXappMessages(params->sctpMap,
 649                                         rmrMessageBuffer,
 650                                         message.message.time) != 0) {
 651                     mdclog_write(MDCLOG_ERR, "Error handling Xapp message");
 652                 }
 653             } else if (params->inotifyFD == events[i].data.fd) {
 654                 mdclog_write(MDCLOG_INFO, "Got event from inotify (configuration update)");
 655                 handleConfigChange(params);
 656             } else {
 657                 /* We RMR_ERR_RETRY have data on the fd waiting to be read. Read and display it.
 658                  * We must read whatever data is available completely, as we are running
 659                  *  in edge-triggered mode and won't get a notification again for the same data. */
 660                 num_of_messages.fetch_add(1, std::memory_order_release);
 661                 if (mdclog_level_get() >= MDCLOG_DEBUG) {
 662                     mdclog_write(MDCLOG_DEBUG, "new message from SCTP, epoll flags are : %0x", events[i].events);
 663                 }
 664                 receiveDataFromSctp(&events[i],
 665                                     params->sctpMap,
 666                                     num_of_SCTP_messages,
 667                                     rmrMessageBuffer,
 668                                     message.message.time);
 669             }
 670
 671             clock_gettime(CLOCK_MONOTONIC, &end);
 672             if (mdclog_level_get() >= MDCLOG_INFO) {
 673                 totalTime += ((end.tv_sec + 1.0e-9 * end.tv_nsec) -
 674                               ((double) start.tv_sec + 1.0e-9 * start.tv_nsec));
 675             }
 676             if (mdclog_level_get() >= MDCLOG_DEBUG) {
 677                 mdclog_write(MDCLOG_DEBUG, "message handling is %ld seconds %ld nanoseconds",
 678                              end.tv_sec - start.tv_sec,
 679                              end.tv_nsec - start.tv_nsec);
 680             }
 681         }
 682     }
 683 }
 684
 685 /**
 686  *
 687  * @param sctpParams
 688  */
 689 void handleConfigChange(sctp_params_t *sctpParams) {
 690     char buf[4096] __attribute__ ((aligned(__alignof__(struct inotify_event))));
 691     const struct inotify_event *event;
 692     char *ptr;
 693
 694     path p = (sctpParams->configFilePath + "/" + sctpParams->configFileName).c_str();
 695     auto endlessLoop = true;
 696     while (endlessLoop) {
 697         auto len = read(sctpParams->inotifyFD, buf, sizeof buf);
 698         if (len == -1) {
 699             if (errno != EAGAIN) {
 700                 mdclog_write(MDCLOG_ERR, "read %s ", strerror(errno));
 701                 endlessLoop = false;
 702                 continue;
 703             }
 704             else {
 705                 endlessLoop = false;
 706                 continue;
 707             }
 708         }
 709
 710         for (ptr = buf; ptr < buf + len; ptr += sizeof(struct inotify_event) + event->len) {
 711             event = (const struct inotify_event *)ptr;
 712             if (event->mask & (uint32_t)IN_ISDIR) {
 713                 continue;
 714             }
 715
 716             // the directory name
 717             if (sctpParams->inotifyWD == event->wd) {
 718                 // not the directory
 719             }
 720             if (event->len) {
 721                 auto  retVal = strcmp(sctpParams->configFileName.c_str(), event->name);
 722                 if (retVal != 0) {
 723                     continue;
 724                 }
 725             }
 726             // only the file we want
 727             if (event->mask & (uint32_t)IN_CLOSE_WRITE) {
 728                 if (mdclog_level_get() >= MDCLOG_INFO) {
 729                     mdclog_write(MDCLOG_INFO, "Configuration file changed");
 730                 }
 731                 if (exists(p)) {
 732                     const int size = 2048;
 733                     auto fileSize = file_size(p);
 734                     if (fileSize > size) {
 735                         mdclog_write(MDCLOG_ERR, "File %s larger than %d", p.string().c_str(), size);
 736                         return;
 737                     }
 738                 } else {
 739                     mdclog_write(MDCLOG_ERR, "Configuration File %s not exists", p.string().c_str());
 740                     return;
 741                 }
 742
 743                 ReadConfigFile conf;
 744                 if (conf.openConfigFile(p.string()) == -1) {
 745                     mdclog_write(MDCLOG_ERR, "Filed to open config file %s, %s",
 746                                  p.string().c_str(), strerror(errno));
 747                     return;
 748                 }
 749
 750                 auto tmpStr = conf.getStringValue("loglevel");
 751                 if (tmpStr.length() == 0) {
 752                     mdclog_write(MDCLOG_ERR, "illigal loglevel. Set loglevel to MDCLOG_INFO");
 753                     tmpStr = "info";
 754                 }
 755                 transform(tmpStr.begin(), tmpStr.end(), tmpStr.begin(), ::tolower);
 756
 757                 if ((tmpStr.compare("debug")) == 0) {
 758                     mdclog_write(MDCLOG_INFO, "Log level set to MDCLOG_DEBUG");
 759                     sctpParams->logLevel = MDCLOG_DEBUG;
 760                 } else if ((tmpStr.compare("info")) == 0) {
 761                     mdclog_write(MDCLOG_INFO, "Log level set to MDCLOG_INFO");
 762                     sctpParams->logLevel = MDCLOG_INFO;
 763                 } else if ((tmpStr.compare("warning")) == 0) {
 764                     mdclog_write(MDCLOG_INFO, "Log level set to MDCLOG_WARN");
 765                     sctpParams->logLevel = MDCLOG_WARN;
 766                 } else if ((tmpStr.compare("error")) == 0) {
 767                     mdclog_write(MDCLOG_INFO, "Log level set to MDCLOG_ERR");
 768                     sctpParams->logLevel = MDCLOG_ERR;
 769                 } else {
 770                     mdclog_write(MDCLOG_ERR, "illigal loglevel = %s. Set loglevel to MDCLOG_INFO", tmpStr.c_str());
 771                     sctpParams->logLevel = MDCLOG_INFO;
 772                 }
 773                 mdclog_level_set(sctpParams->logLevel);
 774
 775
 776                 tmpStr = conf.getStringValue("trace");
 777                 if (tmpStr.length() == 0) {
 778                     mdclog_write(MDCLOG_ERR, "illigal trace. Set trace to stop");
 779                     tmpStr = "stop";
 780                 }
 781
 782                 transform(tmpStr.begin(), tmpStr.end(), tmpStr.begin(), ::tolower);
 783                 if ((tmpStr.compare("start")) == 0) {
 784                     mdclog_write(MDCLOG_INFO, "Trace set to: start");
 785                     sctpParams->trace = true;
 786                 } else if ((tmpStr.compare("stop")) == 0) {
 787                     mdclog_write(MDCLOG_INFO, "Trace set to: stop");
 788                     sctpParams->trace = false;
 789                 } else {
 790                     mdclog_write(MDCLOG_ERR, "Trace was set to wrong value %s, set to stop", tmpStr.c_str());
 791                     sctpParams->trace = false;
 792                 }
 793                 jsonTrace = sctpParams->trace;
 794                 endlessLoop = false;
 795             }
 796         }
 797     }
 798 }
 799
 800 /**
 801  *
 802  * @param event
 803  * @param message
 804  * @param rmrMessageBuffer
 805  * @param params
 806  */
 807 void handleEinprogressMessages(struct epoll_event &event,
 808                                ReportingMessages_t &message,
 809                                RmrMessagesBuffer_t &rmrMessageBuffer,
 810                                sctp_params_t *params) {
 811     auto *peerInfo = (ConnectedCU_t *)event.data.ptr;
 812     memcpy(message.message.enodbName, peerInfo->enodbName, sizeof(peerInfo->enodbName));
 813
 814     mdclog_write(MDCLOG_INFO, "file descriptor %d got EPOLLOUT", peerInfo->fileDescriptor);
 815     auto retVal = 0;
 816     socklen_t retValLen = 0;
 817     auto rc = getsockopt(peerInfo->fileDescriptor, SOL_SOCKET, SO_ERROR, &retVal, &retValLen);
 818     if (rc != 0 || retVal != 0) {
 819         if (rc != 0) {
 820             rmrMessageBuffer.sendMessage->len = snprintf((char *)rmrMessageBuffer.sendMessage->payload, 256,
 821                                                          "%s|Failed SCTP Connection, after EINPROGRESS the getsockopt%s",
 822                                                          peerInfo->enodbName, strerror(errno));
 823         } else if (retVal != 0) {
 824             rmrMessageBuffer.sendMessage->len = snprintf((char *)rmrMessageBuffer.sendMessage->payload, 256,
 825                                                          "%s|Failed SCTP Connection after EINPROGRESS, SO_ERROR",
 826                                                          peerInfo->enodbName);
 827         }
 828
 829         message.message.asndata = rmrMessageBuffer.sendMessage->payload;
 830         message.message.asnLength = rmrMessageBuffer.sendMessage->len;
 831         mdclog_write(MDCLOG_ERR, "%s", rmrMessageBuffer.sendMessage->payload);
 832         message.message.direction = 'N';
 833         if (sendRequestToXapp(message, RIC_SCTP_CONNECTION_FAILURE, rmrMessageBuffer) != 0) {
 834             mdclog_write(MDCLOG_ERR, "SCTP_CONNECTION_FAIL message failed to send to xAPP");
 835         }
 836         memset(peerInfo->asnData, 0, peerInfo->asnLength);
 837         peerInfo->asnLength = 0;
 838         peerInfo->mtype = 0;
 839         return;
 840     }
 841
 842     peerInfo->isConnected = true;
 843
 844     if (modifyToEpoll(params->epoll_fd, peerInfo, (EPOLLIN | EPOLLET), params->sctpMap, peerInfo->enodbName,
 845                       peerInfo->mtype) != 0) {
 846         mdclog_write(MDCLOG_ERR, "epoll_ctl EPOLL_CTL_MOD");
 847         return;
 848     }
 849
 850     message.message.asndata = (unsigned char *)peerInfo->asnData;
 851     message.message.asnLength = peerInfo->asnLength;
 852     message.message.messageType = peerInfo->mtype;
 853     memcpy(message.message.enodbName, peerInfo->enodbName, sizeof(peerInfo->enodbName));
 854     num_of_messages.fetch_add(1, std::memory_order_release);
 855     if (mdclog_level_get() >= MDCLOG_DEBUG) {
 856         mdclog_write(MDCLOG_DEBUG, "send the delayed SETUP/ENDC SETUP to sctp for %s",
 857                      message.message.enodbName);
 858     }
 859     if (sendSctpMsg(peerInfo, message, params->sctpMap) != 0) {
 860         if (mdclog_level_get() >= MDCLOG_DEBUG) {
 861             mdclog_write(MDCLOG_DEBUG, "Error write to SCTP  %s %d", __func__, __LINE__);
 862         }
 863         return;
 864     }
 865
 866     memset(peerInfo->asnData, 0, peerInfo->asnLength);
 867     peerInfo->asnLength = 0;
 868     peerInfo->mtype = 0;
 869 }
 870
 871
 872 void handlepoll_error(struct epoll_event &event,
 873                       ReportingMessages_t &message,
 874                       RmrMessagesBuffer_t &rmrMessageBuffer,
 875                       sctp_params_t *params) {
 876     if (event.data.fd != params->rmrListenFd) {
 877         auto *peerInfo = (ConnectedCU_t *)event.data.ptr;
 878         mdclog_write(MDCLOG_ERR, "epoll error, events %0x on fd %d, RAN NAME : %s",
 879                      event.events, peerInfo->fileDescriptor, peerInfo->enodbName);
 880
 881         rmrMessageBuffer.sendMessage->len = snprintf((char *)rmrMessageBuffer.sendMessage->payload, 256,
 882                                                      "%s|Failed SCTP Connection",
 883                                                      peerInfo->enodbName);
 884         message.message.asndata = rmrMessageBuffer.sendMessage->payload;
 885         message.message.asnLength = rmrMessageBuffer.sendMessage->len;
 886
 887         memcpy(message.message.enodbName, peerInfo->enodbName, sizeof(peerInfo->enodbName));
 888         message.message.direction = 'N';
 889         if (sendRequestToXapp(message, RIC_SCTP_CONNECTION_FAILURE, rmrMessageBuffer) != 0) {
 890             mdclog_write(MDCLOG_ERR, "SCTP_CONNECTION_FAIL message failed to send to xAPP");
 891         }
 892
 893         close(peerInfo->fileDescriptor);
 894         params->sctpMap->erase(peerInfo->enodbName);
 895         cleanHashEntry((ConnectedCU_t *) event.data.ptr, params->sctpMap);
 896     } else {
 897         mdclog_write(MDCLOG_ERR, "epoll error, events %0x on RMR FD", event.events);
 898     }
 899 }
 900 /**
 901  *
 902  * @param socket
 903  * @return
 904  */
 905 int setSocketNoBlocking(int socket) {
 906     auto flags = fcntl(socket, F_GETFL, 0);
 907
 908     if (flags == -1) {
 909         mdclog_mdc_add("func", "fcntl");
 910         mdclog_write(MDCLOG_ERR, "%s, %s", __FUNCTION__, strerror(errno));
 911         mdclog_mdc_clean();
 912         return -1;
 913     }
 914
 915     flags = (unsigned) flags | (unsigned) O_NONBLOCK;
 916     if (fcntl(socket, F_SETFL, flags) == -1) {
 917         mdclog_mdc_add("func", "fcntl");
 918         mdclog_write(MDCLOG_ERR, "%s, %s", __FUNCTION__, strerror(errno));
 919         mdclog_mdc_clean();
 920         return -1;
 921     }
 922
 923     return 0;
 924 }
 925
 926 /**
 927  *
 928  * @param val
 929  * @param m
 930  */
 931 void cleanHashEntry(ConnectedCU_t *val, Sctp_Map_t *m) {
 932     char *dummy;
 933     auto port = (uint16_t) strtol(val->portNumber, &dummy, 10);
 934     char searchBuff[2048]{};
 935
 936     snprintf(searchBuff, sizeof searchBuff, "host:%s:%d", val->hostName, port);
 937     m->erase(searchBuff);
 938
 939     m->erase(val->enodbName);
 940     free(val);
 941 }
 942
 943 /**
 944  *
 945  * @param fd file discriptor
 946  * @param data the asn data to send
 947  * @param len  length of the data
 948  * @param enodbName the enodbName as in the map for printing purpose
 949  * @param m map host information
 950  * @param mtype message number
 951  * @return 0 success, anegative number on fail
 952  */
 953 int sendSctpMsg(ConnectedCU_t *peerInfo, ReportingMessages_t &message, Sctp_Map_t *m) {
 954     auto loglevel = mdclog_level_get();
 955     int fd = peerInfo->fileDescriptor;
 956     if (loglevel >= MDCLOG_DEBUG) {
 957         mdclog_write(MDCLOG_DEBUG, "Send SCTP message for CU %s, %s",
 958                      message.message.enodbName, __FUNCTION__);
 959     }
 960
 961     while (true) {
 962         if (send(fd,message.message.asndata, message.message.asnLength,MSG_NOSIGNAL) < 0) {
 963             if (errno == EINTR) {
 964                 continue;
 965             }
 966             mdclog_write(MDCLOG_ERR, "error writing to CU a message, %s ", strerror(errno));
 967             if (!peerInfo->isConnected) {
 968                 mdclog_write(MDCLOG_ERR, "connection to CU %s is still in progress.", message.message.enodbName);
 969                 return -1;
 970             }
 971             cleanHashEntry(peerInfo, m);
 972             close(fd);
 973             char key[MAX_ENODB_NAME_SIZE * 2];
 974             snprintf(key, MAX_ENODB_NAME_SIZE * 2, "msg:%s|%d", message.message.enodbName,
 975                      message.message.messageType);
 976             if (loglevel >= MDCLOG_DEBUG) {
 977                 mdclog_write(MDCLOG_DEBUG, "remove key = %s from %s at line %d", key, __FUNCTION__, __LINE__);
 978             }
 979             auto tmp = m->find(key);
 980             if (tmp) {
 981                 free(tmp);
 982             }
 983             m->erase(key);
 984             return -1;
 985         }
 986         // TODO remove stat update
 987         //message.statCollector->incSentMessage(string(message.message.enodbName));
 988         message.message.direction = 'D';
 989         // send report.buffer of size
 990         buildJsonMessage(message);
 991
 992         if (loglevel >= MDCLOG_DEBUG) {
 993             mdclog_write(MDCLOG_DEBUG,
 994                          "SCTP message for CU %s sent from %s",
 995                          message.message.enodbName,
 996                          __FUNCTION__);
 997         }
 998         return 0;
 999     }
1000 }
1001
1002 /**
1003  *
1004  * @param message
1005  * @param rmrMessageBuffer
1006  */
1007 void getRequestMetaData(ReportingMessages_t &message, RmrMessagesBuffer_t &rmrMessageBuffer) {
1008     rmr_get_meid(rmrMessageBuffer.rcvMessage, (unsigned char *) (message.message.enodbName));
1009
1010     message.message.asndata = rmrMessageBuffer.rcvMessage->payload;
1011     message.message.asnLength = rmrMessageBuffer.rcvMessage->len;
1012
1013     if (mdclog_level_get() >= MDCLOG_DEBUG) {
1014         mdclog_write(MDCLOG_DEBUG, "Message from Xapp RAN name = %s message length = %ld",
1015                      message.message.enodbName, (unsigned long) message.message.asnLength);
1016     }
1017 }
1018
1019
1020
1021 /**
1022  *
1023  * @param events
1024  * @param sctpMap
1025  * @param numOfMessages
1026  * @param rmrMessageBuffer
1027  * @param ts
1028  * @return
1029  */
1030 int receiveDataFromSctp(struct epoll_event *events,
1031                         Sctp_Map_t *sctpMap,
1032                         int &numOfMessages,
1033                         RmrMessagesBuffer_t &rmrMessageBuffer,
1034                         struct timespec &ts) {
1035     /* We have data on the fd waiting to be read. Read and display it.
1036  * We must read whatever data is available completely, as we are running
1037  *  in edge-triggered mode and won't get a notification again for the same data. */
1038     ReportingMessages_t message {};
1039     auto done = 0;
1040     auto loglevel = mdclog_level_get();
1041
1042     // get the identity of the interface
1043     message.peerInfo = (ConnectedCU_t *)events->data.ptr;
1044
1045     message.statCollector = StatCollector::GetInstance();
1046     struct timespec start{0, 0};
1047     struct timespec decodestart{0, 0};
1048     struct timespec end{0, 0};
1049
1050     E2AP_PDU_t *pdu = nullptr;
1051
1052
1053     while (true) {
1054         if (loglevel >= MDCLOG_DEBUG) {
1055             mdclog_write(MDCLOG_DEBUG, "Start Read from SCTP %d fd", message.peerInfo->fileDescriptor);
1056             clock_gettime(CLOCK_MONOTONIC, &start);
1057         }
1058         // read the buffer directly to rmr payload
1059         message.message.asndata = rmrMessageBuffer.sendMessage->payload;
1060         message.message.asnLength = rmrMessageBuffer.sendMessage->len =
1061                 read(message.peerInfo->fileDescriptor, rmrMessageBuffer.sendMessage->payload, RECEIVE_SCTP_BUFFER_SIZE);
1062
1063         if (loglevel >= MDCLOG_DEBUG) {
1064             mdclog_write(MDCLOG_DEBUG, "Finish Read from SCTP %d fd message length = %ld",
1065                          message.peerInfo->fileDescriptor, message.message.asnLength);
1066         }
1067
1068         memcpy(message.message.enodbName, message.peerInfo->enodbName, sizeof(message.peerInfo->enodbName));
1069         message.statCollector->incRecvMessage(string(message.message.enodbName));
1070         message.message.direction = 'U';
1071         message.message.time.tv_nsec = ts.tv_nsec;
1072         message.message.time.tv_sec = ts.tv_sec;
1073
1074         if (message.message.asnLength < 0) {
1075             if (errno == EINTR) {
1076                 continue;
1077             }
1078             /* If errno == EAGAIN, that means we have read all
1079                data. So goReportingMessages_t back to the main loop. */
1080             if (errno != EAGAIN) {
1081                 mdclog_write(MDCLOG_ERR, "Read error, %s ", strerror(errno));
1082                 done = 1;
1083             } else if (loglevel >= MDCLOG_DEBUG) {
1084                 mdclog_write(MDCLOG_DEBUG, "EAGAIN - descriptor = %d", message.peerInfo->fileDescriptor);
1085             }
1086             break;
1087         } else if (message.message.asnLength == 0) {
1088             /* End of file. The remote has closed the connection. */
1089             if (loglevel >= MDCLOG_INFO) {
1090                 mdclog_write(MDCLOG_INFO, "END of File Closed connection - descriptor = %d",
1091                              message.peerInfo->fileDescriptor);
1092             }
1093             done = 1;
1094             break;
1095         }
1096
1097         if (loglevel >= MDCLOG_DEBUG) {
1098             char printBuffer[4096]{};
1099             char *tmp = printBuffer;
1100             for (size_t i = 0; i < (size_t)message.message.asnLength; ++i) {
1101                 snprintf(tmp, 3, "%02x", message.message.asndata[i]);
1102                 tmp += 2;
1103             }
1104             printBuffer[message.message.asnLength] = 0;
1105             clock_gettime(CLOCK_MONOTONIC, &end);
1106             mdclog_write(MDCLOG_DEBUG, "Before Encoding E2AP PDU for : %s, Read time is : %ld seconds, %ld nanoseconds",
1107                          message.peerInfo->enodbName, end.tv_sec - start.tv_sec, end.tv_nsec - start.tv_nsec);
1108             mdclog_write(MDCLOG_DEBUG, "PDU buffer length = %ld, data =  : %s", message.message.asnLength,
1109                          printBuffer);
1110             clock_gettime(CLOCK_MONOTONIC, &decodestart);
1111         }
1112
1113         auto rval = asn_decode(nullptr, ATS_ALIGNED_BASIC_PER, &asn_DEF_E2AP_PDU, (void **) &pdu,
1114                           message.message.asndata, message.message.asnLength);
1115         if (rval.code != RC_OK) {
1116             mdclog_write(MDCLOG_ERR, "Error %d Decoding (unpack) E2AP PDU from RAN : %s", rval.code,
1117                          message.peerInfo->enodbName);
1118             //todo may need reset to pdu
1119             break;
1120         }
1121
1122         if (loglevel >= MDCLOG_DEBUG) {
1123             clock_gettime(CLOCK_MONOTONIC, &end);
1124             mdclog_write(MDCLOG_DEBUG, "After Encoding E2AP PDU for : %s, Read time is : %ld seconds, %ld nanoseconds",
1125                          message.peerInfo->enodbName, end.tv_sec - decodestart.tv_sec, end.tv_nsec - decodestart.tv_nsec);
1126             char *printBuffer;
1127             size_t size;
1128             FILE *stream = open_memstream(&printBuffer, &size);
1129             asn_fprint(stream, &asn_DEF_E2AP_PDU, pdu);
1130             mdclog_write(MDCLOG_DEBUG, "Encoding E2AP PDU past : %s", printBuffer);
1131             clock_gettime(CLOCK_MONOTONIC, &decodestart);
1132         }
1133
1134         switch (pdu->present) {
1135             case E2AP_PDU_PR_initiatingMessage: {//initiating message
1136                 asnInitiatingRequest(pdu, sctpMap,message, rmrMessageBuffer);
1137                 break;
1138             }
1139             case E2AP_PDU_PR_successfulOutcome: { //successful outcome
1140                 asnSuccsesfulMsg(pdu, sctpMap, message,  rmrMessageBuffer);
1141                 break;
1142             }
1143             case E2AP_PDU_PR_unsuccessfulOutcome: { //Unsuccessful Outcome
1144                 asnUnSuccsesfulMsg(pdu, sctpMap, message, rmrMessageBuffer);
1145                 break;
1146             }
1147             default:
1148                 mdclog_write(MDCLOG_ERR, "Unknown index %d in E2AP PDU", pdu->present);
1149                 break;
1150         }
1151         if (loglevel >= MDCLOG_DEBUG) {
1152             clock_gettime(CLOCK_MONOTONIC, &end);
1153             mdclog_write(MDCLOG_DEBUG,
1154                          "After processing message and sent to rmr for : %s, Read time is : %ld seconds, %ld nanoseconds",
1155                          message.peerInfo->enodbName, end.tv_sec - decodestart.tv_sec, end.tv_nsec - decodestart.tv_nsec);
1156         }
1157         numOfMessages++;
1158         if (pdu != nullptr) {
1159             ASN_STRUCT_RESET(asn_DEF_E2AP_PDU, pdu);
1160             //ASN_STRUCT_FREE(asn_DEF_E2AP_PDU, pdu);
1161             //pdu = nullptr;
1162         }
1163     }
1164
1165     if (done) {
1166         if (loglevel >= MDCLOG_INFO) {
1167             mdclog_write(MDCLOG_INFO, "Closed connection - descriptor = %d", message.peerInfo->fileDescriptor);
1168         }
1169         message.message.asnLength = rmrMessageBuffer.sendMessage->len =
1170                 snprintf((char *)rmrMessageBuffer.sendMessage->payload,
1171                          256,
1172                          "%s|CU disconnected unexpectedly",
1173                          message.peerInfo->enodbName);
1174         message.message.asndata = rmrMessageBuffer.sendMessage->payload;
1175
1176         if (sendRequestToXapp(message,
1177                               RIC_SCTP_CONNECTION_FAILURE,
1178                               rmrMessageBuffer) != 0) {
1179             mdclog_write(MDCLOG_ERR, "SCTP_CONNECTION_FAIL message failed to send to xAPP");
1180         }
1181
1182         /* Closing descriptor make epoll remove it from the set of descriptors which are monitored. */
1183         close(message.peerInfo->fileDescriptor);
1184         cleanHashEntry((ConnectedCU_t *) events->data.ptr, sctpMap);
1185     }
1186     if (loglevel >= MDCLOG_DEBUG) {
1187         clock_gettime(CLOCK_MONOTONIC, &end);
1188         mdclog_write(MDCLOG_DEBUG, "from receive SCTP to send RMR time is %ld seconds and %ld nanoseconds",
1189                      end.tv_sec - start.tv_sec, end.tv_nsec - start.tv_nsec);
1190
1191     }
1192     return 0;
1193 }
1194
1195 static void buildAndsendSetupRequest(ReportingMessages_t &message,
1196                                      RmrMessagesBuffer_t &rmrMessageBuffer,
1197                                      E2AP_PDU_t *pdu,
1198                                      vector<string> &repValues) {
1199     auto logLevel = mdclog_level_get();
1200
1201     // now we can send the data to e2Mgr
1202     auto buffer_size = RECEIVE_SCTP_BUFFER_SIZE * 2;
1203
1204     auto *rmrMsg = rmr_alloc_msg(rmrMessageBuffer.rmrCtx, buffer_size);
1205     // add addrees to message
1206
1207
1208     // unsigned char *buffer = &rmrMsg->payload[j];
1209     unsigned char buffer[RECEIVE_SCTP_BUFFER_SIZE * 2];
1210     // encode to xml
1211     auto er = asn_encode_to_buffer(nullptr, ATS_BASIC_XER, &asn_DEF_E2AP_PDU, pdu, buffer, buffer_size);
1212     if (er.encoded == -1) {
1213         mdclog_write(MDCLOG_ERR, "encoding of %s failed, %s", asn_DEF_E2AP_PDU.name, strerror(errno));
1214     } else if (er.encoded > (ssize_t) buffer_size) {
1215         mdclog_write(MDCLOG_ERR, "Buffer of size %d is to small for %s, at %s line %d",
1216                      (int) buffer_size,
1217                      asn_DEF_E2AP_PDU.name, __func__, __LINE__);
1218     } else {
1219
1220         buildXmlData(repValues, buffer);
1221         // we have the XML
1222         rmrMsg->len = snprintf((char *)rmrMsg->payload, RECEIVE_SCTP_BUFFER_SIZE * 2, "%s:%d|%s",
1223                                message.peerInfo->sctpParams->myIP.c_str(),
1224                                message.peerInfo->sctpParams->rmrPort,
1225                                buffer);
1226         if (logLevel >= MDCLOG_DEBUG) {
1227             mdclog_write(MDCLOG_DEBUG, "Setup request of size %d :\n %s\n", rmrMsg->len, rmrMsg->payload);
1228         }
1229         // send to RMR
1230         message.message.messageType = rmrMsg->mtype = RIC_E2_SETUP_REQ;
1231         rmrMsg->state = 0;
1232         rmr_bytes2meid(rmrMsg, (unsigned char *) message.message.enodbName, strlen(message.message.enodbName));
1233
1234         static unsigned char tx[32];
1235         snprintf((char *) tx, sizeof tx, "%15ld", transactionCounter++);
1236         rmr_bytes2xact(rmrMsg, tx, strlen((const char *) tx));
1237
1238         rmrMsg = rmr_send_msg(rmrMessageBuffer.rmrCtx, rmrMsg);
1239         if (rmrMsg == nullptr) {
1240             mdclog_write(MDCLOG_ERR, "RMR failed to send returned nullptr");
1241         } else if (rmrMsg->state != 0) {
1242             char meid[RMR_MAX_MEID]{};
1243             if (rmrMsg->state == RMR_ERR_RETRY) {
1244                 usleep(5);
1245                 rmrMsg->state = 0;
1246                 mdclog_write(MDCLOG_INFO, "RETRY sending Message %d to Xapp from %s",
1247                              rmrMsg->mtype, rmr_get_meid(rmrMsg, (unsigned char *) meid));
1248                 rmrMsg = rmr_send_msg(rmrMessageBuffer.rmrCtx, rmrMsg);
1249                 if (rmrMsg == nullptr) {
1250                     mdclog_write(MDCLOG_ERR, "RMR failed send returned nullptr");
1251                 } else if (rmrMsg->state != 0) {
1252                     mdclog_write(MDCLOG_ERR,
1253                                  "RMR Retry failed %s sending request %d to Xapp from %s",
1254                                  translateRmrErrorMessages(rmrMsg->state).c_str(),
1255                                  rmrMsg->mtype,
1256                                  rmr_get_meid(rmrMsg, (unsigned char *) meid));
1257                 }
1258             } else {
1259                 mdclog_write(MDCLOG_ERR, "RMR failed: %s. sending request %d to Xapp from %s",
1260                              translateRmrErrorMessages(rmrMsg->state).c_str(),
1261                              rmrMsg->mtype,
1262                              rmr_get_meid(rmrMsg, (unsigned char *) meid));
1263             }
1264         }
1265         message.peerInfo->gotSetup = true;
1266         buildJsonMessage(message);
1267         if (rmrMsg != nullptr) {
1268             rmr_free_msg(rmrMsg);
1269         }
1270     }
1271
1272 }
1273
1274
1275
1276
1277 int collectSetupRequestData(E2AP_PDU_t *pdu,
1278                             Sctp_Map_t *sctpMap,
1279                             ReportingMessages_t &message,
1280                             vector <string> &runFunDEFXML_v) {
1281     auto index = 0;
1282     memset(message.peerInfo->enodbName, 0 , MAX_ENODB_NAME_SIZE);
1283     for (auto i = 0; i < pdu->choice.initiatingMessage->value.choice.E2setupRequest.protocolIEs.list.count; i++) {
1284         auto *ie = pdu->choice.initiatingMessage->value.choice.E2setupRequest.protocolIEs.list.array[i];
1285         if (ie->id == ProtocolIE_ID_id_GlobalE2node_ID) {
1286             // get the ran name for meid
1287             if (ie->value.present == E2setupRequestIEs__value_PR_GlobalE2node_ID) {
1288                 if (buildRanName(message.peerInfo->enodbName, ie) < 0) {
1289                     mdclog_write(MDCLOG_ERR, "Bad param in E2setupRequestIEs GlobalE2node_ID.\n");
1290                     // no mesage will be sent
1291                     return -1;
1292                 }
1293                 memcpy(message.message.enodbName, message.peerInfo->enodbName, strlen(message.peerInfo->enodbName));
1294                 sctpMap->setkey(message.message.enodbName, message.peerInfo);
1295             }
1296         }
1297         // reformat RANFUNCTION Definition to XML
1298         if (ie->id == ProtocolIE_ID_id_RANfunctionsAdded) {
1299             if (ie->value.present == E2setupRequestIEs__value_PR_RANfunctions_List) {
1300                 if (mdclog_level_get() >= MDCLOG_DEBUG) {
1301                     mdclog_write(MDCLOG_DEBUG, "Run function list have %d entries and size %d",
1302                                  ie->value.choice.RANfunctions_List.list.count,
1303                                  ie->value.choice.RANfunctions_List.list.size);
1304                 }
1305                 for (auto j = 0; i < ie->value.choice.RANfunctions_List.list.count; i++) {
1306                     auto *raNfunctionItemIEs = (RANfunction_ItemIEs_t *)ie->value.choice.RANfunctions_List.list.array[j];
1307                     if (raNfunctionItemIEs->id == ProtocolIE_ID_id_RANfunction_Item &&
1308                         (raNfunctionItemIEs->value.present == RANfunction_ItemIEs__value_PR_RANfunction_Item)) {
1309                         // encode to xml
1310                         E2SM_gNB_NRT_RANfunction_Definition_t *ranFunDef = nullptr;
1311                         auto rval = asn_decode(nullptr, ATS_ALIGNED_BASIC_PER,
1312                                                &asn_DEF_E2SM_gNB_NRT_RANfunction_Definition,
1313                                                (void **)&ranFunDef,
1314                                                raNfunctionItemIEs->value.choice.RANfunction_Item.ranFunctionDefinition.buf,
1315                                                raNfunctionItemIEs->value.choice.RANfunction_Item.ranFunctionDefinition.size);
1316                         if (rval.code != RC_OK) {
1317                             mdclog_write(MDCLOG_ERR, "Error %d Decoding (unpack) E2SM message from : %s",
1318                                          rval.code,
1319                                          asn_DEF_E2SM_gNB_NRT_RANfunction_Definition.name);
1320                             return -1;
1321                         }
1322
1323 //                        if (mdclog_level_get() >= MDCLOG_DEBUG) {
1324 //                            char *printBuffer;
1325 //                            size_t size;
1326 //                            FILE *stream = open_memstream(&printBuffer, &size);
1327 //                            asn_fprint(stream, &asn_DEF_E2SM_gNB_NRT_RANfunction_Definition, ranFunDef);
1328 //                            mdclog_write(MDCLOG_DEBUG, "Encoding E2SM %s PDU past : %s",
1329 //                                         asn_DEF_E2SM_gNB_NRT_RANfunction_Definition.name,
1330 //                                         printBuffer);
1331 //                        }
1332                         auto xml_buffer_size = RECEIVE_SCTP_BUFFER_SIZE * 2;
1333                         unsigned char xml_buffer[RECEIVE_SCTP_BUFFER_SIZE * 2];
1334                         // encode to xml
1335                         auto er = asn_encode_to_buffer(nullptr,
1336                                                   ATS_BASIC_XER,
1337                                                   &asn_DEF_E2SM_gNB_NRT_RANfunction_Definition,
1338                                                   ranFunDef,
1339                                                   xml_buffer,
1340                                                   xml_buffer_size);
1341                         if (er.encoded == -1) {
1342                             mdclog_write(MDCLOG_ERR, "encoding of %s failed, %s",
1343                                          asn_DEF_E2SM_gNB_NRT_RANfunction_Definition.name,
1344                                          strerror(errno));
1345                         } else if (er.encoded > (ssize_t)xml_buffer_size) {
1346                             mdclog_write(MDCLOG_ERR, "Buffer of size %d is to small for %s, at %s line %d",
1347                                          (int) xml_buffer_size,
1348                                          asn_DEF_E2SM_gNB_NRT_RANfunction_Definition.name, __func__, __LINE__);
1349                         } else {
1350                             if (mdclog_level_get() >= MDCLOG_DEBUG) {
1351                                 mdclog_write(MDCLOG_DEBUG, "Encoding E2SM %s PDU number %d : %s",
1352                                              asn_DEF_E2SM_gNB_NRT_RANfunction_Definition.name,
1353                                              index++,
1354                                              xml_buffer);
1355                             }
1356                             string runFuncs = (char *)(xml_buffer);
1357                             runFunDEFXML_v.emplace_back(runFuncs);
1358                         }
1359
1360                     }
1361                 }
1362             }
1363         }
1364     }
1365     if (mdclog_level_get() >= MDCLOG_DEBUG) {
1366         mdclog_write(MDCLOG_DEBUG, "Run function vector have %ld entries",
1367                      runFunDEFXML_v.size());
1368     }
1369     return 0;
1370 }
1371 /**
1372  *
1373  * @param pdu
1374  * @param message
1375  * @param rmrMessageBuffer
1376  */
1377 void asnInitiatingRequest(E2AP_PDU_t *pdu,
1378                           Sctp_Map_t *sctpMap,
1379                           ReportingMessages_t &message,
1380                           RmrMessagesBuffer_t &rmrMessageBuffer) {
1381     auto logLevel = mdclog_level_get();
1382     auto procedureCode = ((InitiatingMessage_t *) pdu->choice.initiatingMessage)->procedureCode;
1383     if (logLevel >= MDCLOG_DEBUG) {
1384         mdclog_write(MDCLOG_DEBUG, "Initiating message %ld\n", procedureCode);
1385     }
1386     switch (procedureCode) {
1387         case ProcedureCode_id_E2setup: {
1388             if (logLevel >= MDCLOG_DEBUG) {
1389                 mdclog_write(MDCLOG_DEBUG, "Got E2setup\n");
1390             }
1391
1392             // first get the message as XML buffer
1393             auto setup_xml_buffer_size = RECEIVE_SCTP_BUFFER_SIZE * 2;
1394             unsigned char setup_xml_buffer[RECEIVE_SCTP_BUFFER_SIZE * 2];
1395             //unsigned char *tmp_buff_cursor = setup_xml_buffer;
1396
1397             auto er = asn_encode_to_buffer(nullptr, ATS_BASIC_XER, &asn_DEF_E2AP_PDU, pdu, setup_xml_buffer, setup_xml_buffer_size);
1398             if (er.encoded == -1) {
1399                 mdclog_write(MDCLOG_ERR, "encoding of %s failed, %s", asn_DEF_E2AP_PDU.name, strerror(errno));
1400             } else if (er.encoded > (ssize_t) setup_xml_buffer_size) {
1401                 mdclog_write(MDCLOG_ERR, "Buffer of size %d is to small for %s, at %s line %d",
1402                              (int)setup_xml_buffer_size,
1403                              asn_DEF_E2AP_PDU.name, __func__, __LINE__);
1404             }
1405             std::string xmlString(setup_xml_buffer_size,  setup_xml_buffer_size + er.encoded);
1406
1407             vector <string> runFunDEFXML_v;
1408             runFunDEFXML_v.clear();
1409
1410             auto ret = collectSetupRequestData(pdu, sctpMap,  message, runFunDEFXML_v);
1411             if (ret != 0) {
1412                 break;
1413             }
1414
1415             //build all parts and send the XML (need to copy the XML with the header to the rmrMessageBuffer payload
1416             //TODO replace with new function
1417             buildAndsendSetupRequest(message, rmrMessageBuffer, pdu, runFunDEFXML_v);
1418             break;
1419         }
1420         case ProcedureCode_id_ErrorIndication: {
1421             if (logLevel >= MDCLOG_DEBUG) {
1422                 mdclog_write(MDCLOG_DEBUG, "Got ErrorIndication %s", message.message.enodbName);
1423             }
1424             if (sendRequestToXapp(message, RIC_ERROR_INDICATION, rmrMessageBuffer) != 0) {
1425                 mdclog_write(MDCLOG_ERR, "RIC_ERROR_INDICATION failed to send to xAPP");
1426             }
1427             break;
1428         }
1429         case ProcedureCode_id_Reset: {
1430             if (logLevel >= MDCLOG_DEBUG) {
1431                 mdclog_write(MDCLOG_DEBUG, "Got Reset %s", message.message.enodbName);
1432             }
1433             if (sendRequestToXapp(message, RIC_X2_RESET, rmrMessageBuffer) != 0) {
1434                 mdclog_write(MDCLOG_ERR, "RIC_X2_RESET message failed to send to xAPP");
1435             }
1436             break;
1437         }
1438         case ProcedureCode_id_RICcontrol: {
1439             if (logLevel >= MDCLOG_DEBUG) {
1440                 mdclog_write(MDCLOG_DEBUG, "Got RICcontrol %s", message.message.enodbName);
1441             }
1442             break;
1443         }
1444         case ProcedureCode_id_RICindication: {
1445             if (logLevel >= MDCLOG_DEBUG) {
1446                 mdclog_write(MDCLOG_DEBUG, "Got RICindication %s", message.message.enodbName);
1447             }
1448             for (auto i = 0; i < pdu->choice.initiatingMessage->value.choice.RICindication.protocolIEs.list.count; i++) {
1449                 auto messageSent = false;
1450                 RICindication_IEs_t *ie = pdu->choice.initiatingMessage->value.choice.RICindication.protocolIEs.list.array[i];
1451                 if (logLevel >= MDCLOG_DEBUG) {
1452                     mdclog_write(MDCLOG_DEBUG, "ie type (ProtocolIE_ID) = %ld", ie->id);
1453                 }
1454                 if (ie->id == ProtocolIE_ID_id_RICrequestID) {
1455                     if (logLevel >= MDCLOG_DEBUG) {
1456                         mdclog_write(MDCLOG_DEBUG, "Got RIC requestId entry, ie type (ProtocolIE_ID) = %ld", ie->id);
1457                     }
1458                     if (ie->value.present == RICindication_IEs__value_PR_RICrequestID) {
1459                         static unsigned char tx[32];
1460                         message.message.messageType = rmrMessageBuffer.sendMessage->mtype = RIC_INDICATION;
1461                         snprintf((char *) tx, sizeof tx, "%15ld", transactionCounter++);
1462                         rmr_bytes2xact(rmrMessageBuffer.sendMessage, tx, strlen((const char *) tx));
1463                         rmr_bytes2meid(rmrMessageBuffer.sendMessage,
1464                                        (unsigned char *)message.message.enodbName,
1465                                        strlen(message.message.enodbName));
1466                         rmrMessageBuffer.sendMessage->state = 0;
1467                         rmrMessageBuffer.sendMessage->sub_id = (int)ie->value.choice.RICrequestID.ricInstanceID;
1468
1469                         //ie->value.choice.RICrequestID.ricInstanceID;
1470                         if (mdclog_level_get() >= MDCLOG_DEBUG) {
1471                             mdclog_write(MDCLOG_DEBUG, "sub id = %d, mtype = %d, ric instance id %ld, requestor id = %ld",
1472                                          rmrMessageBuffer.sendMessage->sub_id,
1473                                          rmrMessageBuffer.sendMessage->mtype,
1474                                          ie->value.choice.RICrequestID.ricInstanceID,
1475                                          ie->value.choice.RICrequestID.ricRequestorID);
1476                         }
1477                         sendRmrMessage(rmrMessageBuffer, message);
1478                         messageSent = true;
1479                     } else if (ie->value.present == RICindication_IEs__value_PR_RICindicationSN) {
1480                         rmrMessageBuffer.sendMessage->sub_id = (int)ie->value.choice.RICindicationSN;
1481
1482                     } else {
1483                         mdclog_write(MDCLOG_ERR, "RIC request id missing illigal request");
1484                     }
1485                 }
1486                 if (messageSent) {
1487                     break;
1488                 }
1489             }
1490             break;
1491         }
1492         case ProcedureCode_id_RICserviceQuery: {
1493             if (logLevel >= MDCLOG_DEBUG) {
1494                 mdclog_write(MDCLOG_DEBUG, "Got RICserviceQuery %s", message.message.enodbName);
1495             }
1496             break;
1497         }
1498         case ProcedureCode_id_RICserviceUpdate: {
1499             if (logLevel >= MDCLOG_DEBUG) {
1500                 mdclog_write(MDCLOG_DEBUG, "Got RICserviceUpdate %s", message.message.enodbName);
1501             }
1502             if (sendRequestToXapp(message, RIC_SERVICE_UPDATE, rmrMessageBuffer) != 0) {
1503                 mdclog_write(MDCLOG_ERR, "RIC_SERVICE_UPDATE message failed to send to xAPP");
1504             }
1505             break;
1506         }
1507         case ProcedureCode_id_RICsubscription: {
1508             if (logLevel >= MDCLOG_DEBUG) {
1509                 mdclog_write(MDCLOG_DEBUG, "Got RICsubscription %s", message.message.enodbName);
1510             }
1511             break;
1512         }
1513         case ProcedureCode_id_RICsubscriptionDelete: {
1514             if (logLevel >= MDCLOG_DEBUG) {
1515                 mdclog_write(MDCLOG_DEBUG, "Got RICsubscriptionDelete %s", message.message.enodbName);
1516             }
1517             break;
1518         }
1519         default: {
1520             mdclog_write(MDCLOG_ERR, "Undefined or not supported message = %ld", procedureCode);
1521             message.message.messageType = 0; // no RMR message type yet
1522
1523             buildJsonMessage(message);
1524
1525             break;
1526         }
1527     }
1528 }
1529
1530 /**
1531  *
1532  * @param pdu
1533  * @param message
1534  * @param rmrMessageBuffer
1535  */
1536 void asnSuccsesfulMsg(E2AP_PDU_t *pdu,
1537                       Sctp_Map_t *sctpMap,
1538                       ReportingMessages_t &message,
1539                       RmrMessagesBuffer_t &rmrMessageBuffer) {
1540     auto procedureCode = pdu->choice.successfulOutcome->procedureCode;
1541     auto logLevel = mdclog_level_get();
1542     if (logLevel >= MDCLOG_INFO) {
1543         mdclog_write(MDCLOG_INFO, "Successful Outcome %ld", procedureCode);
1544     }
1545     switch (procedureCode) {
1546         case ProcedureCode_id_E2setup: {
1547             if (logLevel >= MDCLOG_DEBUG) {
1548                 mdclog_write(MDCLOG_DEBUG, "Got E2setup\n");
1549             }
1550             break;
1551         }
1552         case ProcedureCode_id_ErrorIndication: {
1553             if (logLevel >= MDCLOG_DEBUG) {
1554                 mdclog_write(MDCLOG_DEBUG, "Got ErrorIndication %s", message.message.enodbName);
1555             }
1556             if (sendRequestToXapp(message, RIC_ERROR_INDICATION, rmrMessageBuffer) != 0) {
1557                 mdclog_write(MDCLOG_ERR, "RIC_ERROR_INDICATION failed to send to xAPP");
1558             }
1559             break;
1560         }
1561         case ProcedureCode_id_Reset: {
1562             if (logLevel >= MDCLOG_DEBUG) {
1563                 mdclog_write(MDCLOG_DEBUG, "Got Reset %s", message.message.enodbName);
1564             }
1565             if (sendRequestToXapp(message, RIC_X2_RESET, rmrMessageBuffer) != 0) {
1566                 mdclog_write(MDCLOG_ERR, "RIC_X2_RESET message failed to send to xAPP");
1567             }
1568             break;
1569         }
1570         case ProcedureCode_id_RICcontrol: {
1571             if (logLevel >= MDCLOG_DEBUG) {
1572                 mdclog_write(MDCLOG_DEBUG, "Got RICcontrol %s", message.message.enodbName);
1573             }
1574             for (auto i = 0;
1575                  i < pdu->choice.successfulOutcome->value.choice.RICcontrolAcknowledge.protocolIEs.list.count; i++) {
1576                 auto messageSent = false;
1577                 RICcontrolAcknowledge_IEs_t *ie = pdu->choice.successfulOutcome->value.choice.RICcontrolAcknowledge.protocolIEs.list.array[i];
1578                 if (mdclog_level_get() >= MDCLOG_DEBUG) {
1579                     mdclog_write(MDCLOG_DEBUG, "ie type (ProtocolIE_ID) = %ld", ie->id);
1580                 }
1581                 if (ie->id == ProtocolIE_ID_id_RICrequestID) {
1582                     if (mdclog_level_get() >= MDCLOG_DEBUG) {
1583                         mdclog_write(MDCLOG_DEBUG, "Got RIC requestId entry, ie type (ProtocolIE_ID) = %ld", ie->id);
1584                     }
1585                     if (ie->value.present == RICcontrolAcknowledge_IEs__value_PR_RICrequestID) {
1586                         message.message.messageType = rmrMessageBuffer.sendMessage->mtype = RIC_CONTROL_ACK;
1587                         rmrMessageBuffer.sendMessage->state = 0;
1588                         rmrMessageBuffer.sendMessage->sub_id = (int) ie->value.choice.RICrequestID.ricRequestorID;
1589                         static unsigned char tx[32];
1590                         snprintf((char *) tx, sizeof tx, "%15ld", transactionCounter++);
1591                         rmr_bytes2xact(rmrMessageBuffer.sendMessage, tx, strlen((const char *) tx));
1592                         rmr_bytes2meid(rmrMessageBuffer.sendMessage,
1593                                        (unsigned char *)message.message.enodbName,
1594                                        strlen(message.message.enodbName));
1595
1596                         sendRmrMessage(rmrMessageBuffer, message);
1597                         messageSent = true;
1598                     } else {
1599                         mdclog_write(MDCLOG_ERR, "RIC request id missing illigal request");
1600                     }
1601                 }
1602                 if (messageSent) {
1603                     break;
1604                 }
1605             }
1606
1607             break;
1608         }
1609         case ProcedureCode_id_RICindication: {
1610             if (logLevel >= MDCLOG_DEBUG) {
1611                 mdclog_write(MDCLOG_DEBUG, "Got RICindication %s", message.message.enodbName);
1612             }
1613             for (auto i = 0; i < pdu->choice.initiatingMessage->value.choice.RICindication.protocolIEs.list.count; i++) {
1614                 auto messageSent = false;
1615                 RICindication_IEs_t *ie = pdu->choice.initiatingMessage->value.choice.RICindication.protocolIEs.list.array[i];
1616                 if (logLevel >= MDCLOG_DEBUG) {
1617                     mdclog_write(MDCLOG_DEBUG, "ie type (ProtocolIE_ID) = %ld", ie->id);
1618                 }
1619                 if (ie->id == ProtocolIE_ID_id_RICrequestID) {
1620                     if (logLevel >= MDCLOG_DEBUG) {
1621                         mdclog_write(MDCLOG_DEBUG, "Got RIC requestId entry, ie type (ProtocolIE_ID) = %ld", ie->id);
1622                     }
1623                     if (ie->value.present == RICindication_IEs__value_PR_RICrequestID) {
1624                         static unsigned char tx[32];
1625                         message.message.messageType = rmrMessageBuffer.sendMessage->mtype = RIC_INDICATION;
1626                         snprintf((char *) tx, sizeof tx, "%15ld", transactionCounter++);
1627                         rmr_bytes2xact(rmrMessageBuffer.sendMessage, tx, strlen((const char *) tx));
1628                         rmr_bytes2meid(rmrMessageBuffer.sendMessage,
1629                                        (unsigned char *)message.message.enodbName,
1630                                        strlen(message.message.enodbName));
1631                         rmrMessageBuffer.sendMessage->state = 0;
1632                         rmrMessageBuffer.sendMessage->sub_id = (int) ie->value.choice.RICrequestID.ricRequestorID;
1633                         if (mdclog_level_get() >= MDCLOG_DEBUG) {
1634                             mdclog_write(MDCLOG_DEBUG, "RIC sub id = %d, message type = %d",
1635                                          rmrMessageBuffer.sendMessage->sub_id,
1636                                          rmrMessageBuffer.sendMessage->mtype);
1637                         }
1638                         sendRmrMessage(rmrMessageBuffer, message);
1639                         messageSent = true;
1640                     } else {
1641                         mdclog_write(MDCLOG_ERR, "RIC request id missing illigal request");
1642                     }
1643                 }
1644                 if (messageSent) {
1645                     break;
1646                 }
1647             }
1648             break;
1649         }
1650         case ProcedureCode_id_RICserviceQuery: {
1651             if (logLevel >= MDCLOG_DEBUG) {
1652                 mdclog_write(MDCLOG_DEBUG, "Got RICserviceQuery %s", message.message.enodbName);
1653             }
1654             break;
1655         }
1656         case ProcedureCode_id_RICserviceUpdate: {
1657             if (logLevel >= MDCLOG_DEBUG) {
1658                 mdclog_write(MDCLOG_DEBUG, "Got RICserviceUpdate %s", message.message.enodbName);
1659             }
1660             if (sendRequestToXapp(message, RIC_SERVICE_UPDATE, rmrMessageBuffer) != 0) {
1661                 mdclog_write(MDCLOG_ERR, "RIC_SERVICE_UPDATE message failed to send to xAPP");
1662             }
1663             break;
1664         }
1665         case ProcedureCode_id_RICsubscription: {
1666             if (logLevel >= MDCLOG_DEBUG) {
1667                 mdclog_write(MDCLOG_DEBUG, "Got RICsubscription %s", message.message.enodbName);
1668             }
1669             if (sendRequestToXapp(message, RIC_SUB_RESP, rmrMessageBuffer) != 0) {
1670                 mdclog_write(MDCLOG_ERR, "Subscription successful message failed to send to xAPP");
1671             }
1672             break;
1673         }
1674         case ProcedureCode_id_RICsubscriptionDelete: {
1675             if (logLevel >= MDCLOG_DEBUG) {
1676                 mdclog_write(MDCLOG_DEBUG, "Got RICsubscriptionDelete %s", message.message.enodbName);
1677             }
1678             if (sendRequestToXapp(message, RIC_SUB_DEL_RESP, rmrMessageBuffer) != 0) {
1679                 mdclog_write(MDCLOG_ERR, "Subscription delete successful message failed to send to xAPP");
1680             }
1681             break;
1682         }
1683         default: {
1684             mdclog_write(MDCLOG_WARN, "Undefined or not supported message = %ld", procedureCode);
1685             message.message.messageType = 0; // no RMR message type yet
1686             buildJsonMessage(message);
1687
1688             break;
1689         }
1690     }
1691 }
1692
1693 /**
1694  *
1695  * @param pdu
1696  * @param message
1697  * @param rmrMessageBuffer
1698  */
1699 void asnUnSuccsesfulMsg(E2AP_PDU_t *pdu,
1700                         Sctp_Map_t *sctpMap,
1701                         ReportingMessages_t &message,
1702                         RmrMessagesBuffer_t &rmrMessageBuffer) {
1703     auto procedureCode = pdu->choice.unsuccessfulOutcome->procedureCode;
1704     auto logLevel = mdclog_level_get();
1705     if (logLevel >= MDCLOG_INFO) {
1706         mdclog_write(MDCLOG_INFO, "Unsuccessful Outcome %ld", procedureCode);
1707     }
1708     switch (procedureCode) {
1709         case ProcedureCode_id_E2setup: {
1710             if (logLevel >= MDCLOG_DEBUG) {
1711                 mdclog_write(MDCLOG_DEBUG, "Got E2setup\n");
1712             }
1713             break;
1714         }
1715         case ProcedureCode_id_ErrorIndication: {
1716             if (logLevel >= MDCLOG_DEBUG) {
1717                 mdclog_write(MDCLOG_DEBUG, "Got ErrorIndication %s", message.message.enodbName);
1718             }
1719             if (sendRequestToXapp(message, RIC_ERROR_INDICATION, rmrMessageBuffer) != 0) {
1720                 mdclog_write(MDCLOG_ERR, "RIC_ERROR_INDICATION failed to send to xAPP");
1721             }
1722             break;
1723         }
1724         case ProcedureCode_id_Reset: {
1725             if (logLevel >= MDCLOG_DEBUG) {
1726                 mdclog_write(MDCLOG_DEBUG, "Got Reset %s", message.message.enodbName);
1727             }
1728             if (sendRequestToXapp(message, RIC_X2_RESET, rmrMessageBuffer) != 0) {
1729                 mdclog_write(MDCLOG_ERR, "RIC_X2_RESET message failed to send to xAPP");
1730             }
1731             break;
1732         }
1733         case ProcedureCode_id_RICcontrol: {
1734             if (logLevel >= MDCLOG_DEBUG) {
1735                 mdclog_write(MDCLOG_DEBUG, "Got RICcontrol %s", message.message.enodbName);
1736             }
1737             for (int i = 0;
1738                  i < pdu->choice.unsuccessfulOutcome->value.choice.RICcontrolFailure.protocolIEs.list.count; i++) {
1739                 auto messageSent = false;
1740                 RICcontrolFailure_IEs_t *ie = pdu->choice.unsuccessfulOutcome->value.choice.RICcontrolFailure.protocolIEs.list.array[i];
1741                 if (logLevel >= MDCLOG_DEBUG) {
1742                     mdclog_write(MDCLOG_DEBUG, "ie type (ProtocolIE_ID) = %ld", ie->id);
1743                 }
1744                 if (ie->id == ProtocolIE_ID_id_RICrequestID) {
1745                     if (logLevel >= MDCLOG_DEBUG) {
1746                         mdclog_write(MDCLOG_DEBUG, "Got RIC requestId entry, ie type (ProtocolIE_ID) = %ld", ie->id);
1747                     }
1748                     if (ie->value.present == RICcontrolFailure_IEs__value_PR_RICrequestID) {
1749                         message.message.messageType = rmrMessageBuffer.sendMessage->mtype = RIC_CONTROL_FAILURE;
1750                         rmrMessageBuffer.sendMessage->state = 0;
1751                         rmrMessageBuffer.sendMessage->sub_id = (int) ie->value.choice.RICrequestID.ricRequestorID;
1752                         static unsigned char tx[32];
1753                         snprintf((char *) tx, sizeof tx, "%15ld", transactionCounter++);
1754                         rmr_bytes2xact(rmrMessageBuffer.sendMessage, tx, strlen((const char *) tx));
1755                         rmr_bytes2meid(rmrMessageBuffer.sendMessage, (unsigned char *) message.message.enodbName,
1756                                        strlen(message.message.enodbName));
1757                         sendRmrMessage(rmrMessageBuffer, message);
1758                         messageSent = true;
1759                     } else {
1760                         mdclog_write(MDCLOG_ERR, "RIC request id missing illigal request");
1761                     }
1762                 }
1763                 if (messageSent) {
1764                     break;
1765                 }
1766             }
1767             break;
1768         }
1769         case ProcedureCode_id_RICindication: {
1770             if (logLevel >= MDCLOG_DEBUG) {
1771                 mdclog_write(MDCLOG_DEBUG, "Got RICindication %s", message.message.enodbName);
1772             }
1773             for (auto i = 0; i < pdu->choice.initiatingMessage->value.choice.RICindication.protocolIEs.list.count; i++) {
1774                 auto messageSent = false;
1775                 RICindication_IEs_t *ie = pdu->choice.initiatingMessage->value.choice.RICindication.protocolIEs.list.array[i];
1776                 if (logLevel >= MDCLOG_DEBUG) {
1777                     mdclog_write(MDCLOG_DEBUG, "ie type (ProtocolIE_ID) = %ld", ie->id);
1778                 }
1779                 if (ie->id == ProtocolIE_ID_id_RICrequestID) {
1780                     if (logLevel >= MDCLOG_DEBUG) {
1781                         mdclog_write(MDCLOG_DEBUG, "Got RIC requestId entry, ie type (ProtocolIE_ID) = %ld", ie->id);
1782                     }
1783                     if (ie->value.present == RICindication_IEs__value_PR_RICrequestID) {
1784                         static unsigned char tx[32];
1785                         message.message.messageType = rmrMessageBuffer.sendMessage->mtype = RIC_INDICATION;
1786                         snprintf((char *) tx, sizeof tx, "%15ld", transactionCounter++);
1787                         rmr_bytes2xact(rmrMessageBuffer.sendMessage, tx, strlen((const char *) tx));
1788                         rmr_bytes2meid(rmrMessageBuffer.sendMessage,
1789                                        (unsigned char *)message.message.enodbName,
1790                                        strlen(message.message.enodbName));
1791                         rmrMessageBuffer.sendMessage->state = 0;
1792                         rmrMessageBuffer.sendMessage->sub_id = (int) ie->value.choice.RICrequestID.ricRequestorID;
1793                         if (mdclog_level_get() >= MDCLOG_DEBUG) {
1794                             mdclog_write(MDCLOG_DEBUG, "RIC sub id = %d, message type = %d",
1795                                          rmrMessageBuffer.sendMessage->sub_id,
1796                                          rmrMessageBuffer.sendMessage->mtype);
1797                         }
1798                         sendRmrMessage(rmrMessageBuffer, message);
1799                         messageSent = true;
1800                     } else {
1801                         mdclog_write(MDCLOG_ERR, "RIC request id missing illigal request");
1802                     }
1803                 }
1804                 if (messageSent) {
1805                     break;
1806                 }
1807             }
1808             break;
1809         }
1810         case ProcedureCode_id_RICserviceQuery: {
1811             if (logLevel >= MDCLOG_DEBUG) {
1812                 mdclog_write(MDCLOG_DEBUG, "Got RICserviceQuery %s", message.message.enodbName);
1813             }
1814             break;
1815         }
1816         case ProcedureCode_id_RICserviceUpdate: {
1817             if (logLevel >= MDCLOG_DEBUG) {
1818                 mdclog_write(MDCLOG_DEBUG, "Got RICserviceUpdate %s", message.message.enodbName);
1819             }
1820             if (sendRequestToXapp(message, RIC_SERVICE_UPDATE, rmrMessageBuffer) != 0) {
1821                 mdclog_write(MDCLOG_ERR, "RIC_SERVICE_UPDATE message failed to send to xAPP");
1822             }
1823             break;
1824         }
1825         case ProcedureCode_id_RICsubscription: {
1826             if (logLevel >= MDCLOG_DEBUG) {
1827                 mdclog_write(MDCLOG_DEBUG, "Got RICsubscription %s", message.message.enodbName);
1828             }
1829             if (sendRequestToXapp(message, RIC_SUB_FAILURE, rmrMessageBuffer) != 0) {
1830                 mdclog_write(MDCLOG_ERR, "Subscription unsuccessful message failed to send to xAPP");
1831             }
1832             break;
1833         }
1834         case ProcedureCode_id_RICsubscriptionDelete: {
1835             if (logLevel >= MDCLOG_DEBUG) {
1836                 mdclog_write(MDCLOG_DEBUG, "Got RICsubscriptionDelete %s", message.message.enodbName);
1837             }
1838             if (sendRequestToXapp(message, RIC_SUB_DEL_FAILURE, rmrMessageBuffer) != 0) {
1839                 mdclog_write(MDCLOG_ERR, "Subscription Delete unsuccessful message failed to send to xAPP");
1840             }
1841             break;
1842         }
1843         default: {
1844             mdclog_write(MDCLOG_WARN, "Undefined or not supported message = %ld", procedureCode);
1845             message.message.messageType = 0; // no RMR message type yet
1846
1847             buildJsonMessage(message);
1848
1849             break;
1850         }
1851     }
1852 }
1853
1854 /**
1855  *
1856  * @param message
1857  * @param requestId
1858  * @param rmrMmessageBuffer
1859  * @return
1860  */
1861 int sendRequestToXapp(ReportingMessages_t &message,
1862                       int requestId,
1863                       RmrMessagesBuffer_t &rmrMmessageBuffer) {
1864     rmr_bytes2meid(rmrMmessageBuffer.sendMessage,
1865                    (unsigned char *)message.message.enodbName,
1866                    strlen(message.message.enodbName));
1867     message.message.messageType = rmrMmessageBuffer.sendMessage->mtype = requestId;
1868     rmrMmessageBuffer.sendMessage->state = 0;
1869     static unsigned char tx[32];
1870     snprintf((char *) tx, sizeof tx, "%15ld", transactionCounter++);
1871     rmr_bytes2xact(rmrMmessageBuffer.sendMessage, tx, strlen((const char *) tx));
1872
1873     auto rc = sendRmrMessage(rmrMmessageBuffer, message);
1874     return rc;
1875 }
1876
1877
1878 void getRmrContext(sctp_params_t &pSctpParams) {
1879     pSctpParams.rmrCtx = nullptr;
1880     pSctpParams.rmrCtx = rmr_init(pSctpParams.rmrAddress, RMR_MAX_RCV_BYTES, RMRFL_NONE);
1881     if (pSctpParams.rmrCtx == nullptr) {
1882         mdclog_write(MDCLOG_ERR, "Failed to initialize RMR");
1883         return;
1884     }
1885
1886     rmr_set_stimeout(pSctpParams.rmrCtx, 0);    // disable retries for any send operation
1887     // we need to find that routing table exist and we can run
1888     if (mdclog_level_get() >= MDCLOG_INFO) {
1889         mdclog_write(MDCLOG_INFO, "We are after RMR INIT wait for RMR_Ready");
1890     }
1891     int rmrReady = 0;
1892     int count = 0;
1893     while (!rmrReady) {
1894         if ((rmrReady = rmr_ready(pSctpParams.rmrCtx)) == 0) {
1895             sleep(1);
1896         }
1897         count++;
1898         if (count % 60 == 0) {
1899             mdclog_write(MDCLOG_INFO, "waiting to RMR ready state for %d seconds", count);
1900         }
1901     }
1902     if (mdclog_level_get() >= MDCLOG_INFO) {
1903         mdclog_write(MDCLOG_INFO, "RMR running");
1904     }
1905     rmr_init_trace(pSctpParams.rmrCtx, 200);
1906     // get the RMR fd for the epoll
1907     pSctpParams.rmrListenFd = rmr_get_rcvfd(pSctpParams.rmrCtx);
1908     struct epoll_event event{};
1909     // add RMR fd to epoll
1910     event.events = (EPOLLIN);
1911     event.data.fd = pSctpParams.rmrListenFd;
1912     // add listening RMR FD to epoll
1913     if (epoll_ctl(pSctpParams.epoll_fd, EPOLL_CTL_ADD, pSctpParams.rmrListenFd, &event)) {
1914         mdclog_write(MDCLOG_ERR, "Failed to add RMR descriptor to epoll");
1915         close(pSctpParams.rmrListenFd);
1916         rmr_close(pSctpParams.rmrCtx);
1917         pSctpParams.rmrCtx = nullptr;
1918     }
1919 }
1920
1921 int BuildPERSetupResponseMessaeFromXML(ReportingMessages_t &message, RmrMessagesBuffer_t &rmrMessageBuffer) {
1922     E2AP_PDU_t *pdu;
1923
1924     if (mdclog_level_get() >= MDCLOG_DEBUG) {
1925         mdclog_write(MDCLOG_DEBUG, "got xml setup response \n %s\n", rmrMessageBuffer.rcvMessage->payload);
1926     }
1927     auto rval = asn_decode(nullptr, ATS_BASIC_XER, &asn_DEF_E2AP_PDU, (void **) &pdu,
1928                            rmrMessageBuffer.rcvMessage->payload, rmrMessageBuffer.rcvMessage->len);
1929     if (rval.code != RC_OK) {
1930         mdclog_write(MDCLOG_ERR, "Error %d Decoding (unpack) setup response  from E2MGR : %s",
1931                      rval.code,
1932                      message.message.enodbName);
1933         return -1;
1934     }
1935
1936     int buff_size = RECEIVE_XAPP_BUFFER_SIZE;
1937     auto er = asn_encode_to_buffer(nullptr, ATS_ALIGNED_BASIC_PER, &asn_DEF_E2AP_PDU, pdu,
1938                                    rmrMessageBuffer.rcvMessage->payload, buff_size);
1939     if (er.encoded == -1) {
1940         mdclog_write(MDCLOG_ERR, "encoding of %s failed, %s", asn_DEF_E2AP_PDU.name, strerror(errno));
1941         return -1;
1942     } else if (er.encoded > (ssize_t)buff_size) {
1943         mdclog_write(MDCLOG_ERR, "Buffer of size %d is to small for %s, at %s line %d",
1944                      (int)rmrMessageBuffer.rcvMessage->len,
1945                      asn_DEF_E2AP_PDU.name,
1946                      __func__,
1947                      __LINE__);
1948         return -1;
1949     }
1950     rmrMessageBuffer.rcvMessage->len = er.encoded;
1951     return 0;
1952 }
1953
1954 /**
1955  *
1956  * @param sctpMap
1957  * @param rmrMessageBuffer
1958  * @param ts
1959  * @return
1960  */
1961 int receiveXappMessages(Sctp_Map_t *sctpMap,
1962                         RmrMessagesBuffer_t &rmrMessageBuffer,
1963                         struct timespec &ts) {
1964     if (rmrMessageBuffer.rcvMessage == nullptr) {
1965         //we have error
1966         mdclog_write(MDCLOG_ERR, "RMR Allocation message, %s", strerror(errno));
1967         return -1;
1968     }
1969
1970     if (mdclog_level_get() >= MDCLOG_DEBUG) {
1971         mdclog_write(MDCLOG_DEBUG, "Call to rmr_rcv_msg");
1972     }
1973     rmrMessageBuffer.rcvMessage = rmr_rcv_msg(rmrMessageBuffer.rmrCtx, rmrMessageBuffer.rcvMessage);
1974     if (rmrMessageBuffer.rcvMessage == nullptr) {
1975         mdclog_write(MDCLOG_ERR, "RMR Receving message with null pointer, Realloc rmr mesage buffer");
1976         rmrMessageBuffer.rcvMessage = rmr_alloc_msg(rmrMessageBuffer.rmrCtx, RECEIVE_XAPP_BUFFER_SIZE);
1977         return -2;
1978     }
1979     ReportingMessages_t message;
1980     message.message.direction = 'D';
1981     message.message.time.tv_nsec = ts.tv_nsec;
1982     message.message.time.tv_sec = ts.tv_sec;
1983
1984     // get message payload
1985     //auto msgData = msg->payload;
1986     if (rmrMessageBuffer.rcvMessage->state != 0) {
1987         mdclog_write(MDCLOG_ERR, "RMR Receving message with stat = %d", rmrMessageBuffer.rcvMessage->state);
1988         return -1;
1989     }
1990     rmr_get_meid(rmrMessageBuffer.rcvMessage, (unsigned char *)message.message.enodbName);
1991     switch (rmrMessageBuffer.rcvMessage->mtype) {
1992         case RIC_E2_SETUP_RESP : {
1993             if (BuildPERSetupResponseMessaeFromXML(message, rmrMessageBuffer) != 0) {
1994                 break;
1995             }
1996
1997             if (sendDirectionalSctpMsg(rmrMessageBuffer, message, 0, sctpMap) != 0) {
1998                 mdclog_write(MDCLOG_ERR, "Failed to send RIC_E2_SETUP_RESP");
1999                 return -6;
2000             }
2001             break;
2002         }
2003         case RIC_E2_SETUP_FAILURE : {
2004             if (BuildPERSetupResponseMessaeFromXML(message, rmrMessageBuffer) != 0) {
2005                 break;
2006             }
2007             if (sendDirectionalSctpMsg(rmrMessageBuffer, message, 0, sctpMap) != 0) {
2008                 mdclog_write(MDCLOG_ERR, "Failed to send RIC_E2_SETUP_FAILURE");
2009                 return -6;
2010             }
2011             break;
2012         }
2013         case RIC_ERROR_INDICATION: {
2014             if (sendDirectionalSctpMsg(rmrMessageBuffer, message, 0, sctpMap) != 0) {
2015                 mdclog_write(MDCLOG_ERR, "Failed to send RIC_ERROR_INDICATION");
2016                 return -6;
2017             }
2018             break;
2019         }
2020         case RIC_SUB_REQ: {
2021             if (sendDirectionalSctpMsg(rmrMessageBuffer, message, 0, sctpMap) != 0) {
2022                 mdclog_write(MDCLOG_ERR, "Failed to send RIC_SUB_REQ");
2023                 return -6;
2024             }
2025             break;
2026         }
2027         case RIC_SUB_DEL_REQ: {
2028             if (sendDirectionalSctpMsg(rmrMessageBuffer, message, 0, sctpMap) != 0) {
2029                 mdclog_write(MDCLOG_ERR, "Failed to send RIC_SUB_DEL_REQ");
2030                 return -6;
2031             }
2032             break;
2033         }
2034         case RIC_CONTROL_REQ: {
2035             if (sendDirectionalSctpMsg(rmrMessageBuffer, message, 0, sctpMap) != 0) {
2036                 mdclog_write(MDCLOG_ERR, "Failed to send RIC_CONTROL_REQ");
2037                 return -6;
2038             }
2039             break;
2040         }
2041         case RIC_SERVICE_QUERY: {
2042             if (sendDirectionalSctpMsg(rmrMessageBuffer, message, 0, sctpMap) != 0) {
2043                 mdclog_write(MDCLOG_ERR, "Failed to send RIC_SERVICE_QUERY");
2044                 return -6;
2045             }
2046             break;
2047         }
2048         case RIC_SERVICE_UPDATE_ACK: {
2049             if (sendDirectionalSctpMsg(rmrMessageBuffer, message, 0, sctpMap) != 0) {
2050                 mdclog_write(MDCLOG_ERR, "Failed to send RIC_SERVICE_UPDATE_ACK");
2051                 return -6;
2052             }
2053             break;
2054         }
2055         case RIC_SERVICE_UPDATE_FAILURE: {
2056             if (sendDirectionalSctpMsg(rmrMessageBuffer, message, 0, sctpMap) != 0) {
2057                 mdclog_write(MDCLOG_ERR, "Failed to send RIC_SERVICE_UPDATE_FAILURE");
2058                 return -6;
2059             }
2060             break;
2061         }
2062         case RIC_X2_RESET: {
2063             if (sendDirectionalSctpMsg(rmrMessageBuffer, message, 0, sctpMap) != 0) {
2064                 mdclog_write(MDCLOG_ERR, "Failed to send RIC_X2_RESET");
2065                 return -6;
2066             }
2067             break;
2068         }
2069         case RIC_X2_RESET_RESP: {
2070             if (sendDirectionalSctpMsg(rmrMessageBuffer, message, 0, sctpMap) != 0) {
2071                 mdclog_write(MDCLOG_ERR, "Failed to send RIC_X2_RESET_RESP");
2072                 return -6;
2073             }
2074             break;
2075         }
2076         case RIC_SCTP_CLEAR_ALL: {
2077             mdclog_write(MDCLOG_INFO, "RIC_SCTP_CLEAR_ALL");
2078             // loop on all keys and close socket and then erase all map.
2079             vector<char *> v;
2080             sctpMap->getKeys(v);
2081             for (auto const &iter : v) { //}; iter != sctpMap.end(); iter++) {
2082                 if (!boost::starts_with((string) (iter), "host:") && !boost::starts_with((string) (iter), "msg:")) {
2083                     auto *peerInfo = (ConnectedCU_t *) sctpMap->find(iter);
2084                     if (peerInfo == nullptr) {
2085                         continue;
2086                     }
2087                     close(peerInfo->fileDescriptor);
2088                     memcpy(message.message.enodbName, peerInfo->enodbName, sizeof(peerInfo->enodbName));
2089                     message.message.direction = 'D';
2090                     message.message.time.tv_nsec = ts.tv_nsec;
2091                     message.message.time.tv_sec = ts.tv_sec;
2092
2093                     message.message.asnLength = rmrMessageBuffer.sendMessage->len =
2094                             snprintf((char *)rmrMessageBuffer.sendMessage->payload,
2095                                      256,
2096                                      "%s|RIC_SCTP_CLEAR_ALL",
2097                                      peerInfo->enodbName);
2098                     message.message.asndata = rmrMessageBuffer.sendMessage->payload;
2099                     mdclog_write(MDCLOG_INFO, "%s", message.message.asndata);
2100                     if (sendRequestToXapp(message, RIC_SCTP_CONNECTION_FAILURE, rmrMessageBuffer) != 0) {
2101                         mdclog_write(MDCLOG_ERR, "SCTP_CONNECTION_FAIL message failed to send to xAPP");
2102                     }
2103                     free(peerInfo);
2104                 }
2105             }
2106
2107             sleep(1);
2108             sctpMap->clear();
2109             break;
2110         }
2111         case E2_TERM_KEEP_ALIVE_REQ: {
2112             // send message back
2113             rmr_bytes2payload(rmrMessageBuffer.sendMessage,
2114                               (unsigned char *)rmrMessageBuffer.ka_message,
2115                               rmrMessageBuffer.ka_message_len);
2116             rmrMessageBuffer.sendMessage->mtype = E2_TERM_KEEP_ALIVE_RESP;
2117             rmrMessageBuffer.sendMessage->state = 0;
2118             static unsigned char tx[32];
2119             auto txLen = snprintf((char *) tx, sizeof tx, "%15ld", transactionCounter++);
2120             rmr_bytes2xact(rmrMessageBuffer.sendMessage, tx, txLen);
2121             rmrMessageBuffer.sendMessage = rmr_send_msg(rmrMessageBuffer.rmrCtx, rmrMessageBuffer.sendMessage);
2122             if (rmrMessageBuffer.sendMessage == nullptr) {
2123                 rmrMessageBuffer.sendMessage = rmr_alloc_msg(rmrMessageBuffer.rmrCtx, RECEIVE_XAPP_BUFFER_SIZE);
2124                 mdclog_write(MDCLOG_ERR, "Failed to send E2_TERM_KEEP_ALIVE_RESP RMR message returned NULL");
2125             } else if (rmrMessageBuffer.sendMessage->state != 0)  {
2126                 mdclog_write(MDCLOG_ERR, "Failed to send E2_TERM_KEEP_ALIVE_RESP, on RMR state = %d ( %s)",
2127                              rmrMessageBuffer.sendMessage->state, translateRmrErrorMessages(rmrMessageBuffer.sendMessage->state).c_str());
2128             } else if (mdclog_level_get() >= MDCLOG_DEBUG) {
2129                 mdclog_write(MDCLOG_DEBUG, "Got Keep Alive Request send : %s", rmrMessageBuffer.ka_message);
2130             }
2131
2132             break;
2133         }
2134         default:
2135             mdclog_write(MDCLOG_WARN, "Message Type : %d is not seported", rmrMessageBuffer.rcvMessage->mtype);
2136             message.message.asndata = rmrMessageBuffer.rcvMessage->payload;
2137             message.message.asnLength = rmrMessageBuffer.rcvMessage->len;
2138             message.message.time.tv_nsec = ts.tv_nsec;
2139             message.message.time.tv_sec = ts.tv_sec;
2140             message.message.messageType = rmrMessageBuffer.rcvMessage->mtype;
2141
2142             buildJsonMessage(message);
2143
2144
2145             return -7;
2146     }
2147     if (mdclog_level_get() >= MDCLOG_DEBUG) {
2148         mdclog_write(MDCLOG_DEBUG, "EXIT OK from %s", __FUNCTION__);
2149     }
2150     return 0;
2151 }
2152
2153 /**
2154  * Send message to the CU that is not expecting for successful or unsuccessful results
2155  * @param messageBuffer
2156  * @param message
2157  * @param failedMsgId
2158  * @param sctpMap
2159  * @return
2160  */
2161 int sendDirectionalSctpMsg(RmrMessagesBuffer_t &messageBuffer,
2162                            ReportingMessages_t &message,
2163                            int failedMsgId,
2164                            Sctp_Map_t *sctpMap) {
2165
2166     getRequestMetaData(message, messageBuffer);
2167     if (mdclog_level_get() >= MDCLOG_INFO) {
2168         mdclog_write(MDCLOG_INFO, "send message to %s address", message.message.enodbName);
2169     }
2170
2171     auto rc = sendMessagetoCu(sctpMap, messageBuffer, message, failedMsgId);
2172     return rc;
2173 }
2174
2175 /**
2176  *
2177  * @param sctpMap
2178  * @param messageBuffer
2179  * @param message
2180  * @param failedMesgId
2181  * @return
2182  */
2183 int sendMessagetoCu(Sctp_Map_t *sctpMap,
2184                     RmrMessagesBuffer_t &messageBuffer,
2185                     ReportingMessages_t &message,
2186                     int failedMesgId) {
2187     auto *peerInfo = (ConnectedCU_t *) sctpMap->find(message.message.enodbName);
2188     if (peerInfo == nullptr) {
2189         if (failedMesgId != 0) {
2190             sendFailedSendingMessagetoXapp(messageBuffer, message, failedMesgId);
2191         } else {
2192             mdclog_write(MDCLOG_ERR, "Failed to send message no CU entry %s", message.message.enodbName);
2193         }
2194         return -1;
2195     }
2196
2197     // get the FD
2198     message.message.messageType = messageBuffer.rcvMessage->mtype;
2199     auto rc = sendSctpMsg(peerInfo, message, sctpMap);
2200     return rc;
2201 }
2202
2203 /**
2204  *
2205  * @param rmrCtx the rmr context to send and receive
2206  * @param msg the msg we got fromxApp
2207  * @param metaData data from xApp in ordered struct
2208  * @param failedMesgId the return message type error
2209  */
2210 void
2211 sendFailedSendingMessagetoXapp(RmrMessagesBuffer_t &rmrMessageBuffer, ReportingMessages_t &message, int failedMesgId) {
2212     rmr_mbuf_t *msg = rmrMessageBuffer.sendMessage;
2213     msg->len = snprintf((char *) msg->payload, 200, "the gNb/eNode name %s not found",
2214                         message.message.enodbName);
2215     if (mdclog_level_get() >= MDCLOG_INFO) {
2216         mdclog_write(MDCLOG_INFO, "%s", msg->payload);
2217     }
2218     msg->mtype = failedMesgId;
2219     msg->state = 0;
2220
2221     static unsigned char tx[32];
2222     snprintf((char *) tx, sizeof tx, "%15ld", transactionCounter++);
2223     rmr_bytes2xact(msg, tx, strlen((const char *) tx));
2224
2225     sendRmrMessage(rmrMessageBuffer, message);
2226 }
2227
2228
2229
2230 /**
2231  *
2232  * @param epoll_fd
2233  * @param peerInfo
2234  * @param events
2235  * @param sctpMap
2236  * @param enodbName
2237  * @param msgType
2238  * @return
2239  */
2240 int addToEpoll(int epoll_fd,
2241                ConnectedCU_t *peerInfo,
2242                uint32_t events,
2243                Sctp_Map_t *sctpMap,
2244                char *enodbName,
2245                int msgType) {
2246     // Add to Epol
2247     struct epoll_event event{};
2248     event.data.ptr = peerInfo;
2249     event.events = events;
2250     if (epoll_ctl(epoll_fd, EPOLL_CTL_ADD, peerInfo->fileDescriptor, &event) < 0) {
2251         if (mdclog_level_get() >= MDCLOG_DEBUG) {
2252             mdclog_write(MDCLOG_DEBUG, "epoll_ctl EPOLL_CTL_ADD (may chack not to quit here), %s, %s %d",
2253                          strerror(errno), __func__, __LINE__);
2254         }
2255         close(peerInfo->fileDescriptor);
2256         if (enodbName != nullptr) {
2257             cleanHashEntry(peerInfo, sctpMap);
2258             char key[MAX_ENODB_NAME_SIZE * 2];
2259             snprintf(key, MAX_ENODB_NAME_SIZE * 2, "msg:%s|%d", enodbName, msgType);
2260             if (mdclog_level_get() >= MDCLOG_DEBUG) {
2261                 mdclog_write(MDCLOG_DEBUG, "remove key = %s from %s at line %d", key, __FUNCTION__, __LINE__);
2262             }
2263             auto tmp = sctpMap->find(key);
2264             if (tmp) {
2265                 free(tmp);
2266                 sctpMap->erase(key);
2267             }
2268         } else {
2269             peerInfo->enodbName[0] = 0;
2270         }
2271         mdclog_write(MDCLOG_ERR, "epoll_ctl EPOLL_CTL_ADD (may chack not to quit here)");
2272         return -1;
2273     }
2274     return 0;
2275 }
2276
2277 /**
2278  *
2279  * @param epoll_fd
2280  * @param peerInfo
2281  * @param events
2282  * @param sctpMap
2283  * @param enodbName
2284  * @param msgType
2285  * @return
2286  */
2287 int modifyToEpoll(int epoll_fd,
2288                   ConnectedCU_t *peerInfo,
2289                   uint32_t events,
2290                   Sctp_Map_t *sctpMap,
2291                   char *enodbName,
2292                   int msgType) {
2293     // Add to Epol
2294     struct epoll_event event{};
2295     event.data.ptr = peerInfo;
2296     event.events = events;
2297     if (epoll_ctl(epoll_fd, EPOLL_CTL_MOD, peerInfo->fileDescriptor, &event) < 0) {
2298         if (mdclog_level_get() >= MDCLOG_DEBUG) {
2299             mdclog_write(MDCLOG_DEBUG, "epoll_ctl EPOLL_CTL_MOD (may chack not to quit here), %s, %s %d",
2300                          strerror(errno), __func__, __LINE__);
2301         }
2302         close(peerInfo->fileDescriptor);
2303         cleanHashEntry(peerInfo, sctpMap);
2304         char key[MAX_ENODB_NAME_SIZE * 2];
2305         snprintf(key, MAX_ENODB_NAME_SIZE * 2, "msg:%s|%d", enodbName, msgType);
2306         if (mdclog_level_get() >= MDCLOG_DEBUG) {
2307             mdclog_write(MDCLOG_DEBUG, "remove key = %s from %s at line %d", key, __FUNCTION__, __LINE__);
2308         }
2309         auto tmp = sctpMap->find(key);
2310         if (tmp) {
2311             free(tmp);
2312         }
2313         sctpMap->erase(key);
2314         mdclog_write(MDCLOG_ERR, "epoll_ctl EPOLL_CTL_ADD (may chack not to quit here)");
2315         return -1;
2316     }
2317     return 0;
2318 }
2319
2320
2321 int sendRmrMessage(RmrMessagesBuffer_t &rmrMessageBuffer, ReportingMessages_t &message) {
2322     buildJsonMessage(message);
2323
2324     rmrMessageBuffer.sendMessage = rmr_send_msg(rmrMessageBuffer.rmrCtx, rmrMessageBuffer.sendMessage);
2325
2326     if (rmrMessageBuffer.sendMessage == nullptr) {
2327         rmrMessageBuffer.sendMessage = rmr_alloc_msg(rmrMessageBuffer.rmrCtx, RECEIVE_XAPP_BUFFER_SIZE);
2328         mdclog_write(MDCLOG_ERR, "RMR failed send message returned with NULL pointer");
2329         return -1;
2330     }
2331
2332     if (rmrMessageBuffer.sendMessage->state != 0) {
2333         char meid[RMR_MAX_MEID]{};
2334         if (rmrMessageBuffer.sendMessage->state == RMR_ERR_RETRY) {
2335             usleep(5);
2336             rmrMessageBuffer.sendMessage->state = 0;
2337             mdclog_write(MDCLOG_INFO, "RETRY sending Message type %d to Xapp from %s",
2338                          rmrMessageBuffer.sendMessage->mtype,
2339                          rmr_get_meid(rmrMessageBuffer.sendMessage, (unsigned char *)meid));
2340             rmrMessageBuffer.sendMessage = rmr_send_msg(rmrMessageBuffer.rmrCtx, rmrMessageBuffer.sendMessage);
2341             if (rmrMessageBuffer.sendMessage == nullptr) {
2342                 mdclog_write(MDCLOG_ERR, "RMR failed send message returned with NULL pointer");
2343                 rmrMessageBuffer.sendMessage = rmr_alloc_msg(rmrMessageBuffer.rmrCtx, RECEIVE_XAPP_BUFFER_SIZE);
2344                 return -1;
2345             } else if (rmrMessageBuffer.sendMessage->state != 0) {
2346                 mdclog_write(MDCLOG_ERR,
2347                              "Message state %s while sending request %d to Xapp from %s after retry of 10 microseconds",
2348                              translateRmrErrorMessages(rmrMessageBuffer.sendMessage->state).c_str(),
2349                              rmrMessageBuffer.sendMessage->mtype,
2350                              rmr_get_meid(rmrMessageBuffer.sendMessage, (unsigned char *)meid));
2351                 auto rc = rmrMessageBuffer.sendMessage->state;
2352                 return rc;
2353             }
2354         } else {
2355             mdclog_write(MDCLOG_ERR, "Message state %s while sending request %d to Xapp from %s",
2356                          translateRmrErrorMessages(rmrMessageBuffer.sendMessage->state).c_str(),
2357                          rmrMessageBuffer.sendMessage->mtype,
2358                          rmr_get_meid(rmrMessageBuffer.sendMessage, (unsigned char *)meid));
2359             return rmrMessageBuffer.sendMessage->state;
2360         }
2361     }
2362     return 0;
2363 }
2364
2365 void buildJsonMessage(ReportingMessages_t &message) {
2366     if (jsonTrace) {
2367         message.outLen = sizeof(message.base64Data);
2368         base64::encode((const unsigned char *) message.message.asndata,
2369                        (const int) message.message.asnLength,
2370                        message.base64Data,
2371                        message.outLen);
2372         if (mdclog_level_get() >= MDCLOG_DEBUG) {
2373             mdclog_write(MDCLOG_DEBUG, "Tracing: ASN length = %d, base64 message length = %d ",
2374                          (int) message.message.asnLength,
2375                          (int) message.outLen);
2376         }
2377
2378         snprintf(message.buffer, sizeof(message.buffer),
2379                  "{\"header\": {\"ts\": \"%ld.%09ld\","
2380                  "\"ranName\": \"%s\","
2381                  "\"messageType\": %d,"
2382                  "\"direction\": \"%c\"},"
2383                  "\"base64Length\": %d,"
2384                  "\"asnBase64\": \"%s\"}",
2385                  message.message.time.tv_sec,
2386                  message.message.time.tv_nsec,
2387                  message.message.enodbName,
2388                  message.message.messageType,
2389                  message.message.direction,
2390                  (int) message.outLen,
2391                  message.base64Data);
2392         static src::logger_mt &lg = my_logger::get();
2393
2394         BOOST_LOG(lg) << message.buffer;
2395     }
2396 }
2397
2398
2399 /**
2400  * take RMR error code to string
2401  * @param state
2402  * @return
2403  */
2404 string translateRmrErrorMessages(int state) {
2405     string str = {};
2406     switch (state) {
2407         case RMR_OK:
2408             str = "RMR_OK - state is good";
2409             break;
2410         case RMR_ERR_BADARG:
2411             str = "RMR_ERR_BADARG - argument passd to function was unusable";
2412             break;
2413         case RMR_ERR_NOENDPT:
2414             str = "RMR_ERR_NOENDPT - send//call could not find an endpoint based on msg type";
2415             break;
2416         case RMR_ERR_EMPTY:
2417             str = "RMR_ERR_EMPTY - msg received had no payload; attempt to send an empty message";
2418             break;
2419         case RMR_ERR_NOHDR:
2420             str = "RMR_ERR_NOHDR - message didn't contain a valid header";
2421             break;
2422         case RMR_ERR_SENDFAILED:
2423             str = "RMR_ERR_SENDFAILED - send failed; errno has nano reason";
2424             break;
2425         case RMR_ERR_CALLFAILED:
2426             str = "RMR_ERR_CALLFAILED - unable to send call() message";
2427             break;
2428         case RMR_ERR_NOWHOPEN:
2429             str = "RMR_ERR_NOWHOPEN - no wormholes are open";
2430             break;
2431         case RMR_ERR_WHID:
2432             str = "RMR_ERR_WHID - wormhole id was invalid";
2433             break;
2434         case RMR_ERR_OVERFLOW:
2435             str = "RMR_ERR_OVERFLOW - operation would have busted through a buffer/field size";
2436             break;
2437         case RMR_ERR_RETRY:
2438             str = "RMR_ERR_RETRY - request (send/call/rts) failed, but caller should retry (EAGAIN for wrappers)";
2439             break;
2440         case RMR_ERR_RCVFAILED:
2441             str = "RMR_ERR_RCVFAILED - receive failed (hard error)";
2442             break;
2443         case RMR_ERR_TIMEOUT:
2444             str = "RMR_ERR_TIMEOUT - message processing call timed out";
2445             break;
2446         case RMR_ERR_UNSET:
2447             str = "RMR_ERR_UNSET - the message hasn't been populated with a transport buffer";
2448             break;
2449         case RMR_ERR_TRUNC:
2450             str = "RMR_ERR_TRUNC - received message likely truncated";
2451             break;
2452         case RMR_ERR_INITFAILED:
2453             str = "RMR_ERR_INITFAILED - initialisation of something (probably message) failed";
2454             break;
2455         case RMR_ERR_NOTSUPP:
2456             str = "RMR_ERR_NOTSUPP - the request is not supported, or RMr was not initialised for the request";
2457             break;
2458         default:
2459             char buf[128]{};
2460             snprintf(buf, sizeof buf, "UNDOCUMENTED RMR_ERR : %d", state);
2461             str = buf;
2462             break;
2463     }
2464     return str;
2465 }
2466
2467