builder: mozilla-central_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-067 starttime: 1497198686.93 results: success (0) revision: 981da978f1f686ad024fa958c9d27d2f8acc5ad0 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-06-11 09:31:26.928430) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-06-11 09:31:26.928870) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-06-11 09:31:26.929164) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-06-11 09:31:26.947583) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-06-11 09:31:26.947841) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=e0e61f6f900f4dc42e3e8956000001ad-1497174785.535695-1174067972 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-06-11 09:31:27-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 46.4M=0s 2017-06-11 09:31:27 (46.4 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.130659 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-06-11 09:31:27.091533) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-06-11 09:31:27.091844) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=e0e61f6f900f4dc42e3e8956000001ad-1497174785.535695-1174067972 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.020329 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-06-11 09:31:27.141098) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-06-11 09:31:27.141481) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 981da978f1f686ad024fa958c9d27d2f8acc5ad0 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo mozilla-central --rev 981da978f1f686ad024fa958c9d27d2f8acc5ad0 --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=e0e61f6f900f4dc42e3e8956000001ad-1497174785.535695-1174067972 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-06-11 09:31:27,906 truncating revision to first 12 chars 2017-06-11 09:31:27,906 Setting DEBUG logging. 2017-06-11 09:31:27,906 attempt 1/10 2017-06-11 09:31:27,906 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/981da978f1f6?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-06-11 09:31:28,164 unpacking tar archive at: mozilla-central-981da978f1f6/testing/mozharness/ program finished with exit code 0 elapsedTime=0.551426 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-06-11 09:31:27.705078) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-06-11 09:31:27.705418) ========= script_repo_revision: 981da978f1f686ad024fa958c9d27d2f8acc5ad0 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-06-11 09:31:27.705819) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-06-11 09:31:27.706123) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-06-11 09:31:27.715079) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 48 secs) (at 2017-06-11 09:31:27.715521) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=e0e61f6f900f4dc42e3e8956000001ad-1497174785.535695-1174067972 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 09:31:28 INFO - MultiFileLogger online at 20170611 09:31:28 in /builds/slave/test 09:31:28 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 09:31:28 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 09:31:28 INFO - {'append_to_log': False, 09:31:28 INFO - 'base_work_dir': '/builds/slave/test', 09:31:28 INFO - 'blob_upload_branch': 'Firefox', 09:31:28 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 09:31:28 INFO - 'branch': 'Firefox', 09:31:28 INFO - 'buildbot_json_path': 'buildprops.json', 09:31:28 INFO - 'config_files': ('talos/linux_config.py',), 09:31:28 INFO - 'default_actions': ('clobber', 09:31:28 INFO - 'read-buildbot-config', 09:31:28 INFO - 'download-and-extract', 09:31:28 INFO - 'populate-webroot', 09:31:28 INFO - 'create-virtualenv', 09:31:28 INFO - 'install', 09:31:28 INFO - 'setup-mitmproxy', 09:31:28 INFO - 'run-tests'), 09:31:28 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 09:31:28 INFO - 'download_minidump_stackwalk': True, 09:31:28 INFO - 'download_symbols': 'ondemand', 09:31:28 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 09:31:28 INFO - 'tooltool.py': '/tools/tooltool.py', 09:31:28 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 09:31:28 INFO - '/tools/misc-python/virtualenv.py')}, 09:31:28 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 09:31:28 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 09:31:28 INFO - 'gecko_profile': False, 09:31:28 INFO - 'gecko_profile_interval': 0, 09:31:28 INFO - 'installer_path': 'installer.exe', 09:31:28 INFO - 'log_level': 'info', 09:31:28 INFO - 'log_name': 'talos', 09:31:28 INFO - 'log_to_console': True, 09:31:28 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 09:31:28 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 09:31:28 INFO - 'opt_config_files': (), 09:31:28 INFO - 'pip_index': False, 09:31:28 INFO - 'suite': 'dromaeojs-e10s', 09:31:28 INFO - 'system_bits': '32', 09:31:28 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 09:31:28 INFO - 'title': 'talos-linux64-ix-067', 09:31:28 INFO - 'tooltool_cache': '/builds/tooltool_cache', 09:31:28 INFO - 'use_talos_json': True, 09:31:28 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 09:31:28 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 09:31:28 INFO - 'work_dir': 'build'} 09:31:28 INFO - [mozharness: 2017-06-11 16:31:28.580826Z] Running clobber step. 09:31:28 INFO - Running pre-action listener: _resource_record_pre_action 09:31:28 INFO - Running main action method: clobber 09:31:28 INFO - rmtree: /builds/slave/test/build 09:31:28 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 09:31:30 INFO - Running post-action listener: _resource_record_post_action 09:31:30 INFO - [mozharness: 2017-06-11 16:31:30.128746Z] Finished clobber step (success) 09:31:30 INFO - [mozharness: 2017-06-11 16:31:30.128846Z] Running read-buildbot-config step. 09:31:30 INFO - Running pre-action listener: _resource_record_pre_action 09:31:30 INFO - Running main action method: read_buildbot_config 09:31:30 INFO - Using buildbot properties: 09:31:30 INFO - { 09:31:30 INFO - "project": "", 09:31:30 INFO - "product": "firefox", 09:31:30 INFO - "who": "ffxbld@noreply.mozilla.org", 09:31:30 INFO - "installer_path": "public/build/target.tar.bz2", 09:31:30 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs-e10s", 09:31:30 INFO - "repository": "https://hg.mozilla.org/mozilla-central/", 09:31:30 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central pgo talos dromaeojs-e10s", 09:31:30 INFO - "stage_platform": "linux64-pgo", 09:31:30 INFO - "basedir": "/builds/slave/test", 09:31:30 INFO - "buildnumber": 9, 09:31:30 INFO - "platform": "ubuntu64_hw", 09:31:30 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 09:31:30 INFO - "slavebuilddir": "test", 09:31:30 INFO - "taskId": "a8irLcinRFmVBeKpP5C-pA", 09:31:30 INFO - "branch": "mozilla-central", 09:31:30 INFO - "script_repo_revision": "production", 09:31:30 INFO - "revision": "981da978f1f686ad024fa958c9d27d2f8acc5ad0", 09:31:30 INFO - "slavename": "talos-linux64-ix-067", 09:31:30 INFO - "repo_path": "mozilla-central" 09:31:30 INFO - } 09:31:30 INFO - Finding installer, test and symbols from parent task. 09:31:30 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/a8irLcinRFmVBeKpP5C-pA'}, attempt #1 09:31:30 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/a8irLcinRFmVBeKpP5C-pA'}, attempt #1 09:31:31 INFO - Task dependencies: IMrkpCVbT4CboiWlPBweYQ 09:31:31 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/IMrkpCVbT4CboiWlPBweYQ'}, attempt #1 09:31:31 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/IMrkpCVbT4CboiWlPBweYQ/artifacts/public/build/target.tar.bz2 09:31:31 INFO - Set test_url: https://queue.taskcluster.net/v1/task/IMrkpCVbT4CboiWlPBweYQ/artifacts/public/build/test_packages.json 09:31:31 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/IMrkpCVbT4CboiWlPBweYQ/artifacts/public/build/target.crashreporter-symbols.zip 09:31:31 INFO - Running post-action listener: _resource_record_post_action 09:31:31 INFO - [mozharness: 2017-06-11 16:31:31.468200Z] Finished read-buildbot-config step (success) 09:31:31 INFO - [mozharness: 2017-06-11 16:31:31.468421Z] Running download-and-extract step. 09:31:31 INFO - Running pre-action listener: _resource_record_pre_action 09:31:31 INFO - Running main action method: download_and_extract 09:31:31 INFO - mkdir: /builds/slave/test/build/tests 09:31:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:31:31 INFO - trying https://queue.taskcluster.net/v1/task/IMrkpCVbT4CboiWlPBweYQ/artifacts/public/build/target.test_packages.json 09:31:31 INFO - Downloading https://queue.taskcluster.net/v1/task/IMrkpCVbT4CboiWlPBweYQ/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 09:31:31 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/IMrkpCVbT4CboiWlPBweYQ/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 09:31:32 INFO - Downloaded 989 bytes. 09:31:32 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 09:31:32 INFO - Using the following test package requirements: 09:31:32 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 09:31:32 INFO - u'common': [u'target.common.tests.zip'], 09:31:32 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 09:31:32 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 09:31:32 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 09:31:32 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 09:31:32 INFO - u'mozbase': [u'target.common.tests.zip'], 09:31:32 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 09:31:32 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 09:31:32 INFO - u'web-platform': [u'target.common.tests.zip', 09:31:32 INFO - u'target.web-platform.tests.tar.gz'], 09:31:32 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 09:31:32 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 09:31:32 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/IMrkpCVbT4CboiWlPBweYQ/artifacts/public/build/target.common.tests.zip 09:31:32 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/IMrkpCVbT4CboiWlPBweYQ/artifacts/public/build/target.common.tests.zip'}, attempt #1 09:31:32 INFO - Fetch https://queue.taskcluster.net/v1/task/IMrkpCVbT4CboiWlPBweYQ/artifacts/public/build/target.common.tests.zip into memory 09:31:33 INFO - Content-Length response header: 68482821 09:31:33 INFO - Bytes received: 68482821 09:31:44 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 09:31:44 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/IMrkpCVbT4CboiWlPBweYQ/artifacts/public/build/target.common.tests.zip 09:31:44 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/IMrkpCVbT4CboiWlPBweYQ/artifacts/public/build/target.common.tests.zip'}, attempt #1 09:31:44 INFO - Fetch https://queue.taskcluster.net/v1/task/IMrkpCVbT4CboiWlPBweYQ/artifacts/public/build/target.common.tests.zip into memory 09:31:45 INFO - Content-Length response header: 68482821 09:31:45 INFO - Bytes received: 68482821 09:31:57 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/IMrkpCVbT4CboiWlPBweYQ/artifacts/public/build/target.talos.tests.zip 09:31:57 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/IMrkpCVbT4CboiWlPBweYQ/artifacts/public/build/target.talos.tests.zip'}, attempt #1 09:31:57 INFO - Fetch https://queue.taskcluster.net/v1/task/IMrkpCVbT4CboiWlPBweYQ/artifacts/public/build/target.talos.tests.zip into memory 09:31:58 INFO - Content-Length response header: 14450010 09:31:58 INFO - Bytes received: 14450010 09:31:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:31:58 INFO - trying https://queue.taskcluster.net/v1/task/IMrkpCVbT4CboiWlPBweYQ/artifacts/public/build/target.tar.bz2 09:31:58 INFO - Downloading https://queue.taskcluster.net/v1/task/IMrkpCVbT4CboiWlPBweYQ/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 09:31:58 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/IMrkpCVbT4CboiWlPBweYQ/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 09:31:59 INFO - Downloaded 60349995 bytes. 09:31:59 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/IMrkpCVbT4CboiWlPBweYQ/artifacts/public/build/target.tar.bz2 09:31:59 INFO - mkdir: /builds/slave/test/properties 09:31:59 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 09:31:59 INFO - Writing to file /builds/slave/test/properties/build_url 09:31:59 INFO - Contents: 09:31:59 INFO - build_url:https://queue.taskcluster.net/v1/task/IMrkpCVbT4CboiWlPBweYQ/artifacts/public/build/target.tar.bz2 09:31:59 INFO - Running post-action listener: _resource_record_post_action 09:31:59 INFO - Running post-action listener: set_extra_try_arguments 09:31:59 INFO - [mozharness: 2017-06-11 16:31:59.519727Z] Finished download-and-extract step (success) 09:31:59 INFO - [mozharness: 2017-06-11 16:31:59.519824Z] Running populate-webroot step. 09:31:59 INFO - Running pre-action listener: _resource_record_pre_action 09:31:59 INFO - Running main action method: populate_webroot 09:31:59 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 09:31:59 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 09:31:59 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 09:31:59 INFO - '--tppagecycles', 09:31:59 INFO - '7'], 09:31:59 INFO - 'tests': ['tsvgm']}}, 09:31:59 INFO - 'suites': {'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 09:31:59 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 09:31:59 INFO - 'tests': ['dromaeo_css', 'kraken']}, 09:31:59 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 09:31:59 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 09:31:59 INFO - 'talos_options': ['--disable-e10s'], 09:31:59 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 09:31:59 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 09:31:59 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 09:31:59 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 09:31:59 INFO - 'talos_options': ['--disable-e10s'], 09:31:59 INFO - 'tests': ['damp', 'tps']}, 09:31:59 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 09:31:59 INFO - 'tests': ['damp', 'tps']}, 09:31:59 INFO - 'g3': {'talos_options': ['--disable-e10s'], 09:31:59 INFO - 'tests': ['dromaeo_dom']}, 09:31:59 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 09:31:59 INFO - 'g4': {'talos_options': ['--disable-e10s'], 09:31:59 INFO - 'tests': ['basic_compositor_video', 'glvideo']}, 09:31:59 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 09:31:59 INFO - 'g5-e10s': {'pagesets_name': 'tp5n.zip', 09:31:59 INFO - 'tests': ['ts_paint_webext', 'tp5o_webext']}, 09:31:59 INFO - 'other': {'talos_options': ['--disable-e10s'], 09:31:59 INFO - 'tests': ['a11yr', 09:31:59 INFO - 'ts_paint', 09:31:59 INFO - 'tpaint', 09:31:59 INFO - 'sessionrestore', 09:31:59 INFO - 'sessionrestore_no_auto_restore', 09:31:59 INFO - 'tabpaint']}, 09:31:59 INFO - 'other-e10s': {'tests': ['a11yr', 09:31:59 INFO - 'ts_paint', 09:31:59 INFO - 'tpaint', 09:31:59 INFO - 'sessionrestore', 09:31:59 INFO - 'sessionrestore_no_auto_restore', 09:31:59 INFO - 'tabpaint']}, 09:31:59 INFO - 'other-e10s_l64': {'tests': ['a11yr', 09:31:59 INFO - 'ts_paint', 09:31:59 INFO - 'tpaint', 09:31:59 INFO - 'sessionrestore', 09:31:59 INFO - 'sessionrestore_no_auto_restore', 09:31:59 INFO - 'tabpaint']}, 09:31:59 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 09:31:59 INFO - 'ts_paint', 09:31:59 INFO - 'tpaint', 09:31:59 INFO - 'sessionrestore', 09:31:59 INFO - 'sessionrestore_no_auto_restore', 09:31:59 INFO - 'tabpaint']}, 09:31:59 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 09:31:59 INFO - 'tests': ['a11yr', 09:31:59 INFO - 'ts_paint', 09:31:59 INFO - 'tpaint', 09:31:59 INFO - 'sessionrestore', 09:31:59 INFO - 'sessionrestore_no_auto_restore', 09:31:59 INFO - 'tabpaint']}, 09:31:59 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 09:31:59 INFO - 'tests': ['a11yr', 09:31:59 INFO - 'ts_paint', 09:31:59 INFO - 'tpaint', 09:31:59 INFO - 'sessionrestore', 09:31:59 INFO - 'sessionrestore_no_auto_restore', 09:31:59 INFO - 'tabpaint']}, 09:31:59 INFO - 'perf-reftest': {'tests': ['bloom_basic', 'bloom_basic_ref']}, 09:31:59 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic', 09:31:59 INFO - 'bloom_basic_ref']}, 09:31:59 INFO - 'quantum-pageload-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 09:31:59 INFO - 'talos_options': ['--mitmproxy', 09:31:59 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 09:31:59 INFO - '--firstNonBlankPaint'], 09:31:59 INFO - 'tests': ['quantum_pageload_google', 09:31:59 INFO - 'quantum_pageload_youtube', 09:31:59 INFO - 'quantum_pageload_amazon', 09:31:59 INFO - 'quantum_pageload_facebook']}, 09:31:59 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 09:31:59 INFO - 'tests': ['tsvgx', 09:31:59 INFO - 'tsvgr_opacity', 09:31:59 INFO - 'tart', 09:31:59 INFO - 'tscrollx', 09:31:59 INFO - 'cart', 09:31:59 INFO - 'tsvg_static']}, 09:31:59 INFO - 'svgr-e10s': {'tests': ['tsvgx', 09:31:59 INFO - 'tsvgr_opacity', 09:31:59 INFO - 'tart', 09:31:59 INFO - 'tscrollx', 09:31:59 INFO - 'cart', 09:31:59 INFO - 'tsvg_static']}, 09:31:59 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 09:31:59 INFO - 'talos_options': ['--disable-e10s'], 09:31:59 INFO - 'tests': ['tp5o']}, 09:31:59 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 09:31:59 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 09:31:59 INFO - 'talos_options': ['--disable-e10s', 09:31:59 INFO - '--xperf_path', 09:31:59 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 09:31:59 INFO - 'tests': ['tp5n']}, 09:31:59 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 09:31:59 INFO - 'talos_options': ['--xperf_path', 09:31:59 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 09:31:59 INFO - 'tests': ['tp5n']}}, 09:31:59 INFO - 'talos.zip': {'path': '', 09:31:59 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 09:31:59 INFO - Running post-action listener: _resource_record_post_action 09:31:59 INFO - [mozharness: 2017-06-11 16:31:59.534754Z] Finished populate-webroot step (success) 09:31:59 INFO - [mozharness: 2017-06-11 16:31:59.534843Z] Running create-virtualenv step. 09:31:59 INFO - Running pre-action listener: _resource_record_pre_action 09:31:59 INFO - Running main action method: create_virtualenv 09:31:59 INFO - Creating virtualenv /builds/slave/test/build/venv 09:31:59 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 09:31:59 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 09:31:59 INFO - Using partial env: {'VIRTUALENV_NO_DOWNLOAD': '1'} 09:31:59 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 09:31:59 INFO - Using real prefix '/usr' 09:31:59 INFO - New python executable in /builds/slave/test/build/venv/bin/python 09:32:00 INFO - Installing distribute.............................................................................................................................................................................................done. 09:32:02 INFO - Installing pip.................done. 09:32:02 INFO - Return code: 0 09:32:02 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 09:32:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 09:32:02 INFO - Reading from file tmpfile_stdout 09:32:02 INFO - Output received: 09:32:02 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 09:32:02 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 09:32:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:32:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:32:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:32:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:32:02 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x165b3b0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1835a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19d99a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19d7140>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19d7a40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19d7ed0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'e0e61f6f900f4dc42e3e8956000001ad-1497174785.535695-1174067972', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 09:32:02 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 09:32:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 09:32:02 INFO - Using env: {'DISPLAY': ':0', 09:32:02 INFO - 'HOME': '/home/cltbld', 09:32:02 INFO - 'LANG': 'en_US.UTF-8', 09:32:02 INFO - 'LANGUAGE': 'en_US:en', 09:32:02 INFO - 'LOGNAME': 'cltbld', 09:32:02 INFO - 'MAIL': '/var/mail/cltbld', 09:32:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:32:02 INFO - 'MOZ_NO_REMOTE': '1', 09:32:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:32:02 INFO - 'NO_EM_RESTART': '1', 09:32:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:32:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:32:02 INFO - 'PWD': '/builds/slave/test', 09:32:02 INFO - 'SHELL': '/bin/bash', 09:32:02 INFO - 'SHLVL': '1', 09:32:02 INFO - 'TERM': 'linux', 09:32:02 INFO - 'TMOUT': '86400', 09:32:02 INFO - 'USER': 'cltbld', 09:32:02 INFO - 'XDG_SESSION_COOKIE': 'e0e61f6f900f4dc42e3e8956000001ad-1497174785.535695-1174067972', 09:32:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:32:02 INFO - '_': '/tools/buildbot/bin/python'} 09:32:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:32:02 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 09:32:02 INFO - Cleaning up... 09:32:02 INFO - Return code: 0 09:32:02 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 09:32:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:32:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:32:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:32:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:32:02 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x165b3b0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1835a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19d99a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19d7140>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19d7a40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19d7ed0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'e0e61f6f900f4dc42e3e8956000001ad-1497174785.535695-1174067972', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 09:32:02 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 09:32:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 09:32:02 INFO - Using env: {'DISPLAY': ':0', 09:32:02 INFO - 'HOME': '/home/cltbld', 09:32:02 INFO - 'LANG': 'en_US.UTF-8', 09:32:02 INFO - 'LANGUAGE': 'en_US:en', 09:32:02 INFO - 'LOGNAME': 'cltbld', 09:32:02 INFO - 'MAIL': '/var/mail/cltbld', 09:32:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:32:02 INFO - 'MOZ_NO_REMOTE': '1', 09:32:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:32:02 INFO - 'NO_EM_RESTART': '1', 09:32:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:32:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:32:02 INFO - 'PWD': '/builds/slave/test', 09:32:02 INFO - 'SHELL': '/bin/bash', 09:32:02 INFO - 'SHLVL': '1', 09:32:02 INFO - 'TERM': 'linux', 09:32:02 INFO - 'TMOUT': '86400', 09:32:02 INFO - 'USER': 'cltbld', 09:32:02 INFO - 'XDG_SESSION_COOKIE': 'e0e61f6f900f4dc42e3e8956000001ad-1497174785.535695-1174067972', 09:32:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:32:02 INFO - '_': '/tools/buildbot/bin/python'} 09:32:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:32:02 INFO - Downloading/unpacking psutil>=3.1.1 09:32:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:32:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:32:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:32:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:32:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 09:32:03 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 09:32:03 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 09:32:03 INFO - Installing collected packages: psutil 09:32:03 INFO - Running setup.py install for psutil 09:32:04 INFO - building 'psutil._psutil_linux' extension 09:32:04 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 09:32:04 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 09:32:04 INFO - building 'psutil._psutil_posix' extension 09:32:04 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 09:32:04 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 09:32:04 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 09:32:04 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 09:32:04 INFO - Successfully installed psutil 09:32:04 INFO - Cleaning up... 09:32:04 INFO - Return code: 0 09:32:04 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 09:32:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:32:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:32:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:32:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:32:04 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x165b3b0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1835a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19d99a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19d7140>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19d7a40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19d7ed0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'e0e61f6f900f4dc42e3e8956000001ad-1497174785.535695-1174067972', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 09:32:04 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 09:32:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 09:32:04 INFO - Using env: {'DISPLAY': ':0', 09:32:04 INFO - 'HOME': '/home/cltbld', 09:32:04 INFO - 'LANG': 'en_US.UTF-8', 09:32:04 INFO - 'LANGUAGE': 'en_US:en', 09:32:04 INFO - 'LOGNAME': 'cltbld', 09:32:04 INFO - 'MAIL': '/var/mail/cltbld', 09:32:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:32:04 INFO - 'MOZ_NO_REMOTE': '1', 09:32:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:32:04 INFO - 'NO_EM_RESTART': '1', 09:32:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:32:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:32:04 INFO - 'PWD': '/builds/slave/test', 09:32:04 INFO - 'SHELL': '/bin/bash', 09:32:04 INFO - 'SHLVL': '1', 09:32:04 INFO - 'TERM': 'linux', 09:32:04 INFO - 'TMOUT': '86400', 09:32:04 INFO - 'USER': 'cltbld', 09:32:04 INFO - 'XDG_SESSION_COOKIE': 'e0e61f6f900f4dc42e3e8956000001ad-1497174785.535695-1174067972', 09:32:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:32:04 INFO - '_': '/tools/buildbot/bin/python'} 09:32:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:32:04 INFO - Downloading/unpacking mozsystemmonitor==0.3 09:32:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:32:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:32:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:32:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:32:05 INFO - Downloading mozsystemmonitor-0.3.tar.gz 09:32:05 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 09:32:05 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 09:32:05 INFO - Installing collected packages: mozsystemmonitor 09:32:05 INFO - Running setup.py install for mozsystemmonitor 09:32:05 INFO - Successfully installed mozsystemmonitor 09:32:05 INFO - Cleaning up... 09:32:05 INFO - Return code: 0 09:32:05 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 09:32:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:32:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:32:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:32:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:32:05 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x165b3b0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1835a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19d99a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19d7140>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19d7a40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19d7ed0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'e0e61f6f900f4dc42e3e8956000001ad-1497174785.535695-1174067972', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 09:32:05 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 09:32:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 09:32:05 INFO - Using env: {'DISPLAY': ':0', 09:32:05 INFO - 'HOME': '/home/cltbld', 09:32:05 INFO - 'LANG': 'en_US.UTF-8', 09:32:05 INFO - 'LANGUAGE': 'en_US:en', 09:32:05 INFO - 'LOGNAME': 'cltbld', 09:32:05 INFO - 'MAIL': '/var/mail/cltbld', 09:32:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:32:05 INFO - 'MOZ_NO_REMOTE': '1', 09:32:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:32:05 INFO - 'NO_EM_RESTART': '1', 09:32:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:32:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:32:05 INFO - 'PWD': '/builds/slave/test', 09:32:05 INFO - 'SHELL': '/bin/bash', 09:32:05 INFO - 'SHLVL': '1', 09:32:05 INFO - 'TERM': 'linux', 09:32:06 INFO - 'TMOUT': '86400', 09:32:06 INFO - 'USER': 'cltbld', 09:32:06 INFO - 'XDG_SESSION_COOKIE': 'e0e61f6f900f4dc42e3e8956000001ad-1497174785.535695-1174067972', 09:32:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:32:06 INFO - '_': '/tools/buildbot/bin/python'} 09:32:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:32:06 INFO - Downloading/unpacking jsonschema==2.5.1 09:32:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:32:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:32:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:32:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:32:07 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 09:32:07 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 09:32:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:32:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:32:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:32:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:32:07 INFO - Downloading functools32-3.2.3-2.tar.gz 09:32:07 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 09:32:07 INFO - warning: no files found matching '*.txt' 09:32:07 INFO - no previously-included directories found matching 'build' 09:32:07 INFO - no previously-included directories found matching 'dist' 09:32:07 INFO - no previously-included directories found matching '.git*' 09:32:07 INFO - Installing collected packages: jsonschema, functools32 09:32:07 INFO - Running setup.py install for functools32 09:32:07 INFO - warning: no files found matching '*.txt' 09:32:07 INFO - no previously-included directories found matching 'build' 09:32:07 INFO - no previously-included directories found matching 'dist' 09:32:07 INFO - no previously-included directories found matching '.git*' 09:32:07 INFO - Successfully installed jsonschema functools32 09:32:07 INFO - Cleaning up... 09:32:07 INFO - Return code: 0 09:32:07 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 09:32:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:32:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:32:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:32:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:32:07 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x165b3b0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1835a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19d99a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19d7140>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19d7a40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19d7ed0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'e0e61f6f900f4dc42e3e8956000001ad-1497174785.535695-1174067972', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 09:32:07 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 09:32:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 09:32:07 INFO - Using env: {'DISPLAY': ':0', 09:32:07 INFO - 'HOME': '/home/cltbld', 09:32:07 INFO - 'LANG': 'en_US.UTF-8', 09:32:07 INFO - 'LANGUAGE': 'en_US:en', 09:32:07 INFO - 'LOGNAME': 'cltbld', 09:32:07 INFO - 'MAIL': '/var/mail/cltbld', 09:32:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:32:07 INFO - 'MOZ_NO_REMOTE': '1', 09:32:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:32:07 INFO - 'NO_EM_RESTART': '1', 09:32:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:32:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:32:07 INFO - 'PWD': '/builds/slave/test', 09:32:07 INFO - 'SHELL': '/bin/bash', 09:32:07 INFO - 'SHLVL': '1', 09:32:07 INFO - 'TERM': 'linux', 09:32:07 INFO - 'TMOUT': '86400', 09:32:07 INFO - 'USER': 'cltbld', 09:32:07 INFO - 'XDG_SESSION_COOKIE': 'e0e61f6f900f4dc42e3e8956000001ad-1497174785.535695-1174067972', 09:32:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:32:07 INFO - '_': '/tools/buildbot/bin/python'} 09:32:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:32:07 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 09:32:07 INFO - Cleaning up... 09:32:07 INFO - Return code: 0 09:32:07 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 09:32:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:32:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:32:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:32:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:32:07 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x165b3b0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1835a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19d99a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19d7140>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19d7a40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19d7ed0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'e0e61f6f900f4dc42e3e8956000001ad-1497174785.535695-1174067972', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 09:32:07 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 09:32:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 09:32:07 INFO - Using env: {'DISPLAY': ':0', 09:32:07 INFO - 'HOME': '/home/cltbld', 09:32:07 INFO - 'LANG': 'en_US.UTF-8', 09:32:07 INFO - 'LANGUAGE': 'en_US:en', 09:32:07 INFO - 'LOGNAME': 'cltbld', 09:32:07 INFO - 'MAIL': '/var/mail/cltbld', 09:32:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:32:07 INFO - 'MOZ_NO_REMOTE': '1', 09:32:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:32:07 INFO - 'NO_EM_RESTART': '1', 09:32:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:32:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:32:07 INFO - 'PWD': '/builds/slave/test', 09:32:07 INFO - 'SHELL': '/bin/bash', 09:32:07 INFO - 'SHLVL': '1', 09:32:07 INFO - 'TERM': 'linux', 09:32:07 INFO - 'TMOUT': '86400', 09:32:07 INFO - 'USER': 'cltbld', 09:32:07 INFO - 'XDG_SESSION_COOKIE': 'e0e61f6f900f4dc42e3e8956000001ad-1497174785.535695-1174067972', 09:32:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:32:07 INFO - '_': '/tools/buildbot/bin/python'} 09:32:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:32:08 INFO - Downloading/unpacking blobuploader==1.2.4 09:32:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:32:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:32:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:32:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:32:09 INFO - Downloading blobuploader-1.2.4.tar.gz 09:32:09 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 09:32:09 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 09:32:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:32:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:32:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:32:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:32:09 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 09:32:09 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 09:32:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:32:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:32:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:32:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:32:09 INFO - Downloading docopt-0.6.1.tar.gz 09:32:09 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 09:32:09 INFO - Installing collected packages: blobuploader, requests, docopt 09:32:09 INFO - Running setup.py install for blobuploader 09:32:09 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 09:32:09 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 09:32:09 INFO - Running setup.py install for requests 09:32:10 INFO - Running setup.py install for docopt 09:32:10 INFO - Successfully installed blobuploader requests docopt 09:32:10 INFO - Cleaning up... 09:32:10 INFO - Return code: 0 09:32:10 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:32:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:32:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:32:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:32:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:32:10 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x165b3b0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1835a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19d99a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19d7140>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19d7a40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19d7ed0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'e0e61f6f900f4dc42e3e8956000001ad-1497174785.535695-1174067972', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 09:32:10 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 09:32:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 09:32:10 INFO - Using env: {'DISPLAY': ':0', 09:32:10 INFO - 'HOME': '/home/cltbld', 09:32:10 INFO - 'LANG': 'en_US.UTF-8', 09:32:10 INFO - 'LANGUAGE': 'en_US:en', 09:32:10 INFO - 'LOGNAME': 'cltbld', 09:32:10 INFO - 'MAIL': '/var/mail/cltbld', 09:32:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:32:10 INFO - 'MOZ_NO_REMOTE': '1', 09:32:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:32:10 INFO - 'NO_EM_RESTART': '1', 09:32:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:32:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:32:10 INFO - 'PWD': '/builds/slave/test', 09:32:10 INFO - 'SHELL': '/bin/bash', 09:32:10 INFO - 'SHLVL': '1', 09:32:10 INFO - 'TERM': 'linux', 09:32:10 INFO - 'TMOUT': '86400', 09:32:10 INFO - 'USER': 'cltbld', 09:32:10 INFO - 'XDG_SESSION_COOKIE': 'e0e61f6f900f4dc42e3e8956000001ad-1497174785.535695-1174067972', 09:32:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:32:10 INFO - '_': '/tools/buildbot/bin/python'} 09:32:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:32:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 09:32:10 INFO - Running setup.py (path:/tmp/pip-R5sbzg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 09:32:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 09:32:10 INFO - Running setup.py (path:/tmp/pip-EDoJM7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 09:32:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 09:32:10 INFO - Running setup.py (path:/tmp/pip-3jmsA5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 09:32:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 09:32:10 INFO - Running setup.py (path:/tmp/pip-F72OYC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 09:32:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 09:32:10 INFO - Running setup.py (path:/tmp/pip-EV0vgW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 09:32:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 09:32:10 INFO - Running setup.py (path:/tmp/pip-okRTpj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 09:32:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 09:32:11 INFO - Running setup.py (path:/tmp/pip-QmdOj_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 09:32:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 09:32:11 INFO - Running setup.py (path:/tmp/pip-6ltYTi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 09:32:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 09:32:11 INFO - Running setup.py (path:/tmp/pip-bRNDNh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 09:32:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 09:32:11 INFO - Running setup.py (path:/tmp/pip-k5gXdF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 09:32:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 09:32:11 INFO - Running setup.py (path:/tmp/pip-i4TFSe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 09:32:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 09:32:11 INFO - Running setup.py (path:/tmp/pip-Spn7Do-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 09:32:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 09:32:11 INFO - Running setup.py (path:/tmp/pip-EKRlgM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 09:32:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 09:32:11 INFO - Running setup.py (path:/tmp/pip-3Tt8u7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 09:32:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 09:32:11 INFO - Running setup.py (path:/tmp/pip-TJMF3e-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 09:32:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 09:32:11 INFO - Running setup.py (path:/tmp/pip-dbt40z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 09:32:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 09:32:11 INFO - Running setup.py (path:/tmp/pip-Q4mhn2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 09:32:11 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 09:32:11 INFO - Running setup.py install for manifestparser 09:32:11 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 09:32:11 INFO - Running setup.py install for mozcrash 09:32:12 INFO - Running setup.py install for mozdebug 09:32:12 INFO - Running setup.py install for mozdevice 09:32:12 INFO - Installing dm script to /builds/slave/test/build/venv/bin 09:32:12 INFO - Running setup.py install for mozfile 09:32:12 INFO - Running setup.py install for mozhttpd 09:32:12 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 09:32:12 INFO - Running setup.py install for mozinfo 09:32:12 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 09:32:12 INFO - Running setup.py install for mozInstall 09:32:12 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 09:32:12 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 09:32:12 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 09:32:12 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 09:32:12 INFO - Running setup.py install for mozleak 09:32:12 INFO - Running setup.py install for mozlog 09:32:12 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 09:32:12 INFO - Running setup.py install for moznetwork 09:32:12 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 09:32:12 INFO - Running setup.py install for mozprocess 09:32:13 INFO - Running setup.py install for mozprofile 09:32:13 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 09:32:13 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 09:32:13 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 09:32:13 INFO - Running setup.py install for mozrunner 09:32:13 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 09:32:13 INFO - Running setup.py install for mozscreenshot 09:32:13 INFO - Running setup.py install for moztest 09:32:13 INFO - Running setup.py install for mozversion 09:32:13 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 09:32:13 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 09:32:13 INFO - Cleaning up... 09:32:13 INFO - Return code: 0 09:32:13 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:32:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:32:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:32:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:32:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:32:13 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x165b3b0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1835a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19d99a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19d7140>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19d7a40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19d7ed0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'e0e61f6f900f4dc42e3e8956000001ad-1497174785.535695-1174067972', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 09:32:13 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 09:32:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 09:32:13 INFO - Using env: {'DISPLAY': ':0', 09:32:13 INFO - 'HOME': '/home/cltbld', 09:32:13 INFO - 'LANG': 'en_US.UTF-8', 09:32:13 INFO - 'LANGUAGE': 'en_US:en', 09:32:13 INFO - 'LOGNAME': 'cltbld', 09:32:13 INFO - 'MAIL': '/var/mail/cltbld', 09:32:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:32:13 INFO - 'MOZ_NO_REMOTE': '1', 09:32:13 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:32:13 INFO - 'NO_EM_RESTART': '1', 09:32:13 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:32:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:32:13 INFO - 'PWD': '/builds/slave/test', 09:32:13 INFO - 'SHELL': '/bin/bash', 09:32:13 INFO - 'SHLVL': '1', 09:32:13 INFO - 'TERM': 'linux', 09:32:13 INFO - 'TMOUT': '86400', 09:32:13 INFO - 'USER': 'cltbld', 09:32:13 INFO - 'XDG_SESSION_COOKIE': 'e0e61f6f900f4dc42e3e8956000001ad-1497174785.535695-1174067972', 09:32:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:32:13 INFO - '_': '/tools/buildbot/bin/python'} 09:32:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:32:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 09:32:13 INFO - Running setup.py (path:/tmp/pip-pbtJGO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 09:32:13 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 09:32:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 09:32:13 INFO - Running setup.py (path:/tmp/pip-JHf0GR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 09:32:13 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 09:32:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 09:32:13 INFO - Running setup.py (path:/tmp/pip-4bqZCK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 09:32:14 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 09:32:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 09:32:14 INFO - Running setup.py (path:/tmp/pip-_fGe9Y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 09:32:14 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.51 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 09:32:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 09:32:14 INFO - Running setup.py (path:/tmp/pip-RTNVMw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 09:32:14 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 09:32:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 09:32:14 INFO - Running setup.py (path:/tmp/pip-scZkGg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 09:32:14 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 09:32:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 09:32:14 INFO - Running setup.py (path:/tmp/pip-qRCJUg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 09:32:14 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.10 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 09:32:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 09:32:14 INFO - Running setup.py (path:/tmp/pip-7z8hNy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 09:32:14 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.13 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 09:32:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 09:32:14 INFO - Running setup.py (path:/tmp/pip-z9jYSr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 09:32:14 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 09:32:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 09:32:14 INFO - Running setup.py (path:/tmp/pip-YBGOLn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 09:32:14 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 09:32:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 09:32:14 INFO - Running setup.py (path:/tmp/pip-jZwSSO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 09:32:14 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 09:32:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 09:32:14 INFO - Running setup.py (path:/tmp/pip-6Tbbd0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 09:32:14 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.25 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 09:32:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 09:32:14 INFO - Running setup.py (path:/tmp/pip-vKyb84-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 09:32:14 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 09:32:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 09:32:14 INFO - Running setup.py (path:/tmp/pip-7cVp8l-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 09:32:14 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 09:32:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 09:32:14 INFO - Running setup.py (path:/tmp/pip-F0YWzn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 09:32:14 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 09:32:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 09:32:14 INFO - Running setup.py (path:/tmp/pip-fd4eud-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 09:32:14 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 09:32:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 09:32:14 INFO - Running setup.py (path:/tmp/pip-TJKEWb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 09:32:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 09:32:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 09:32:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 09:32:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 09:32:15 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.51->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 09:32:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.51->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 09:32:15 INFO - Requirement already satisfied (use --upgrade to upgrade): requests in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozInstall==1.13->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 09:32:15 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 09:32:15 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:32:15 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:32:15 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:32:15 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:32:16 INFO - Downloading blessings-1.6.tar.gz 09:32:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 09:32:16 INFO - Installing collected packages: blessings 09:32:16 INFO - Running setup.py install for blessings 09:32:16 INFO - Successfully installed blessings 09:32:16 INFO - Cleaning up... 09:32:16 INFO - Return code: 0 09:32:16 INFO - Done creating virtualenv /builds/slave/test/build/venv. 09:32:16 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 09:32:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 09:32:16 INFO - Reading from file tmpfile_stdout 09:32:16 INFO - Current package versions: 09:32:16 INFO - argparse == 1.2.1 09:32:16 INFO - blessings == 1.6 09:32:16 INFO - blobuploader == 1.2.4 09:32:16 INFO - docopt == 0.6.1 09:32:16 INFO - functools32 == 3.2.3-2 09:32:16 INFO - jsonschema == 2.5.1 09:32:16 INFO - manifestparser == 1.1 09:32:16 INFO - mozInstall == 1.13 09:32:16 INFO - mozcrash == 1.0 09:32:16 INFO - mozdebug == 0.1 09:32:16 INFO - mozdevice == 0.51 09:32:16 INFO - mozfile == 1.2 09:32:16 INFO - mozhttpd == 0.7 09:32:16 INFO - mozinfo == 0.10 09:32:16 INFO - mozleak == 0.1 09:32:16 INFO - mozlog == 3.4 09:32:16 INFO - moznetwork == 0.27 09:32:16 INFO - mozprocess == 0.25 09:32:16 INFO - mozprofile == 0.28 09:32:16 INFO - mozrunner == 6.13 09:32:16 INFO - mozscreenshot == 0.1 09:32:16 INFO - mozsystemmonitor == 0.3 09:32:16 INFO - moztest == 0.8 09:32:16 INFO - mozversion == 1.4 09:32:16 INFO - psutil == 3.1.1 09:32:16 INFO - requests == 1.2.3 09:32:16 INFO - wsgiref == 0.1.2 09:32:16 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:32:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:32:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:32:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:32:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:32:16 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x165b3b0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1835a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19d99a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19d7140>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19d7a40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19d7ed0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'e0e61f6f900f4dc42e3e8956000001ad-1497174785.535695-1174067972', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 09:32:16 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 09:32:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 09:32:16 INFO - Using env: {'DISPLAY': ':0', 09:32:16 INFO - 'HOME': '/home/cltbld', 09:32:16 INFO - 'LANG': 'en_US.UTF-8', 09:32:16 INFO - 'LANGUAGE': 'en_US:en', 09:32:16 INFO - 'LOGNAME': 'cltbld', 09:32:16 INFO - 'MAIL': '/var/mail/cltbld', 09:32:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:32:16 INFO - 'MOZ_NO_REMOTE': '1', 09:32:16 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:32:16 INFO - 'NO_EM_RESTART': '1', 09:32:16 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:32:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:32:16 INFO - 'PWD': '/builds/slave/test', 09:32:16 INFO - 'SHELL': '/bin/bash', 09:32:16 INFO - 'SHLVL': '1', 09:32:16 INFO - 'TERM': 'linux', 09:32:16 INFO - 'TMOUT': '86400', 09:32:16 INFO - 'USER': 'cltbld', 09:32:16 INFO - 'XDG_SESSION_COOKIE': 'e0e61f6f900f4dc42e3e8956000001ad-1497174785.535695-1174067972', 09:32:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:32:16 INFO - '_': '/tools/buildbot/bin/python'} 09:32:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:32:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 09:32:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 09:32:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 09:32:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 09:32:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 09:32:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 09:32:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 09:32:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 09:32:16 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 09:32:16 INFO - Downloading/unpacking marionette-driver>=1.4.0 (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 09:32:16 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:32:16 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:32:16 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:32:16 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:32:17 INFO - Downloading marionette_driver-1.4.0.tar.gz 09:32:17 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/marionette-driver/setup.py) egg_info for package marionette-driver 09:32:17 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 09:32:17 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 09:32:17 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner>=6.9 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from marionette-driver>=1.4.0->-r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 09:32:17 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice>=0.37 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozrunner>=6.9->marionette-driver>=1.4.0->-r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 09:32:17 INFO - Installing collected packages: marionette-driver 09:32:17 INFO - Running setup.py install for marionette-driver 09:32:18 INFO - Successfully installed marionette-driver 09:32:18 INFO - Cleaning up... 09:32:18 INFO - Return code: 0 09:32:18 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 09:32:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:32:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:32:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:32:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:32:18 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x165b3b0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1835a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19d99a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19d7140>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19d7a40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19d7ed0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'e0e61f6f900f4dc42e3e8956000001ad-1497174785.535695-1174067972', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 09:32:18 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 09:32:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 09:32:18 INFO - Using env: {'DISPLAY': ':0', 09:32:18 INFO - 'HOME': '/home/cltbld', 09:32:18 INFO - 'LANG': 'en_US.UTF-8', 09:32:18 INFO - 'LANGUAGE': 'en_US:en', 09:32:18 INFO - 'LOGNAME': 'cltbld', 09:32:18 INFO - 'MAIL': '/var/mail/cltbld', 09:32:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:32:18 INFO - 'MOZ_NO_REMOTE': '1', 09:32:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:32:18 INFO - 'NO_EM_RESTART': '1', 09:32:18 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:32:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:32:18 INFO - 'PWD': '/builds/slave/test', 09:32:18 INFO - 'SHELL': '/bin/bash', 09:32:18 INFO - 'SHLVL': '1', 09:32:18 INFO - 'TERM': 'linux', 09:32:18 INFO - 'TMOUT': '86400', 09:32:18 INFO - 'USER': 'cltbld', 09:32:18 INFO - 'XDG_SESSION_COOKIE': 'e0e61f6f900f4dc42e3e8956000001ad-1497174785.535695-1174067972', 09:32:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:32:18 INFO - '_': '/tools/buildbot/bin/python'} 09:32:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:32:18 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 09:32:18 INFO - Cleaning up... 09:32:18 INFO - Return code: 0 09:32:18 INFO - Running post-action listener: _resource_record_post_action 09:32:18 INFO - Running post-action listener: _start_resource_monitoring 09:32:18 INFO - Starting resource monitoring. 09:32:18 INFO - [mozharness: 2017-06-11 16:32:18.382142Z] Finished create-virtualenv step (success) 09:32:18 INFO - [mozharness: 2017-06-11 16:32:18.382589Z] Running install step. 09:32:18 INFO - Running pre-action listener: _resource_record_pre_action 09:32:18 INFO - Running main action method: install 09:32:18 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 09:32:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 09:32:18 INFO - Reading from file tmpfile_stdout 09:32:18 INFO - Detecting whether we're running mozinstall >=1.0... 09:32:18 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 09:32:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 09:32:18 INFO - Reading from file tmpfile_stdout 09:32:18 INFO - Output received: 09:32:18 INFO - Usage: mozinstall [options] installer 09:32:18 INFO - Options: 09:32:18 INFO - -h, --help show this help message and exit 09:32:18 INFO - -d DEST, --destination=DEST 09:32:18 INFO - Directory to install application into. [default: 09:32:18 INFO - "/builds/slave/test"] 09:32:18 INFO - --app=APP Application being installed. [default: firefox] 09:32:18 INFO - mkdir: /builds/slave/test/build/application 09:32:18 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/target.tar.bz2', '--destination', '/builds/slave/test/build/application'] 09:32:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 09:32:35 INFO - Reading from file tmpfile_stdout 09:32:35 INFO - Output received: 09:32:35 INFO - /builds/slave/test/build/application/firefox/firefox 09:32:35 INFO - Running post-action listener: _resource_record_post_action 09:32:35 INFO - [mozharness: 2017-06-11 16:32:35.783647Z] Finished install step (success) 09:32:35 INFO - [mozharness: 2017-06-11 16:32:35.783925Z] Running setup-mitmproxy step. 09:32:35 INFO - Running pre-action listener: _resource_record_pre_action 09:32:35 INFO - Running main action method: setup_mitmproxy 09:32:35 INFO - Skipping: mitmproxy is not required 09:32:35 INFO - Running post-action listener: _resource_record_post_action 09:32:35 INFO - [mozharness: 2017-06-11 16:32:35.785082Z] Finished setup-mitmproxy step (success) 09:32:35 INFO - [mozharness: 2017-06-11 16:32:35.785307Z] Running run-tests step. 09:32:35 INFO - Running pre-action listener: _resource_record_pre_action 09:32:35 INFO - Running main action method: run_tests 09:32:35 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 09:32:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 09:32:35 INFO - Python 2.7.3 09:32:35 INFO - Return code: 0 09:32:35 INFO - grabbing minidump binary from tooltool 09:32:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:32:35 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19d7140>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19d7a40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19d7ed0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 09:32:35 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 09:32:35 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 09:32:35 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 09:32:35 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 09:32:35 INFO - Return code: 0 09:32:35 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 09:32:35 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 09:32:35 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 09:32:35 INFO - ENV: RUST_BACKTRACE is now 1 09:32:35 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 09:32:35 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 09:32:35 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/IMrkpCVbT4CboiWlPBweYQ/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-067', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 09:32:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/IMrkpCVbT4CboiWlPBweYQ/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-067 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 09:32:35 INFO - Using env: {'DISPLAY': ':0', 09:32:35 INFO - 'HOME': '/home/cltbld', 09:32:35 INFO - 'LANG': 'en_US.UTF-8', 09:32:35 INFO - 'LANGUAGE': 'en_US:en', 09:32:35 INFO - 'LOGNAME': 'cltbld', 09:32:35 INFO - 'MAIL': '/var/mail/cltbld', 09:32:35 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 09:32:35 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 09:32:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:32:35 INFO - 'MOZ_NO_REMOTE': '1', 09:32:35 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 09:32:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:32:35 INFO - 'NO_EM_RESTART': '1', 09:32:35 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:32:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:32:35 INFO - 'PWD': '/builds/slave/test', 09:32:35 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 09:32:35 INFO - 'RUST_BACKTRACE': '1', 09:32:35 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 09:32:35 INFO - 'SHELL': '/bin/bash', 09:32:35 INFO - 'SHLVL': '1', 09:32:35 INFO - 'TERM': 'linux', 09:32:35 INFO - 'TMOUT': '86400', 09:32:35 INFO - 'USER': 'cltbld', 09:32:35 INFO - 'XDG_SESSION_COOKIE': 'e0e61f6f900f4dc42e3e8956000001ad-1497174785.535695-1174067972', 09:32:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:32:35 INFO - '_': '/tools/buildbot/bin/python'} 09:32:35 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/IMrkpCVbT4CboiWlPBweYQ/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-067', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 09:32:36 INFO - mozversion application_buildid: 20170611153143 09:32:36 INFO - mozversion application_changeset: 981da978f1f686ad024fa958c9d27d2f8acc5ad0 09:32:36 INFO - mozversion application_display_name: Nightly 09:32:36 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 09:32:36 INFO - mozversion application_name: Firefox 09:32:36 INFO - mozversion application_remotingname: firefox 09:32:36 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 09:32:36 INFO - mozversion application_vendor: Mozilla 09:32:36 INFO - mozversion application_version: 55.0a1 09:32:36 INFO - mozversion platform_buildid: 20170611153143 09:32:36 INFO - mozversion platform_changeset: 981da978f1f686ad024fa958c9d27d2f8acc5ad0 09:32:36 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 09:32:36 INFO - mozversion platform_version: 55.0a1 09:32:36 INFO - using testdate: 1497198756 09:32:36 INFO - actual date: 1497198756 09:32:36 INFO - starting webserver on 'localhost:60432' 09:32:36 INFO - SUITE-START | Running 2 tests 09:32:36 INFO - TEST-START | dromaeo_css 09:32:36 INFO - operating with platform_type : linux_ 09:32:36 INFO - Initialising browser for dromaeo_css test... 09:32:36 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:60432/getInfo.html -profile /tmp/tmp9CleBo/profile 09:32:36 INFO - TEST-INFO | started process 11031 (/builds/slave/test/build/application/firefox/firefox http://localhost:60432/getInfo.html) 09:33:10 INFO - TEST-INFO | 11031: killed by SIGTERM 09:33:10 INFO - Browser initialized. 09:33:10 INFO - Running cycle 1/1 for dromaeo_css test... 09:33:10 INFO - TEST-INFO | started process 11240 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp9CleBo/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 09:33:21 INFO - PID 11240 | RSS: Main: 178081792 09:33:21 INFO - PID 11240 | 09:36:23 INFO - PID 11240 | Cycle 1(1): loaded http://localhost:60432/tests/dromaeo/cssquery-dojo.html (next: http://localhost:60432/tests/dromaeo/cssquery-ext.html) 09:36:25 INFO - PID 11240 | RSS: Main: 177963008 09:36:25 INFO - PID 11240 | 09:39:26 INFO - PID 11240 | Cycle 1(1): loaded http://localhost:60432/tests/dromaeo/cssquery-ext.html (next: http://localhost:60432/tests/dromaeo/cssquery-jquery.html) 09:39:27 INFO - PID 11240 | RSS: Main: 178163712 09:39:27 INFO - PID 11240 | 09:42:29 INFO - PID 11240 | Cycle 1(1): loaded http://localhost:60432/tests/dromaeo/cssquery-jquery.html (next: http://localhost:60432/tests/dromaeo/cssquery-mootools.html) 09:42:29 INFO - PID 11240 | RSS: Main: 178171904 09:42:29 INFO - PID 11240 | 09:45:31 INFO - PID 11240 | Cycle 1(1): loaded http://localhost:60432/tests/dromaeo/cssquery-mootools.html (next: http://localhost:60432/tests/dromaeo/cssquery-prototype.html) 09:45:32 INFO - PID 11240 | RSS: Main: 177795072 09:45:32 INFO - PID 11240 | 09:48:34 INFO - PID 11240 | Cycle 1(1): loaded http://localhost:60432/tests/dromaeo/cssquery-prototype.html (next: http://localhost:60432/tests/dromaeo/cssquery-yui.html) 09:48:35 INFO - PID 11240 | RSS: Main: 180854784 09:48:35 INFO - PID 11240 | 09:51:37 INFO - PID 11240 | Cycle 1(1): loaded http://localhost:60432/tests/dromaeo/cssquery-yui.html (next: http://localhost:60432/tests/dromaeo/cssquery-dojo.html) 09:51:37 INFO - PID 11240 | RSS: Main: 177807360 09:51:37 INFO - PID 11240 | 09:51:37 INFO - PID 11240 | __start_tp_report 09:51:37 INFO - PID 11240 | _x_x_mozilla_page_load 09:51:37 INFO - PID 11240 | _x_x_mozilla_page_load_details 09:51:37 INFO - PID 11240 | |i|pagename|runs| 09:51:37 INFO - PID 11240 | |0;dojo.html;3336.549565808615;3372.494125881119;3378.273671160701;3397.60927493338;3462.0652423845563;6065.514758819295;6093.207882975213;6114.480269177114;6137.048757442592;6139.416755408229;6027.216461859952;6038.426349496802;6043.969780151093;6051.273847138338;6061.605995610283;5282.709450980195;5282.973585132069;5339.172428273624;5342.946570534284;5346.812861549846;5322.973385133069;5386.78452861885;5386.91919621206;5392.595555333366;5394.236432057968;5378.489043540857;5425.565954723613;5436.130219164915;5467.781288748445;5479.04116779566;5390.5418039466695;5390.946090539122;5395.379531353866;5421.783128674848;5427.782888684448;5341.973290133525;5347.6256662033675;5351.759170837322;5356.9732151339385;5374.328208973879;5882;5971.373005834368;6014;6084.878302433926;6095.573309868311;6417.647029413381;6573.408393244631;6633.104530888317;6647.66761661915;6657.667116644148;6654.035164901111;6684.598924064571;6687.699053542602;6707.899381509281;6713.630750308731;6154.815355539341;6173.98129308659;6189.6286222826775;6192.845178870564;6214.8135555933395;6605.207375114921;6693.799186024427;6705.430038446689;6707.5975441473665;6836.282190370039;6405.327440618761;6418.293987661354;6467.223933128054;6489.2212934447225;6496.967515162394;6552.246491653521;6583.572067815577;6607.339266073451;6623.933760662428;6639.336066393322;6568.408843204134;6621.172353455818;6622.8344291393105;6629.436497897636;6635.2037755469655;6426.485881129498;6559.212894452697;6632.43624291931;6633.9668301658185;6659.500537459709;4953.0589188054155;4967.552920237196;4983.377077865267;4997.25041243809;5020.021095886267;4387.692861499728;4390.05613793036;4390.297552391666;4437.733735975852;4444.911101777946;6121.632702037892;6127.356627554132;6132.202813634199;6133.233345831771;6137.263528376623;6518.641474718841;6567.704453299613;6572.967135164389;6582.901256481156;6586.341365863375;6022.909656355158;6082.90875636857;6087.908681369783;6105.877882442415;6128.050152226412;5607.49532542065;5613.129964855454;5616.522595579421;5618.831435056954;5624.0439125348785;6834.965825170842;6904.758333458506;6907.965460172667;6908.5509441886115;6916.619585922823;6675.632840193836;6705.1283333166375;6705.228898676714;6707.3628005339415;6721.260661327152;6646.60120392778;6757.222919364336;6893.03497510359;6908.171019477695;6918.411934985381;6368.808935731936;6433.228012638513;6449.677516124269;6472.15861937945;6491.870162596816;6565.868682626417;6681.465482761465;6690.330966903465;6705.798826035227;6714.597124172566;6476.805695829133;6489.513286503437;6507.414332710079;6516.771912983023;6527.608343499405;6266.091416744455;6355.618662880242;6472.805815825533;6492.5455218134275;6493.902591461227;6295.653739044214;6308.52686048539;6328.208973878265;6344.143540621957;6382.074599183;6424.518161138027;6483.643399612878;6496.545241833026;6496.798092352929;6518.706658200487;6280.654563999024;6358.1734374531015;6369.394907483782;6369.9044514333245;6388 09:51:37 INFO - PID 11240 | |1;ext.html;788.3614272439324;802.9558374289412;834.4492634860993;848.0163010907348;861.4874149880819;37915.24169516608;39295.80352098236;39329.41005884907;39351.80324098383;39362.40956385653;34242.8287858561;34352;38451.80774096125;38646.806765966205;38887.22225555487;7012.684429200685;7094.85810283794;7099.645017749118;7101.360877521022;7106.85786284274;6941.757038503653;7025.121859767529;7045.788626341218;7077.796774548339;7083.574985500861;7012.684429200673;7032.0506731591095;7047.85904281914;7086.07880975475;7096.574205547684;7020.929790702105;7045.612491312976;7085.574865508061;7092.184398794101;7096.822579435504;7010.474214433887;7032.859342813166;7036.40190583801;7049.189343225544;7054.118235220598;37125.628743712485;37535.06162345936;37541.24917501662;37647.4352884707;37744.24511509755;3494.405950988338;3531.099569609759;3532.04634748619;3533.169705119295;3533.7349698772437;29148.70851291481;29217.123486295444;29218.269543261376;29261.707382926324;29350.41299174026;3494.4408894577;3525.189206482498;3535.646435356444;3541.94687079694;3589.6410358964154;192095;192914;193635;194121.99999999857;194253;45768.313475297895;46703.766481167375;46890.53109468862;46919.296210556866;47027.29459058117;48954.51045489571;49477.257841132414;49581;49668.75165624221;49708.50291497111;14827.481038163613;14896.553103406915;14942.925285373722;14958.252087395587;14982.775258371134;12066.336351500577;12069.879301207051;12079.3356365399;12113.939430302968;12115.15193936416;12899.677508062374;13251.469941202437;13292.401841917137;13349.46602135923;13371.53199638008;4833.709977401367;4852.975735121302;4953.90092198154;4964.751762411865;5006.073876332817;922.9538523073819;925.5973651461636;951.4481600671594;987.8863930647924;990.0643891522442;22150.55698886013;22663.433414164447;22754.31737047891;22942.65586016211;23251.7674823253;1025.738436698652;1044.5769463367349;1055.2244100586063;1060.6923992042375;1067.7330667333167;11445.427728613537;11803.468843902045;12030.699232519082;12036.074228123458;12100.455479503444;225702;227594;227621;251043;253643;52169.73915130476;52191;52256.47743522592;52285.2157217642;52524;1476.6898951220364;1482.5552334299666;1485.2944851195812;1487.323267913097;1495.5513345996158;26839.865800670872;28302.85848570744;28370.290742730773;28558.42883142284;28726.281842954093;37760;37764.24471510609;37787.9999999989;37852.43221351737;37866.242675146896;192763.03618481816;193334;193787;194428;194616;29649.25876853096;30851.382972340878;30877.8456107718;31131.221719457193;31290.21774455657;40742.59257407388;41061.58938410578;41575;42750.78624606857;42830.35754463623;30414.239644009078;31485.52771708472;31872.6812731879;31877.36245275128;32279.35441291208;31033.224169395944;31230.843845780626;31558;31679.683203168595;32227.35545289128;38416.6158338413;38469.807650961564;38516.42225366678;38519;38581.228375431776;28759.28101797388;30215.697843021288;30438.543421849132;30814.229644259074;31421.371572568878;22871.771282286965;25193.289642470667;25579.744202558482;25820.225393238234;26058.73941260639 09:51:37 INFO - PID 11240 | |2;jquery.html;496.00798403193613;504.6417043898834;508.819369123961;523.2386877093829;531.7447625139932;19562.608747825034;19686.606267874635;19742.605147897033;19999.300024499127;20198.29305974291;22524.8873755631;22947.541049179006;23043.42391440215;23203.071877124894;23215.071397144136;5490.094134467808;5541.833744987636;5608.859778505529;5619.4942455179025;5623.690697011662;5521.613487055887;5624.3813180550105;5624.971875140619;5626.831195064155;5634.04221282381;5412.296401467804;5572.4148964358765;5606.943930560703;5672.205891175238;5694.174344720013;5532.28080349554;5556.638818476786;5611.214429979766;5614.3543492498475;5617.691026993513;5146.944876300349;5216.113260745645;5228.503292187236;5229.607779416559;5233.764480598345;25212.11757588494;25387.238382848544;25473.235802925756;25605.231843044738;25672.358191045187;2108.768035516092;2166.9349919502442;2189.135291559825;2214.081156320125;2218.5784700906775;17565.473035808947;17611.207495662726;17683.823161768345;17779.644407111915;17800.198991045436;2183.3340831046526;2199.373178644095;2256.8420210585264;2264.5810525052752;2270.6934563834;106037;108942;109522.45238773755;118979;122278.3886080564;13236.470541178245;13236.536721214903;13369.66575835612;13720.862791372158;13948.651283717785;19916.402507924784;20018.399448016582;20091;20092.59814803696;20134.093965771575;8400.453970491899;9062.909370906338;9172.12864777845;9184.54549543471;9217;8282.254597086292;8287.668493260322;8288.8342233155;8356;8438.915610843937;8344.791380215422;8370.874436883452;8429.199226073513;8431.409801313972;8557.358198135165;2494.36393719604;2540.9364765881;2559.6032614944716;2584.9224523264334;2632.8025398094837;1003.1322905686528;1005.9195264378832;1007.6372505897871;1049.2864851900629;1051.3849398102043;19361.225550977804;19363.4190974271;19427.80572194288;19719.802801972084;20004.599908001757;1014.3812274512542;1017.4404077757204;1039.7709946191533;1042.5048102151568;1053.6996955867542;10455.68632941013;10815.945920270347;12132.393380330948;13395.732085358433;13503.392347344394;527242;542879;548687;571490;585496;113522;114303.42848285871;117099;117915;117964;1200.4837919694614;1254.523281153156;1293.8937208686436;1306.941187646558;1312.0422091872986;19471.513212169808;19598.412047638594;19780.802191977895;19880.801191987895;20231.291904783262;51914.22128668149;51946.220806687175;52831.735841320544;53561.464385357205;53673;65811.34188658051;66435.66782166058;66561.33438665746;67200.66399667971;67455;11167.441627918734;11254.649442067004;11319.830202546804;11399.487023083815;11498.137639677225;16792.832071679615;16913.15434228259;16916;17165.828341716424;17216.225269862636;13744.587662370144;13840.169589824643;14043;14096.08375455592;14262.928685356921;12383.133180677267;12950.740985180055;13110.803337949748;13241.536546220836;13304.46782128704;14529.854701453272;14651.413943442143;14732.042417243274;14766.557003289918;14910.776338354717;11154.442277885912;11200.43997800123;11278.94360528225;11305.03907167867;11391.943040285078;13876.514321999086;13910.37403316833;14152.646183845487;14184;14294.71410571762 09:51:37 INFO - PID 11240 | |3;mootools.html;1383.88236999855;1450.6735984403504;1451.5163607342377;1458.6790906000676;1466.2888499077944;13125.737485250289;13215.60353189406;13625.727485450285;13633.590992270223;13720.451181952722;12816.29510376929;13423.127496712706;13424.261665608388;13449.32753362333;13537.59387218385;2392.043182726906;2441.170002199252;2446.2783478873775;2447.412620970963;2448.0207916833233;2264.6829443877787;2337.6026075567192;2342.9062837486567;2349.2012715676665;2353.211674089182;2049.528608420057;2104.4738815296178;2112;2410.819188560856;2419.4798118404537;2241.7870302321335;2308.261356365955;2309.145616122029;2317.8725170115636;2317.953640927189;2226.0094258055174;2238.6194346960892;2242.9102835886547;2245.640697488394;2247.6740872573387;12786.808197877039;12895.419706113247;12895.67760805978;12919.418626161845;12929.159604625764;6904.723811047552;7223.097112860893;7252.202257751643;7257.02030225918;7265.709371625128;3885.417187421909;3987.1228329767405;4076.8369265229653;4091.9590804091877;4105.220008198433;1470.551481798051;1490.9478168264168;1525.4660868695867;1556.9299381527744;1562.6405926636824;21216.151353945825;21501.462463438384;21507.03218355178;21614.675779863315;21648.67526987112;5820.388859169726;5956.225690660273;6054.485368743618;6108.267007959073;6113.510919126459;13888.513902013583;14028.368723407268;14073.648158796112;14075.155490670593;14081.577552673436;7071.646417679095;7216.206217316091;7290.4896657233485;7294.744683936143;7303.561786292839;6496.058071579689;6577.276499585042;6626.56927299724;6644.60132392058;6765.188177418741;4856.927146092811;4902.460729319772;4983.401991761012;5016.724080175625;5160.716160611128;1371.3760239091189;1397.5108711950736;1413.3074793351389;1413.406369324886;1443.0259574786976;901.7970956534728;903.503073309677;906.5603182456504;921.2169655792522;926.8748718922994;7073.221945586084;7313.451491138079;7613.733519326797;7948.523088614702;8459.407841451162;988.649029594498;994.4977786217913;1033.338663255517;1046.853440518328;1059.924176960386;4778.654685544849;4841.588464980446;4945.629077819178;4961.05739909416;5078;17921.193546290448;18279.451616451526;18281.725774113398;18407.815921840876;18619.348322808637;16985;17466.126693665265;17635.382761603283;17790.733139002925;17807.19867605961;10586.629467968583;10613;10668.839967400496;10761.623343182951;10819.296745711503;7846.686132554634;8125.349972002344;8196.057453392936;8366.205210504992;8494.447860889022;15871.920640396724;16057.678846422772;16257.3497060121;16838.326466941675;16971;15792.289346979183;16072.919635401748;16586.25361858695;16610.66778664444;17054.488365349058;10549.841752373566;10629.787404251718;10801.135909127408;10809.297395669257;10935.726606834893;12993.415296311878;13008.804867927178;13067.607971760863;13138.408771605491;13230.073894827654;10123.848142277724;10562;10661.89338106609;10702.250842440955;10750.677479675622;9552.57013434411;10133.493325333557;10247.231457640557;10296.124829389286;10429.426381549089;8887.422317549339;8899.777505562413;8916.28669706435;8939.195472407515;9061.77345566366;6489.772857949949;6582.80251592453;6869.381755641816;6936.826579335355;7133.928660713326;6079.392060794062;6172.722227499684;6716.294789047275;6885.139357580302;7111.648786730505 09:51:37 INFO - PID 11240 | |4;prototype.html;434.2660903073803;449.15110441265995;451.31174958188757;456.2950241876302;470.7615289299381;6302.747890084397;6353.968230158855;6374.394432528914;6382.744690212392;6390.520710946675;6009.188759517464;6232.15865858109;6244.687765611712;6273.121762953178;6282.151909492217;4824.807007719696;4836.806527738886;4839.104765618355;4845.5396737310075;4855.5387238212315;4788.0423915216925;4788.928166077511;4795.304680821278;4862.659613827033;4876.122297986361;4755.26293424518;4760.476347601761;4765.237561990082;4767.140815082121;4787.305840653104;4570.063137056912;4729.172394830925;4752.500987396343;4766.261229509431;4784.784684689197;4221.366794980747;4236.343366778155;4243.681723870691;4247.7893800266775;4260.936085958713;6017.247844019497;6039.896287636983;6053.727582258765;6060.2424696912885;6133.172021777048;5675.460831221028;5680.971595142039;5683.204351390808;5684.744186511575;5718.256626638552;6640.900386494206;6641.535092543524;6651.16860392451;6656.201255849281;6659.633720145439;4788.754923719858;4789.37738094049;4797.616190704735;4805.327254184417;4805.7597120143855;6920.273371295992;6938.861222775567;6949.30506949301;7011.859762804766;7039.824004399879;4937.876553086202;4939.530744579331;4940.431850337185;4946.604271658259;4957.256411538226;4956.231784073474;4966.652334336562;4987.351644286219;4997.625178111656;5034.615480742825;5672.773089076473;5673.375928647845;5677.37548869624;5697.116946873241;5700.771969121189;6669.899951500732;6693.263740988487;6723.7646682365885;6757.222919364238;6763.628000459924;1605.9678806423806;1721.9139043047799;1723.3623559283146;1739.330357812226;1761.409927674218;1144.6508814811395;1157.7915975124558;1167.9532818687157;1176.8881956214145;1180.9232399893979;6118.479929205978;6124;6261.499080073583;6307;6307.653079080695;6817.216020157646;6829.453643708492;6849.212340580897;6854.280300568468;6920.7231710731;6272.686365681698;6304.005597341226;6326.525510586633;6377.394147555975;6396.488280937514;3502.285728560386;3567.3935430976794;3608.9097772555897;3616.710663146942;3622.927541449209;6979.30206979298;7013.4038606719005;7027;7029.683664235122;7054.294570542905;6962.1645402551;6981.965090174618;6992.755253566101;6997.265287144878;7005.684744186524;6946.51374403797;7024.824379390556;7033.9296607033275;7047.964760176166;7069.505134640629;6766;6785.728570857111;6809.353111454404;6841.692123854538;6845.349691779273;6759.357861003196;6796.932030679828;6801.18385793708;6810.353016463428;6816.693248803716;6947.201071876799;7021.473389495911;7023.964880175567;7070.540414873222;7123.287671232835;4892.633052521004;4919.237518184687;4936.086823937583;4938.209886418156;4945.159322915041;6882.827929301808;6891.552049116792;6916.3429474199875;6923.099997000358;6935.33551947539;6454.354564543508;6605.860277853602;6725.0248713935225;6732.495062870402;6755.2231493378895;6516.9580376954755;6656.001599760075;6663.900041499478;6698.330166983263;6701.195856497252;6590.406863382319;6644.800655980328;6652.534322597372;6662.6335551545135;6685.53201275906;6656.7337306509135;6664.333566643297;6689;6702.899456508254;6708.966455167693;6216.160818289654;6334.714937827901;6477.643729594917;6544.345565443417;6550.7707230246715 09:51:37 INFO - PID 11240 | |5;yui.html;834.9290310323622;847.8558645030345;849.0236228337415;854.8974123105228;867.609575690939;17604.471865844014;17862.642747145048;17947.91026044868;17980.550486237833;18025.639487210265;18176.636467270648;19526.90236548819;19551.804481955176;19562.02189890507;19635.90182049091;1007.9294449388545;1014.9035841595037;1020.0411613083678;1030.6392762533092;1031.5564307347838;1034.684421251518;1034.7309699478153;1035.321864178964;1035.6634093919506;1040.3497813866334;974.4786539201529;1094.1301665176204;1106.9446527673624;1110.6834552152638;1110.8889111088868;1052.768390953989;1061.6390427254732;1063.787242551485;1068.6900798768347;1071.276888100533;770.1335997003371;776.9805754856118;777.9649915753805;778.2917545034048;779.4426984705963;18063;18106.90946545272;18593.070346482622;18756.531086722804;18820.905895470572;18217.908910455495;18829.435116946515;18830.52923676919;18890.716639250422;18956.43130706081;14653.340599672934;14727.263636818116;14737.557873263819;14815.259237038104;14826.481073162387;3376.6960973512255;3447.293304872495;3474.9131271718156;3488.6162522122545;3494.0042088005052;102929;103811.48094259556;104742.47628761808;106314.46842765737;106711.46644266807;14758.48345307909;14938.925305373403;15057.096574205583;15076.321565529577;15241;26077;27590.172294831187;27620;27752.167434976982;27879.442411151664;7283.490155689157;7540.736074237376;7569.3566046886635;7571.962140189264;7618.047744031996;3832.9425058624142;3913.1195481016543;3924.548676902136;3930.1746633207345;3968.6428221460205;4589.2886602576655;4604.953950460519;4624.5375462453485;4686.594021793517;4748;766.4711349169055;780.056132080178;791.8218400859876;800.5636927874323;801.6512816924657;588.229527161493;680.4726337088796;723.9674214660353;735.3859527294662;744.5383862005591;11712.824307635392;12168.756624867454;12630.305333206577;12905;12970;661.715462351184;699.6781480518916;733.66618188724;735.1105162753022;742.6101296819213;5556.222128901957;5638.154276858422;5639.802606908738;5818.127280907813;5960.254968128984;94308;96539.51730241303;98112;100465.49767251116;100896;83556.58221708852;87027.56486217528;87406.56296718476;91255.54372228097;92479;76273.23726762661;78384;78942.6052869732;79225.20774792178;82177;11902.821457677968;12341.814872777095;12431.254124752544;12808.039397045073;12842.935785321013;37331.6266837339;38081.61918380781;38222.80888595539;39118.608813911495;39701.20597587974;46656;49456;50671.49328506668;52330.47669523256;66720;16218.513444596681;16293.59266018359;16328.67342653164;16374.345026198818;16384.918075409547;18571.350002749838;18743.812561874205;18826.28306717055;19354.903225483784;19535.60928781388;17125.400610978555;18160.90919545394;18239.08804559793;18434.539136521158;18528.0735963204;17104.40134595333;17817.821821781617;17858.374956876447;17894.642107158044;18193;17050.829491704924;17710;17776.377826776;18240.45278641643;18284.451466456027;11500.772063190416;12007.81988270194;12093;12137.575184868487;12662.430190641258;13128.803067953797;13361.799573006607;13622.386992585556;13645.199167217563;14034.087784293988 09:51:37 INFO - PID 11240 | __end_tp_report 09:51:37 INFO - PID 11240 | __start_cc_report 09:51:37 INFO - PID 11240 | _x_x_mozilla_cycle_collect,331 09:51:37 INFO - PID 11240 | __end_cc_report 09:51:37 INFO - PID 11240 | __startTimestamp1497199897254__endTimestamp 09:51:37 INFO - PID 11240 | 09:51:37 INFO - PID 11240 | ------- Summary: start ------- 09:51:37 INFO - PID 11240 | Number of tests: 6 09:51:37 INFO - PID 11240 | 09:51:37 INFO - PID 11240 | [#0] dojo.html Cycles:165 Average:6069.36 Median:6358.17 stddev:758.91 (11.9%) stddev-sans-first:730.33 09:51:37 INFO - PID 11240 | Values: 3336.5 3372.5 3378.3 3397.6 3462.1 6065.5 6093.2 6114.5 6137.0 6139.4 6027.2 6038.4 6044.0 6051.3 6061.6 5282.7 5283.0 5339.2 5342.9 5346.8 5323.0 5386.8 5386.9 5392.6 5394.2 5378.5 5425.6 5436.1 5467.8 5479.0 5390.5 5390.9 5395.4 5421.8 5427.8 5342.0 5347.6 5351.8 5357.0 5374.3 5882.0 5971.4 6014.0 6084.9 6095.6 6417.6 6573.4 6633.1 6647.7 6657.7 6654.0 6684.6 6687.7 6707.9 6713.6 6154.8 6174.0 6189.6 6192.8 6214.8 6605.2 6693.8 6705.4 6707.6 6836.3 6405.3 6418.3 6467.2 6489.2 6497.0 6552.2 6583.6 6607.3 6623.9 6639.3 6568.4 6621.2 6622.8 6629.4 6635.2 6426.5 6559.2 6632.4 6634.0 6659.5 4953.1 4967.6 4983.4 4997.3 5020.0 4387.7 4390.1 4390.3 4437.7 4444.9 6121.6 6127.4 6132.2 6133.2 6137.3 6518.6 6567.7 6573.0 6582.9 6586.3 6022.9 6082.9 6087.9 6105.9 6128.1 5607.5 5613.1 5616.5 5618.8 5624.0 6835.0 6904.8 6908.0 6908.6 6916.6 6675.6 6705.1 6705.2 6707.4 6721.3 6646.6 6757.2 6893.0 6908.2 6918.4 6368.8 6433.2 6449.7 6472.2 6491.9 6565.9 6681.5 6690.3 6705.8 6714.6 6476.8 6489.5 6507.4 6516.8 6527.6 6266.1 6355.6 6472.8 6492.5 6493.9 6295.7 6308.5 6328.2 6344.1 6382.1 6424.5 6483.6 6496.5 6496.8 6518.7 6280.7 6358.2 6369.4 6369.9 6388.0 09:51:37 INFO - PID 11240 | 09:51:37 INFO - PID 11240 | [#1] ext.html Cycles:180 Average:37152.92 Median:3531.57 stddev:54314.90 (1538.0%) stddev-sans-first:54398.63 09:51:37 INFO - PID 11240 | Values: 788.4 803.0 834.4 848.0 861.5 37915.2 39295.8 39329.4 39351.8 39362.4 34242.8 34352.0 38451.8 38646.8 38887.2 7012.7 7094.9 7099.6 7101.4 7106.9 6941.8 7025.1 7045.8 7077.8 7083.6 7012.7 7032.1 7047.9 7086.1 7096.6 7020.9 7045.6 7085.6 7092.2 7096.8 7010.5 7032.9 7036.4 7049.2 7054.1 37125.6 37535.1 37541.2 37647.4 37744.2 3494.4 3531.1 3532.0 3533.2 3533.7 29148.7 29217.1 29218.3 29261.7 29350.4 3494.4 3525.2 3535.6 3541.9 3589.6 192095.0 192914.0 193635.0 194122.0 194253.0 45768.3 46703.8 46890.5 46919.3 47027.3 48954.5 49477.3 49581.0 49668.8 49708.5 14827.5 14896.6 14942.9 14958.3 14982.8 12066.3 12069.9 12079.3 12113.9 12115.2 12899.7 13251.5 13292.4 13349.5 13371.5 4833.7 4853.0 4953.9 4964.8 5006.1 923.0 925.6 951.4 987.9 990.1 22150.6 22663.4 22754.3 22942.7 23251.8 1025.7 1044.6 1055.2 1060.7 1067.7 11445.4 11803.5 12030.7 12036.1 12100.5 225702.0 227594.0 227621.0 251043.0 253643.0 52169.7 52191.0 52256.5 52285.2 52524.0 1476.7 1482.6 1485.3 1487.3 1495.6 26839.9 28302.9 28370.3 28558.4 28726.3 37760.0 37764.2 37788.0 37852.4 37866.2 192763.0 193334.0 193787.0 194428.0 194616.0 29649.3 30851.4 30877.8 31131.2 31290.2 40742.6 41061.6 41575.0 42750.8 42830.4 30414.2 31485.5 31872.7 31877.4 32279.4 31033.2 31230.8 31558.0 31679.7 32227.4 38416.6 38469.8 38516.4 38519.0 38581.2 28759.3 30215.7 30438.5 30814.2 31421.4 22871.8 25193.3 25579.7 25820.2 26058.7 09:51:37 INFO - PID 11240 | 09:51:37 INFO - PID 11240 | [#2] jquery.html Cycles:180 Average:34290.65 Median:20091.80 stddev:92299.36 (459.4%) stddev-sans-first:92523.40 09:51:37 INFO - PID 11240 | Values: 496.0 504.6 508.8 523.2 531.7 19562.6 19686.6 19742.6 19999.3 20198.3 22524.9 22947.5 23043.4 23203.1 23215.1 5490.1 5541.8 5608.9 5619.5 5623.7 5521.6 5624.4 5625.0 5626.8 5634.0 5412.3 5572.4 5606.9 5672.2 5694.2 5532.3 5556.6 5611.2 5614.4 5617.7 5146.9 5216.1 5228.5 5229.6 5233.8 25212.1 25387.2 25473.2 25605.2 25672.4 2108.8 2166.9 2189.1 2214.1 2218.6 17565.5 17611.2 17683.8 17779.6 17800.2 2183.3 2199.4 2256.8 2264.6 2270.7 106037.0 108942.0 109522.5 118979.0 122278.4 13236.5 13236.5 13369.7 13720.9 13948.7 19916.4 20018.4 20091.0 20092.6 20134.1 8400.5 9062.9 9172.1 9184.5 9217.0 8282.3 8287.7 8288.8 8356.0 8438.9 8344.8 8370.9 8429.2 8431.4 8557.4 2494.4 2540.9 2559.6 2584.9 2632.8 1003.1 1005.9 1007.6 1049.3 1051.4 19361.2 19363.4 19427.8 19719.8 20004.6 1014.4 1017.4 1039.8 1042.5 1053.7 10455.7 10815.9 12132.4 13395.7 13503.4 527242.0 542879.0 548687.0 571490.0 585496.0 113522.0 114303.4 117099.0 117915.0 117964.0 1200.5 1254.5 1293.9 1306.9 1312.0 19471.5 19598.4 19780.8 19880.8 20231.3 51914.2 51946.2 52831.7 53561.5 53673.0 65811.3 66435.7 66561.3 67200.7 67455.0 11167.4 11254.6 11319.8 11399.5 11498.1 16792.8 16913.2 16916.0 17165.8 17216.2 13744.6 13840.2 14043.0 14096.1 14262.9 12383.1 12950.7 13110.8 13241.5 13304.5 14529.9 14651.4 14732.0 14766.6 14910.8 11154.4 11200.4 11278.9 11305.0 11391.9 13876.5 13910.4 14152.6 14184.0 14294.7 09:51:37 INFO - PID 11240 | 09:51:37 INFO - PID 11240 | [#3] mootools.html Cycles:180 Average:8225.56 Median:2232.31 stddev:5608.51 (251.2%) stddev-sans-first:5600.69 09:51:37 INFO - PID 11240 | Values: 1383.9 1450.7 1451.5 1458.7 1466.3 13125.7 13215.6 13625.7 13633.6 13720.5 12816.3 13423.1 13424.3 13449.3 13537.6 2392.0 2441.2 2446.3 2447.4 2448.0 2264.7 2337.6 2342.9 2349.2 2353.2 2049.5 2104.5 2112.0 2410.8 2419.5 2241.8 2308.3 2309.1 2317.9 2318.0 2226.0 2238.6 2242.9 2245.6 2247.7 12786.8 12895.4 12895.7 12919.4 12929.2 6904.7 7223.1 7252.2 7257.0 7265.7 3885.4 3987.1 4076.8 4092.0 4105.2 1470.6 1490.9 1525.5 1556.9 1562.6 21216.2 21501.5 21507.0 21614.7 21648.7 5820.4 5956.2 6054.5 6108.3 6113.5 13888.5 14028.4 14073.6 14075.2 14081.6 7071.6 7216.2 7290.5 7294.7 7303.6 6496.1 6577.3 6626.6 6644.6 6765.2 4856.9 4902.5 4983.4 5016.7 5160.7 1371.4 1397.5 1413.3 1413.4 1443.0 901.8 903.5 906.6 921.2 926.9 7073.2 7313.5 7613.7 7948.5 8459.4 988.6 994.5 1033.3 1046.9 1059.9 4778.7 4841.6 4945.6 4961.1 5078.0 17921.2 18279.5 18281.7 18407.8 18619.3 16985.0 17466.1 17635.4 17790.7 17807.2 10586.6 10613.0 10668.8 10761.6 10819.3 7846.7 8125.3 8196.1 8366.2 8494.4 15871.9 16057.7 16257.3 16838.3 16971.0 15792.3 16072.9 16586.3 16610.7 17054.5 10549.8 10629.8 10801.1 10809.3 10935.7 12993.4 13008.8 13067.6 13138.4 13230.1 10123.8 10562.0 10661.9 10702.3 10750.7 9552.6 10133.5 10247.2 10296.1 10429.4 8887.4 8899.8 8916.3 8939.2 9061.8 6489.8 6582.8 6869.4 6936.8 7133.9 6079.4 6172.7 6716.3 6885.1 7111.6 09:51:37 INFO - PID 11240 | 09:51:37 INFO - PID 11240 | [#4] prototype.html Cycles:180 Average:5593.48 Median:6303.38 stddev:1650.88 (26.2%) stddev-sans-first:1609.46 09:51:37 INFO - PID 11240 | Values: 434.3 449.2 451.3 456.3 470.8 6302.7 6354.0 6374.4 6382.7 6390.5 6009.2 6232.2 6244.7 6273.1 6282.2 4824.8 4836.8 4839.1 4845.5 4855.5 4788.0 4788.9 4795.3 4862.7 4876.1 4755.3 4760.5 4765.2 4767.1 4787.3 4570.1 4729.2 4752.5 4766.3 4784.8 4221.4 4236.3 4243.7 4247.8 4260.9 6017.2 6039.9 6053.7 6060.2 6133.2 5675.5 5681.0 5683.2 5684.7 5718.3 6640.9 6641.5 6651.2 6656.2 6659.6 4788.8 4789.4 4797.6 4805.3 4805.8 6920.3 6938.9 6949.3 7011.9 7039.8 4937.9 4939.5 4940.4 4946.6 4957.3 4956.2 4966.7 4987.4 4997.6 5034.6 5672.8 5673.4 5677.4 5697.1 5700.8 6669.9 6693.3 6723.8 6757.2 6763.6 1606.0 1721.9 1723.4 1739.3 1761.4 1144.7 1157.8 1168.0 1176.9 1180.9 6118.5 6124.0 6261.5 6307.0 6307.7 6817.2 6829.5 6849.2 6854.3 6920.7 6272.7 6304.0 6326.5 6377.4 6396.5 3502.3 3567.4 3608.9 3616.7 3622.9 6979.3 7013.4 7027.0 7029.7 7054.3 6962.2 6982.0 6992.8 6997.3 7005.7 6946.5 7024.8 7033.9 7048.0 7069.5 6766.0 6785.7 6809.4 6841.7 6845.3 6759.4 6796.9 6801.2 6810.4 6816.7 6947.2 7021.5 7024.0 7070.5 7123.3 4892.6 4919.2 4936.1 4938.2 4945.2 6882.8 6891.6 6916.3 6923.1 6935.3 6454.4 6605.9 6725.0 6732.5 6755.2 6517.0 6656.0 6663.9 6698.3 6701.2 6590.4 6644.8 6652.5 6662.6 6685.5 6656.7 6664.3 6689.0 6702.9 6709.0 6216.2 6334.7 6477.6 6544.3 6550.8 09:51:37 INFO - PID 11240 | 09:51:37 INFO - PID 11240 | [#5] yui.html Cycles:180 Average:21288.45 Median:18827.86 stddev:27809.36 (147.7%) stddev-sans-first:27844.96 09:51:37 INFO - PID 11240 | Values: 834.9 847.9 849.0 854.9 867.6 17604.5 17862.6 17947.9 17980.6 18025.6 18176.6 19526.9 19551.8 19562.0 19635.9 1007.9 1014.9 1020.0 1030.6 1031.6 1034.7 1034.7 1035.3 1035.7 1040.3 974.5 1094.1 1106.9 1110.7 1110.9 1052.8 1061.6 1063.8 1068.7 1071.3 770.1 777.0 778.0 778.3 779.4 18063.0 18106.9 18593.1 18756.5 18820.9 18217.9 18829.4 18830.5 18890.7 18956.4 14653.3 14727.3 14737.6 14815.3 14826.5 3376.7 3447.3 3474.9 3488.6 3494.0 102929.0 103811.5 104742.5 106314.5 106711.5 14758.5 14938.9 15057.1 15076.3 15241.0 26077.0 27590.2 27620.0 27752.2 27879.4 7283.5 7540.7 7569.4 7572.0 7618.0 3832.9 3913.1 3924.5 3930.2 3968.6 4589.3 4605.0 4624.5 4686.6 4748.0 766.5 780.1 791.8 800.6 801.7 588.2 680.5 724.0 735.4 744.5 11712.8 12168.8 12630.3 12905.0 12970.0 661.7 699.7 733.7 735.1 742.6 5556.2 5638.2 5639.8 5818.1 5960.3 94308.0 96539.5 98112.0 100465.5 100896.0 83556.6 87027.6 87406.6 91255.5 92479.0 76273.2 78384.0 78942.6 79225.2 82177.0 11902.8 12341.8 12431.3 12808.0 12842.9 37331.6 38081.6 38222.8 39118.6 39701.2 46656.0 49456.0 50671.5 52330.5 66720.0 16218.5 16293.6 16328.7 16374.3 16384.9 18571.4 18743.8 18826.3 19354.9 19535.6 17125.4 18160.9 18239.1 18434.5 18528.1 17104.4 17817.8 17858.4 17894.6 18193.0 17050.8 17710.0 17776.4 18240.5 18284.5 11500.8 12007.8 12093.0 12137.6 12662.4 13128.8 13361.8 13622.4 13645.2 14034.1 09:51:37 INFO - PID 11240 | -------- Summary: end -------- 09:51:37 INFO - PID 11240 | 09:51:38 INFO - TEST-INFO | 11240: exit 0 09:51:38 INFO - TEST-OK | dromaeo_css | took 1142016ms 09:51:38 INFO - TEST-START | kraken 09:51:38 INFO - operating with platform_type : linux_ 09:51:38 INFO - Initialising browser for kraken test... 09:51:38 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:60432/getInfo.html -profile /tmp/tmpqpGMYN/profile 09:51:38 INFO - TEST-INFO | started process 11649 (/builds/slave/test/build/application/firefox/firefox http://localhost:60432/getInfo.html) 09:52:12 INFO - TEST-INFO | 11649: killed by SIGTERM 09:52:12 INFO - Browser initialized. 09:52:12 INFO - Running cycle 1/1 for kraken test... 09:52:12 INFO - TEST-INFO | started process 11859 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpqpGMYN/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 09:52:23 INFO - PID 11859 | RSS: Main: 178212864 09:52:23 INFO - PID 11859 | 09:52:26 INFO - PID 11859 | Cycle 1(1): loaded http://localhost:60432/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:60432/tests/kraken/driver.html?testName=audio-beat-detection) 09:52:27 INFO - PID 11859 | RSS: Main: 180596736 09:52:27 INFO - PID 11859 | 09:52:29 INFO - PID 11859 | Cycle 1(1): loaded http://localhost:60432/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:60432/tests/kraken/driver.html?testName=audio-dft) 09:52:30 INFO - PID 11859 | RSS: Main: 181260288 09:52:30 INFO - PID 11859 | 09:52:33 INFO - PID 11859 | Cycle 1(1): loaded http://localhost:60432/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:60432/tests/kraken/driver.html?testName=audio-fft) 09:52:34 INFO - PID 11859 | RSS: Main: 176414720 09:52:34 INFO - PID 11859 | 09:52:36 INFO - PID 11859 | Cycle 1(1): loaded http://localhost:60432/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:60432/tests/kraken/driver.html?testName=audio-oscillator) 09:52:36 INFO - PID 11859 | RSS: Main: 178413568 09:52:36 INFO - PID 11859 | 09:52:38 INFO - PID 11859 | Cycle 1(1): loaded http://localhost:60432/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:60432/tests/kraken/driver.html?testName=imaging-gaussian-blur) 09:52:39 INFO - PID 11859 | RSS: Main: 178323456 09:52:39 INFO - PID 11859 | 09:52:42 INFO - PID 11859 | Cycle 1(1): loaded http://localhost:60432/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:60432/tests/kraken/driver.html?testName=imaging-darkroom) 09:52:43 INFO - PID 11859 | RSS: Main: 180232192 09:52:43 INFO - PID 11859 | 09:52:46 INFO - PID 11859 | Cycle 1(1): loaded http://localhost:60432/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:60432/tests/kraken/driver.html?testName=imaging-desaturate) 09:52:47 INFO - PID 11859 | RSS: Main: 180998144 09:52:47 INFO - PID 11859 | 09:52:50 INFO - PID 11859 | Cycle 1(1): loaded http://localhost:60432/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:60432/tests/kraken/driver.html?testName=json-parse-financial) 09:52:50 INFO - PID 11859 | RSS: Main: 180039680 09:52:50 INFO - PID 11859 | 09:52:52 INFO - PID 11859 | Cycle 1(1): loaded http://localhost:60432/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:60432/tests/kraken/driver.html?testName=json-stringify-tinderbox) 09:52:52 INFO - PID 11859 | RSS: Main: 179453952 09:52:52 INFO - PID 11859 | 09:52:54 INFO - PID 11859 | Cycle 1(1): loaded http://localhost:60432/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:60432/tests/kraken/driver.html?testName=stanford-crypto-aes) 09:52:55 INFO - PID 11859 | RSS: Main: 179281920 09:52:55 INFO - PID 11859 | 09:52:57 INFO - PID 11859 | Cycle 1(1): loaded http://localhost:60432/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:60432/tests/kraken/driver.html?testName=stanford-crypto-ccm) 09:52:57 INFO - PID 11859 | RSS: Main: 179433472 09:52:57 INFO - PID 11859 | 09:53:00 INFO - PID 11859 | Cycle 1(1): loaded http://localhost:60432/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:60432/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 09:53:01 INFO - PID 11859 | RSS: Main: 179109888 09:53:01 INFO - PID 11859 | 09:53:04 INFO - PID 11859 | Cycle 1(1): loaded http://localhost:60432/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:60432/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 09:53:04 INFO - PID 11859 | RSS: Main: 179011584 09:53:04 INFO - PID 11859 | 09:53:06 INFO - PID 11859 | Cycle 1(1): loaded http://localhost:60432/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:60432/tests/kraken/driver.html?testName=ai-astar) 09:53:06 INFO - PID 11859 | RSS: Main: 181075968 09:53:06 INFO - PID 11859 | 09:53:06 INFO - PID 11859 | __start_tp_report 09:53:06 INFO - PID 11859 | _x_x_mozilla_page_load 09:53:06 INFO - PID 11859 | _x_x_mozilla_page_load_details 09:53:06 INFO - PID 11859 | |i|pagename|runs| 09:53:06 INFO - PID 11859 | |0;ai-astar;100;107;108;106;113;110;114;112;111;110 09:53:06 INFO - PID 11859 | |1;audio-beat-detection;151;117;149;175;120;149;148;119;159;120 09:53:06 INFO - PID 11859 | |2;audio-dft;163;165;163;162;166;167;160;166;180;172 09:53:06 INFO - PID 11859 | |3;audio-fft;75;77;74;187;74;74;76;77;183;75 09:53:06 INFO - PID 11859 | |4;audio-oscillator;82;82;139;83;82;82;129;82;82;129 09:53:06 INFO - PID 11859 | |5;imaging-gaussian-blur;115;115;114;114;114;114;114;114;114;114 09:53:06 INFO - PID 11859 | |6;imaging-darkroom;148;149;150;148;148;148;148;148;148;149 09:53:06 INFO - PID 11859 | |7;imaging-desaturate;94;95;95;95;94;94;95;96;95;94 09:53:06 INFO - PID 11859 | |8;json-parse-financial;49;46;46;45;47;47;46;48;47;47 09:53:06 INFO - PID 11859 | |9;json-stringify-tinderbox;55;56;55;56;55;56;56;55;55;56 09:53:06 INFO - PID 11859 | |10;stanford-crypto-aes;78;80;77;79;78;78;77;78;79;78 09:53:06 INFO - PID 11859 | |11;stanford-crypto-ccm;132;139;127;128;124;133;123;121;122;143 09:53:06 INFO - PID 11859 | |12;stanford-crypto-pbkdf2;166;169;175;178;176;178;171;175;168;174 09:53:06 INFO - PID 11859 | |13;stanford-crypto-sha256-iterative;66;67;65;68;64;64;68;66;63;63 09:53:06 INFO - PID 11859 | __end_tp_report 09:53:06 INFO - PID 11859 | __start_cc_report 09:53:06 INFO - PID 11859 | _x_x_mozilla_cycle_collect,925 09:53:06 INFO - PID 11859 | __end_cc_report 09:53:06 INFO - PID 11859 | __startTimestamp1497199986569__endTimestamp 09:53:06 INFO - PID 11859 | 09:53:06 INFO - PID 11859 | ------- Summary: start ------- 09:53:06 INFO - PID 11859 | Number of tests: 14 09:53:06 INFO - PID 11859 | 09:53:06 INFO - PID 11859 | [#0] ai-astar Cycles:10 Average:109.10 Median:110.50 stddev:4.09 (3.7%) stddev-sans-first:2.71 09:53:06 INFO - PID 11859 | Values: 100.0 107.0 108.0 106.0 113.0 110.0 114.0 112.0 111.0 110.0 09:53:06 INFO - PID 11859 | 09:53:06 INFO - PID 11859 | [#1] audio-beat-detection Cycles:10 Average:140.70 Median:149.00 stddev:20.27 (13.6%) stddev-sans-first:21.15 09:53:06 INFO - PID 11859 | Values: 151.0 117.0 149.0 175.0 120.0 149.0 148.0 119.0 159.0 120.0 09:53:06 INFO - PID 11859 | 09:53:06 INFO - PID 11859 | [#2] audio-dft Cycles:10 Average:166.40 Median:166.00 stddev:5.80 (3.5%) stddev-sans-first:6.02 09:53:06 INFO - PID 11859 | Values: 163.0 165.0 163.0 162.0 166.0 167.0 160.0 166.0 180.0 172.0 09:53:06 INFO - PID 11859 | 09:53:06 INFO - PID 11859 | [#3] audio-fft Cycles:10 Average:97.20 Median:75.00 stddev:46.30 (61.7%) stddev-sans-first:48.40 09:53:06 INFO - PID 11859 | Values: 75.0 77.0 74.0 187.0 74.0 74.0 76.0 77.0 183.0 75.0 09:53:06 INFO - PID 11859 | 09:53:06 INFO - PID 11859 | [#4] audio-oscillator Cycles:10 Average:97.20 Median:82.00 stddev:24.40 (29.8%) stddev-sans-first:25.25 09:53:06 INFO - PID 11859 | Values: 82.0 82.0 139.0 83.0 82.0 82.0 129.0 82.0 82.0 129.0 09:53:06 INFO - PID 11859 | 09:53:06 INFO - PID 11859 | [#5] imaging-gaussian-blur Cycles:10 Average:114.20 Median:114.00 stddev:0.42 (0.4%) stddev-sans-first:0.33 09:53:06 INFO - PID 11859 | Values: 115.0 115.0 114.0 114.0 114.0 114.0 114.0 114.0 114.0 114.0 09:53:06 INFO - PID 11859 | 09:53:06 INFO - PID 11859 | [#6] imaging-darkroom Cycles:10 Average:148.40 Median:148.00 stddev:0.70 (0.5%) stddev-sans-first:0.73 09:53:06 INFO - PID 11859 | Values: 148.0 149.0 150.0 148.0 148.0 148.0 148.0 148.0 148.0 149.0 09:53:06 INFO - PID 11859 | 09:53:06 INFO - PID 11859 | [#7] imaging-desaturate Cycles:10 Average:94.70 Median:95.00 stddev:0.67 (0.7%) stddev-sans-first:0.67 09:53:06 INFO - PID 11859 | Values: 94.0 95.0 95.0 95.0 94.0 94.0 95.0 96.0 95.0 94.0 09:53:06 INFO - PID 11859 | 09:53:06 INFO - PID 11859 | [#8] json-parse-financial Cycles:10 Average:46.80 Median:47.00 stddev:1.14 (2.4%) stddev-sans-first:0.88 09:53:06 INFO - PID 11859 | Values: 49.0 46.0 46.0 45.0 47.0 47.0 46.0 48.0 47.0 47.0 09:53:06 INFO - PID 11859 | 09:53:06 INFO - PID 11859 | [#9] json-stringify-tinderbox Cycles:10 Average:55.50 Median:56.00 stddev:0.53 (0.9%) stddev-sans-first:0.53 09:53:06 INFO - PID 11859 | Values: 55.0 56.0 55.0 56.0 55.0 56.0 56.0 55.0 55.0 56.0 09:53:06 INFO - PID 11859 | 09:53:06 INFO - PID 11859 | [#10] stanford-crypto-aes Cycles:10 Average:78.20 Median:78.00 stddev:0.92 (1.2%) stddev-sans-first:0.97 09:53:06 INFO - PID 11859 | Values: 78.0 80.0 77.0 79.0 78.0 78.0 77.0 78.0 79.0 78.0 09:53:06 INFO - PID 11859 | 09:53:06 INFO - PID 11859 | [#11] stanford-crypto-ccm Cycles:10 Average:129.20 Median:130.00 stddev:7.45 (5.7%) stddev-sans-first:7.83 09:53:06 INFO - PID 11859 | Values: 132.0 139.0 127.0 128.0 124.0 133.0 123.0 121.0 122.0 143.0 09:53:06 INFO - PID 11859 | 09:53:06 INFO - PID 11859 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:173.00 Median:175.00 stddev:4.24 (2.4%) stddev-sans-first:3.67 09:53:06 INFO - PID 11859 | Values: 166.0 169.0 175.0 178.0 176.0 178.0 171.0 175.0 168.0 174.0 09:53:06 INFO - PID 11859 | 09:53:06 INFO - PID 11859 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:65.40 Median:66.00 stddev:1.90 (2.9%) stddev-sans-first:2.00 09:53:06 INFO - PID 11859 | Values: 66.0 67.0 65.0 68.0 64.0 64.0 68.0 66.0 63.0 63.0 09:53:06 INFO - PID 11859 | -------- Summary: end -------- 09:53:06 INFO - PID 11859 | 09:53:07 INFO - TEST-INFO | 11859: exit 0 09:53:07 INFO - TEST-OK | kraken | took 89718ms 09:53:07 INFO - SUITE-END | took 1231s 09:53:08 INFO - Completed test suite (00:20:32) 09:53:08 INFO - javascript benchmark 09:53:08 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 8081.102236010628, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3336.549565808615, 3372.494125881119, 3378.273671160701, 3397.60927493338, 3462.0652423845563, 6065.514758819295, 6093.207882975213, 6114.480269177114, 6137.048757442592, 6139.416755408229, 6027.216461859952, 6038.426349496802, 6043.969780151093, 6051.273847138338, 6061.605995610283, 5282.709450980195, 5282.973585132069, 5339.172428273624, 5342.946570534284, 5346.812861549846, 5322.973385133069, 5386.78452861885, 5386.91919621206, 5392.595555333366, 5394.236432057968, 5378.489043540857, 5425.565954723613, 5436.130219164915, 5467.781288748445, 5479.04116779566, 5390.5418039466695, 5390.946090539122, 5395.379531353866, 5421.783128674848, 5427.782888684448, 5341.973290133525, 5347.6256662033675, 5351.759170837322, 5356.9732151339385, 5374.328208973879, 5882.0, 5971.373005834368, 6014.0, 6084.878302433926, 6095.573309868311, 6417.647029413381, 6573.408393244631, 6633.104530888317, 6647.66761661915, 6657.667116644148, 6654.035164901111, 6684.598924064571, 6687.699053542602, 6707.899381509281, 6713.630750308731, 6154.815355539341, 6173.98129308659, 6189.6286222826775, 6192.845178870564, 6214.8135555933395, 6605.207375114921, 6693.799186024427, 6705.430038446689, 6707.5975441473665, 6836.282190370039, 6405.327440618761, 6418.293987661354, 6467.223933128054, 6489.2212934447225, 6496.967515162394, 6552.246491653521, 6583.572067815577, 6607.339266073451, 6623.933760662428, 6639.336066393322, 6568.408843204134, 6621.172353455818, 6622.8344291393105, 6629.436497897636, 6635.2037755469655, 6426.485881129498, 6559.212894452697, 6632.43624291931, 6633.9668301658185, 6659.500537459709, 4953.0589188054155, 4967.552920237196, 4983.377077865267, 4997.25041243809, 5020.021095886267, 4387.692861499728, 4390.05613793036, 4390.297552391666, 4437.733735975852, 4444.911101777946, 6121.632702037892, 6127.356627554132, 6132.202813634199, 6133.233345831771, 6137.263528376623, 6518.641474718841, 6567.704453299613, 6572.967135164389, 6582.901256481156, 6586.341365863375, 6022.909656355158, 6082.90875636857, 6087.908681369783, 6105.877882442415, 6128.050152226412, 5607.49532542065, 5613.129964855454, 5616.522595579421, 5618.831435056954, 5624.0439125348785, 6834.965825170842, 6904.758333458506, 6907.965460172667, 6908.5509441886115, 6916.619585922823, 6675.632840193836, 6705.1283333166375, 6705.228898676714, 6707.3628005339415, 6721.260661327152, 6646.60120392778, 6757.222919364336, 6893.03497510359, 6908.171019477695, 6918.411934985381, 6368.808935731936, 6433.228012638513, 6449.677516124269, 6472.15861937945, 6491.870162596816, 6565.868682626417, 6681.465482761465, 6690.330966903465, 6705.798826035227, 6714.597124172566, 6476.805695829133, 6489.513286503437, 6507.414332710079, 6516.771912983023, 6527.608343499405, 6266.091416744455, 6355.618662880242, 6472.805815825533, 6492.5455218134275, 6493.902591461227, 6295.653739044214, 6308.52686048539, 6328.208973878265, 6344.143540621957, 6382.074599183, 6424.518161138027, 6483.643399612878, 6496.545241833026, 6496.798092352929, 6518.706658200487, 6280.654563999024, 6358.1734374531015, 6369.394907483782, 6369.9044514333245, 6388.0], "value": 6012.88715764158, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [788.3614272439324, 802.9558374289412, 834.4492634860993, 848.0163010907348, 861.4874149880819, 37915.24169516608, 39295.80352098236, 39329.41005884907, 39351.80324098383, 39362.40956385653, 34242.8287858561, 34352.0, 38451.80774096125, 38646.806765966205, 38887.22225555487, 7012.684429200685, 7094.85810283794, 7099.645017749118, 7101.360877521022, 7106.85786284274, 6941.757038503653, 7025.121859767529, 7045.788626341218, 7077.796774548339, 7083.574985500861, 7012.684429200673, 7032.0506731591095, 7047.85904281914, 7086.07880975475, 7096.574205547684, 7020.929790702105, 7045.612491312976, 7085.574865508061, 7092.184398794101, 7096.822579435504, 7010.474214433887, 7032.859342813166, 7036.40190583801, 7049.189343225544, 7054.118235220598, 37125.628743712485, 37535.06162345936, 37541.24917501662, 37647.4352884707, 37744.24511509755, 3494.405950988338, 3531.099569609759, 3532.04634748619, 3533.169705119295, 3533.7349698772437, 29148.70851291481, 29217.123486295444, 29218.269543261376, 29261.707382926324, 29350.41299174026, 3494.4408894577, 3525.189206482498, 3535.646435356444, 3541.94687079694, 3589.6410358964154, 192095.0, 192914.0, 193635.0, 194121.99999999857, 194253.0, 45768.313475297895, 46703.766481167375, 46890.53109468862, 46919.296210556866, 47027.29459058117, 48954.51045489571, 49477.257841132414, 49581.0, 49668.75165624221, 49708.50291497111, 14827.481038163613, 14896.553103406915, 14942.925285373722, 14958.252087395587, 14982.775258371134, 12066.336351500577, 12069.879301207051, 12079.3356365399, 12113.939430302968, 12115.15193936416, 12899.677508062374, 13251.469941202437, 13292.401841917137, 13349.46602135923, 13371.53199638008, 4833.709977401367, 4852.975735121302, 4953.90092198154, 4964.751762411865, 5006.073876332817, 922.9538523073819, 925.5973651461636, 951.4481600671594, 987.8863930647924, 990.0643891522442, 22150.55698886013, 22663.433414164447, 22754.31737047891, 22942.65586016211, 23251.7674823253, 1025.738436698652, 1044.5769463367349, 1055.2244100586063, 1060.6923992042375, 1067.7330667333167, 11445.427728613537, 11803.468843902045, 12030.699232519082, 12036.074228123458, 12100.455479503444, 225702.0, 227594.0, 227621.0, 251043.0, 253643.0, 52169.73915130476, 52191.0, 52256.47743522592, 52285.2157217642, 52524.0, 1476.6898951220364, 1482.5552334299666, 1485.2944851195812, 1487.323267913097, 1495.5513345996158, 26839.865800670872, 28302.85848570744, 28370.290742730773, 28558.42883142284, 28726.281842954093, 37760.0, 37764.24471510609, 37787.9999999989, 37852.43221351737, 37866.242675146896, 192763.03618481816, 193334.0, 193787.0, 194428.0, 194616.0, 29649.25876853096, 30851.382972340878, 30877.8456107718, 31131.221719457193, 31290.21774455657, 40742.59257407388, 41061.58938410578, 41575.0, 42750.78624606857, 42830.35754463623, 30414.239644009078, 31485.52771708472, 31872.6812731879, 31877.36245275128, 32279.35441291208, 31033.224169395944, 31230.843845780626, 31558.0, 31679.683203168595, 32227.35545289128, 38416.6158338413, 38469.807650961564, 38516.42225366678, 38519.0, 38581.228375431776, 28759.28101797388, 30215.697843021288, 30438.543421849132, 30814.229644259074, 31421.371572568878, 22871.771282286965, 25193.289642470667, 25579.744202558482, 25820.225393238234, 26058.73941260639], "value": 16431.89351189492, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [496.00798403193613, 504.6417043898834, 508.819369123961, 523.2386877093829, 531.7447625139932, 19562.608747825034, 19686.606267874635, 19742.605147897033, 19999.300024499127, 20198.29305974291, 22524.8873755631, 22947.541049179006, 23043.42391440215, 23203.071877124894, 23215.071397144136, 5490.094134467808, 5541.833744987636, 5608.859778505529, 5619.4942455179025, 5623.690697011662, 5521.613487055887, 5624.3813180550105, 5624.971875140619, 5626.831195064155, 5634.04221282381, 5412.296401467804, 5572.4148964358765, 5606.943930560703, 5672.205891175238, 5694.174344720013, 5532.28080349554, 5556.638818476786, 5611.214429979766, 5614.3543492498475, 5617.691026993513, 5146.944876300349, 5216.113260745645, 5228.503292187236, 5229.607779416559, 5233.764480598345, 25212.11757588494, 25387.238382848544, 25473.235802925756, 25605.231843044738, 25672.358191045187, 2108.768035516092, 2166.9349919502442, 2189.135291559825, 2214.081156320125, 2218.5784700906775, 17565.473035808947, 17611.207495662726, 17683.823161768345, 17779.644407111915, 17800.198991045436, 2183.3340831046526, 2199.373178644095, 2256.8420210585264, 2264.5810525052752, 2270.6934563834, 106037.0, 108942.0, 109522.45238773755, 118979.0, 122278.3886080564, 13236.470541178245, 13236.536721214903, 13369.66575835612, 13720.862791372158, 13948.651283717785, 19916.402507924784, 20018.399448016582, 20091.0, 20092.59814803696, 20134.093965771575, 8400.453970491899, 9062.909370906338, 9172.12864777845, 9184.54549543471, 9217.0, 8282.254597086292, 8287.668493260322, 8288.8342233155, 8356.0, 8438.915610843937, 8344.791380215422, 8370.874436883452, 8429.199226073513, 8431.409801313972, 8557.358198135165, 2494.36393719604, 2540.9364765881, 2559.6032614944716, 2584.9224523264334, 2632.8025398094837, 1003.1322905686528, 1005.9195264378832, 1007.6372505897871, 1049.2864851900629, 1051.3849398102043, 19361.225550977804, 19363.4190974271, 19427.80572194288, 19719.802801972084, 20004.599908001757, 1014.3812274512542, 1017.4404077757204, 1039.7709946191533, 1042.5048102151568, 1053.6996955867542, 10455.68632941013, 10815.945920270347, 12132.393380330948, 13395.732085358433, 13503.392347344394, 527242.0, 542879.0, 548687.0, 571490.0, 585496.0, 113522.0, 114303.42848285871, 117099.0, 117915.0, 117964.0, 1200.4837919694614, 1254.523281153156, 1293.8937208686436, 1306.941187646558, 1312.0422091872986, 19471.513212169808, 19598.412047638594, 19780.802191977895, 19880.801191987895, 20231.291904783262, 51914.22128668149, 51946.220806687175, 52831.735841320544, 53561.464385357205, 53673.0, 65811.34188658051, 66435.66782166058, 66561.33438665746, 67200.66399667971, 67455.0, 11167.441627918734, 11254.649442067004, 11319.830202546804, 11399.487023083815, 11498.137639677225, 16792.832071679615, 16913.15434228259, 16916.0, 17165.828341716424, 17216.225269862636, 13744.587662370144, 13840.169589824643, 14043.0, 14096.08375455592, 14262.928685356921, 12383.133180677267, 12950.740985180055, 13110.803337949748, 13241.536546220836, 13304.46782128704, 14529.854701453272, 14651.413943442143, 14732.042417243274, 14766.557003289918, 14910.776338354717, 11154.442277885912, 11200.43997800123, 11278.94360528225, 11305.03907167867, 11391.943040285078, 13876.514321999086, 13910.37403316833, 14152.646183845487, 14184.0, 14294.71410571762], "value": 10785.9737631466, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1383.88236999855, 1450.6735984403504, 1451.5163607342377, 1458.6790906000676, 1466.2888499077944, 13125.737485250289, 13215.60353189406, 13625.727485450285, 13633.590992270223, 13720.451181952722, 12816.29510376929, 13423.127496712706, 13424.261665608388, 13449.32753362333, 13537.59387218385, 2392.043182726906, 2441.170002199252, 2446.2783478873775, 2447.412620970963, 2448.0207916833233, 2264.6829443877787, 2337.6026075567192, 2342.9062837486567, 2349.2012715676665, 2353.211674089182, 2049.528608420057, 2104.4738815296178, 2112.0, 2410.819188560856, 2419.4798118404537, 2241.7870302321335, 2308.261356365955, 2309.145616122029, 2317.8725170115636, 2317.953640927189, 2226.0094258055174, 2238.6194346960892, 2242.9102835886547, 2245.640697488394, 2247.6740872573387, 12786.808197877039, 12895.419706113247, 12895.67760805978, 12919.418626161845, 12929.159604625764, 6904.723811047552, 7223.097112860893, 7252.202257751643, 7257.02030225918, 7265.709371625128, 3885.417187421909, 3987.1228329767405, 4076.8369265229653, 4091.9590804091877, 4105.220008198433, 1470.551481798051, 1490.9478168264168, 1525.4660868695867, 1556.9299381527744, 1562.6405926636824, 21216.151353945825, 21501.462463438384, 21507.03218355178, 21614.675779863315, 21648.67526987112, 5820.388859169726, 5956.225690660273, 6054.485368743618, 6108.267007959073, 6113.510919126459, 13888.513902013583, 14028.368723407268, 14073.648158796112, 14075.155490670593, 14081.577552673436, 7071.646417679095, 7216.206217316091, 7290.4896657233485, 7294.744683936143, 7303.561786292839, 6496.058071579689, 6577.276499585042, 6626.56927299724, 6644.60132392058, 6765.188177418741, 4856.927146092811, 4902.460729319772, 4983.401991761012, 5016.724080175625, 5160.716160611128, 1371.3760239091189, 1397.5108711950736, 1413.3074793351389, 1413.406369324886, 1443.0259574786976, 901.7970956534728, 903.503073309677, 906.5603182456504, 921.2169655792522, 926.8748718922994, 7073.221945586084, 7313.451491138079, 7613.733519326797, 7948.523088614702, 8459.407841451162, 988.649029594498, 994.4977786217913, 1033.338663255517, 1046.853440518328, 1059.924176960386, 4778.654685544849, 4841.588464980446, 4945.629077819178, 4961.05739909416, 5078.0, 17921.193546290448, 18279.451616451526, 18281.725774113398, 18407.815921840876, 18619.348322808637, 16985.0, 17466.126693665265, 17635.382761603283, 17790.733139002925, 17807.19867605961, 10586.629467968583, 10613.0, 10668.839967400496, 10761.623343182951, 10819.296745711503, 7846.686132554634, 8125.349972002344, 8196.057453392936, 8366.205210504992, 8494.447860889022, 15871.920640396724, 16057.678846422772, 16257.3497060121, 16838.326466941675, 16971.0, 15792.289346979183, 16072.919635401748, 16586.25361858695, 16610.66778664444, 17054.488365349058, 10549.841752373566, 10629.787404251718, 10801.135909127408, 10809.297395669257, 10935.726606834893, 12993.415296311878, 13008.804867927178, 13067.607971760863, 13138.408771605491, 13230.073894827654, 10123.848142277724, 10562.0, 10661.89338106609, 10702.250842440955, 10750.677479675622, 9552.57013434411, 10133.493325333557, 10247.231457640557, 10296.124829389286, 10429.426381549089, 8887.422317549339, 8899.777505562413, 8916.28669706435, 8939.195472407515, 9061.77345566366, 6489.772857949949, 6582.80251592453, 6869.381755641816, 6936.826579335355, 7133.928660713326, 6079.392060794062, 6172.722227499684, 6716.294789047275, 6885.139357580302, 7111.648786730505], "value": 5984.612043366979, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [434.2660903073803, 449.15110441265995, 451.31174958188757, 456.2950241876302, 470.7615289299381, 6302.747890084397, 6353.968230158855, 6374.394432528914, 6382.744690212392, 6390.520710946675, 6009.188759517464, 6232.15865858109, 6244.687765611712, 6273.121762953178, 6282.151909492217, 4824.807007719696, 4836.806527738886, 4839.104765618355, 4845.5396737310075, 4855.5387238212315, 4788.0423915216925, 4788.928166077511, 4795.304680821278, 4862.659613827033, 4876.122297986361, 4755.26293424518, 4760.476347601761, 4765.237561990082, 4767.140815082121, 4787.305840653104, 4570.063137056912, 4729.172394830925, 4752.500987396343, 4766.261229509431, 4784.784684689197, 4221.366794980747, 4236.343366778155, 4243.681723870691, 4247.7893800266775, 4260.936085958713, 6017.247844019497, 6039.896287636983, 6053.727582258765, 6060.2424696912885, 6133.172021777048, 5675.460831221028, 5680.971595142039, 5683.204351390808, 5684.744186511575, 5718.256626638552, 6640.900386494206, 6641.535092543524, 6651.16860392451, 6656.201255849281, 6659.633720145439, 4788.754923719858, 4789.37738094049, 4797.616190704735, 4805.327254184417, 4805.7597120143855, 6920.273371295992, 6938.861222775567, 6949.30506949301, 7011.859762804766, 7039.824004399879, 4937.876553086202, 4939.530744579331, 4940.431850337185, 4946.604271658259, 4957.256411538226, 4956.231784073474, 4966.652334336562, 4987.351644286219, 4997.625178111656, 5034.615480742825, 5672.773089076473, 5673.375928647845, 5677.37548869624, 5697.116946873241, 5700.771969121189, 6669.899951500732, 6693.263740988487, 6723.7646682365885, 6757.222919364238, 6763.628000459924, 1605.9678806423806, 1721.9139043047799, 1723.3623559283146, 1739.330357812226, 1761.409927674218, 1144.6508814811395, 1157.7915975124558, 1167.9532818687157, 1176.8881956214145, 1180.9232399893979, 6118.479929205978, 6124.0, 6261.499080073583, 6307.0, 6307.653079080695, 6817.216020157646, 6829.453643708492, 6849.212340580897, 6854.280300568468, 6920.7231710731, 6272.686365681698, 6304.005597341226, 6326.525510586633, 6377.394147555975, 6396.488280937514, 3502.285728560386, 3567.3935430976794, 3608.9097772555897, 3616.710663146942, 3622.927541449209, 6979.30206979298, 7013.4038606719005, 7027.0, 7029.683664235122, 7054.294570542905, 6962.1645402551, 6981.965090174618, 6992.755253566101, 6997.265287144878, 7005.684744186524, 6946.51374403797, 7024.824379390556, 7033.9296607033275, 7047.964760176166, 7069.505134640629, 6766.0, 6785.728570857111, 6809.353111454404, 6841.692123854538, 6845.349691779273, 6759.357861003196, 6796.932030679828, 6801.18385793708, 6810.353016463428, 6816.693248803716, 6947.201071876799, 7021.473389495911, 7023.964880175567, 7070.540414873222, 7123.287671232835, 4892.633052521004, 4919.237518184687, 4936.086823937583, 4938.209886418156, 4945.159322915041, 6882.827929301808, 6891.552049116792, 6916.3429474199875, 6923.099997000358, 6935.33551947539, 6454.354564543508, 6605.860277853602, 6725.0248713935225, 6732.495062870402, 6755.2231493378895, 6516.9580376954755, 6656.001599760075, 6663.900041499478, 6698.330166983263, 6701.195856497252, 6590.406863382319, 6644.800655980328, 6652.534322597372, 6662.6335551545135, 6685.53201275906, 6656.7337306509135, 6664.333566643297, 6689.0, 6702.899456508254, 6708.966455167693, 6216.160818289654, 6334.714937827901, 6477.643729594917, 6544.345565443417, 6550.7707230246715], "value": 5085.848597240908, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [834.9290310323622, 847.8558645030345, 849.0236228337415, 854.8974123105228, 867.609575690939, 17604.471865844014, 17862.642747145048, 17947.91026044868, 17980.550486237833, 18025.639487210265, 18176.636467270648, 19526.90236548819, 19551.804481955176, 19562.02189890507, 19635.90182049091, 1007.9294449388545, 1014.9035841595037, 1020.0411613083678, 1030.6392762533092, 1031.5564307347838, 1034.684421251518, 1034.7309699478153, 1035.321864178964, 1035.6634093919506, 1040.3497813866334, 974.4786539201529, 1094.1301665176204, 1106.9446527673624, 1110.6834552152638, 1110.8889111088868, 1052.768390953989, 1061.6390427254732, 1063.787242551485, 1068.6900798768347, 1071.276888100533, 770.1335997003371, 776.9805754856118, 777.9649915753805, 778.2917545034048, 779.4426984705963, 18063.0, 18106.90946545272, 18593.070346482622, 18756.531086722804, 18820.905895470572, 18217.908910455495, 18829.435116946515, 18830.52923676919, 18890.716639250422, 18956.43130706081, 14653.340599672934, 14727.263636818116, 14737.557873263819, 14815.259237038104, 14826.481073162387, 3376.6960973512255, 3447.293304872495, 3474.9131271718156, 3488.6162522122545, 3494.0042088005052, 102929.0, 103811.48094259556, 104742.47628761808, 106314.46842765737, 106711.46644266807, 14758.48345307909, 14938.925305373403, 15057.096574205583, 15076.321565529577, 15241.0, 26077.0, 27590.172294831187, 27620.0, 27752.167434976982, 27879.442411151664, 7283.490155689157, 7540.736074237376, 7569.3566046886635, 7571.962140189264, 7618.047744031996, 3832.9425058624142, 3913.1195481016543, 3924.548676902136, 3930.1746633207345, 3968.6428221460205, 4589.2886602576655, 4604.953950460519, 4624.5375462453485, 4686.594021793517, 4748.0, 766.4711349169055, 780.056132080178, 791.8218400859876, 800.5636927874323, 801.6512816924657, 588.229527161493, 680.4726337088796, 723.9674214660353, 735.3859527294662, 744.5383862005591, 11712.824307635392, 12168.756624867454, 12630.305333206577, 12905.0, 12970.0, 661.715462351184, 699.6781480518916, 733.66618188724, 735.1105162753022, 742.6101296819213, 5556.222128901957, 5638.154276858422, 5639.802606908738, 5818.127280907813, 5960.254968128984, 94308.0, 96539.51730241303, 98112.0, 100465.49767251116, 100896.0, 83556.58221708852, 87027.56486217528, 87406.56296718476, 91255.54372228097, 92479.0, 76273.23726762661, 78384.0, 78942.6052869732, 79225.20774792178, 82177.0, 11902.821457677968, 12341.814872777095, 12431.254124752544, 12808.039397045073, 12842.935785321013, 37331.6266837339, 38081.61918380781, 38222.80888595539, 39118.608813911495, 39701.20597587974, 46656.0, 49456.0, 50671.49328506668, 52330.47669523256, 66720.0, 16218.513444596681, 16293.59266018359, 16328.67342653164, 16374.345026198818, 16384.918075409547, 18571.350002749838, 18743.812561874205, 18826.28306717055, 19354.903225483784, 19535.60928781388, 17125.400610978555, 18160.90919545394, 18239.08804559793, 18434.539136521158, 18528.0735963204, 17104.40134595333, 17817.821821781617, 17858.374956876447, 17894.642107158044, 18193.0, 17050.829491704924, 17710.0, 17776.377826776, 18240.45278641643, 18284.451466456027, 11500.772063190416, 12007.81988270194, 12093.0, 12137.575184868487, 12662.430190641258, 13128.803067953797, 13361.799573006607, 13622.386992585556, 13645.199167217563, 14034.087784293988], "value": 8585.570189767459, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1516.0000000000002, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [100.0, 107.0, 108.0, 106.0, 113.0, 110.0, 114.0, 112.0, 111.0, 110.0], "value": 109.1, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [151.0, 117.0, 149.0, 175.0, 120.0, 149.0, 148.0, 119.0, 159.0, 120.0], "value": 140.7, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 165.0, 163.0, 162.0, 166.0, 167.0, 160.0, 166.0, 180.0, 172.0], "value": 166.4, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 77.0, 74.0, 187.0, 74.0, 74.0, 76.0, 77.0, 183.0, 75.0], "value": 97.2, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 82.0, 139.0, 83.0, 82.0, 82.0, 129.0, 82.0, 82.0, 129.0], "value": 97.2, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [115.0, 115.0, 114.0, 114.0, 114.0, 114.0, 114.0, 114.0, 114.0, 114.0], "value": 114.2, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 149.0, 150.0, 148.0, 148.0, 148.0, 148.0, 148.0, 148.0, 149.0], "value": 148.4, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 95.0, 95.0, 95.0, 94.0, 94.0, 95.0, 96.0, 95.0, 94.0], "value": 94.7, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [49.0, 46.0, 46.0, 45.0, 47.0, 47.0, 46.0, 48.0, 47.0, 47.0], "value": 46.8, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [55.0, 56.0, 55.0, 56.0, 55.0, 56.0, 56.0, 55.0, 55.0, 56.0], "value": 55.5, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [78.0, 80.0, 77.0, 79.0, 78.0, 78.0, 77.0, 78.0, 79.0, 78.0], "value": 78.2, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [132.0, 139.0, 127.0, 128.0, 124.0, 133.0, 123.0, 121.0, 122.0, 143.0], "value": 129.2, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [166.0, 169.0, 175.0, 178.0, 176.0, 178.0, 171.0, 175.0, 168.0, 174.0], "value": 173.0, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 67.0, 65.0, 68.0, 64.0, 64.0, 68.0, 66.0, 63.0, 63.0], "value": 65.4, "unit": "score"}]}]} 09:53:08 INFO - Return code: 0 09:53:08 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 09:53:08 INFO - # TBPL SUCCESS # 09:53:08 INFO - Running post-action listener: _resource_record_post_action 09:53:08 INFO - [mozharness: 2017-06-11 16:53:08.438744Z] Finished run-tests step (success) 09:53:08 INFO - Running post-run listener: _resource_record_post_run 09:53:08 INFO - Total resource usage - Wall time: 1249s; CPU: 13.0%; Read bytes: 16384; Write bytes: 422445056; Read time: 300; Write time: 248756 09:53:08 INFO - TinderboxPrint: CPU usage
12.5% 09:53:08 INFO - TinderboxPrint: I/O read bytes / time
16,384 / 300 09:53:08 INFO - TinderboxPrint: I/O write bytes / time
422,445,056 / 248,756 09:53:08 INFO - TinderboxPrint: CPU idle
8,718.2 (87.5%) 09:53:08 INFO - TinderboxPrint: CPU user
1,199.9 (12.0%) 09:53:08 INFO - TinderboxPrint: Swap in / out
0 / 0 09:53:08 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 4096; Write bytes: 103858176; Read time: 76; Write time: 81448 09:53:08 INFO - setup-mitmproxy - Wall time: 0s; CPU: Can't collect data; Read bytes: 0; Write bytes: 0; Read time: 0; Write time: 0 09:53:08 INFO - run-tests - Wall time: 1233s; CPU: 13.0%; Read bytes: 8192; Write bytes: 318586880; Read time: 216; Write time: 167308 09:53:09 INFO - Running post-run listener: _upload_blobber_files 09:53:09 INFO - Blob upload gear active. 09:53:09 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 09:53:09 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 09:53:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Firefox', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 09:53:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Firefox -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 09:53:09 INFO - (blobuploader) - INFO - Open directory for files ... 09:53:09 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 09:53:09 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:53:09 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:53:11 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 09:53:11 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:53:11 INFO - (blobuploader) - INFO - Done attempting. 09:53:11 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 09:53:11 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:53:11 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:53:12 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 09:53:12 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:53:12 INFO - (blobuploader) - INFO - Done attempting. 09:53:12 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 09:53:12 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:53:12 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:53:16 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 09:53:16 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:53:16 INFO - (blobuploader) - INFO - Done attempting. 09:53:16 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 09:53:16 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:53:16 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:53:17 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 09:53:17 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:53:17 INFO - (blobuploader) - INFO - Done attempting. 09:53:17 INFO - (blobuploader) - INFO - Iteration through files over. 09:53:17 INFO - Return code: 0 09:53:17 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 09:53:17 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 09:53:17 INFO - Setting buildbot property blobber_files to {"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d44950550c8436ea4b1cb7d8eebf129eb30895aa4f10bd140ce3cc10dc1229a950486d8ae06846cd4014a41a9f913b83895e5f937bf63e68c7841f3cb2afcc3b", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/1931919db2ef47177c828f2926a3346dc7adb127fc73b7770ef8d204d5fb0345cc7e213d2ff27c6548d16a0b014bb2e49f7204dcc6f69d73620ad11bbc579883", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/aa0415fd48b2cf5fc43378af6fb2b9b4268bb78b6934baf78e11abd83300b14308128abbc3933b0fe2feb402b9fa5ab68e561fd07c5954a9db283f037525e492", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/595344a89e1c8f0768714bd52c9b83ca980e6fad5321e0054bc42f6542fd6210e5b07598046dc1e6e48d665539840809df291f88b0223ffb566cd8429a2a9b60"} 09:53:17 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 09:53:17 INFO - Writing to file /builds/slave/test/properties/blobber_files 09:53:17 INFO - Contents: 09:53:17 INFO - blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d44950550c8436ea4b1cb7d8eebf129eb30895aa4f10bd140ce3cc10dc1229a950486d8ae06846cd4014a41a9f913b83895e5f937bf63e68c7841f3cb2afcc3b", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/1931919db2ef47177c828f2926a3346dc7adb127fc73b7770ef8d204d5fb0345cc7e213d2ff27c6548d16a0b014bb2e49f7204dcc6f69d73620ad11bbc579883", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/aa0415fd48b2cf5fc43378af6fb2b9b4268bb78b6934baf78e11abd83300b14308128abbc3933b0fe2feb402b9fa5ab68e561fd07c5954a9db283f037525e492", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/595344a89e1c8f0768714bd52c9b83ca980e6fad5321e0054bc42f6542fd6210e5b07598046dc1e6e48d665539840809df291f88b0223ffb566cd8429a2a9b60"} 09:53:17 INFO - Running post-run listener: copy_logs_to_upload_dir 09:53:17 INFO - Copying logs to upload dir... 09:53:17 INFO - mkdir: /builds/slave/test/build/upload/logs 09:53:17 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1308.851951 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 48 secs) (at 2017-06-11 09:53:16.576144) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-06-11 09:53:16.582969) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=e0e61f6f900f4dc42e3e8956000001ad-1497174785.535695-1174067972 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d44950550c8436ea4b1cb7d8eebf129eb30895aa4f10bd140ce3cc10dc1229a950486d8ae06846cd4014a41a9f913b83895e5f937bf63e68c7841f3cb2afcc3b", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/1931919db2ef47177c828f2926a3346dc7adb127fc73b7770ef8d204d5fb0345cc7e213d2ff27c6548d16a0b014bb2e49f7204dcc6f69d73620ad11bbc579883", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/aa0415fd48b2cf5fc43378af6fb2b9b4268bb78b6934baf78e11abd83300b14308128abbc3933b0fe2feb402b9fa5ab68e561fd07c5954a9db283f037525e492", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/595344a89e1c8f0768714bd52c9b83ca980e6fad5321e0054bc42f6542fd6210e5b07598046dc1e6e48d665539840809df291f88b0223ffb566cd8429a2a9b60"} build_url:https://queue.taskcluster.net/v1/task/IMrkpCVbT4CboiWlPBweYQ/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011221 build_url: 'https://queue.taskcluster.net/v1/task/IMrkpCVbT4CboiWlPBweYQ/artifacts/public/build/target.tar.bz2' blobber_files: '{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d44950550c8436ea4b1cb7d8eebf129eb30895aa4f10bd140ce3cc10dc1229a950486d8ae06846cd4014a41a9f913b83895e5f937bf63e68c7841f3cb2afcc3b", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/1931919db2ef47177c828f2926a3346dc7adb127fc73b7770ef8d204d5fb0345cc7e213d2ff27c6548d16a0b014bb2e49f7204dcc6f69d73620ad11bbc579883", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/aa0415fd48b2cf5fc43378af6fb2b9b4268bb78b6934baf78e11abd83300b14308128abbc3933b0fe2feb402b9fa5ab68e561fd07c5954a9db283f037525e492", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/595344a89e1c8f0768714bd52c9b83ca980e6fad5321e0054bc42f6542fd6210e5b07598046dc1e6e48d665539840809df291f88b0223ffb566cd8429a2a9b60"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-06-11 09:53:16.609671) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-06-11 09:53:16.610248) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=e0e61f6f900f4dc42e3e8956000001ad-1497174785.535695-1174067972 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004494 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-06-11 09:53:16.694572) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-06-11 09:53:16.694945) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-06-11 09:53:16.695337) ========= ========= Total master_lag: 0.16 =========